Veritas-bu

[Veritas-bu] status 41 from NetWare client

2000-10-06 15:19:03
Subject: [Veritas-bu] status 41 from NetWare client
From: RYAN C. ANDERSON ryan_anderson AT udlp DOT com
Date: Fri, 6 Oct 2000 14:19:03 -0500
Backups for a NetWare server I have haven't been working recently, and
they exit every time with a 'status 41' (network connection time out). 
I am having the darndest time finding out why it can't be reached.

A big question I have:

- No one is manually turning this off, yet in the master's bpbrm log,
why does it say: 

22:04:04 [3639] <4> bpbrm process_media_msg: media manager for backup id
s774_0970799637 exited with status 150: termination requested by
administrator

I've pasted the bpbrm log from our Solaris NetBackup 3.1.1 server and
the bpcd log from the NetWare client for the same window of time last
night.

Regards,

Ryan
--
---------------------------------------------------
Ryan C. Anderson           United Defense L.P. 
UNIX Administrator         http://www.udlp.com/ 
(desk) 763.572.6684        (pager) 612.235.9936 
ryan_anderson AT udlp DOT com     Mail stop M313 
---------------------------------------------------


10/05/00 bpbrm log form the NetBackup master server:
----------------------------------------------------

21:33:55 [3575] <4> bpbrm process_media_msg: media manager for backup id
s774_0970797794 exited with status 150: termination requested by
administrator
21:33:55 [3575] <4> bpbrm send_status_to_parent: EXIT s774_0970797794 41
sent to parent process.
21:33:55 [3575] <2> OpenMailPipe: /usr/ucb/mail -s "Backup by root on
s774 st..." root >/dev/null 2>/dev/null
21:33:55 [3575] <2> OpenMailPipe: Before subject string write
21:33:55 [3575] <2> OpenMailPipe: After subject string write
21:33:58 [3639] <4> bpbrm process_start_backup_msg: job_id = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: backup_id =
s774_0970799637
21:33:58 [3639] <4> bpbrm process_start_backup_msg: bkup_time =
970799637
21:33:58 [3639] <4> bpbrm process_start_backup_msg: class = netware_3
21:33:58 [3639] <4> bpbrm process_start_backup_msg: client = s774
21:33:58 [3639] <4> bpbrm process_start_backup_msg: client_hostname =
s774
21:33:58 [3639] <4> bpbrm process_start_backup_msg: delta_time = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: block_incr = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: file_sys_only = 1
21:33:58 [3639] <4> bpbrm process_start_backup_msg: nfsok = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: requesting_group =
NULL
21:33:58 [3639] <4> bpbrm process_start_backup_msg: ret_level = 3
21:33:58 [3639] <4> bpbrm process_start_backup_msg: ret_period_str =
2678400
21:33:58 [3639] <4> bpbrm process_start_backup_msg: requesting_user =
root
21:33:58 [3639] <4> bpbrm process_start_backup_msg: sched = Full_NoDupe
21:33:58 [3639] <4> bpbrm process_start_backup_msg: secure_clnt = 1
21:33:58 [3639] <4> bpbrm process_start_backup_msg: sched_type = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: requesting_client =
s774
21:33:58 [3639] <4> bpbrm process_start_backup_msg: true_image = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: connect_from_client
= 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg:
use_non_reserved_ports = 0
21:33:58 [3639] <4> bpbrm process_start_backup_msg: clnt_lc_messages = C
21:33:58 [3639] <4> bpbrm process_start_backup_msg: clnt_lc_time = C
21:33:58 [3639] <4> bpbrm process_start_backup_msg: clnt_lc_ctype = C
21:33:58 [3639] <4> bpbrm process_start_backup_msg: clnt_lc_collate = C
21:33:58 [3639] <4> bpbrm process_start_backup_msg: clnt_lc_numeric = C
21:33:58 [3639] <2> hosts_equal: hostnames DO NOT compare
21:33:58 [3639] <2> hosts_equal: name1=s774  name2=athena
21:33:58 [3639] <2> hosts_equal: hostbuf=s774
hostentry->h_name=athena-qfe0
21:33:58 [3639] <2> hosts_equal: compare s774 with alias athena
21:33:58 [3639] <2> hosts_equal: compare s774 with alias
athena.mpls.udlp.com
21:33:58 [3639] <2> hosts_equal: compare athena-qfe0 with alias
s774.mpls.udlp.com
21:33:58 [3639] <2> hosts_equal: addresses DO NOT match
21:33:58 [3639] <4> hosts_equal: s774=0xa011503 athena=0xa010310
21:33:58 [3639] <4> bpbrm read_filelist: filepath from bpsched: FILEPATH
s774_0970799637 /
21:33:58 [3639] <4> bpbrm read_filelist: filepath from bpsched: CONTINUE
s774_0970799637
21:34:00 [3639] <4> bpbrm multiplexed_backup: DATASOCKET = 4998 for
client s774
21:34:00 [17978] <2> getsockconnected: host=s774 service=bpcd
address=10.1.21.3 protocol=tcp reserved port=13782
21:34:01 [17978] <4> bpbrm write_filelist: closing COMM_SOCK 7
21:34:01 [17978] <4> bpbrm handle_backup: from client s774: INF - adding
to backup list: /S774/S774.NetWare File System/S774/SYS
21:34:01 [17978] <4> bpbrm handle_backup: from client s774: INF - adding
to backup list: /S774/S774.NetWare File System/S774/Server Specific Info
21:34:01 [17978] <4> bpbrm handle_backup: from client s774: INF - adding
to backup list: /S774/S774.NetWare File System/S774/MAIL
22:04:04 [3639] <4> bpbrm process_media_msg: media manager for backup id
s774_0970799637 exited with status 150: termination requested by
administrator
22:04:04 [3639] <4> bpbrm send_status_to_parent: EXIT s774_0970799637 41
sent to parent process.
22:04:04 [3639] <2> OpenMailPipe: /usr/ucb/mail -s "Backup by root on
s774 st..." root >/dev/null 2>/dev/null




10/05/00 bpcd log from the NetWare NetBackup client (s774) at the same
time period as the log file above:
------------------------------------------------------------------------------

10/05/00 9:34:01 PM: [150]: BPCD - Starting process
10/05/00 9:34:01 PM: [150]: INF - attempt to validate server as
athena-hme0 (err = 0)
10/05/00 9:34:01 PM: [150]: BPCD - BPCD_GET_STDOUT_SOCKET_RQST
10/05/00 9:34:02 PM: [150]: BPCD - BPCD_FORK_CMD_RQST
10/05/00 9:34:02 PM: [150]: INF - fork command:
'/usr/openv/netbackup/bin/bpbkar bpbkar -r 2678400 -ru root -dt 0 -to 0
-c lnt s774 -class netware_3 -sched Full_NoDupe -st FULL -bpstart_to 300
-bpend_to 300 -read_to 1800 -b s774_0970799637 -kl 6 -fso -ct 10'
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPCD
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BP
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\ALTPATH
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPBACK
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPREST
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPSRV
10/05/00 9:34:02 PM: [150]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\USER_OPS
10/05/00 9:34:02 PM: [150]: INF - backup privileges enabled, previous =
0
10/05/00 9:34:02 PM: [150]: INF - security privileges enabled, previous
= 0
10/05/00 9:34:02 PM: [150]: TAR - CONTINUE BACKUP received
10/05/00 9:34:02 PM: [150]: INF - adding to backup list:
/S774/S774.NetWare File System/S774/SYS
10/05/00 9:34:02 PM: [150]: INF - adding to backup list:
/S774/S774.NetWare File System/S774/Server Specific Info
10/05/00 9:34:02 PM: [150]: INF - adding to backup list:
/S774/S774.NetWare File System/S774/MAIL
10/05/00 9:39:16 PM: [100]: Timestamp
10/05/00 10:04:04 PM: [151]: BPCD - Starting process
10/05/00 10:04:04 PM: [151]: INF - attempt to validate server as
athena-hme0 (err = 0)
10/05/00 10:04:04 PM: [151]: BPCD - BPCD_GET_STDOUT_SOCKET_RQST
10/05/00 10:04:04 PM: [151]: BPCD - BPCD_FORK_CMD_RQST
10/05/00 10:04:04 PM: [151]: INF - fork command:
'/usr/openv/netbackup/bin/bpbkar bpbkar -r 2678400 -ru root -dt 0 -to 0
-c lnt s774 -class netware_3 -sched Full_NoDupe -st FULL -bpstart_to 300
-bpend_to 300 -read_to 1800 -b s774_0970801445 -kl 6 -fso -ct 10'
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPCD
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BP
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\ALTPATH
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPBACK
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPREST
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\BPSRV
10/05/00 10:04:04 PM: [151]: INF - Purging log files from:
SYS:\OPENV\NETBACK\LOGS\USER_OPS
10/05/00 10:04:04 PM: [151]: INF - backup privileges enabled, previous =
0
10/05/00 10:04:04 PM: [151]: INF - security privileges enabled, previous
= 0
10/05/00 10:04:04 PM: [151]: TAR - CONTINUE BACKUP received
10/05/00 10:04:04 PM: [151]: INF - adding to backup list:
/S774/S774.NetWare File System/S774/SYS
10/05/00 10:04:04 PM: [151]: INF - adding to backup list:
/S774/S774.NetWare File System/S774/Server Specific Info
10/05/00 10:04:04 PM: [151]: INF - adding to backup list:
/S774/S774.NetWare File System/S774/MAIL
10/05/00 10:39:16 PM: [100]: Timestamp



<Prev in Thread] Current Thread [Next in Thread>