Arcserve 11.1 Crashing on Win2003 server

[Achillesx]

Hi all,

Please help.
I had Arcserve 11.1 installed on a Windows 2003 server (Sp1 patched) however, when clicking on 'Backup' or 'Restore' shortcuts from the main menu, the program hangs.

To get round this, I have patched Arcserve to SP1 and also installed the post SP1 update. However, it was still crashing when clicking on certain shortcuts.

I then removed the program (clearing the registry as best I could) and deleted the program directory(s). Then reinstalled and patched the program again.
Still no joy however.

I think it may be something to do with the database, however I am unsure how to get round it. Should I go for SQL database rather than the standard Arcserve database if I cant find a solution here?

Many thanks.

NP

 

[davidmichel]

http://supportconnectw.ca.com/public/storage/downloads/nt/111/basb111-patchmenu.asp

QO68139 17.9 MB 05/23/05 NT -WINDOWS 2003 SP 1 SUPPORT UPDATE

 

[Achillesx]

Hi, thanks for the reply.

I had already installed 4 of the patches from that page.
NT -WINDOWS 2003 SP 1 SUPPORT UPDATE SP1
NT -BAB R11.1 SERVICE PACK 1 - ENGLISH
NT -DATABASE AGENT SECURITY UPDATE - R11.1
and
NT -DISCOVERY SERVICE SECURITY VULNERABILITY
Though had no joy..
Still hanging.
I can get into the backup and restore pages if I stop the engines. However, it tries to start the tape engine and eventually crashes.

Thanks

N

 

[Cyklops]

arcserve logs (brightstor.log and tape.log) / windows event log messages ??

 

[davidmichel]

copy in here the startup of the Tape Engine debug log tape.log.

 

[Achillesx]

Hi, thanks for the reply.

Posting Tape.log below!
..........................................
08/18 16:19:51 [04e8] TapeDrive[2] ABSL:2160 <PV-100T-DDS4 8160> S/N[HJ0GSX3]
08/18 16:19:51 [04e8] ABSL = 0 0 0 0, adapterTransferSize = 131072
08/18 16:19:51 [04e8] ABSL = 2 0 6 0, adapterTransferSize = 69632
08/18 16:19:51 [04e8] ABSL = 2 1 6 0, adapterTransferSize = 69632
08/18 16:19:51 [04e8] ABSL = 2 2 57 0, adapterTransferSize = 69632
08/18 16:19:51 [04e8] ABSL = 2 3 0 0, adapterTransferSize = 69632
08/18 16:19:56 [04e8] ClientActivateTapesvr:: WaitForSingleObject timed out for hDBInitThread. Thus possibility of DB dummy funcs.
08/18 16:20:01 [04e8] ClientActivateTapesvr:: WaitForSingleObject timed out for hDBInitThread. Thus possibility of DB dummy funcs.
08/18 16:20:06 [04e8] ClientActivateTapesvr:: WaitForSingleObject timed out for hDBInitThread. Thus possibility of DB dummy funcs.
08/18 16:20:11 [04e8] ClientActivateTapesvr:: WaitForSingleObject timed out for hDBInitThread. Thus possibility of DB dummy funcs.
08/18 16:20:16 [04e8] ClientActivateTapesvr:: WaitForSingleObject timed out for hDBInitThread. Thus possibility of DB dummy funcs.
08/18 16:20:18 [05c8] DB: Database Library not ready.
08/18 16:20:18 [05c8] DB:: SetDummyEntryPoints:: Executing SetDummyEntryPoints. error = 1
08/18 16:20:18 [05c8] DB:SetHooks: Error in DB_GetEntryPoints. error = 1
08/18 16:20:18 [05c8] DB:: SetHooks:: Retrying. count = 1
08/18 16:20:18 [05c8] DB: Database Library not ready.
08/18 16:20:18 [05c8] DB:: SetDummyEntryPoints:: Executing SetDummyEntryPoints. error = 1
08/18 16:20:18 [05c8] DB:SetHooks: Error in DB_GetEntryPoints. error = 1

edit... SNIP - Removing 18 other retries!!!!

08/18 16:20:19 [05c8] DB:: SetHooks:: Retrying. count = 20
08/18 16:20:19 [05c8] DB: Database Library not ready.
08/18 16:20:19 [05c8] DB:: SetDummyEntryPoints:: Executing SetDummyEntryPoints. error = 1
08/18 16:20:19 [05c8] DB:SetHooks: Error in DB_GetEntryPoints. error = 1
08/19 14:57:04 [089c] DRV:2 Got SCSI Unit Attention, Go test drive again with Unit Attention
08/19 14:57:29 [089c] DB: Database Library not ready.
08/19 14:57:29 [089c] DB:: SetDummyEntryPoints:: Executing SetDummyEntryPoints. error = 1
08/19 15:00:03 [089c] =>ABSL:2160 Command:[READ ] <Drive>
08/19 15:00:03 [089c] ABSL:2160 Sense Key status: Media Error [03]
08/19 15:00:03 [089c] ABSL:2160 Additional sense: Sequential Positioning Error [3b, 00]
08/19 15:00:03 [089c] !!!!!
08/19 15:00:03 [089c] !!!!! Media error encountered, device[2][SN:]
08/19 15:00:03 [089c] !!!!! We'll retry reading the block(s). RetryCount[1]
08/19 15:00:03 [089c] !!!!!
08/19 15:00:03 [089c] ** hDevice->pTapeInfo->blocksRead[0] ulBlocksIn512Byte[32] hDevice->ulCurrentBlockAddress[-1]
08/19 15:00:03 [089c] ABSL:2160 SCSICommandRetry: Actually Read, but off by more then 1 block.
08/19 15:00:03 [089c] =>ABSL:2160 Command:[READ ] <Drive>
08/19 15:00:03 [089c] ABSL:2160 Sense Key status: Media Error [03]
08/19 15:00:03 [089c] ABSL:2160 Additional sense: Sequential Positioning Error [3b, 00]
08/19 15:00:03 [089c] !!!!!
08/19 15:00:03 [089c] !!!!! Media error encountered, device[2][SN:]
08/19 15:00:03 [089c] !!!!! We'll retry reading the block(s). RetryCount[2]
08/19 15:00:03 [089c] !!!!!
..................................................

I dont think we had media in the drive when we were checking this. However, I didnt think this made a difference - you should still be able to browse the different sections of the job manager etc.

Brightstor.log below

....................................................
[08/20/2005-12:00:28 ,1,1073741827,0,0,-1,2,18,0,0] Pruning sessions older than 30 days.
[08/20/2005-14:22:53 ,1,1073741827,0,0,-1,2,1,0,0] E4101 Unable to login to database engine. (DATABASE=BrightStor ARCserve Backup, EC=-2005)
[08/20/2005-14:22:53 ,1,1073741827,0,0,-1,2,18,0,0] End pruning database. (PRUNED=0)
[08/20/2005-14:22:53 ,1,1073741827,0,0,-1,2,18,0,0] ** Summary for Job **
[08/20/2005-14:22:53 ,1,1073741827,0,0,-1,2,18,0,0] Prune Database Operation Successful.
[08/20/2005-14:23:13 ,1,1073741827,0,0,-1,2,18,0,0] Begin pruning logs.
[08/20/2005-14:23:13 ,1,1073741827,0,0,-1,2,18,0,0] End pruning logs
[08/20/2005-14:28:12 ,1,0,0,0,-1,2,1,0,0] E4101 Unable to login to database engine. (DATABASE=ourserver, EC=-2005)
[08/20/2005-14:28:12 ,1,1073741827,0,0,-1,2,18,0,0] Reschedule Prune Database Job for 21/08/05 at 12:00.
[08/20/2005-14:28:12 ,1,0,0,0,-1,2,3,0,0] [JOBQUEUE]: Rescheduled for 21/08/05 at 12:00 [Job No: 1] [Description: ]
[08/20/2005-14:28:12 ,1,0,0,0,-1,2,3,0,0] [JOBQUEUE]: Status changed from Active to Ready [Job No: 1] [Description: ]
[08/21/2005-12:00:01 ,1,0,0,0,-1,2,3,0,0] [JOBQUEUE]: Status changed from Ready to Active [Job No: 1] [Description: ]
[08/21/2005-12:00:28 ,1,0,0,0,-1,2,1,0,0] E4101 Unable to login to database engine. (DATABASE=ourserver, EC=-2005)
[08/21/2005-12:00:28 ,1,1073741828,0,0,-1,2,18,0,0] Run Prune Database Job Scheduled for 21/08/05 at 12:00.
[08/21/2005-12:00:28 ,1,1073741828,0,0,-1,2,18,0,0] Begin pruning database.
[08/21/2005-12:00:28 ,1,1073741828,0,0,-1,2,18,0,0] Pruning sessions older than 30 days.
[08/21/2005-14:23:09 ,1,1073741828,0,0,-1,2,1,0,0] E4101 Unable to login to database engine. (DATABASE=BrightStor ARCserve Backup, EC=-2005)
[08/21/2005-14:23:09 ,1,1073741828,0,0,-1,2,18,0,0] End pruning database. (PRUNED=0)
[08/21/2005-14:23:09 ,1,1073741828,0,0,-1,2,18,0,0] ** Summary for Job **
[08/21/2005-14:23:09 ,1,1073741828,0,0,-1,2,18,0,0] Prune Database Operation Successful.
[08/21/2005-14:23:29 ,1,1073741828,0,0,-1,2,18,0,0] Begin pruning logs.
[08/21/2005-14:23:29 ,1,1073741828,0,0,-1,2,18,0,0] End pruning logs
[08/21/2005-14:28:29 ,1,0,0,0,-1,2,1,0,0] E4101 Unable to login to database engine. (DATABASE=ourserver, EC=-2005)
[08/21/2005-14:28:29 ,1,1073741828,0,0,-1,2,18,0,0] Reschedule Prune Database Job for 22/08/05 at 12:00.
[08/21/2005-14:28:29 ,1,0,0,0,-1,2,3,0,0] [JOBQUEUE]: Rescheduled for 22/08/05 at 12:00 [Job No: 1] [Description: ]
[08/21/2005-14:28:29 ,1,0,0,0,-1,2,3,0,0] [JOBQUEUE]: Status changed from Active to Ready [Job No: 1] [Description: ]
.........................................................

Any suggestions?
DB or tape drive problems??

Oh.. I have tried installing the client management utilities on a desktop PC to connect to the server. It crashes on that also.

Many thanks,

NP

 

[vschumpy]

Looks like database corruption - since opening some of the GUI page requires information from the DB, this might be why it 'hangs'. Check the FAQs here or on CA's supportconnect site for information on how to fix it.

 

[Achillesx]

Bear it in mind that the program (and database) has been stripped off the server and reinstalled twice. Surely this would have recreated the database?

In any case, I have tried to reinitialize the database. However, it freezes when doing so.

Thanks.

NP

 

[Achillesx]

Aww crap...

Looks like the problem was an Environmental variable (RNNAME) in Windows that was left over from the previous machine name. That was why I missed it when I cleaned out the registry.

I changed it to the new server name and it works with no problems now..

Thanks for your help.

N