outlook cant contact excange .. HTTP/1.1 503 Service Unavailable

What is in the event log, and what is your hard drive space like?

503 unavailable will happen if the store is dismounted, but either way, it will be in the logs.

-red

hi...disk space is fine....80 GB free.... i had to reboot the server this morning...in my wisdom, i decided to clear the logs b4 i rebooted it so i could see exactly what was going on....i will copy up the logs when it happens again...ger

>>in my wisdom, i decided to clear the logs b4 i rebooted it so i could see exactly what was going on

This will teach you to save them before clearing them next time :)

Problem arose again today....i have posted the last few days of the event log below...

<<removed by -red>>

no-one is going to sift through thousands of event logs, so pick out the relevant failures and give us those.

If you are going to post the full event, then don't post any more than say the top 5.

-red

Sorry!!


i have now pasted the last few relevant lines

there was a huge amount of entries referring to a problem with backup exec.....not sure if this had a bearing..



 For more information, click the following link:
http://eventlookup.veritas.com/eventlookup/EventLookup.jhtml"
02/08/2007      11:02:12      MSExchangeSA      Error      MAPI Session       9175      N/A      SBSSERVER      "The MAPI call 'OpenMsgStore' failed with the following error:
The attempt to log on to the Microsoft Exchange Server computer has failed.
The MAPI provider failed.
Microsoft Exchange Server Information Store
ID no: 8004011d-0512-00000000

For more information, click http://www.microsoft.com/contentredirect.asp."
02/08/2007      11:01:53      Backup Exec      Error      None      33808      N/A      SBSSERVER      "An error occurred while processing a B2D command.
 Changer: MoveMedium() Attempt to Lock Slot Failed (F:\VERITAS\B2D\B2D000022.lck).  Error=5



 For more information, click the following link:
http://eventlookup.veritas.com/eventlookup/EventLookup.jhtml"
02/08/2007      11:00:20      MSExchangeSA      Error      MAPI Session       9175      N/A      SBSSERVER      "The MAPI call 'OpenMsgStore' failed with the following error:
The attempt to log on to the Microsoft Exchange Server computer has failed.
The MAPI provider failed.
Microsoft Exchange Server Information Store
ID no: 8004011d-0512-00000000



 For more information, click the following link:
http://eventlookup.veritas.com/eventlookup/EventLookup.jhtml"
02/08/2007      10:59:24      MSExchangeSA      Error      MAPI Session       9175      N/A      SBSSERVER      "The MAPI call 'OpenMsgStore' failed with the following error:
The attempt to log on to the Microsoft Exchange Server computer has failed.
The MAPI provider failed.
Microsoft Exchange Server Information Store
ID no: 8004011d-0512-00000000



 For more information, click the following link:
http://eventlookup.veritas.com/eventlookup/EventLookup.jhtml"
02/08/2007      10:58:46      MSExchangeSA      Error      MAPI Session       9175      N/A      SBSSERVER      "The MAPI call 'OpenMsgStore' failed with the following error:
The attempt to log on to the Microsoft Exchange Server computer has failed.
The MAPI provider failed.
Microsoft Exchange Server Information Store
ID no: 8004011d-0512-00000000



 For more information, click the following link:
http://eventlookup.veritas.com/eventlookup/EventLookup.jhtml"
02/08/2007      10:57:32      MSExchangeSA      Error      MAPI Session       9175      N/A      SBSSERVER      "The MAPI call 'OpenMsgStore' failed with the following error:
The attempt to log on to the Microsoft Exchange Server computer has failed.
The MAPI provider failed.
Microsoft Exchange Server Information Store
ID no: 8004011d-0512-00000000

I have located the exact errors in the log that i believe are causing the problem..i have alos founf a microsoft KB on the problem burt there is a lot of info in there and i am not sure how to read it.  (support.microsoft.com/kb/896143)  can anyone shed any light on it by looking at the logs below



For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:45:29      ESE      Error      General       104      N/A      SBSSERVER      "Information Store (3676) First Storage Group: The database engine stopped the instance (0) with error (-510).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:45:28      MSExchangeIS Public Store      Information      General       9539      N/A      SBSSERVER      "The Microsoft Exchange Information Store database ""First Storage Group\Public Folder Store (SBSSERVER)"" was stopped.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:45:28      MSExchangeIS Mailbox Store      Information      General       9539      N/A      SBSSERVER      "The Microsoft Exchange Information Store database ""First Storage Group\Mailbox Store (SBSSERVER)"" was stopped.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:45:25      MSExchangeIS      Error      General       9558      N/A      SBSSERVER      "An error occurred while writing to the database log file of storage group ""First Storage Group"". Attempting to unmount all databases in this storage group.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:44      NTBackup      Error      None      8019      N/A      SBSSERVER      "End Operation: Warnings or errors were encountered.
Consult the backup report for more details."
08/08/2007      03:08:37      ESE      Warning      Logging/Recovery       219      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Error (-510) occured during database headers update with the backup information.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:37      ESE      Information      Logging/Recovery       213      N/A      SBSSERVER      "Information Store (3676) First Storage Group: The backup procedure has been successfully completed.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:37      ESE      Information      Logging/Recovery       225      N/A      SBSSERVER      "Information Store (3676) First Storage Group: No log files can be truncated.  

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:37      NTBackup      Error      None      8001      N/A      SBSSERVER      "End Backup of 'SBSSERVER\Microsoft Information Store\First Storage Group' 'Warnings or errors were encountered.'

       Verify:  Off
       Mode:  Append
       Type:  Normal
 
Consult the backup report for more details.
"
08/08/2007      03:08:37      ESE      Error      Logging/Recovery       492      N/A      SBSSERVER      "Information Store (3676) First Storage Group: The logfile sequence in ""C:\Program Files\Exchsrvr\mdbdata\"" has been halted due to a fatal error.  No further updates are possible for the databases that use this logfile sequence.  Please correct the problem and restart or restore from backup.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:37      ESE      Error      Logging/Recovery       413      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Unable to create a new logfile because the database cannot write to the log drive. The drive may be read-only, out of disk space, misconfigured, or corrupted. Error -1032.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:35      ESE      Error      General       486      N/A      SBSSERVER      "Information Store (3676) First Storage Group: An attempt to move the file ""C:\Program Files\Exchsrvr\mdbdata\E00.log"" to ""C:\Program Files\Exchsrvr\mdbdata\E00005BE.log"" failed with system error 32 (0x00000020): ""The process cannot access the file because it is being used by another process. "".  The move file operation will fail with error -1032 (0xfffffbf8).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:15      ESE      Information      Logging/Recovery       221      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Ending the backup of the file C:\Program Files\Exchsrvr\mdbdata\pub1.stm.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:14      ESE      Information      Logging/Recovery       220      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Beginning the backup of the file C:\Program Files\Exchsrvr\mdbdata\pub1.stm (size 2 Mb).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:14      ESE      Information      Logging/Recovery       221      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Ending the backup of the file C:\Program Files\Exchsrvr\mdbdata\pub1.edb.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:11      ESE      Information      Logging/Recovery       220      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Beginning the backup of the file C:\Program Files\Exchsrvr\mdbdata\pub1.edb (size 20 Mb).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:08:11      ESE      Information      Logging/Recovery       221      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Ending the backup of the file C:\Program Files\Exchsrvr\mdbdata\priv1.stm.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:07:42      ESE      Information      Logging/Recovery       220      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Beginning the backup of the file C:\Program Files\Exchsrvr\mdbdata\priv1.stm (size 188 Mb).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:07:42      ESE      Information      Logging/Recovery       221      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Ending the backup of the file C:\Program Files\Exchsrvr\mdbdata\priv1.edb.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:02:02      ESE BACKUP      Information      Backup       907      N/A      SBSSERVER      "Information Store (3676) Backup data transfer method is shared memory (64kb).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:02:02      ESE      Information      Logging/Recovery       220      N/A      SBSSERVER      "Information Store (3676) First Storage Group: Beginning the backup of the file C:\Program Files\Exchsrvr\mdbdata\priv1.edb (size 2313 Mb).

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:02:02      ESE      Information      Logging/Recovery       210      N/A      SBSSERVER      "Information Store (3676) First Storage Group: A full backup is starting.

For more information, click http://www.microsoft.com/contentredirect.asp."
08/08/2007      03:02:00      NTBackup      Information      None      8000      N/A      SBSSERVER      "Begin Backup of 'SBSSERVER\Microsoft Information Store\First Storage Group'

       Verify:  Off
       Mode:  Append
       Type:  Normal
"
08/08/2007      03:01:59      NTBackup      Information      None      8001      N/A      SBSSERVER      "End Backup of 'D:' '
The operation was successfully completed.'

Does the store mount itself automatically again after that, or do you have to reboot?

Do you have anti-virus on that server?

Have you messed with the Transaction logs at all?

the store does not mount automatically but after looking at these logs, i simply mounted the stores maulally and all was well... i have nod32 AV on that server ( as i do on another 50 servers all configured the same way!) i did however today exclude the exchsrvr folder form any scanning....with regards to the transactions logs..i would not even know how!  i am running Veritas Backup exec for sbs ver 10...this would be configured to do backup exchange as well..this might be doing something to the logs...as u can see from the initial posting of logs, there are a lot of vertias errors happening around this time as well...

>>i did however today exclude the exchsrvr folder form any scanning

That is what I was driving at by asking about AV.

What I expect is happening is as follows, Backup Exec tries to do a backup, as it is a full backup it is going to flush the transaction logs, but when it tries to access them, NOD gets it's panties in a bind and stop it - making Exchange stop the store as a precaution, making backup exec fail.

I don't know how close to accurate that really is - I am just filling in the gaps of NOD breaking it and BE looking like it is involved.

I am 100% certain though that NOD is the cause of the problem - file system anti-virus is pointless on an exchange server, but if you are going to have it, you MUST exclude the exchange directories.

-red

i will know in the next few days!  thanks for ur help so far..i appreciate it...

ger

Hi this problem has occurred again.... i can confirm that nod is not scanning theexchange folder.  i have even stopped veritas from backing up the exchange (currently doint it manually)

any further ideas?


ger

i uninstalled nod and while a "version" of the problem has happened a couple of times, not nearly as often as before.  i think the most recent ones were down to the store exceeding the default limit set in sbs