Hi, On Monday 27 June 2005 11:54, Dominic Marks wrote:
> What OS is the client PC running? > > Have you looked through the systems logs for any clues? > > You could try setting the debuglevel on the fd to a high value, > 500 is the one I see on the lists most frequently. The Server is running bacula 1.36.0 (20 October 2004) i686-redhat-linux-gnu redhat (Tettnang) on FC3. The client in this case is a Win XP SP2 client. Here is the funny thing: a standard 10/100MB NIC being put into the same system works perfectly. On Monday 27 June 2005 12:13, Arno Lehmann wrote: >I do remember some nasty comments about nVidia networks on other > lists... although I never experienced problems with the few I managed > myself. > > So, it might simply be a hardware fault. Of course, drivers are > important, too, and probably firewall settings or timeouts... I don't > know about your RedHat version, but perhaps these are manageb by the > network interfaces ethernet ID? Fedora Core 3 (2.6.5-1.358). Much appreciated. Stephan Heine Support Engineer Genetic Interactive Tel: +27 861 99 88 99 Fax: +27 861 99 77 99 Cell: +27 82 467 1164 EMail: [EMAIL PROTECTED] Let me get you the debug output from the job: backer-dir: job.c:174 =====Start Job========= backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f7268 to job.c:554 backer-dir: job.c:559 Created Client octane-fd record 23 backer-dir: job.c:594 Created FileSet Octane Docs Set record 93 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f73f8 to fd_cmds.c:152 backer-dir: fd_cmds.c:186 Level=F last start time= backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f7628 to backup.c:84 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f7758 to message.c:669 backer-dir: message.c:368 mailname=/usr/local/bacula/bin/working/backer-dir.mail.OctaneDocs.2005-06-28 _09.43.18.161447032 backer-dir: backup.c:128 JobId=4966 JobLevel=F backer-dir: backup.c:140 Open connection with storage daemon backer-dir: msgchan.c:76 bnet_connect to Storage daemon backer.rapsfin.local:9103 backer-dir: bnet.c:696 Current host[ipv4:192.168.0.10:9103] All host[ipv4:192.168.0.10:9103] backer-dir: bnet.c:950 who=Storage daemon host=backer.rapsfin.local port=9103 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f8b68 to bnet.c:955 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f8d98 to bnet.c:956 backer-dir: watchdog.c:184 Registered watchdog 0x99f9030, interval 60 one shot backer-dir: btimers.c:168 Start thread timer 0x99f8a90 tip 0xf5277bb0 for 60 secs. backer-dir: cram-md5.c:99 cram-get: auth cram-md5 <[EMAIL PROTECTED]> ssl=0 backer-dir: cram-md5.c:119 sending resp to challenge: X9p1wx+jE5/AS9BeXmAWxD backer-dir: cram-md5.c:52 send: auth cram-md5 <[EMAIL PROTECTED]> ssl=0 backer-dir: cram-md5.c:69 Authenticate OK backer-dir: authenticate.c:80 >stored: 1000 OK auth backer-dir: authenticate.c:87 <stored: 3000 OK Hello backer-dir: btimers.c:182 Stop bsock timer 0x99f8a90 tid 0xf5277bb0. backer-dir: watchdog.c:204 Unregistered watchdog 0x99f9030 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f9070 to ../lib/mem_pool.h:81 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f9120 to ../lib/mem_pool.h:81 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f91d0 to ../lib/mem_pool.h:81 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f9280 to ../lib/mem_pool.h:81 backer-dir: msgchan.c:118 Jobcmd=JobId=4966 job=OctaneDocs.2005-06-28_09.43.18 job_name=OctaneDocs client_name=octane-fd type=66 level=70 FileSet=OctaneDocsSet NoAttr=0 SpoolAttr=0 FileSetMD5=vk/uK0+Ys8+BV//qS21QfA SpoolData=0 backer-dir: getmsg.c:78 bget_dirmsg 91: 3000 OK Job SDid=1 SDtime=1119944505 Authorization=OMCO-ENND-FHMC-GENN-GJAI-LGAB-IOOJ-JMOK backer-dir: msgchan.c:123 <stored: 3000 OK Job SDid=1 SDtime=1119944505 Authorization=OMCO-ENND-FHMC-GENN-GJAI-LGAB-IOOJ-JMOK backer-dir: msgchan.c:131 sd_auth_key=OMCO-ENND-FHMC-GENN-GJAI-LGAB-IOOJ-JMOK backer-dir: msgchan.c:152 >stored: use device=DocsFullStorage media_type=File pool_name=OctaneDocsFull pool_type=Backup backer-dir: getmsg.c:78 bget_dirmsg 19: 3000 OK use device backer-dir: getmsg.c:225 3000 OK use device backer-dir: mem_pool.c:221 free_pool_memory 99f9280 pool=1 from ../lib/mem_pool.h:83 backer-dir: mem_pool.c:221 free_pool_memory 99f91d0 pool=1 from ../lib/mem_pool.h:83 backer-dir: mem_pool.c:221 free_pool_memory 99f9120 pool=1 from ../lib/mem_pool.h:83 backer-dir: mem_pool.c:221 free_pool_memory 99f9070 pool=1 from ../lib/mem_pool.h:83 backer-dir: msgchan.c:177 Start SD msg_thread. backer-dir: msgchan.c:225 Start msg_thread loop backer-dir: getmsg.c:7 8b2a398 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a448 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a4f8 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a5a8 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a658 to ../lib/mem_pool.h:81 backer-sd: job.c:79 Job_cmd: JobId=4966 job=OctaneDocs.2005-06-28_09.43.18 job_name=OctaneDocs client_name=octane-fd type=66 level=70 FileSet=OctaneDocsSet NoAttr=0 SpoolAttr=0 FileSetMD5=vk/uK0+Ys8+BV//qS21QfA SpoolData=0 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a708 to job.c:105 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a7b8 to job.c:108 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a868 to job.c:111 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2a918 to job.c:118 backer-sd: job.c:128 >dird: 3000 OK Job SDid=1 SDtime=1119944505 Authorization=OMCO-ENND-FHMC-GENN-GJAI-LGAB-IOOJ-JMOK backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2b220 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2b2d0 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2b380 to ../lib/mem_pool.h:81 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b2b430 to ../lib/mem_pool.h:81 backer-sd: job.c:250 Use device: use device=DocsFullStorage media_type=File pool_name=OctaneDocsFull pool_type=Backup backer-sd: block.c:122 Returning new block=8b2ab50 backer-sd: mem_pool.c:111 sm_get_pool_memory reuse 8b2a0f0 to record.c:154 backer-sd: job.c:269 Found device DocsFullStorage backer-sd: job.c:275 Got: use device=DocsFullStorage media_type=File pool_name=OctaneDocsFull pool_type=Backup backer-sd: mem_pool.c:221 free_pool_memory 8b2b430 pool=1 from ../lib/mem_pool.h:83 backer-sd: mem_pool.c:221 free_pool_memory 8b2b380 pool=1 from ../lib/mem_pool.h:83 backer-sd: mem_pool.c:221 free_pool_memory 8b2b2d0 pool=1 from ../lib/mem_pool.h:83 backer-sd: mem_pool.c:221 free_pool_memory 8b2b220 pool=1 from ../lib/mem_pool.h:83 backer-sd: job.c:158 OctaneDocs.2005-06-28_09.43.18 waiting on FD to contact SD backer-sd: bnet.c:950 who=client host=16.0.0.0 port=36643 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b3b5f0 to bnet.c:955 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b3b820 to bnet.c:956 backer-sd: workq.c:152 workq_add backer-sd: workq.c:167 add item to queue backer-sd: workq.c:195 Create worker thread backer-sd: workq.c:293 Start workq_server backer-sd: workq.c:205 Return workq_add backer-sd: workq.c:302 Top of for loop backer-sd: workq.c:304 gettimeofday() backer-sd: workq.c:346 Calling user engine. backer-sd: dircmd.c:152 Conn: Hello Start Job OctaneDocs.2005-06-28_09.43.18 backer-sd: jcr.c:499 Inc get_jcr 0x8b29c90 use_count=2 backer-sd: job.c:200 Found Job OctaneDocs.2005-06-28_09.43.18 backer-sd: watchdog.c:184 Registered watchdog 0x8b3bb48, interval 300 one shot backer-sd: btimers.c:168 Start thread timer 0x8b3bb10 tip 0xf5bfcbb0 for 300 secs. backer-sd: cram-md5.c:52 send: auth cram-md5 <[EMAIL PROTECTED]> ssl=0 backer-sd: cram-md5.c:69 Authenticate OK backer-sd: cram-md5.c:99 cram-get: auth cram-md5 <[EMAIL PROTECTED]> ssl=0 backer-sd: cram-md5.c:119 sending resp to challenge: k7lO+S+KKk+OTG/N0+pvTB backer-sd: btimers.c:182 Stop bsock timer 0x8b3bb10 tid 0xf5bfcbb0. backer-sd: watchdog.c:204 Unregistered watchdog 0x8b3bb48 backer-sd: job.c:217 OK Authentication Job OctaneDocs.2005-06-28_09.43.18 backer-sd: jcr.c:344 Enter free_jcr 0x8b29c90 from job.c:226 backer-sd: jcr.c:362 Dec free_jcr 0x8b29c90 use_count=1 jobid=4966 backer-sd: jcr.c:365 free_jcr 0x8b29c90 use_count=1 backer-sd: workq.c:348 Back from user engine. backer-sd: workq.c:350 relock mutex backer-sd: workq.c:354 Done lock mutex backer-sd: workq.c:371 Check for work request backer-sd: workq.c:375 wq->first==NULL = 1 backer-sd: workq.c:376 timedout=0 backer-sd: workq.c:382 Loop again backer-sd: workq.c:302 Top of for loop backer-sd: workq.c:304 gettimeofday() backer-sd: workq.c:313 pthread_cond_timedwait() backer-sd: jo8 bget_dirmsg 53: 3012 Job OctaneDocs.2005-06-28_09.43.18 jobstatus 70 backer-dir: msgchan.c:227 <stored: 3012 Job OctaneDocs.2005-06-28_09.43.18 jobstatus 70 backer-dir: msgchan.c:181 SD msg_thread started. backer-dir: backup.c:160 Storage daemon connection OK backer-dir: bnet.c:696 Current host[ipv4:192.168.0.129:9102] All host[ipv4:192.168.0.129:9102] backer-dir: bnet.c:950 who=File daemon host=octane.rapsfin.local port=9102 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f9440 to bnet.c:955 backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f9670 to bnet.c:956 backer-dir: fd_cmds.c:87 Opened connection with File daemon backer-dir: watchdog.c:184 Registered watchdog 0x99f98d8, interval 300 one shot backer-dir: btimers.c:168 Start thread timer 0x99f8a90 tip 0xf5277bb0 for 300 secs. backer-dir: cram-md5.c:99 cram-get: auth cram-md5 <[EMAIL PROTECTED]> ssl=0 backer-dir: cram-md5.c:119 sending resp to challenge: w7hfI/Y9yX/5NEs7a7+9oD backer-dir: cram-md5.c:52 send: auth cram-md5 <[EMAIL PROTECTED]> ssl=0 backer-dir: cram-md5.c:69 Authenticate OK backer-dir: authenticate.c:124 >filed: 1000 OK auth backer-dir: authenticate.c:131 <stored: 2000 OK Hello backer-dir: btimers.c:182 Stop bsock timer 0x99f8a90 tid 0xf5277bb0. backer-dir: watchdog.c:204 Unregistered watchdog 0x99f98d8 backer-dir: fd_cmds.c:108 >filed: JobId=4966 Job=OctaneDocs.2005-06-28_09.43.18 SDid=1 SDtime=1119944505 Authorization=OMCO-ENND-FHMC-GENN-GJAI-LGAB-IOOJ-JMOK backer-dir: getmsg.c:78 bget_dirmsg 38: 2000 OK Job Windows XP,MVS,NT 5.1.2600 backer-dir: fd_cmds.c:110 <filed: 2000 OK Job Windows XP,MVS,NT 5.1.2600backer-dir: fd_cmds.c:475 Inc/Exc name=F C:/Documents and Settings/Shell/My Documents backer-dir: fd_cmds.c:475 Inc/Exc name=F C:/OCT backer-dir: fd_cmds.c:475 Inc/Exc name=F C:/NVIDIA backer-dir: fd_cmds.c:475 Inc/Exc name=F *.mov backer-dir: fd_cmds.c:475 Inc/Exc name=F *.mpeg backer-dir: fd_cmds.c:475 Inc/Exc name=F *.avi backer-dir: fd_cmds.c:475 Inc/Exc name=F *.mp3 backer-dir: fd_cmds.c:475 Inc/Exc name=F *.tmp backer-dir: fd_cmds.c:475 Inc/Exc name=F *.wma backer-dir: getmsg.c:78 bget_dirmsg 16: 2000 OK include backer-dir: getmsg.c:225 2000 OK include backer-dir: fd_cmds.c:225 >filed: level = full mtime_only=0 backer-dir: getmsg.c:78 bget_dirmsg 14: 2000 OK level backer-dir: getmsg.c:225 2000 OK level backer-dir: getmsg.c:78 bget_dirmsg 16: 2000 OK storage backer-dir: getmsg.c:225 2000 OK storage backer-dir: mem_pool.c:127 sm_get_pool_memory give 99f98d8 to fd_cmds.c:575 backer-dir: mem_pool.c:221 free_pool_memory 99f98d8 pool=2 from fd_cmds.c:597 backer-dir: getmsg.c:78 bget_dirmsg 46: 3010 Job OctaneDocs.2005-06-28_09.43.18 start backer-dir: msgchan.c:227 <stored: 3010 Job OctaneDocs.2005-06-28_09.43.18 start backer-dir: getmsg.c:78 bget_dirmsg 53: 3012 Job OctaneDocs.2005-06-28_09.43.18 jobstatus 82 backer-dir: msgchan.c:227 <stored: 3012 Job OctaneDocs.2005-06-28_09.43.18 jobstatus 82 backer-dir: getmsg.c:78 bget_dirmsg 15: 2000 OK backup backer-dir: getmsg.c:225 2000 OK backup backer-dir: getmsg.c:78 bget_dirmsg 54: CatReq Job=OctaneDocs.2005-06-28_09.43.18 FindMedia=1 backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:176 Catalog req jcr 0x99f67f8: CatReq Job=OctaneDocs.2005-06-28_09.43.18 FindMedia=1 backer-dir: catreq.c:105 catreq CatReq Job=OctaneDocs.2005-06-28_09.43.18 FindMedia=1 backer-dir: next_vol.c:52 CatReq FindMedia: Id=72, MediaType=File backer-dir: next_vol.c:68 catreq after find_next_vol ok=1 FW=0 backer-dir: next_vol.c:137 VolJobs=0 FirstWritten=0 backer-dir: catreq.c:86 Vol Info for OctaneDocs.2005-06-28_09.43.18: 1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=6 VolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-dir: catreq.c:278 >CatReq response: 1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=6 b.c:176 Running job OctaneDocs.2005-06-28_09.43.18 backer-sd: fd_cmds.c:118 Start run Job=OctaneDocs.2005-06-28_09.43.18 backer-sd: fd_cmds.c:135 <filed: append open session backer-sd: fd_cmds.c:211 Append open session: append open session backer-sd: fd_cmds.c:217 Append open session: /arch/backup/full/docs backer-sd: fd_cmds.c:222 >filed: 3000 OK open ticket = 1 backer-sd: fd_cmds.c:135 <filed: append data 1 backer-sd: fd_cmds.c:173 Append data: append data 1 backer-sd: fd_cmds.c:175 <bfiled: append data 1 backer-sd: append.c:51 Start append data. backer-sd: bnet.c:884 set network buffer size=32768 backer-sd: append.c:66 just before acquire_device backer-sd: device.c:349 lock 0 from acquire.c:259 backer-sd: device.c:414 block set 3 from acquire.c:260 backer-sd: device.c:400 unlock from acquire.c:261 backer-sd: acquire.c:263 acquire_append device is disk backer-sd: acquire.c:331 Not in append mode, try mount. backer-sd: acquire.c:341 Do mount_next_write_vol backer-sd: mount.c:57 Enter mount_next_volume() backer-sd: mount.c:92 Before dir_find_next_appendable_volume. backer-sd: askdir.c:156 dir_find_next_appendable_volume backer-sd: askdir.c:91 Get vol info=1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=6 VolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-sd: askdir.c:112 do_reqest_vol_info got slot=0 Volume=octanedocsfull_0001 backer-sd: askdir.c:165 JobId=4966 got possible Vol=octanedocsfull_0001 backer-sd: jcr.c:583 Inc get_next_jcr 0x8b29c90 use_count=2 backer-sd: jcr.c:390 Dec free_locked_jcr 0x8b29c90 use_count=1 backer-sd: askdir.c:190 dir_find_next_appendable_volume return true backer-sd: mount.c:104 After find_next_append. Vol=octanedocsfull_0001 Slot=0 backer-sd: autochanger.c:73 Want changer slot=0 backer-sd: mount.c:126 autoload_dev returns 0 backer-sd: mount.c:140 Ask=0 autochanger=0 backer-sd: mount.c:150 want vol=octanedocsfull_0001 backer-sd: dev.c:255 open_dev: tape=0 dev_name=/arch/backup/full/docs vol=octanedocsfull_0001 backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b3b5f0 to dev.c:320 backer-sd: dev.c:326 open_dev: device is disk /arch/backup/full/docs/octanedocsfull_0001 backer-sd: dev.c:348 open_dev: disk fd=7 opened backer-sd: mem_pool.c:221 free_pool_memory 8b3b5f0 pool=2 from dev.c:349 backer-sd: label.c:69 Enter read_volume_label device=/arch/backup/full/docs vol=octanedocsfull_0001 dev_Vol= backer-sd: dev.c:374 rewind_dev /arch/backup/full/docs backer-sd: mem_pool.c:127 sm_get_pool_memory give 8b43ba8 to record.c:154 backer-sd: label.c:102 Big if statement in read_volume_label backer-sd: block.c:752 Full read() in read_block_from_device() len=64512 backer-sd: block.c:789 Read device got 64512 bytes backer-sd: block.c:286 unser_block_header block_len=213 backer-sd: block.c:297 Read binbuf = 189 24 block_len=213 backer-sd: block.c:911 At end of read block backer-sd: block.c:917 Did lseek blk_size=213 rdlen=64512 backer-sd: block.c:922 Exit read_block read_len=64512 block_len=213 backer-sd: record.c:407 Block=0 Ver=2 size=213 backer-sd: record.c:415 Enter read_record_block: remlen=189 data_len=0 rem=0 blkver=2 backer-sd: record.c:475 rd_rec_blk() got FI=VOL_LABEL SessId=1 Strm=0 len=177 remlen=177 data_len=0 backer-sd: record.c:529 Rtn full rd_rec_blk FI=VOL_LABEL SessId=1 Strm=0 len=177 backer-sd: label.c:243 ser_read_vol Volume Label: Id : Bacula 1.0 immortal VerNo : 11 VolName : octanedocsfull_0001 PrevVolName : VolFile : 0 LabelType : VOL_LABEL LabelSize : 177 PoolName : OctaneDocsFull MediaType : File PoolType : Backup HostName : backer Date label written: 24-Jun-2005 08:38 backer-sd: record.c:173 Enter free_record. backer-sd: mem_pool.c:221 free_pool_memory 8b43dd8 pool=3 from record.c:175 backer-sd: record.c:177 Data buf is freed. backer-sd: mem_pool.c:221 free_pool_memory 8b3b720 pool=0 from record.c:178 backer-sd: rVolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-dir: catreq.c:279 Leave catreq jcr 0x99f67f8 backer-dir: getmsg.c:178 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:179 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 138: Jmsg Job=OctaneDocs.2005-06-28_09.43.18 type=6 level=0 backer-sd: Volume "octanedocsfull_0001" previously written, moving to end of data. backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:158 Got msg: Jmsg Job=OctaneDocs.2005-06-28_09.43.18 type=6 level=0 backer-sd: Volume "octanedocsfull_0001" previously written, moving to end of data. backer-dir: getmsg.c:166 Dispatch msg: backer-sd: Volume "octanedocsfull_0001" previously written, moving to end of data. backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:168 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 270: CatReq Job=OctaneDocs.2005-06-28_09.43.18 UpdateMedia VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 EndTime=1119944603 VolStatus=Append Slot=0 relabel=0 InChanger=0 VolReadTime=0 VolWriteTime=0 backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:176 Catalog req jcr 0x99f67f8: CatReq Job=OctaneDocs.2005-06-28_09.43.18 UpdateMedia VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 EndTime=1119944603 VolStatus=Append Slot=0 relabel=0 InChanger=0 VolReadTime=0 VolWriteTime=0 backer-dir: catreq.c:105 catreq CatReq Job=OctaneDocs.2005-06-28_09.43.18 UpdateMedia VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 EndTime=1119944603 VolStatus=Append Slot=0 relabel=0 InChanger=0 VolReadTime=0 VolWriteTime=0 backer-dir: catreq.c:191 Update media octanedocsfull_0001 oldStat= newStat=Append backer-dir: catreq.c:206 label=0 labeldate=0 backer-dir: catreq.c:218 Update media: BefVolJobs=0 After=0 backer-dir: catreq.c:234 db_update_media_record. Stat=Append Vol=octanedocsfull_0001 backer-dir: sql_update.c:267 update_media: FirstWritten=1119944600 backer-dir: sql_update.c:325 UPDATE Media SET VolJobs=0,VolFiles=0,VolBlocks=0,VolBytes=1,VolMounts=7,VolErrors=0,VolWrite s=1,MaxVolBytes=0,LastWritten='2005-06-28 09:43:23',VolStatus='Append',Slot=0,InChanger=0,VolReadTime=0,VolWriteTime=0 WHERE VolumeName='octanedocsfull_0001' backer-dir: catreq.c:86 Vol Info for OctaneDocs.2005-06-28_09.43.18: 1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-dir: catreq.c:278 >CatReq response: 1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-dir: catreq.c:279 Leave catreq jcr 0x99f67f8 backer-dir: getmsg.c:178 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:179 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 53: 3012 Job OctaneDocs.2005-06-28_09.43.18 jobstatus 82 backer-dir: msgchan.c:227 <stored: 3012 Job OctaneDocs.2005-06-28_09.43.18 jobstatus 82 backer-dir: getmsg.c:78 bget_dirmsg 231: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:183 Catalog upd jcr 0x99f67f8: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:320 UpdCat msg=UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:322 UpdCat VolSessId=1 VolSessT=1119944505 FI=1 Strm=5 data_len=154 backer-dir: catreq.c:333 dird<stored: stream=5 C:/Documents and Settings/Shell/My Documents/desktop.ini backer-dir: catreq.c:334 dird<stored: attr=A A IP4 B A A A BM BAA B BCwPoT BCfwsD BCfwr+ A A E backer-dir: catreq.c:342 dird<filed: stream=5 C:/Documents and Settings/Shell/My Documents/desktop.ini backer-dir: catreq.c:343 dird<filed: attr=A A IP4 B A A A BM BAA B BCwPoT BCfwsD BCfwr+ A A E backer-dir: sql_create.c:504 Fname=C:/Documents and Settings/Shell/My Documents/desktop.ini backer-dir: sql_create.c:505 put_file_into_catalog backer-dir: sql.c:397 split path=C:/Documents and Settings/Shell/My Documents/ file=desktop.ini backer-dir: sql_create.c:522 db_create_filename_record: desktop.ini backer-dir: sql_create.c:528 db_create_path_record: C:/Documents and Settings/Shell/My Documents/ backer-dir: sql_create.c:534 db_create_file_record OK backer-dir: sql_create.c:536 CreateAttributes Path=C:/Documents and Settings/Shell/My Documents/ File=desktop.ini FilenameId=1 backer-dir: getmsg.c:185 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:186 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 93: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:183 Catalog upd jcr 0x99f67f8: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:320 UpdCat msg=UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:322 UpdCat VolSessId=1 VolSessT=1119944505 FI=1 Strm=3 data_len=16 backer-dir: catreq.c:367 SIGlen=22 SIG=tGUTrwd4fA+7u5/ZczYX1C type=3 backer-dir: getmsg.c:185 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:186 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 241: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:183 Catalog upd jcr 0x99f67f8: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:320 UpdCat msg=UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:322 UpdCat VolSessId=1 VolSessT=1119944505 FI=2 Strm=5 data_len=164 backer-dir: catreq.c:333 dird<stored: stream=5 C:/Documents and Settings/Shell/My Documents/OctaneInfo/Octane.txt backer-dir: catreq.c:334 dird<stored: attr=A A IH/ B A A A CF BAA B BCwPoT BCt8LX BCt8LX A A E backer-dir: catreq.c:342 dird<filed: stream=5 C:/Documents and Settings/Shell/My Documents/OctaneInfo/Octane.txt backer-dir: catreq.c:343 dird<filed: attr=A A IH/ B A A A CF BAA B BCwPoT BCt8LX BCt8LX A A E backer-dir: sql_create.c:504 Fname=C:/Documents and Settings/Shell/My Documents/OctaneInfo/Octane.txt backer-dir: sql_create.c:505 put_file_into_catalog backer-dir: sql.c:397 split path=C:/Documents and Settings/Shell/My Documents/OctaneInfo/ file=Octane.txt backer-dir: sql_create.c:522 db_create_filename_record: Octane.txt backer-dir: sql_create.c:528 db_create_path_record: C:/Documents and Settings/Shell/My Documents/OctaneInfo/ backer-dir: sql_create.c:534 db_create_file_record OK backer-dir: sql_create.c:536 CreateAttributes Path=C:/Documents and Settings/Shell/My Documents/OctaneInfo/ File=Octane.txt FilenameId=111447 backer-dir: getmsg.c:185 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:186 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 93: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:183 Catalog upd jcr 0x99f67f8: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:320 UpdCat msg=UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:322 UpdCat VolSessId=1 VolSessT=1119944505 FI=2 Strm=3 data_len=16 backer-dir: catreq.c:367 SIGlen=22 SIG=pkJ+BX+Zy21fyk+Al6pctD type=3 backer-dir: getmsg.c:185 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:186 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 229: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:183 Catalog upd jcr 0x99f67f8: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:320 UpdCat msg=UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:322 UpdCat VolSessId=1 VolSessT=1119944505 FI=3 Strm=5 data_len=152 backer-dir: catreq.c:333 dird<stored: stream=5 C:/Documents and Settings/Shell/My Documents/OctaneInfo/ backer-dir: catreq.c:334 dird<stored: attr=A A EH/ B A A A A BAA A BCwPoT BCt8LX BCt8K/ A A E backer-dir: catreq.c:342 dird<filed: stream=5 C:/Documents and Settings/Shell/My Documents/OctaneInfo/ backer-dir: catreq.c:343 dird<filed: attr=A A EH/ B A A A A BAA A BCwPoT BCt8LX BCt8K/ A A E backer-dir: sql_create.c:504 Fname=C:/Documents and Settings/Shell/My Documents/OctaneInfo/ backer-dir: sql_create.c:505 put_file_into_catalog backer-dir: sql.c:397 split path=C:/Documents and Settings/Shell/My Documents/OctaneInfo/ file= backer-dir: sql_create.c:522 db_create_filename_record: backer-dir: sql_create.c:528 db_create_path_record: C:/Documents and Settings/Shell/My Documents/OctaneInfo/ backer-dir: sql_create.c:534 db_create_file_record OK backer-dir: sql_create.c:536 CreateAttributes Path=C:/Documents and Settings/Shell/My Documents/OctaneInfo/ File= FilenameId=6 backer-dir: getmsg.c:185 Calling freejcr 0x99f67f8 backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:186 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 218: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:183 Catalog upd jcr 0x99f67f8: UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:320 UpdCat msg=UpdCat Job=OctaneDocs.2005-06-28_09.43.18 FileAttributes backer-dir: catreq.c:322 UpdCat VolSessId=1 VolSessT=1119944505 FI=4 Strm=5 data_len=141 backer-dir: catreq.c:333 dird<stored: stream=5 C:/Documents and Settings/Shell/My Documents/ backer-dir: catreq.c:334 dird<stored: attr=A A EDb B A A A A BAA A BCwPoT BCt8LG BCfwr9 A A E backer-dir: catreq.c:342 dird<filed: stream=5 C:/Documents and Settings/Shell/My Documents/ backer-dir: catreq.c:343 dird<filed: attr=A A EDb B A A A A BAA A BCwPoT BCt8LG BCfwr9 A A E backer-dir: sql_create.c:504 Fname=C:/Documents and Settings/Shell/My Documents/ backer-dir: sql_create.c:505 put_file_into_catalog backer-dir: sql.c:397 split path=C:/Documents and Settings/Shell/My Documents/ file= backer-dir: sql_create.c:522 db_create_filename_record: backer-dir: sql_create.c:528 db_create_path_record: C:/Documents and Settings/Shell/My Documents/ backer-dir: sql_create.c:534 db_create_file_record OK backer-dir: sql_create.c:536 CreateAttributes Path=C:/Documents and Settings/Shell/My Documents/ File= FilenameId=6 backer-dir: getmsg.c:185 Calling freejcr 0x99f67f8 backer-dir: jcr.c:ecord.c:179 Leave free_record. backer-sd: dev.c:374 rewind_dev /arch/backup/full/docs backer-sd: label.c:163 Compare Vol names: VolName=octanedocsfull_0001 hdr=octanedocsfull_0001 backer-sd: label.c:177 Copy vol_name=octanedocsfull_0001 Volume Label: Id : Bacula 1.0 immortal VerNo : 11 VolName : octanedocsfull_0001 PrevVolName : VolFile : 0 LabelType : VOL_LABEL LabelSize : 177 PoolName : OctaneDocsFull MediaType : File PoolType : Backup HostName : backer Date label written: 24-Jun-2005 08:38 backer-sd: label.c:182 Leave read_volume_label() VOL_OK backer-sd: mount.c:185 dirVol=octanedocsfull_0001 dirStat=Append backer-sd: mount.c:192 Vol OK name=octanedocsfull_0001 backer-sd: mount.c:319 Device previously written, moving to end of data backer-sd: dev.c:436 eod_dev backer-sd: mount.c:346 update volinfo mounts=7 backer-sd: askdir.c:229 Update cat VolFiles=0 backer-sd: askdir.c:247 update_volume_info(): CatReq Job=OctaneDocs.2005-06-28_09.43.18 UpdateMedia VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 EndTime=1119944603 VolStatus=Append Slot=0 relabel=0 InChanger=0 VolReadTime=0 VolWriteTime=0 backer-sd: askdir.c:91 Get vol info=1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-sd: askdir.c:112 do_reqest_vol_info got slot=0 Volume=octanedocsfull_0001 backer-sd: askdir.c:255 get_volume_info(): 1000 OK VolName=octanedocsfull_0001 VolJobs=0 VolFiles=0 VolBlocks=0 VolBytes=1 VolMounts=7 VolErrors=0 VolWrites=1 MaxVolBytes=0 VolCapacityBytes=0 VolStatus=Append Slot=0 MaxVolJobs=1 MaxVolFiles=0 InChanger=0 VolReadTime=0 VolWriteTime=0 EndFile=0 EndBlock=0 backer-sd: mount.c:354 set APPEND, normal return from read_dev_for_append backer-sd: device.c:427 unblock 3 from acquire.c:369 backer-sd: append.c:77 Begin append device=/arch/backup/full/docs backer-sd: append.c:82 Just after acquire_device_for_append backer-sd: mem_pool.c:111 sm_get_pool_memory reuse 8b43dd8 to record.c:154 backer-sd: label.c:512 session_label record=8b43d78 backer-sd: label.c:568 Write sesson_label record JobId=4966 FI=SOS_LABEL SessId=1 Strm=4966 len=166 remainder=0 backer-sd: record.c:173 Enter free_record. backer-sd: mem_pool.c:221 free_pool_memory 8b43dd8 pool=3 from record.c:175 backer-sd: record.c:177 Data buf is freed. backer-sd: mem_pool.c:221 free_pool_memory 8b43d68 pool=0 from record.c:178 backer-sd: record.c:179 Leave free_record. backer-sd: label.c:572 Leave write_session_label Block=0 File=0 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: append.c:234 Enter bnet_get backer-sd: bget_msg.c:63 Got BNET_EOD backer-sd: append.c:236 End read loop with FD. Stat=-1 backer-sd: workq.c:324 timedwait=110 backer-sd: workq.c:371 Check for work request backer-sd: workq.c:375 wq->first==NULL = 1 backer-sd: workq.c:376 timedout=1 backer-sd: workq.c:378 break big loop backer-sd: workq.c:385 unlock mbacula-fd: mem_pool.c:127 sm_get_pool_memory give 9214800 to parse_conf.c:345 bacula-fd: mem_pool.c:221 free_pool_memory 9214800 pool=4 from parse_conf.c:350 bacula-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214800 to parse_conf.c:345 bacula-fd: mem_pool.c:221 free_pool_memory 9214800 pool=4 from parse_conf.c:350 bacula-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214800 to parse_conf.c:345 bacula-fd: mem_pool.c:221 free_pool_memory 9214800 pool=4 from parse_conf.c:350 bacula-fd: mem_pool.c:127 sm_get_pool_memory give 9214f30 to parse_conf.c:229 bacula-fd: message.c:328 add new d=9215160 msgtype=1 destcode=7 where=backer-dir mailcmd=*None* bacula-fd: message.c:308 Add to existing d=9215160 msgtype=2 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=3 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=4 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=5 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=6 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=7 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=8 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=9 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=10 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=11 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=12 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=13 destcode=7 where=backer-dir bacula-fd: message.c:308 Add to existing d=9215160 msgtype=14 destcode=7 where=backer-dir bacula-fd: message.c:342 Remove_msg_dest d=9215160 where=backer-dir bacula-fd: message.c:347 Found for remove d=9215160 msgtype=9 destcode=7 bacula-fd: message.c:349 Return rem_msg_dest bacula-fd: mem_pool.c:221 free_pool_memory 9214f30 pool=3 from parse_conf.c:254 bacula-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214800 to parse_conf.c:345 bacula-fd: mem_pool.c:221 free_pool_memory 9214800 pool=4 from parse_conf.c:350 bacula-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214800 to parse_conf.c:345 bacula-fd: mem_pool.c:221 free_pool_memory 9214800 pool=4 from parse_conf.c:350 bacula-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214800 to parse_conf.c:345 bacula-fd: mem_pool.c:221 free_pool_memory 9214800 pool=4 from parse_conf.c:350 backer-fd: message.c:417 Close_msg jcr=0x0 backer-fd: message.c:429 ===Begin close msg resource at 0x92140c0 backer-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214f30 to message.c:430 backer-fd: mem_pool.c:221 free_pool_memory 9214f30 pool=3 from message.c:503 backer-fd: message.c:504 Done walking message chain. backer-fd: message.c:511 ===End close msg resource backer-fd: message.c:256 Copy message resource 0x92151a0 to 0x9214248 backer-fd: daemon.c:56 Enter daemon_start backer-fd: daemon.c:109 Exit daemon_start backer-fd: mem_pool.c:127 sm_get_pool_memory give 9214288 to bsys.c:310 backer-fd: mem_pool.c:221 free_pool_memory 9214288 pool=2 from bsys.c:339 backer-fd: mem_pool.c:111 sm_get_pool_memory reuse 9214288 to bsys.c:384 backer-fd: jcr.c:82 read_last_jobs seek to 188 backer-fd: jcr.c:89 Read num_items=10 backer-fd: mem_pool.c:221 free_pool_memory 9214288 pool=2 from bsys.c:416 backer-fd: watchdog.c:71 Initialising NicB-hacked watchdog thread backer-fd: watchdog.c:234 NicB-reworked watchdog thread entered backer-fd: watchdog.c:184 Registered watchdog 0x9214138, interval 30 backer-fd: filed.c:256 filed: listening on port 9102 backer-fd: bnet_server.c:89 Addresses host[ipv4:0.0.0.0:9102] backer-fd: jcr.c:608 Start JCR timeout checks backer-fd: jcr.c:659 Finished JCR timeout checks backer-fd: jcr.c:608 Start JCR timeout checks backer-fd: jcr.c:659 Finished JCR timeout checks backer-fd: jcr.c:608 Start JCR timeout checks backer-fd: jcr.c:659 Finished JCR timeout checks backer-fd: jcr.c:608 Start JCR timeout chec344 Enter free_jcr 0x99f67f8 from getmsg.c:186 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 242: Jmsg Job=OctaneDocs.2005-06-28_09.43.18 type=3 level=0 octane-fd: OctaneDocs.2005-06-28_09.43.18 Fatal error: ..\filed\../../filed/backup.c:472 Network send error 77 to SD. ERR=An existing connection was forcibly closed by the remote host. backer-dir: jcr.c:499 Inc get_jcr 0x99f67f8 use_count=3 backer-dir: getmsg.c:138 Getmsg got jcr 0x99f67f8 backer-dir: getmsg.c:158 Got msg: Jmsg Job=OctaneDocs.2005-06-28_09.43.18 type=3 level=0 octane-fd: OctaneDocs.2005-06-28_09.43.18 Fatal error: ..\filed\../../filed/backup.c:472 Network send error 77 to SD. ERR=An existing connection was forcibly closed by the remote host. backer-dir: getmsg.c:166 Dispatch msg: octane-fd: OctaneDocs.2005-06-28_09.43.18 Fatal error: ..\filed\../../filed/backup.c:472 Network send error 77 to SD. ERR=An existing connection was forcibly closed by the remote host. backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from getmsg.c:168 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=2 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=2 backer-dir: getmsg.c:78 bget_dirmsg 78: 2800 End Job TermCode=102 JobFiles=11 ReadBytes=80991 JobBytes=37441 Errors=0 backer-dir: backup.c:237 FDStatus=f backer-dir: msgchan.c:264 I'm waiting for message thread termination. backer-dir: scheduler.c:206 enter find_runs() <SNIP> backer-dir: scheduler.c:242 Got job: BackupCatalog backer-dir: scheduler.c:285 run_now=0 run_nh=0 backer-dir: scheduler.c:308 Leave find_runs() backer-dir: jcr.c:608 Start JCR timeout checks backer-dir: jcr.c:583 Inc get_next_jcr 0x99f67f8 use_count=3 backer-dir: jcr.c:390 Dec free_locked_jcr 0x99f67f8 use_count=2 backer-dir: jcr.c:583 Inc get_next_jcr 0x99f24b8 use_count=2 backer-dir: jcr.c:390 Dec free_locked_jcr 0x99f24b8 use_count=1 backer-dir: jcr.c:583 Inc get_next_jcr 0x99f1a78 use_count=2 backer-dir: jcr.c:390 Dec free_locked_jcr 0x99f1a78 use_count=1 backer-dir: jcr.c:659 Finished JCR timeout checks backer-dir: job.c:378 job_monitor_watchdog 0x99da180 called backer-dir: jcr.c:583 Inc get_next_jcr 0x99f67f8 use_count=3 backer-dir: jcr.c:390 Dec free_locked_jcr 0x99f67f8 use_count=2 backer-dir: jcr.c:583 Inc get_next_jcr 0x99f24b8 use_count=2 backer-dir: job.c:387 Skipping JCR 0x99f24b8 (*Console*.2005-06-28_09.42.53) with JobId 0 backer-dir: jcr.c:390 Dec free_locked_jcr 0x99f24b8 use_count=1 backer-dir: jcr.c:583 Inc get_next_jcr 0x99f1a78 use_count=2 backer-dir: job.c:387 Skipping JCR 0x99f1a78 (*JobMonitor*.2005-06-28_09.41.47) with JobId 0 backer-dir: jcr.c:390 Dec free_locked_jcr 0x99f1a78 use_count=1 backer-dir: scan.c:138 Next arg=.messages backer-dir: scan.c:167 End arg=.messages next= backer-dir: scan.c:138 Next arg= backer-dir: scan.c:167 End arg= next= backer-dir: ua_dotcmds.c:95 Dot command: .messages backer-dir: msgchan.c:264 I'm waiting for message thread termination. backer-dir: msgchan.c:264 I'm waiting for message thread termination. backer-dir: backup.c:296 Enter backup_cleanup 102 f backer-dir: sql_get.c:331 VolNam=SELECT VolumeName,MAX(VolIndex) FROM JobMedia,Media WHERE JobMedia.JobId=4966 AND JobMedia.MediaId=Media.MediaId GROUP BY VolumeName ORDER BY 2 ASC backer-dir: msgchan.c:192 End msg_thread backer-dir: jcr.c:344 Enter free_jcr 0x99f67f8 from msgchan.c:199 backer-dir: jcr.c:362 Dec free_jcr 0x99f67f8 use_count=1 jobid=4966 backer-dir: jcr.c:365 free_jcr 0x99f67f8 use_count=1 backer-dir: sql_get.c:335 Num rows=0 backer-dir: backup.c:493 Leave backup_cleanup() backer-dir: job.c:286 ======== End Job ========== ------------------------------------------------------- SF.Net email is sponsored by: Discover Easy Linux Migration Strategies from IBM. Find simple to follow Roadmaps, straightforward articles, informative Webcasts and more! Get everything you need to get up to speed, fast. http://ads.osdn.com/?ad_idt77&alloc_id492&op=click _______________________________________________ Bacula-users mailing list Bacula-users@lists.sourceforge.net https://lists.sourceforge.net/lists/listinfo/bacula-users