| Name | 4QGNDmyZPg7n9Rq4apOajLDm4fhM0noT9bVof3QYDmzJWKDmhagPIn_0 |
| Workunit | 232787069 |
| Created | 2 Jun 2025, 19:01:07 UTC |
| Sent | 2 Jun 2025, 19:57:15 UTC |
| Report deadline | 10 Jun 2025, 19:57:15 UTC |
| Received | 6 Jun 2025, 13:04:39 UTC |
| Server state | Over |
| Outcome | Success |
| Client state | Done |
| Exit status | 0 (0x00000000) |
| Computer ID | 10875349 |
| Run time | 1 days 14 hours 49 min 20 sec |
| CPU time | 1 days 14 hours 24 min 13 sec |
| Validate state | Valid |
| Credit | 493.47 |
| Device peak FLOPS | 1.97 GFLOPS |
| Application version | ATLAS Simulation v3.01 (vbox64_mt_mcore_atlas) x86_64-pc-linux-gnu |
| Peak working set size | 4.10 GB |
| Peak swap size | 5.62 GB |
| Peak disk usage | 3.73 GB |
Stderr output
<core_client_version>8.0.2</core_client_version> <![CDATA[ <stderr_txt> http proxy but it is suggested if 2025-06-03 08:37:43 (5877): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-03 08:37:43 (5877): Guest Log: Further information can be found at the LHC@home message board. 2025-06-03 08:37:43 (5877): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-03 08:37:43 (5877): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-03 08:37:43 (5877): Guest Log: 2.6.3.0 1532 1 32112 146718 4 1 3117617 4096000 0 65024 0 0 n/a 0 0 http://s1fnal-cvmfs.openhtc.io:8080/cvmfs/atlas.cern.ch DIRECT 1 2025-06-03 08:37:43 (5877): Guest Log: copied the webapp to /var/www 2025-06-03 08:37:43 (5877): Guest Log: core_number=1 2025-06-03 08:37:43 (5877): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-03 08:37:43 (5877): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-03 08:37:43 (5877): Starting VM using VBoxManage interface. (boinc_9a3f0b489ab163a1, slot#0) 2025-06-03 08:37:50 (5877): Successfully started VM. (PID = '6317') 2025-06-03 08:37:50 (5877): Reporting VM Process ID to BOINC. 2025-06-03 08:37:50 (5877): Guest Log: BIOS: VirtualBox 6.1.50 2025-06-03 08:37:50 (5877): Guest Log: CPUID EDX: 0x178bfbff 2025-06-03 08:37:50 (5877): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2025-06-03 08:37:50 (5877): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2025-06-03 08:37:50 (5877): VM state change detected. (old = 'poweredoff', new = 'running') 2025-06-03 08:37:50 (5877): Detected: Web Application Enabled (http://localhost:45851) 2025-06-03 08:37:50 (5877): Detected: Remote Desktop Enabled (localhost:34945) 2025-06-03 08:37:50 (5877): Status Report: Elapsed Time: '42458.879010' 2025-06-03 08:37:50 (5877): Status Report: CPU Time: '41584.480000' 2025-06-03 08:37:50 (5877): Preference change detected 2025-06-03 08:37:50 (5877): Setting CPU throttle for VM. (100%) 2025-06-03 08:37:51 (5877): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 180 seconds) or (Vbox_job.xml: 900 seconds)) 2025-06-03 08:37:52 (5877): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2025-06-03 08:37:52 (5877): Guest Log: BIOS: Booting from Hard Disk... 2025-06-03 08:38:19 (5877): Guest Log: BIOS: KBD: unsupported int 16h function 03 2025-06-03 08:38:19 (5877): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2025-06-03 08:38:19 (5877): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2025-06-03 08:38:49 (5877): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2025-06-03 08:38:49 (5877): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2025-06-03 08:39:33 (5877): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.000798 main Log opened 2025-06-03T08:39:32.038521000Z 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.001365 main OS Product: Linux 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.001506 main OS Release: 3.10.0-957.27.2.el7.x86_64 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.001626 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.001759 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.001762 main Process ID: 1263 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.001763 main Package type: LINUX_64BITS_GENERIC 2025-06-03 08:39:33 (5877): Guest Log: 00:00:00.007306 main 5.2.32 r132073 started. Verbose level = 0 2025-06-03 08:39:34 (5877): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2025-06-03 08:39:34 (5877): Guest Log: [INFO] Mounting shared directory 2025-06-03 08:39:34 (5877): Guest Log: [INFO] Checking for init_data.xml 2025-06-03 08:40:11 (5877): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2025-06-03 08:40:11 (5877): Guest Log: [INFO] Detected branch: prod 2025-06-03 08:40:12 (5877): Guest Log: This is the prod version of the ATLAS job wrapper 2025-06-03 08:40:12 (5877): Guest Log: Copying input files 2025-06-03 08:40:16 (5877): Guest Log: Copied input files into RunAtlas. 2025-06-03 08:40:16 (5877): Guest Log: This VM did not configure a local http proxy via BOINC. 2025-06-03 08:40:16 (5877): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2025-06-03 08:40:16 (5877): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-03 08:40:16 (5877): Guest Log: Further information can be found at the LHC@home message board. 2025-06-03 08:40:55 (5877): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-03 08:41:00 (5877): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-03 08:41:00 (5877): Guest Log: 2.6.3.0 1550 1 29996 146735 4 1 2485263 4096001 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2025-06-03 08:41:02 (5877): Guest Log: copied the webapp to /var/www 2025-06-03 08:41:03 (5877): Guest Log: core_number=1 2025-06-03 08:41:03 (5877): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-03 08:41:03 (5877): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-03 08:44:32 (5877): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 08:34:34 (5877): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 08:34:36 (5877): Guest Log: 00:05:00.152397 timesync vgsvcTimeSyncWorker: Radical host time change: 85 811 790 000 000ns (HostNow=1 749 026 075 173 000 000 ns HostLast=1 748 940 263 383 000 000 ns) 2025-06-04 08:34:46 (5877): Guest Log: 00:05:10.196809 timesync vgsvcTimeSyncWorker: Radical guest time change: 85 813 027 656 000ns (GuestNow=1 749 026 085 217 617 000 ns GuestLast=1 748 940 272 189 961 000 ns fSetTimeLastLoop=true ) 2025-06-04 08:40:44 (5877): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 08:41:02 (5877): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 10:07:12 (5877): Status Report: Elapsed Time: '48459.269453' 2025-06-04 10:07:12 (5877): Status Report: CPU Time: '47225.170000' 2025-06-04 11:46:12 (5877): Status Report: Elapsed Time: '54459.269453' 2025-06-04 11:46:12 (5877): Status Report: CPU Time: '53169.230000' 2025-06-04 13:25:13 (5877): Status Report: Elapsed Time: '60459.269453' 2025-06-04 13:25:13 (5877): Status Report: CPU Time: '59113.060000' 2025-06-04 15:04:14 (5877): Status Report: Elapsed Time: '66459.269453' 2025-06-04 15:04:14 (5877): Status Report: CPU Time: '65056.950000' 2025-06-04 16:43:14 (5877): Status Report: Elapsed Time: '72459.269453' 2025-06-04 16:43:14 (5877): Status Report: CPU Time: '71002.690000' 2025-06-04 18:22:15 (5877): Status Report: Elapsed Time: '78459.269453' 2025-06-04 18:22:15 (5877): Status Report: CPU Time: '76946.690000' 2025-06-04 19:17:46 (6608): Detected: vboxwrapper 26206 2025-06-04 19:17:46 (6608): Detected: BOINC client v8.0.2 2025-06-04 19:17:55 (6608): Detected: VirtualBox VboxManage Interface (Version: 6.1.50) 2025-06-04 19:17:57 (6608): Guest Log: BIOS: VirtualBox 6.1.50 2025-06-04 19:17:57 (6608): Guest Log: CPUID EDX: 0x178bfbff 2025-06-04 19:17:57 (6608): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2025-06-04 19:17:57 (6608): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2025-06-04 19:17:57 (6608): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2025-06-04 19:17:57 (6608): Guest Log: BIOS: Booting from Hard Disk... 2025-06-04 19:17:57 (6608): Guest Log: BIOS: KBD: unsupported int 16h function 03 2025-06-04 19:17:57 (6608): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2025-06-04 19:17:57 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2025-06-04 19:17:57 (6608): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2025-06-04 19:17:57 (6608): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2025-06-04 19:17:57 (6608): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.000798 main Log opened 2025-06-03T08:39:32.038521000Z 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.001365 main OS Product: Linux 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.001506 main OS Release: 3.10.0-957.27.2.el7.x86_64 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.001626 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.001759 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.001762 main Process ID: 1263 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.001763 main Package type: LINUX_64BITS_GENERIC 2025-06-04 19:17:57 (6608): Guest Log: 00:00:00.007306 main 5.2.32 r132073 started. Verbose level = 0 2025-06-04 19:17:57 (6608): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2025-06-04 19:17:57 (6608): Guest Log: [INFO] Mounting shared directory 2025-06-04 19:17:57 (6608): Guest Log: [INFO] Checking for init_data.xml 2025-06-04 19:17:57 (6608): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2025-06-04 19:17:57 (6608): Guest Log: [INFO] Detected branch: prod 2025-06-04 19:17:57 (6608): Guest Log: This is the prod version of the ATLAS job wrapper 2025-06-04 19:17:57 (6608): Guest Log: Copying input files 2025-06-04 19:17:57 (6608): Guest Log: Copied input files into RunAtlas. 2025-06-04 19:17:57 (6608): Guest Log: This VM did not configure a local http proxy via BOINC. 2025-06-04 19:17:57 (6608): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2025-06-04 19:17:57 (6608): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-04 19:17:57 (6608): Guest Log: Further information can be found at the LHC@home message board. 2025-06-04 19:17:57 (6608): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-04 19:17:57 (6608): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-04 19:17:57 (6608): Guest Log: 2.6.3.0 1550 1 29996 146735 4 1 2485263 4096001 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2025-06-04 19:17:57 (6608): Guest Log: copied the webapp to /var/www 2025-06-04 19:17:57 (6608): Guest Log: core_number=1 2025-06-04 19:17:57 (6608): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-04 19:17:57 (6608): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-04 19:17:57 (6608): Guest Log: 00:05:00.152397 timesync vgsvcTimeSyncWorker: Radical host time change: 85 811 790 000 000ns (HostNow=1 749 026 075 173 000 000 ns HostLast=1 748 940 263 383 000 000 ns) 2025-06-04 19:17:57 (6608): Guest Log: 00:05:10.196809 timesync vgsvcTimeSyncWorker: Radical guest time change: 85 813 027 656 000ns (GuestNow=1 749 026 085 217 617 000 ns GuestLast=1 748 940 272 189 961 000 ns fSetTimeLastLoop=true ) 2025-06-04 19:17:57 (6608): Starting VM using VBoxManage interface. (boinc_9a3f0b489ab163a1, slot#0) 2025-06-04 19:18:08 (6608): Successfully started VM. (PID = '6989') 2025-06-04 19:18:08 (6608): Reporting VM Process ID to BOINC. 2025-06-04 19:18:08 (6608): Guest Log: BIOS: VirtualBox 6.1.50 2025-06-04 19:18:08 (6608): Guest Log: CPUID EDX: 0x178bfbff 2025-06-04 19:18:08 (6608): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2025-06-04 19:18:08 (6608): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2025-06-04 19:18:08 (6608): VM state change detected. (old = 'poweredoff', new = 'running') 2025-06-04 19:18:08 (6608): Detected: Web Application Enabled (http://localhost:45851) 2025-06-04 19:18:08 (6608): Detected: Remote Desktop Enabled (localhost:34945) 2025-06-04 19:18:08 (6608): Status Report: Elapsed Time: '81243.269453' 2025-06-04 19:18:08 (6608): Status Report: CPU Time: '79700.540000' 2025-06-04 19:18:08 (6608): Preference change detected 2025-06-04 19:18:08 (6608): Setting CPU throttle for VM. (100%) 2025-06-04 19:18:09 (6608): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 180 seconds) or (Vbox_job.xml: 900 seconds)) 2025-06-04 19:18:11 (6608): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2025-06-04 19:18:11 (6608): Guest Log: BIOS: Booting from Hard Disk... 2025-06-04 19:18:44 (6608): Guest Log: BIOS: KBD: unsupported int 16h function 03 2025-06-04 19:18:44 (6608): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2025-06-04 19:18:44 (6608): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2025-06-04 19:18:59 (6608): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 19:19:19 (6608): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 19:19:24 (6608): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2025-06-04 19:19:24 (6608): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2025-06-04 19:19:48 (6608): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 19:20:09 (6608): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 19:20:24 (6608): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000418 main Log opened 2025-06-04T19:19:42.954887000Z 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000695 main OS Product: Linux 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000752 main OS Release: 3.10.0-957.27.2.el7.x86_64 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000800 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000851 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000852 main Process ID: 1249 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.000853 main Package type: LINUX_64BITS_GENERIC 2025-06-04 19:20:24 (6608): Guest Log: 00:00:00.003370 main 5.2.32 r132073 started. Verbose level = 0 2025-06-04 19:20:25 (6608): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2025-06-04 19:20:25 (6608): Guest Log: [INFO] Mounting shared directory 2025-06-04 19:20:26 (6608): Guest Log: [INFO] Checking for init_data.xml 2025-06-04 19:21:08 (6608): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2025-06-04 19:21:08 (6608): Guest Log: [INFO] Detected branch: prod 2025-06-04 19:21:09 (6608): Guest Log: This is the prod version of the ATLAS job wrapper 2025-06-04 19:21:09 (6608): Guest Log: Copying input files 2025-06-04 19:21:17 (6608): Guest Log: Copied input files into RunAtlas. 2025-06-04 19:21:18 (6608): Guest Log: This VM did not configure a local http proxy via BOINC. 2025-06-04 19:21:18 (6608): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2025-06-04 19:21:18 (6608): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-04 19:21:18 (6608): Guest Log: Further information can be found at the LHC@home message board. 2025-06-04 19:21:20 (6608): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 19:21:39 (6608): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 19:22:11 (6608): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-04 19:22:15 (6608): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-04 19:22:15 (6608): Guest Log: 2.6.3.0 1541 1 32104 146792 4 1 3094784 4096000 0 65024 0 0 n/a 0 0 http://s1ral-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2025-06-04 19:22:19 (6608): Guest Log: copied the webapp to /var/www 2025-06-04 19:22:19 (6608): Guest Log: core_number=1 2025-06-04 19:22:19 (6608): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-04 19:22:19 (6608): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-04 19:24:47 (6608): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 19:48:25 (6608): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 19:48:25 (6608): Stopping VM. 2025-06-04 19:48:40 (6608): Successfully stopped VM. 2025-06-04 19:51:24 (20787): Detected: vboxwrapper 26206 2025-06-04 19:51:24 (20787): Detected: BOINC client v8.0.2 2025-06-04 19:51:25 (20787): Detected: VirtualBox VboxManage Interface (Version: 6.1.50) 2025-06-04 19:51:26 (20787): Guest Log: BIOS: VirtualBox 6.1.50 2025-06-04 19:51:26 (20787): Guest Log: CPUID EDX: 0x178bfbff 2025-06-04 19:51:26 (20787): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2025-06-04 19:51:26 (20787): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2025-06-04 19:51:26 (20787): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2025-06-04 19:51:26 (20787): Guest Log: BIOS: Booting from Hard Disk... 2025-06-04 19:51:26 (20787): Guest Log: BIOS: KBD: unsupported int 16h function 03 2025-06-04 19:51:26 (20787): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2025-06-04 19:51:26 (20787): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2025-06-04 19:51:26 (20787): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2025-06-04 19:51:26 (20787): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2025-06-04 19:51:26 (20787): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000418 main Log opened 2025-06-04T19:19:42.954887000Z 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000695 main OS Product: Linux 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000752 main OS Release: 3.10.0-957.27.2.el7.x86_64 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000800 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000851 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000852 main Process ID: 1249 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.000853 main Package type: LINUX_64BITS_GENERIC 2025-06-04 19:51:26 (20787): Guest Log: 00:00:00.003370 main 5.2.32 r132073 started. Verbose level = 0 2025-06-04 19:51:26 (20787): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2025-06-04 19:51:26 (20787): Guest Log: [INFO] Mounting shared directory 2025-06-04 19:51:26 (20787): Guest Log: [INFO] Checking for init_data.xml 2025-06-04 19:51:26 (20787): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2025-06-04 19:51:26 (20787): Guest Log: [INFO] Detected branch: prod 2025-06-04 19:51:26 (20787): Guest Log: This is the prod version of the ATLAS job wrapper 2025-06-04 19:51:26 (20787): Guest Log: Copying input files 2025-06-04 19:51:26 (20787): Guest Log: Copied input files into RunAtlas. 2025-06-04 19:51:26 (20787): Guest Log: This VM did not configure a local http proxy via BOINC. 2025-06-04 19:51:26 (20787): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2025-06-04 19:51:26 (20787): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-04 19:51:26 (20787): Guest Log: Further information can be found at the LHC@home message board. 2025-06-04 19:51:26 (20787): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-04 19:51:26 (20787): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-04 19:51:26 (20787): Guest Log: 2.6.3.0 1541 1 32104 146792 4 1 3094784 4096000 0 65024 0 0 n/a 0 0 http://s1ral-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2025-06-04 19:51:26 (20787): Guest Log: copied the webapp to /var/www 2025-06-04 19:51:26 (20787): Guest Log: core_number=1 2025-06-04 19:51:26 (20787): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-04 19:51:26 (20787): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-04 19:51:26 (20787): Starting VM using VBoxManage interface. (boinc_9a3f0b489ab163a1, slot#0) 2025-06-04 19:51:32 (20787): Successfully started VM. (PID = '20889') 2025-06-04 19:51:32 (20787): Reporting VM Process ID to BOINC. 2025-06-04 19:51:32 (20787): VM state change detected. (old = 'poweredoff', new = 'running') 2025-06-04 19:51:32 (20787): Detected: Web Application Enabled (http://localhost:45851) 2025-06-04 19:51:32 (20787): Detected: Remote Desktop Enabled (localhost:34945) 2025-06-04 19:51:32 (20787): Status Report: Elapsed Time: '81581.269453' 2025-06-04 19:51:32 (20787): Status Report: CPU Time: '79816.020000' 2025-06-04 19:51:32 (20787): Preference change detected 2025-06-04 19:51:32 (20787): Setting CPU throttle for VM. (100%) 2025-06-04 19:51:32 (20787): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 180 seconds) or (Vbox_job.xml: 900 seconds)) 2025-06-04 19:58:27 (20787): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 20:01:57 (20787): Stopping VM. 2025-06-04 20:07:48 (38808): Detected: vboxwrapper 26206 2025-06-04 20:07:48 (38808): Detected: BOINC client v8.0.2 2025-06-04 20:07:50 (38808): Detected: VirtualBox VboxManage Interface (Version: 6.1.50) 2025-06-04 20:07:51 (38808): Starting VM using VBoxManage interface. (boinc_9a3f0b489ab163a1, slot#0) 2025-06-04 20:07:53 (38808): Successfully started VM. (PID = '38908') 2025-06-04 20:07:53 (38808): Reporting VM Process ID to BOINC. 2025-06-04 20:07:53 (38808): Guest Log: BIOS: VirtualBox 6.1.50 2025-06-04 20:07:53 (38808): Guest Log: CPUID EDX: 0x178bfbff 2025-06-04 20:07:53 (38808): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2025-06-04 20:07:53 (38808): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2025-06-04 20:07:53 (38808): VM state change detected. (old = 'poweredoff', new = 'running') 2025-06-04 20:07:53 (38808): Detected: Web Application Enabled (http://localhost:45851) 2025-06-04 20:07:53 (38808): Detected: Remote Desktop Enabled (localhost:34945) 2025-06-04 20:07:53 (38808): Status Report: Elapsed Time: '81998.269453' 2025-06-04 20:07:53 (38808): Status Report: CPU Time: '80088.420000' 2025-06-04 20:07:53 (38808): Preference change detected 2025-06-04 20:07:53 (38808): Setting CPU throttle for VM. (100%) 2025-06-04 20:07:53 (38808): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 180 seconds) or (Vbox_job.xml: 900 seconds)) 2025-06-04 20:07:55 (38808): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2025-06-04 20:07:55 (38808): Guest Log: BIOS: Booting from Hard Disk... 2025-06-04 20:07:58 (38808): Guest Log: BIOS: KBD: unsupported int 16h function 03 2025-06-04 20:07:58 (38808): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2025-06-04 20:07:58 (38808): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2025-06-04 20:08:10 (38808): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2025-06-04 20:08:10 (38808): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2025-06-04 20:08:34 (38808): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000406 main Log opened 2025-06-04T20:08:33.869919000Z 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000680 main OS Product: Linux 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000738 main OS Release: 3.10.0-957.27.2.el7.x86_64 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000785 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000836 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000838 main Process ID: 1239 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.000838 main Package type: LINUX_64BITS_GENERIC 2025-06-04 20:08:34 (38808): Guest Log: 00:00:00.003969 main 5.2.32 r132073 started. Verbose level = 0 2025-06-04 20:08:35 (38808): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2025-06-04 20:08:35 (38808): Guest Log: [INFO] Mounting shared directory 2025-06-04 20:08:35 (38808): Guest Log: [INFO] Checking for init_data.xml 2025-06-04 20:09:19 (38808): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2025-06-04 20:09:19 (38808): Guest Log: [INFO] Detected branch: prod 2025-06-04 20:09:19 (38808): Guest Log: This is the prod version of the ATLAS job wrapper 2025-06-04 20:09:19 (38808): Guest Log: Copying input files 2025-06-04 20:09:23 (38808): Guest Log: Copied input files into RunAtlas. 2025-06-04 20:09:23 (38808): Guest Log: This VM did not configure a local http proxy via BOINC. 2025-06-04 20:09:23 (38808): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2025-06-04 20:09:23 (38808): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-04 20:09:23 (38808): Guest Log: Further information can be found at the LHC@home message board. 2025-06-04 20:10:03 (38808): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-04 20:10:07 (38808): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-04 20:10:07 (38808): Guest Log: 2.6.3.0 1533 0 32060 146792 4 1 3100934 4096000 0 65024 0 0 n/a 0 0 http://s1ral-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2025-06-04 20:10:14 (38808): Guest Log: copied the webapp to /var/www 2025-06-04 20:10:14 (38808): Guest Log: core_number=1 2025-06-04 20:10:14 (38808): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-04 20:10:14 (38808): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-04 20:14:53 (38808): VM state change detected. (old = 'running', new = 'paused') 2025-06-04 20:45:48 (38808): VM state change detected. (old = 'paused', new = 'running') 2025-06-04 20:45:49 (38808): Stopping VM. 2025-06-04 20:46:34 (38808): Guest Log: 00:06:20.252311 timesync vgsvcTimeSyncWorker: Radical host time change: 1 865 651 000 000ns (HostNow=1 749 069 949 176 000 000 ns HostLast=1 749 068 083 525 000 000 ns) 2025-06-04 20:46:34 (38808): Successfully stopped VM. 2025-06-04 20:51:49 (6194): Detected: vboxwrapper 26206 2025-06-04 20:51:49 (6194): Detected: BOINC client v8.0.2 2025-06-04 20:52:03 (6194): Detected: VirtualBox VboxManage Interface (Version: 6.1.50) 2025-06-04 20:52:05 (6194): Guest Log: BIOS: VirtualBox 6.1.50 2025-06-04 20:52:05 (6194): Guest Log: CPUID EDX: 0x178bfbff 2025-06-04 20:52:05 (6194): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2025-06-04 20:52:05 (6194): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2025-06-04 20:52:05 (6194): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2025-06-04 20:52:05 (6194): Guest Log: BIOS: Booting from Hard Disk... 2025-06-04 20:52:05 (6194): Guest Log: BIOS: KBD: unsupported int 16h function 03 2025-06-04 20:52:05 (6194): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2025-06-04 20:52:05 (6194): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2025-06-04 20:52:05 (6194): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2025-06-04 20:52:05 (6194): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2025-06-04 20:52:05 (6194): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000406 main Log opened 2025-06-04T20:08:33.869919000Z 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000680 main OS Product: Linux 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000738 main OS Release: 3.10.0-957.27.2.el7.x86_64 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000785 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000836 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000838 main Process ID: 1239 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.000838 main Package type: LINUX_64BITS_GENERIC 2025-06-04 20:52:05 (6194): Guest Log: 00:00:00.003969 main 5.2.32 r132073 started. Verbose level = 0 2025-06-04 20:52:05 (6194): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2025-06-04 20:52:05 (6194): Guest Log: [INFO] Mounting shared directory 2025-06-04 20:52:05 (6194): Guest Log: [INFO] Checking for init_data.xml 2025-06-04 20:52:05 (6194): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2025-06-04 20:52:05 (6194): Guest Log: [INFO] Detected branch: prod 2025-06-04 20:52:05 (6194): Guest Log: This is the prod version of the ATLAS job wrapper 2025-06-04 20:52:05 (6194): Guest Log: Copying input files 2025-06-04 20:52:05 (6194): Guest Log: Copied input files into RunAtlas. 2025-06-04 20:52:05 (6194): Guest Log: This VM did not configure a local http proxy via BOINC. 2025-06-04 20:52:05 (6194): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2025-06-04 20:52:05 (6194): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2025-06-04 20:52:05 (6194): Guest Log: Further information can be found at the LHC@home message board. 2025-06-04 20:52:05 (6194): Guest Log: Running cvmfs_config stat atlas.cern.ch 2025-06-04 20:52:05 (6194): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE 2025-06-04 20:52:05 (6194): Guest Log: 2.6.3.0 1533 0 32060 146792 4 1 3100934 4096000 0 65024 0 0 n/a 0 0 http://s1ral-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2025-06-04 20:52:05 (6194): Guest Log: copied the webapp to /var/www 2025-06-04 20:52:05 (6194): Guest Log: core_number=1 2025-06-04 20:52:05 (6194): Guest Log: Apptainer command /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/data,/home/atlas/RunAtlas /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 2025-06-04 20:52:05 (6194): Guest Log: *** Starting ATLAS job. (PandaID=6677393253 taskID=45006595) *** 2025-06-04 20:52:05 (6194): Guest Log: 00:06:20.252311 timesync vgsvcTimeSyncWorker: Radical host time change: 1 865 651 000 000ns (HostNow=1 749 069 949 176 000 000 ns HostLast=1 749 068 083 525 000 000 ns) 2025-06-04 20:52:05 (6194): Starting VM using VBoxManage interface. (boinc_9a3f0b489ab163a1, slot#0) 2025-06-04 20:53:17 (6194): Successfully started VM. (PID = '6730') 2025-06-04 20:53:18 (6194): Reporting VM Process ID to BOINC. 2025-06-04 20:53:18 (6194): VM state change detected. (old = 'poweredoff', new = 'running') 2025-06-04 20:53:18 (6194): Detected: Web Application Enabled (http://localhost:45851) 2025-06-04 20:53:18 (6194): Detected: Remote Desktop Enabled (localhost:34945) 2025-06-04 20:53:18 (6194): Status Report: Elapsed Time: '82421.670451' 2025-06-04 20:53:18 (6194): Status Report: CPU Time: '80277.340000' 2025-06-04 20:53:18 (6194): Preference change detected 2025-06-04 20:53:18 (6194): Setting CPU throttle for VM. (100%) 2025-06-04 20:53:22 (6194): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 180 seconds) or (Vbox_job.xml: 900 seconds)) 2025-06-04 20:53:27 (6194): Guest Log: 00:06:31.295503 timesync vgsvcTimeSyncWorker: Radical guest time change: 1 866 097 124 000ns (GuestNow=1 749 069 960 218 794 000 ns GuestLast=1 749 068 094 121 670 000 ns fSetTimeLastLoop=true ) 2025-06-04 20:58:51 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-05 20:48:52 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-05 20:48:58 (6194): Guest Log: 00:12:02.300428 timesync vgsvcTimeSyncWorker: Radical host time change: 85 810 721 000 000ns (HostNow=1 749 156 537 969 000 000 ns HostLast=1 749 070 727 248 000 000 ns) 2025-06-05 20:49:08 (6194): Guest Log: 00:12:12.641246 timesync vgsvcTimeSyncWorker: Radical guest time change: 85 810 011 947 000ns (GuestNow=1 749 156 548 309 877 000 ns GuestLast=1 749 070 738 297 930 000 ns fSetTimeLastLoop=true ) 2025-06-05 20:55:54 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-05 20:56:14 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-05 22:22:40 (6194): Status Report: Elapsed Time: '88422.216118' 2025-06-05 22:22:40 (6194): Status Report: CPU Time: '86139.560000' 2025-06-06 00:01:41 (6194): Status Report: Elapsed Time: '94422.216118' 2025-06-06 00:01:41 (6194): Status Report: CPU Time: '92083.130000' 2025-06-06 01:40:41 (6194): Status Report: Elapsed Time: '100422.216118' 2025-06-06 01:40:41 (6194): Status Report: CPU Time: '98026.700000' 2025-06-06 02:01:58 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:02:12 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:03:13 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:03:34 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:11:47 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:12:07 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:12:26 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:13:06 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:13:16 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:13:57 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:14:07 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:14:27 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:14:38 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:14:57 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:15:07 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:15:27 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:15:37 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:15:58 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:16:08 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:16:27 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:16:37 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:16:58 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:17:08 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:17:28 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:17:38 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:17:59 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:18:08 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:18:28 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:18:38 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:18:59 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:19:39 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:19:58 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:20:09 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:20:29 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:20:39 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:20:59 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:21:10 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:21:29 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:21:39 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:23:00 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:23:09 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:23:30 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:23:40 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:24:00 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:24:10 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:24:31 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:24:41 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:25:00 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:25:10 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:25:31 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:25:41 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:26:01 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:26:41 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:27:01 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:27:11 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:27:31 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 02:27:42 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 02:28:02 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 03:31:35 (6194): Status Report: Elapsed Time: '106422.600045' 2025-06-06 03:31:35 (6194): Status Report: CPU Time: '103999.450000' 2025-06-06 05:10:36 (6194): Status Report: Elapsed Time: '112422.600045' 2025-06-06 05:10:36 (6194): Status Report: CPU Time: '109943.120000' 2025-06-06 06:49:37 (6194): Status Report: Elapsed Time: '118422.600045' 2025-06-06 06:49:37 (6194): Status Report: CPU Time: '115886.750000' 2025-06-06 08:28:37 (6194): Status Report: Elapsed Time: '124422.600045' 2025-06-06 08:28:37 (6194): Status Report: CPU Time: '121830.340000' 2025-06-06 08:57:12 (6194): VM state change detected. (old = 'running', new = 'paused') 2025-06-06 08:57:30 (6194): VM state change detected. (old = 'paused', new = 'running') 2025-06-06 10:07:59 (6194): Status Report: Elapsed Time: '130422.600045' 2025-06-06 10:07:59 (6194): Status Report: CPU Time: '127778.290000' 2025-06-06 11:47:00 (6194): Status Report: Elapsed Time: '136423.600045' 2025-06-06 11:47:00 (6194): Status Report: CPU Time: '133723.070000' 2025-06-06 13:04:09 (6194): Guest Log: *** Job finished *** 2025-06-06 13:04:09 (6194): Guest Log: *** The last 20 lines of the pilot log: *** 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:48,728 [wrapper] supervise_pilot (15 min periods counter: 66) 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:49,185 | INFO | [data] copytool_out thread has finished 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:50,071 | INFO | [data] queue_monitor thread has finished 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:51,239 | INFO | only monitor.control thread still running - safe to abort: ['<_MainThread(MainThread, started 139743136835392)>', '<ExcThread(monitor, started 139742691698432)>'] 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:52,076 | WARNING | job_aborted has been set - aborting pilot monitoring 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:52,077 | INFO | [monitor] control thread has ended 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,246 | INFO | all workflow threads have been joined 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,247 | INFO | end of generic workflow (traces error code: 0) 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,248 | INFO | traces error code: 0 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,249 | INFO | pilot has finished (exit code=0, shell exit code=0) 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,850 [wrapper] ==== pilot stdout END ==== 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,860 [wrapper] ==== wrapper stdout RESUME ==== 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,870 [wrapper] pilotpid: 5822 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:56,878 [wrapper] Pilot exit status: 0 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:57,212 [wrapper] pandaids: 6677393253 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:57,260 [wrapper] cleanup supervisor_pilot 13353 5823 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:57,268 [wrapper] Test setup, not cleaning 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:57,277 [wrapper] apfmon messages muted 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:57,285 [wrapper] ==== wrapper stdout END ==== 2025-06-06 13:04:09 (6194): Guest Log: 2025-06-06 12:55:57,293 [wrapper] ==== wrapper stderr END ==== 2025-06-06 13:04:09 (6194): Guest Log: *** Error codes and diagnostics *** 2025-06-06 13:04:09 (6194): Guest Log: "exeErrorCode": 0, 2025-06-06 13:04:09 (6194): Guest Log: "exeErrorDiag": "", 2025-06-06 13:04:09 (6194): Guest Log: "pilotErrorCode": 0, 2025-06-06 13:04:09 (6194): Guest Log: "pilotErrorDiag": "", 2025-06-06 13:04:09 (6194): Guest Log: *** Listing of results directory *** 2025-06-06 13:04:09 (6194): Guest Log: total 195164 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 495897 Jun 2 18:47 pilot3.tar.gz 2025-06-06 13:04:09 (6194): Guest Log: -rwx------. 1 atlas atlas 37140 Jun 2 19:00 runpilot2-wrapper.sh 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 5111 Jun 2 19:00 queuedata.json 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 6459 Jun 4 20:09 init_data.xml 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 15093 Jun 4 20:09 start_atlas.sh 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 508880 Jun 4 20:09 input.tar.gz 2025-06-06 13:04:09 (6194): Guest Log: lrwxrwxrwx. 1 atlas atlas 20 Jun 4 20:09 EVNT.45006593._000338.pool.root.1 -> /data/./ATLAS.root_0 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 2520 Jun 4 20:10 pandaJob.out 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 991007 Jun 4 20:12 agis_schedconf.cvmfs.json 2025-06-06 13:04:09 (6194): Guest Log: drwx------. 4 atlas atlas 4096 Jun 4 20:12 pilot3 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 185099638 Jun 6 12:53 HITS.45006595._008430.pool.root.1 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 1023 Jun 6 12:54 memory_monitor_summary.json 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 1598969 Jun 6 12:54 agis_ddmendpoints.agis.ALL.json 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 646023 Jun 6 12:54 log.45006595._008430.job.log.tgz.1 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 98 Jun 6 12:55 pilot_heartbeat.json 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 7711 Jun 6 12:55 heartbeat.json 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 4536 Jun 6 12:55 pilotlog.txt 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 4847839 Jun 6 12:55 log.45006595._008430.job.log.1 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 357 Jun 6 12:55 output.list 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 620 Jun 6 12:55 runtime_log 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 5509120 Jun 6 12:55 result.tar.gz 2025-06-06 13:04:09 (6194): Guest Log: -rw-r--r--. 1 atlas atlas 8476 Jun 6 12:55 runtime_log.err 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 660 Jun 6 12:55 4QGNDmyZPg7n9Rq4apOajLDm4fhM0noT9bVof3QYDmzJWKDmhagPIn.diag 2025-06-06 13:04:09 (6194): Guest Log: Looking for outputfile HITS.45006595._008430.pool.root.1 2025-06-06 13:04:09 (6194): Guest Log: HITS file was successfully produced 2025-06-06 13:04:09 (6194): Guest Log: -rw-------. 1 atlas atlas 185099638 Jun 6 12:53 /home/atlas/RunAtlas/HITS.45006595._008430.pool.root.1 2025-06-06 13:04:10 (6194): Guest Log: Successfully finished the ATLAS job! 2025-06-06 13:04:10 (6194): Guest Log: Copying the results back to the shared directory! 2025-06-06 13:04:11 (6194): Guest Log: *** Contents of shared directory: *** 2025-06-06 13:04:11 (6194): Guest Log: total 217124 2025-06-06 13:04:11 (6194): Guest Log: -rw-r--r--. 1 root root 216283437 Jun 2 20:25 ATLAS.root_0 2025-06-06 13:04:11 (6194): Guest Log: -rw-r--r--. 1 root root 6459 Jun 2 20:25 init_data.xml 2025-06-06 13:04:11 (6194): Guest Log: -rw-r--r--. 1 root root 508880 Jun 2 20:25 input.tar.gz 2025-06-06 13:04:11 (6194): Guest Log: -rw-r--r--. 1 root root 5509120 Jun 6 2025 result.tar.gz 2025-06-06 13:04:11 (6194): Guest Log: -rw-r--r--. 1 root root 15093 Jun 2 20:25 start_atlas.sh 2025-06-06 13:04:11 (6194): Guest Log: *** Success! Shutting down the machine. *** 2025-06-06 13:04:11 (6194): VM Completion File Detected. 2025-06-06 13:04:11 (6194): Powering off VM. 2025-06-06 13:04:16 (6194): Successfully stopped VM. 2025-06-06 13:04:16 (6194): Deregistering VM. (boinc_9a3f0b489ab163a1, slot#0) 2025-06-06 13:04:17 (6194): Removing network bandwidth throttle group from VM. 2025-06-06 13:04:17 (6194): Removing VM from VirtualBox. 13:04:23 (6194): called boinc_finish(0) </stderr_txt> ]]>
©2025 CERN