Name | 5LYNDmsZwB6n7OlckoGmwREmGgkVDo1bjSoqOlfODm5mlKDmhM4Ofn_0 |
Workunit | 225502173 |
Created | 20 Sep 2024, 17:36:10 UTC |
Sent | 20 Sep 2024, 18:24:21 UTC |
Report deadline | 28 Sep 2024, 18:24:21 UTC |
Received | 20 Sep 2024, 22:04:36 UTC |
Server state | Over |
Outcome | Success |
Client state | Done |
Exit status | 0 (0x00000000) |
Computer ID | 10700350 |
Run time | 1 hours 37 min 57 sec |
CPU time | 8 hours 8 min 51 sec |
Validate state | Valid |
Credit | 560.14 |
Device peak FLOPS | 46.00 GFLOPS |
Application version | ATLAS Simulation v3.01 (vbox64_mt_mcore_atlas) windows_x86_64 |
Peak working set size | 91.05 MB |
Peak swap size | 93.27 MB |
Peak disk usage | 2.72 GB |
<core_client_version>7.20.2</core_client_version> <![CDATA[ <stderr_txt> 2024-09-20 11:34:17 (7628): Detected: vboxwrapper 26206 2024-09-20 11:34:17 (7628): Detected: BOINC client v7.20.2 2024-09-20 11:34:17 (7628): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 11:34:18 (7628): Successfully copied 'init_data.xml' to the shared directory. 2024-09-20 11:34:18 (7628): Create VM. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 11:34:19 (7628): Setting Memory Size for VM. (4800MB) 2024-09-20 11:34:19 (7628): Setting CPU Count for VM. (8) 2024-09-20 11:34:19 (7628): Setting Chipset Options for VM. 2024-09-20 11:34:19 (7628): Setting Graphics Controller Options for VM. 2024-09-20 11:34:20 (7628): Setting Boot Options for VM. 2024-09-20 11:34:20 (7628): Setting Network Configuration for NAT. 2024-09-20 11:34:20 (7628): Enabling VM Network Access. 2024-09-20 11:34:21 (7628): Disabling USB Support for VM. 2024-09-20 11:34:21 (7628): Disabling COM Port Support for VM. 2024-09-20 11:34:21 (7628): Disabling LPT Port Support for VM. 2024-09-20 11:34:21 (7628): Disabling Audio Support for VM. 2024-09-20 11:34:22 (7628): Disabling Clipboard Support for VM. 2024-09-20 11:34:22 (7628): Disabling Drag and Drop Support for VM. 2024-09-20 11:34:22 (7628): Adding storage controller(s) to VM. 2024-09-20 11:34:22 (7628): Adding virtual disk drive to VM. (ATLAS_vbox_3.01_image.vdi) 2024-09-20 11:34:24 (7628): Adding VirtualBox Guest Additions to VM. 2024-09-20 11:34:24 (7628): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB) 2024-09-20 11:34:24 (7628): forwarding host port 59323 to guest port 80 2024-09-20 11:34:24 (7628): Enabling remote desktop for VM. 2024-09-20 11:34:25 (7628): Required extension pack not installed, remote desktop not enabled. 2024-09-20 11:34:25 (7628): Enabling shared directory for VM. 2024-09-20 11:34:25 (7628): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 11:34:29 (7628): Successfully started VM. (PID = '3184') 2024-09-20 11:34:29 (7628): Reporting VM Process ID to BOINC. 2024-09-20 11:34:29 (7628): Guest Log: BIOS: VirtualBox 6.1.34 2024-09-20 11:34:29 (7628): Guest Log: CPUID EDX: 0x178bfbff 2024-09-20 11:34:29 (7628): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-20 11:34:29 (7628): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-20 11:34:29 (7628): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 11:34:29 (7628): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 11:34:30 (7628): VM state change detected. (old = 'running', new = 'paused') 2024-09-20 11:42:56 (7628): Preference change detected 2024-09-20 11:42:56 (7628): Setting CPU throttle for VM. (100%) 2024-09-20 11:42:56 (7628): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 11:42:57 (7628): VM state change detected. (old = 'paused', new = 'running') 2024-09-20 11:42:58 (7628): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-20 11:42:58 (7628): Guest Log: BIOS: Booting from Hard Disk... 2024-09-20 11:43:00 (7628): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-20 11:43:00 (7628): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2024-09-20 11:43:00 (7628): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2024-09-20 11:43:09 (7628): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-20 11:43:09 (7628): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-20 11:43:13 (7628): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000099 main Log opened 2024-09-20T11:34:44.161715000Z 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000163 main OS Product: Linux 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000187 main OS Release: 3.10.0-957.27.2.el7.x86_64 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000207 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000226 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000226 main Process ID: 1363 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000227 main Package type: LINUX_64BITS_GENERIC 2024-09-20 11:43:13 (7628): Guest Log: 00:00:00.000916 main 5.2.32 r132073 started. Verbose level = 0 2024-09-20 11:43:13 (7628): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2024-09-20 11:43:13 (7628): Guest Log: [INFO] Mounting shared directory 2024-09-20 11:43:13 (7628): Guest Log: [INFO] Checking for init_data.xml 2024-09-20 11:43:19 (7628): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2024-09-20 11:43:19 (7628): Guest Log: [INFO] Detected branch: prod 2024-09-20 11:43:20 (7628): Guest Log: This is the prod version of the ATLAS job wrapper 2024-09-20 11:43:20 (7628): Guest Log: Copying input files 2024-09-20 11:43:21 (7628): Guest Log: Copied input files into RunAtlas. 2024-09-20 11:43:21 (7628): Guest Log: This VM did not configure a local http proxy via BOINC. 2024-09-20 11:43:21 (7628): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2024-09-20 11:43:21 (7628): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2024-09-20 11:43:21 (7628): Guest Log: Further information can be found at the LHC@home message board. 2024-09-20 11:43:23 (7628): Guest Log: 00:00:10.023206 timesync vgsvcTimeSyncWorker: Radical guest time change: 25 718 485 520 000ns (GuestNow=1 726 857 802 649 157 000 ns GuestLast=1 726 832 084 163 637 000 ns fSetTimeLastLoop=true ) 2024-09-20 11:43:31 (7628): Guest Log: Running cvmfs_config stat atlas.cern.ch 2024-09-20 11:43:32 (7628): 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 2024-09-20 11:43:32 (7628): Guest Log: 2.6.3.0 1643 0 32196 137462 4 1 3117302 4096000 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2024-09-20 11:43:32 (7628): Guest Log: copied the webapp to /var/www 2024-09-20 11:43:32 (7628): Guest Log: ATHENA_PROC_NUMBER=8 2024-09-20 11:43:32 (7628): Guest Log: ATHENA_CORE_NUMBER=8 2024-09-20 11:43:32 (7628): 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 2024-09-20 11:43:32 (7628): Guest Log: *** Starting ATLAS job. (PandaID=6340251327 taskID=41078623) *** 2024-09-20 11:44:57 (7628): Stopping VM. 2024-09-20 11:45:03 (7628): Successfully stopped VM. 2024-09-20 11:48:05 (17704): Detected: vboxwrapper 26206 2024-09-20 11:48:05 (17704): Detected: BOINC client v7.20.2 2024-09-20 11:48:06 (17704): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 11:48:07 (17704): Guest Log: BIOS: VirtualBox 6.1.34 2024-09-20 11:48:07 (17704): Guest Log: CPUID EDX: 0x178bfbff 2024-09-20 11:48:07 (17704): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-20 11:48:07 (17704): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-20 11:48:07 (17704): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-20 11:48:07 (17704): Guest Log: BIOS: Booting from Hard Disk... 2024-09-20 11:48:07 (17704): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-20 11:48:07 (17704): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2024-09-20 11:48:07 (17704): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2024-09-20 11:48:07 (17704): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-20 11:48:07 (17704): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-20 11:48:07 (17704): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000099 main Log opened 2024-09-20T11:34:44.161715000Z 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000163 main OS Product: Linux 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000187 main OS Release: 3.10.0-957.27.2.el7.x86_64 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000207 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000226 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000226 main Process ID: 1363 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000227 main Package type: LINUX_64BITS_GENERIC 2024-09-20 11:48:07 (17704): Guest Log: 00:00:00.000916 main 5.2.32 r132073 started. Verbose level = 0 2024-09-20 11:48:07 (17704): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2024-09-20 11:48:07 (17704): Guest Log: [INFO] Mounting shared directory 2024-09-20 11:48:07 (17704): Guest Log: [INFO] Checking for init_data.xml 2024-09-20 11:48:07 (17704): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2024-09-20 11:48:07 (17704): Guest Log: [INFO] Detected branch: prod 2024-09-20 11:48:07 (17704): Guest Log: This is the prod version of the ATLAS job wrapper 2024-09-20 11:48:07 (17704): Guest Log: Copying input files 2024-09-20 11:48:07 (17704): Guest Log: Copied input files into RunAtlas. 2024-09-20 11:48:07 (17704): Guest Log: This VM did not configure a local http proxy via BOINC. 2024-09-20 11:48:07 (17704): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2024-09-20 11:48:07 (17704): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2024-09-20 11:48:07 (17704): Guest Log: Further information can be found at the LHC@home message board. 2024-09-20 11:48:07 (17704): Guest Log: 00:00:10.023206 timesync vgsvcTimeSyncWorker: Radical guest time change: 25 718 485 520 000ns (GuestNow=1 726 857 802 649 157 000 ns GuestLast=1 726 832 084 163 637 000 ns fSetTimeLastLoop=true ) 2024-09-20 11:48:07 (17704): Guest Log: Running cvmfs_config stat atlas.cern.ch 2024-09-20 11:48:07 (17704): 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 2024-09-20 11:48:07 (17704): Guest Log: 2.6.3.0 1643 0 32196 137462 4 1 3117302 4096000 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2024-09-20 11:48:07 (17704): Guest Log: copied the webapp to /var/www 2024-09-20 11:48:07 (17704): Guest Log: ATHENA_PROC_NUMBER=8 2024-09-20 11:48:07 (17704): Guest Log: ATHENA_CORE_NUMBER=8 2024-09-20 11:48:07 (17704): 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 2024-09-20 11:48:07 (17704): Guest Log: *** Starting ATLAS job. (PandaID=6340251327 taskID=41078623) *** 2024-09-20 11:48:07 (17704): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 11:48:13 (17704): Successfully started VM. (PID = '21520') 2024-09-20 11:48:13 (17704): Reporting VM Process ID to BOINC. 2024-09-20 11:48:13 (17704): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 11:48:13 (17704): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 11:48:13 (17704): Preference change detected 2024-09-20 11:48:13 (17704): Setting CPU throttle for VM. (100%) 2024-09-20 11:48:13 (17704): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 12:16:28 (17704): VM state change detected. (old = 'running', new = 'paused') 2024-09-20 12:16:38 (17704): VM state change detected. (old = 'paused', new = 'running') 2024-09-20 12:23:45 (17704): Stopping VM. 2024-09-20 12:23:57 (17704): Successfully stopped VM. 2024-09-20 12:35:39 (18724): Detected: vboxwrapper 26206 2024-09-20 12:35:39 (18724): Detected: BOINC client v7.20.2 2024-09-20 12:35:40 (18724): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 12:35:41 (18724): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 12:35:51 (18724): Successfully started VM. (PID = '14948') 2024-09-20 12:35:51 (18724): Reporting VM Process ID to BOINC. 2024-09-20 12:35:51 (18724): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 12:35:51 (18724): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 12:35:52 (18724): VM state change detected. (old = 'running', new = 'paused') 2024-09-20 12:36:01 (18724): Preference change detected 2024-09-20 12:36:01 (18724): Setting CPU throttle for VM. (100%) 2024-09-20 12:36:02 (18724): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 12:36:02 (18724): VM state change detected. (old = 'paused', new = 'running') 2024-09-20 12:37:49 (18724): Stopping VM. 2024-09-20 12:38:02 (18724): Successfully stopped VM. 2024-09-20 12:40:49 (19076): Detected: vboxwrapper 26206 2024-09-20 12:40:49 (19076): Detected: BOINC client v7.20.2 2024-09-20 12:40:50 (19076): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 12:40:51 (19076): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 12:41:01 (19076): Successfully started VM. (PID = '17236') 2024-09-20 12:41:01 (19076): Reporting VM Process ID to BOINC. 2024-09-20 12:41:01 (19076): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 12:41:01 (19076): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 12:41:01 (19076): Preference change detected 2024-09-20 12:41:01 (19076): Setting CPU throttle for VM. (100%) 2024-09-20 12:41:02 (19076): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 12:41:03 (19076): VM state change detected. (old = 'running', new = 'paused') 2024-09-20 12:41:13 (19076): VM state change detected. (old = 'paused', new = 'running') 2024-09-20 12:45:38 (19076): VM state change detected. (old = 'running', new = 'stopping') 2024-09-20 13:14:37 (19076): Stopping VM. 2024-09-20 13:14:37 (19076): Error in stop VM for VM: -108 Command: VBoxManage -q controlvm "boinc_59ae2daa5be7537d" savestate Output: VBoxManage.exe: error: Machine 'boinc_59ae2daa5be7537d' is not currently running 2024-09-20 13:14:37 (19076): VM did not stop when requested. 2024-09-20 13:14:37 (19076): VM was successfully terminated. 2024-09-20 13:17:45 (16336): Detected: vboxwrapper 26206 2024-09-20 13:17:45 (16336): Detected: BOINC client v7.20.2 2024-09-20 13:17:46 (16336): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 13:17:47 (16336): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 13:17:51 (16336): Successfully started VM. (PID = '14452') 2024-09-20 13:17:51 (16336): Reporting VM Process ID to BOINC. 2024-09-20 13:17:51 (16336): Guest Log: BIOS: VirtualBox 6.1.34 2024-09-20 13:17:51 (16336): Guest Log: CPUID EDX: 0x178bfbff 2024-09-20 13:17:51 (16336): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-20 13:17:51 (16336): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-20 13:17:51 (16336): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 13:17:51 (16336): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 13:17:51 (16336): Preference change detected 2024-09-20 13:17:51 (16336): Setting CPU throttle for VM. (100%) 2024-09-20 13:17:51 (16336): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 13:17:53 (16336): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-20 13:17:53 (16336): Guest Log: BIOS: Booting from Hard Disk... 2024-09-20 13:17:55 (16336): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-20 13:17:55 (16336): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2024-09-20 13:17:55 (16336): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2024-09-20 13:18:00 (16336): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-20 13:18:00 (16336): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-20 13:18:04 (16336): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000068 main Log opened 2024-09-20T13:18:01.982214000Z 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000136 main OS Product: Linux 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000161 main OS Release: 3.10.0-957.27.2.el7.x86_64 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000181 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000201 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000201 main Process ID: 1380 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.000202 main Package type: LINUX_64BITS_GENERIC 2024-09-20 13:18:04 (16336): Guest Log: 00:00:00.001565 main 5.2.32 r132073 started. Verbose level = 0 2024-09-20 13:18:04 (16336): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2024-09-20 13:18:04 (16336): Guest Log: [INFO] Mounting shared directory 2024-09-20 13:18:04 (16336): Guest Log: [INFO] Checking for init_data.xml 2024-09-20 13:18:07 (16336): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2024-09-20 13:18:07 (16336): Guest Log: [INFO] Detected branch: prod 2024-09-20 13:18:07 (16336): Guest Log: This is the prod version of the ATLAS job wrapper 2024-09-20 13:18:07 (16336): Guest Log: Copying input files 2024-09-20 13:18:09 (16336): Guest Log: Copied input files into RunAtlas. 2024-09-20 13:18:09 (16336): Guest Log: This VM did not configure a local http proxy via BOINC. 2024-09-20 13:18:09 (16336): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2024-09-20 13:18:09 (16336): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2024-09-20 13:18:09 (16336): Guest Log: Further information can be found at the LHC@home message board. 2024-09-20 13:18:14 (16336): Guest Log: 00:00:10.002804 timesync vgsvcTimeSyncWorker: Radical guest time change: 25 211 666 435 000ns (GuestNow=1 726 863 493 651 179 000 ns GuestLast=1 726 838 281 984 744 000 ns fSetTimeLastLoop=true ) 2024-09-20 13:18:17 (16336): Guest Log: Running cvmfs_config stat atlas.cern.ch 2024-09-20 13:18:17 (16336): 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 2024-09-20 13:18:17 (16336): Guest Log: 2.6.3.0 1660 0 32164 137464 4 1 3979040 4096000 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2024-09-20 13:18:18 (16336): Guest Log: copied the webapp to /var/www 2024-09-20 13:18:18 (16336): Guest Log: ATHENA_PROC_NUMBER=8 2024-09-20 13:18:18 (16336): Guest Log: ATHENA_CORE_NUMBER=8 2024-09-20 13:18:18 (16336): 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 2024-09-20 13:18:18 (16336): Guest Log: *** Starting ATLAS job. (PandaID=6340251327 taskID=41078623) *** 2024-09-20 13:19:55 (16336): Stopping VM. 2024-09-20 13:20:06 (16336): Successfully stopped VM. 2024-09-20 13:32:52 (3300): Detected: vboxwrapper 26206 2024-09-20 13:32:52 (3300): Detected: BOINC client v7.20.2 2024-09-20 13:32:53 (3300): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 13:32:54 (3300): Guest Log: BIOS: VirtualBox 6.1.34 2024-09-20 13:32:54 (3300): Guest Log: CPUID EDX: 0x178bfbff 2024-09-20 13:32:54 (3300): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-20 13:32:54 (3300): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-20 13:32:54 (3300): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-20 13:32:54 (3300): Guest Log: BIOS: Booting from Hard Disk... 2024-09-20 13:32:54 (3300): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-20 13:32:54 (3300): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f 2024-09-20 13:32:54 (3300): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f 2024-09-20 13:32:54 (3300): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-20 13:32:54 (3300): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-20 13:32:54 (3300): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000068 main Log opened 2024-09-20T13:18:01.982214000Z 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000136 main OS Product: Linux 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000161 main OS Release: 3.10.0-957.27.2.el7.x86_64 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000181 main OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000201 main Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000201 main Process ID: 1380 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.000202 main Package type: LINUX_64BITS_GENERIC 2024-09-20 13:32:54 (3300): Guest Log: 00:00:00.001565 main 5.2.32 r132073 started. Verbose level = 0 2024-09-20 13:32:54 (3300): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... 2024-09-20 13:32:54 (3300): Guest Log: [INFO] Mounting shared directory 2024-09-20 13:32:54 (3300): Guest Log: [INFO] Checking for init_data.xml 2024-09-20 13:32:54 (3300): Guest Log: [INFO] Probing /cvmfs/atlas.cern.ch... OK 2024-09-20 13:32:54 (3300): Guest Log: [INFO] Detected branch: prod 2024-09-20 13:32:54 (3300): Guest Log: This is the prod version of the ATLAS job wrapper 2024-09-20 13:32:54 (3300): Guest Log: Copying input files 2024-09-20 13:32:54 (3300): Guest Log: Copied input files into RunAtlas. 2024-09-20 13:32:54 (3300): Guest Log: This VM did not configure a local http proxy via BOINC. 2024-09-20 13:32:54 (3300): Guest Log: Small home clusters do not require a local http proxy but it is suggested if 2024-09-20 13:32:54 (3300): Guest Log: more than 10 cores throughout the same LAN segment are regularly running ATLAS like tasks. 2024-09-20 13:32:54 (3300): Guest Log: Further information can be found at the LHC@home message board. 2024-09-20 13:32:54 (3300): Guest Log: 00:00:10.002804 timesync vgsvcTimeSyncWorker: Radical guest time change: 25 211 666 435 000ns (GuestNow=1 726 863 493 651 179 000 ns GuestLast=1 726 838 281 984 744 000 ns fSetTimeLastLoop=true ) 2024-09-20 13:32:54 (3300): Guest Log: Running cvmfs_config stat atlas.cern.ch 2024-09-20 13:32:54 (3300): 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 2024-09-20 13:32:54 (3300): Guest Log: 2.6.3.0 1660 0 32164 137464 4 1 3979040 4096000 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch DIRECT 1 2024-09-20 13:32:54 (3300): Guest Log: copied the webapp to /var/www 2024-09-20 13:32:54 (3300): Guest Log: ATHENA_PROC_NUMBER=8 2024-09-20 13:32:54 (3300): Guest Log: ATHENA_CORE_NUMBER=8 2024-09-20 13:32:54 (3300): 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 2024-09-20 13:32:54 (3300): Guest Log: *** Starting ATLAS job. (PandaID=6340251327 taskID=41078623) *** 2024-09-20 13:32:54 (3300): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 13:33:03 (3300): Successfully started VM. (PID = '21076') 2024-09-20 13:33:03 (3300): Reporting VM Process ID to BOINC. 2024-09-20 13:33:03 (3300): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 13:33:03 (3300): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 13:33:03 (3300): Preference change detected 2024-09-20 13:33:03 (3300): Setting CPU throttle for VM. (100%) 2024-09-20 13:33:03 (3300): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 13:35:02 (3300): Stopping VM. 2024-09-20 13:35:14 (3300): Successfully stopped VM. 2024-09-20 13:38:02 (12932): Detected: vboxwrapper 26206 2024-09-20 13:38:02 (12932): Detected: BOINC client v7.20.2 2024-09-20 13:38:03 (12932): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 13:38:03 (12932): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 13:38:14 (12932): Successfully started VM. (PID = '14780') 2024-09-20 13:38:14 (12932): Reporting VM Process ID to BOINC. 2024-09-20 13:38:14 (12932): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 13:38:14 (12932): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 13:38:14 (12932): Preference change detected 2024-09-20 13:38:14 (12932): Setting CPU throttle for VM. (100%) 2024-09-20 13:38:14 (12932): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 14:01:42 (12932): Status Report: Elapsed Time: '6000.000000' 2024-09-20 14:01:42 (12932): Status Report: CPU Time: '17477.843750' 2024-09-20 14:11:32 (12932): Stopping VM. 2024-09-20 14:11:45 (12932): Successfully stopped VM. 2024-09-20 14:22:58 (13316): Detected: vboxwrapper 26206 2024-09-20 14:22:58 (13316): Detected: BOINC client v7.20.2 2024-09-20 14:22:59 (13316): Detected: VirtualBox VboxManage Interface (Version: 6.1.34) 2024-09-20 14:22:59 (13316): Starting VM using VBoxManage interface. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 14:23:09 (13316): Successfully started VM. (PID = '15284') 2024-09-20 14:23:09 (13316): Reporting VM Process ID to BOINC. 2024-09-20 14:23:09 (13316): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-20 14:23:09 (13316): Detected: Web Application Enabled (http://localhost:59323) 2024-09-20 14:23:09 (13316): Status Report: Elapsed Time: '6582.900206' 2024-09-20 14:23:09 (13316): Status Report: CPU Time: '22038.687500' 2024-09-20 14:23:09 (13316): Preference change detected 2024-09-20 14:23:09 (13316): Setting CPU throttle for VM. (100%) 2024-09-20 14:23:10 (13316): Setting checkpoint interval to 900 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 900 seconds)) 2024-09-20 14:40:37 (13316): Guest Log: *** Job finished *** 2024-09-20 14:40:37 (13316): Guest Log: *** The last 20 lines of the pilot log: *** 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:23,616 | INFO | [data] queue_monitor thread has finished 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:28,617 | INFO | job.realtimelogging is not enabled 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:29,627 | INFO | [payload] run_realtimelog thread has finished 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:30,899 | INFO | only monitor.control thread still running - safe to abort: ['<_MainThread(MainThread, started 140691458520896)>', '<ExcThread(monitor, started 140691023841024)>'] 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:31,585 | WARNING | job_aborted has been set - aborting pilot monitoring 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:31,585 | INFO | [monitor] control thread has ended 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,904 | INFO | all workflow threads have been joined 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,904 | INFO | end of generic workflow (traces error code: 0) 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,904 | INFO | traces error code: 0 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,905 | INFO | pilot has finished (exit code=0, shell exit code=0) 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,952 [wrapper] ==== pilot stdout END ==== 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,956 [wrapper] ==== wrapper stdout RESUME ==== 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,959 [wrapper] pilotpid: 6003 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:35,962 [wrapper] Pilot exit status: 0 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:36,047 [wrapper] pandaids: 6340251327 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:36,067 [wrapper] cleanup supervisor_pilot 24642 6004 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:36,070 [wrapper] Test setup, not cleaning 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:36,073 [wrapper] ==== wrapper stdout END ==== 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:36,076 [wrapper] ==== wrapper stderr END ==== 2024-09-20 14:40:37 (13316): Guest Log: 2024-09-20 21:40:36,083 [wrapper] apfmon messages muted 2024-09-20 14:40:37 (13316): Guest Log: *** Error codes and diagnostics *** 2024-09-20 14:40:37 (13316): Guest Log: "exeErrorCode": 0, 2024-09-20 14:40:37 (13316): Guest Log: "exeErrorDiag": "", 2024-09-20 14:40:37 (13316): Guest Log: "pilotErrorCode": 0, 2024-09-20 14:40:37 (13316): Guest Log: "pilotErrorDiag": "", 2024-09-20 14:40:37 (13316): Guest Log: *** Listing of results directory *** 2024-09-20 14:40:37 (13316): Guest Log: total 167036 2024-09-20 14:40:37 (13316): Guest Log: -rw-r--r--. 1 atlas atlas 482533 Sep 20 17:21 pilot3.tar.gz 2024-09-20 14:40:37 (13316): Guest Log: -rwx------. 1 atlas atlas 33679 Sep 20 17:26 runpilot2-wrapper.sh 2024-09-20 14:40:37 (13316): Guest Log: -rw-r--r--. 1 atlas atlas 5655 Sep 20 17:26 queuedata.json 2024-09-20 14:40:37 (13316): Guest Log: -rwxr-xr-x. 1 atlas atlas 8667 Sep 20 20:18 init_data.xml 2024-09-20 14:40:37 (13316): Guest Log: -rwxr-xr-x. 1 atlas atlas 495965 Sep 20 20:18 input.tar.gz 2024-09-20 14:40:37 (13316): Guest Log: -rwxr-xr-x. 1 atlas atlas 17539 Sep 20 20:18 start_atlas.sh 2024-09-20 14:40:37 (13316): Guest Log: lrwxrwxrwx. 1 atlas atlas 20 Sep 20 20:18 EVNT.41078621._000418.pool.root.1 -> /data/./ATLAS.root_0 2024-09-20 14:40:37 (13316): Guest Log: -rw-r--r--. 1 atlas atlas 2561 Sep 20 20:18 pandaJob.out 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 424 Sep 20 20:18 setup.sh.local 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 1010652 Sep 20 20:18 agis_schedconf.cvmfs.json 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 1618603 Sep 20 20:18 agis_ddmendpoints.agis.ALL.json 2024-09-20 14:40:37 (13316): Guest Log: drwx------. 4 atlas atlas 4096 Sep 20 20:18 pilot3 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 96 Sep 20 21:39 pilot_heartbeat.json 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 166201270 Sep 20 21:39 HITS.41078623._010894.pool.root.1 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 1027 Sep 20 21:40 memory_monitor_summary.json 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 276513 Sep 20 21:40 log.41078623._010894.job.log.tgz.1 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 7739 Sep 20 21:40 heartbeat.json 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 4470 Sep 20 21:40 pilotlog.txt 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 253129 Sep 20 21:40 log.41078623._010894.job.log.1 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 357 Sep 20 21:40 output.list 2024-09-20 14:40:37 (13316): Guest Log: -rw-r--r--. 1 atlas atlas 620 Sep 20 21:40 runtime_log 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 552960 Sep 20 21:40 result.tar.gz 2024-09-20 14:40:37 (13316): Guest Log: -rw-r--r--. 1 atlas atlas 10934 Sep 20 21:40 runtime_log.err 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 643 Sep 20 21:40 5LYNDmsZwB6n7OlckoGmwREmGgkVDo1bjSoqOlfODm5mlKDmhM4Ofn.diag 2024-09-20 14:40:37 (13316): Guest Log: Looking for outputfile HITS.41078623._010894.pool.root.1 2024-09-20 14:40:37 (13316): Guest Log: HITS file was successfully produced 2024-09-20 14:40:37 (13316): Guest Log: -rw-------. 1 atlas atlas 166201270 Sep 20 21:39 /home/atlas/RunAtlas/HITS.41078623._010894.pool.root.1 2024-09-20 14:40:38 (13316): Guest Log: Successfully finished the ATLAS job! 2024-09-20 14:40:38 (13316): Guest Log: Copying the results back to the shared directory! 2024-09-20 14:40:38 (13316): Guest Log: *** Contents of shared directory: *** 2024-09-20 14:40:38 (13316): Guest Log: total 592872 2024-09-20 14:40:38 (13316): Guest Log: -rwxrwxrwx. 1 root root 439812032 Sep 20 18:34 ATLAS.root_0 2024-09-20 14:40:38 (13316): Guest Log: -rwxrwxrwx. 1 root root 166201270 Sep 20 21:40 HITS.pool.root.1 2024-09-20 14:40:38 (13316): Guest Log: -rwxrwxrwx. 1 root root 8667 Sep 20 18:34 init_data.xml 2024-09-20 14:40:38 (13316): Guest Log: -rwxrwxrwx. 1 root root 495965 Sep 20 18:32 input.tar.gz 2024-09-20 14:40:38 (13316): Guest Log: -rwxrwxrwx. 1 root root 552960 Sep 20 21:40 result.tar.gz 2024-09-20 14:40:38 (13316): Guest Log: -rwxrwxrwx. 1 root root 17539 Sep 20 18:32 start_atlas.sh 2024-09-20 14:40:38 (13316): Guest Log: *** Success! Shutting down the machine. *** 2024-09-20 14:40:38 (13316): VM Completion File Detected. 2024-09-20 14:40:38 (13316): Powering off VM. 2024-09-20 14:40:38 (13316): Successfully stopped VM. 2024-09-20 14:40:38 (13316): Deregistering VM. (boinc_59ae2daa5be7537d, slot#13) 2024-09-20 14:40:38 (13316): Removing network bandwidth throttle group from VM. 2024-09-20 14:40:38 (13316): Removing VM from VirtualBox. 14:40:44 (13316): called boinc_finish(0) </stderr_txt> ]]>
©2024 CERN