Stderr output

<core_client_version>7.14.2</core_client_version>
<![CDATA[
<stderr_txt>
2019-11-10 10:07:15 (2984): Detected: vboxwrapper 26197
2019-11-10 10:07:15 (2984): Detected: BOINC client v7.7
2019-11-10 10:07:15 (2984): Status Report: Detected vboxsvc.exe. (PID = '6772')
2019-11-10 10:07:15 (2984): Detected: VirtualBox VboxManage Interface (Version: 5.2.8)
2019-11-10 10:07:15 (2984): Detected: Sandbox Configuration Enabled
2019-11-10 10:07:16 (2984): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2019-11-10 10:07:16 (2984): Successfully copied 'init_data.xml' to the shared directory.
2019-11-10 10:07:17 (2984): Create VM. (boinc_334bae1d113e7c04, slot#1)
2019-11-10 10:07:17 (2984): Setting Memory Size for VM. (3000MB)
2019-11-10 10:07:17 (2984): Setting CPU Count for VM. (3)
2019-11-10 10:07:18 (2984): Setting Chipset Options for VM.
2019-11-10 10:07:18 (2984): Setting Boot Options for VM.
2019-11-10 10:07:18 (2984): Setting Network Configuration for NAT.
2019-11-10 10:07:19 (2984): Enabling VM Network Access.
2019-11-10 10:07:19 (2984): Disabling USB Support for VM.
2019-11-10 10:07:19 (2984): Disabling COM Port Support for VM.
2019-11-10 10:07:19 (2984): Disabling LPT Port Support for VM.
2019-11-10 10:07:20 (2984): Disabling Audio Support for VM.
2019-11-10 10:07:20 (2984): Disabling Clipboard Support for VM.
2019-11-10 10:07:20 (2984): Disabling Drag and Drop Support for VM.
2019-11-10 10:07:21 (2984): Adding storage controller(s) to VM.
2019-11-10 10:07:21 (2984): Adding virtual disk drive to VM. (vm_image.vdi)
2019-11-10 10:07:21 (2984): Adding VirtualBox Guest Additions to VM.
2019-11-10 10:07:21 (2984): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB)
2019-11-10 10:07:22 (2984): forwarding host port 59139 to guest port 80
2019-11-10 10:07:22 (2984): Enabling remote desktop for VM.
2019-11-10 10:07:22 (2984): Required extension pack not installed, remote desktop not enabled.
2019-11-10 10:07:22 (2984): Enabling shared directory for VM.
2019-11-10 10:07:23 (2984): Starting VM using VBoxManage interface. (boinc_334bae1d113e7c04, slot#1)
2019-11-10 10:07:28 (2984): Successfully started VM. (PID = '7992')
2019-11-10 10:07:28 (2984): Reporting VM Process ID to BOINC.
2019-11-10 10:07:28 (2984): Guest Log: BIOS: VirtualBox 5.2.8

2019-11-10 10:07:28 (2984): Guest Log: CPUID EDX: 0x178bfbff

2019-11-10 10:07:28 (2984): Guest Log: BIOS: ata0-0: PCHS=16383/16/63 LCHS=1024/255/63

2019-11-10 10:07:28 (2984): VM state change detected. (old = 'PoweredOff', new = 'Running')
2019-11-10 10:07:28 (2984): Detected: Web Application Enabled (http://localhost:59139)
2019-11-10 10:07:28 (2984): Preference change detected
2019-11-10 10:07:28 (2984): Setting CPU throttle for VM. (100%)
2019-11-10 10:07:28 (2984): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 200 seconds) or (Vbox_job.xml: 600 seconds))
2019-11-10 10:07:30 (2984): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032

2019-11-10 10:07:30 (2984): Guest Log: BIOS: Booting from Hard Disk...

2019-11-10 10:07:32 (2984): Guest Log: BIOS: KBD: unsupported int 16h function 03

2019-11-10 10:07:32 (2984): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 

2019-11-10 10:07:49 (2984): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds

2019-11-10 10:07:49 (2984): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)

2019-11-10 10:08:18 (2984): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000360 main     Log opened 2019-11-10T09:08:17.693275000Z

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000794 main     OS Product: Linux

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000851 main     OS Release: 4.14.44-11.cernvm.x86_64

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000905 main     OS Version: #1 SMP Mon May 28 16:49:00 CEST 2018

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000953 main     Executable: /usr/share/vboxguest52/usr/sbin/VBoxService

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000955 main     Process ID: 3041

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.000956 main     Package type: LINUX_64BITS_GENERIC

2019-11-10 10:08:18 (2984): Guest Log: 00:00:00.002727 main     5.2.6 r120293 started. Verbose level = 0

2019-11-10 10:08:46 (2984): Guest Log: [INFO] Mounting the shared directory

2019-11-10 10:08:46 (2984): Guest Log: [INFO] Shared directory mounted, enabling vboxmonitor

2019-11-10 10:08:46 (2984): Guest Log: [DEBUG] Testing network connection to cern.ch on port 80

2019-11-10 10:08:46 (2984): Guest Log: [DEBUG] Connection to cern.ch 80 port [tcp/http] succeeded!

2019-11-10 10:08:46 (2984): Guest Log: [DEBUG] 0

2019-11-10 10:08:46 (2984): Guest Log: [DEBUG] Testing VCCS connection to vccs.cern.ch on port 443

2019-11-10 10:08:46 (2984): Guest Log: [DEBUG] Connection to vccs.cern.ch 443 port [tcp/https] succeeded!

2019-11-10 10:08:47 (2984): Guest Log: [DEBUG] 0

2019-11-10 10:08:47 (2984): Guest Log: [DEBUG] Testing connection to Condor server on port 9618

2019-11-10 10:08:47 (2984): Guest Log: [DEBUG] Connection to vccondor01.cern.ch 9618 port [tcp/condor] succeeded!

2019-11-10 10:08:47 (2984): Guest Log: [DEBUG] 0

2019-11-10 10:09:52 (2984): Guest Log: [DEBUG] Probing CVMFS ...

2019-11-10 10:09:55 (2984): Guest Log: Probing /cvmfs/grid.cern.ch... OK

2019-11-10 10:09:57 (2984): 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

2019-11-10 10:09:57 (2984): Guest Log: 2.4.4.0 3759 1 28288 10705 3 1 318381 10240000 2 65024 0 3 100 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1

2019-11-10 10:10:04 (2984): Guest Log: [INFO] Reading volunteer information

2019-11-10 10:10:04 (2984): Guest Log: [INFO] Volunteer: Wildi (217981)

2019-11-10 10:10:04 (2984): Guest Log: [INFO] VMID: e5b01749-9626-457a-8945-16c64690aa2f

2019-11-10 10:10:05 (2984): Guest Log: [INFO] Requesting an X509 credential from LHC@home

2019-11-10 10:10:06 (2984): Guest Log: [INFO] Running the fast benchmark.

2019-11-10 10:11:33 (2984): Guest Log: [INFO] Machine performance 19.22 HEPSPEC06

2019-11-10 10:11:33 (2984): Guest Log: [INFO] Theory application starting. Check log files.

2019-11-10 10:11:34 (2984): Guest Log: [DEBUG] HTCondor ping

2019-11-10 10:11:34 (2984): Guest Log: [DEBUG] 0

2019-11-10 10:12:36 (2984): Guest Log: [INFO] New Job Starting in slot1

2019-11-10 10:12:36 (2984): Guest Log: [INFO] Condor JobID:  514680.29 in slot1

2019-11-10 10:12:36 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 10:12:37 (2984): Guest Log: [INFO] Condor JobID:  514680.34 in slot2

2019-11-10 10:12:41 (2984): Guest Log: [INFO] MCPlots JobID: 52052601 in slot1

2019-11-10 10:12:42 (2984): Guest Log: [INFO] MCPlots JobID: 52052594 in slot2

2019-11-10 10:12:46 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 10:12:35 CET 2019 [boinc pp jets 13000 150,-,1860 - pythia8 8.212 tune-A2 100000 156]

2019-11-10 10:12:47 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 10:12:36 CET 2019 [boinc pp jets 7000 - - pythia6 6.425 pnocr 100000 156]

2019-11-10 10:32:01 (2984): Guest Log: [INFO] New Job Starting in slot3

2019-11-10 10:32:01 (2984): Guest Log: [INFO] Condor JobID:  514681.41 in slot3

2019-11-10 10:32:07 (2984): Guest Log: [INFO] MCPlots JobID: 52052771 in slot3

2019-11-10 10:32:12 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 10:32:01 CET 2019 [boinc pp jets 7000 800 - pythia6 6.428 361 100000 156]

2019-11-10 10:34:46 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 10:34:49 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 10:34:49 (2984): Guest Log: [INFO] Condor JobID:  514681.54 in slot2

2019-11-10 10:34:55 (2984): Guest Log: [INFO] MCPlots JobID: 52052747 in slot2

2019-11-10 10:35:00 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 10:34:50 CET 2019 [boinc pp mb-inelastic 900 - - pythia8 8.180 default-CD 100000 156]

2019-11-10 10:58:14 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 10:58:17 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 10:58:18 (2984): Guest Log: [INFO] Condor JobID:  514683.89 in slot2

2019-11-10 10:58:23 (2984): Guest Log: [INFO] MCPlots JobID: 52052994 in slot2

2019-11-10 10:58:29 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 10:58:18 CET 2019 [boinc pp w1j 7000 100 - pythia8 8.186 default-noFsr 100000 156]

2019-11-10 11:47:32 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 11:47:32 (2984): Status Report: Elapsed Time: '6000.000000'
2019-11-10 11:47:32 (2984): Status Report: CPU Time: '16902.703125'
2019-11-10 12:00:00 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 12:00:03 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 12:00:03 (2984): Guest Log: [INFO] Condor JobID:  514688.36 in slot2

2019-11-10 12:00:09 (2984): Guest Log: [INFO] MCPlots JobID: 52053628 in slot2

2019-11-10 12:00:14 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 12:00:03 CET 2019 [boinc pp ue 7000 - - herwig++ 2.6.1a LHC-UE-EE-4-CTEQ6L1 100000 156]

2019-11-10 12:20:30 (2984): Guest Log: [INFO] Job finished in slot3 with 0.

2019-11-10 12:20:33 (2984): Guest Log: [INFO] New Job Starting in slot3

2019-11-10 12:20:33 (2984): Guest Log: [INFO] Condor JobID:  514377.42 in slot3

2019-11-10 12:20:39 (2984): Guest Log: [INFO] MCPlots JobID: 52010944 in slot3

2019-11-10 12:20:45 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 12:20:33 CET 2019 [boinc pp jets 7000 150,-,2360 - sherpa 2.2.5 default 1000 155]

2019-11-10 13:10:49 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 13:10:52 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 13:10:52 (2984): Guest Log: [INFO] Condor JobID:  514694.6 in slot2

2019-11-10 13:10:58 (2984): Guest Log: [INFO] MCPlots JobID: 52054504 in slot2

2019-11-10 13:11:03 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 13:10:52 CET 2019 [boinc ppbar jets 1960 90 - pythia8 8.235 default-noCR 100000 156]

2019-11-10 13:27:35 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 13:27:35 (2984): Status Report: Elapsed Time: '12000.000000'
2019-11-10 13:27:35 (2984): Status Report: CPU Time: '34767.265625'
2019-11-10 15:07:39 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 15:07:39 (2984): Status Report: Elapsed Time: '18000.000000'
2019-11-10 15:07:39 (2984): Status Report: CPU Time: '52688.890625'
2019-11-10 15:47:08 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 15:47:11 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 15:47:12 (2984): Guest Log: [INFO] Condor JobID:  514704.72 in slot2

2019-11-10 15:47:17 (2984): Guest Log: [INFO] MCPlots JobID: 52055844 in slot2

2019-11-10 15:47:23 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 15:47:12 CET 2019 [boinc pp jets 7000 25,-,760 - pythia8 8.186 default-DL 100000 156]

2019-11-10 16:30:04 (2984): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-10 16:30:07 (2984): Guest Log: [INFO] New Job Starting in slot1

2019-11-10 16:30:09 (2984): Guest Log: [INFO] Condor JobID:  514707.52 in slot1

2019-11-10 16:30:14 (2984): Guest Log: [INFO] MCPlots JobID: 52056357 in slot1

2019-11-10 16:30:20 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 16:30:09 CET 2019 [boinc pp jets 200 - - pythia8 8.230 tune-CUETP8S1 100000 156]

2019-11-10 16:45:05 (2984): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-10 16:45:09 (2984): Guest Log: [INFO] New Job Starting in slot1

2019-11-10 16:45:09 (2984): Guest Log: [INFO] Condor JobID:  514708.41 in slot1

2019-11-10 16:45:14 (2984): Guest Log: [INFO] MCPlots JobID: 52056500 in slot1

2019-11-10 16:45:20 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 16:45:09 CET 2019 [boinc pp jets 7000 20,-,310 - pythia8 8.210 default-noRap 100000 156]

2019-11-10 16:47:43 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 16:47:43 (2984): Status Report: Elapsed Time: '24000.000000'
2019-11-10 16:47:43 (2984): Status Report: CPU Time: '70574.937500'
2019-11-10 18:20:33 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 18:20:36 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 18:20:37 (2984): Guest Log: [INFO] Condor JobID:  514715.96 in slot2

2019-11-10 18:20:43 (2984): Guest Log: [INFO] MCPlots JobID: 52057497 in slot2

2019-11-10 18:20:48 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 18:20:37 CET 2019 [boinc pp winclusive 7000 10 - pythia6 6.428 375 100000 156]

2019-11-10 18:27:47 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 18:27:47 (2984): Status Report: Elapsed Time: '30000.000000'
2019-11-10 18:27:47 (2984): Status Report: CPU Time: '88488.875000'
2019-11-10 19:27:57 (2984): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-10 19:28:01 (2984): Guest Log: [INFO] New Job Starting in slot1

2019-11-10 19:28:01 (2984): Guest Log: [INFO] Condor JobID:  514720.43 in slot1

2019-11-10 19:28:07 (2984): Guest Log: [INFO] MCPlots JobID: 52058223 in slot1

2019-11-10 19:28:12 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 19:28:02 CET 2019 [boinc pp jets 7000 400 - pythia6 6.428 z1-lep 100000 156]

2019-11-10 20:06:51 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 20:06:55 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 20:06:55 (2984): Guest Log: [INFO] Condor JobID:  514723.30 in slot2

2019-11-10 20:07:01 (2984): Guest Log: [INFO] MCPlots JobID: 52058633 in slot2

2019-11-10 20:07:06 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 20:06:57 CET 2019 [boinc pp jets 200 - - sherpa 1.2.2p default 100000 156]

2019-11-10 20:07:50 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 20:07:50 (2984): Status Report: Elapsed Time: '36000.000000'
2019-11-10 20:07:51 (2984): Status Report: CPU Time: '106395.234375'
2019-11-10 20:59:54 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 20:59:58 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 20:59:58 (2984): Guest Log: [INFO] Condor JobID:  514726.2 in slot2

2019-11-10 21:00:04 (2984): Guest Log: [INFO] MCPlots JobID: 52059161 in slot2

2019-11-10 21:00:09 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 20:59:59 CET 2019 [boinc ppbar jets 1960 140 - pythia6 6.423 default 100000 156]

2019-11-10 21:28:48 (2984): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-10 21:28:51 (2984): Guest Log: [INFO] New Job Starting in slot1

2019-11-10 21:28:51 (2984): Guest Log: [INFO] Condor JobID:  514526.52 in slot1

2019-11-10 21:28:57 (2984): Guest Log: [INFO] MCPlots JobID: 52029477 in slot1

2019-11-10 21:29:02 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 21:28:52 CET 2019 [boinc pp mb-inelastic 2360 - - pythia6 6.428 ambt1 100000 156]

2019-11-10 21:47:54 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 21:47:54 (2984): Status Report: Elapsed Time: '42000.000000'
2019-11-10 21:47:54 (2984): Status Report: CPU Time: '124300.593750'
2019-11-10 21:52:30 (2984): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-10 21:52:34 (2984): Guest Log: [INFO] New Job Starting in slot1

2019-11-10 21:52:34 (2984): Guest Log: [INFO] Condor JobID:  514730.4 in slot1

2019-11-10 21:52:39 (2984): Guest Log: [INFO] MCPlots JobID: 52059617 in slot1

2019-11-10 21:52:45 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 21:52:35 CET 2019 [boinc ppbar jets 1800 65 - pythia6 6.425 p6 100000 156]

2019-11-10 22:07:38 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 22:07:42 (2984): Guest Log: [INFO] New Job Starting in slot2

2019-11-10 22:07:42 (2984): Guest Log: [INFO] Condor JobID:  514730.55 in slot2

2019-11-10 22:07:47 (2984): Guest Log: [INFO] MCPlots JobID: 52059622 in slot2

2019-11-10 22:07:53 (2984): Guest Log: [INFO] ===> [runRivet] Sun Nov 10 22:07:43 CET 2019 [boinc pp jets 7000 600 - pythia6 6.426 px 100000 156]

2019-11-10 22:50:47 (2984): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-10 23:25:19 (2984): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-10 23:27:58 (2984): Status Report: Job Duration: '129600.000000'
2019-11-10 23:27:58 (2984): Status Report: Elapsed Time: '48000.000000'
2019-11-10 23:27:58 (2984): Status Report: CPU Time: '140940.609375'
2019-11-11 01:08:02 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 01:08:02 (2984): Status Report: Elapsed Time: '54000.000000'
2019-11-11 01:08:02 (2984): Status Report: CPU Time: '147188.421875'
2019-11-11 02:48:05 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 02:48:05 (2984): Status Report: Elapsed Time: '60000.000000'
2019-11-11 02:48:05 (2984): Status Report: CPU Time: '153432.187500'
2019-11-11 04:28:09 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 04:28:09 (2984): Status Report: Elapsed Time: '66000.000000'
2019-11-11 04:28:09 (2984): Status Report: CPU Time: '159688.796875'
2019-11-11 06:08:12 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 06:08:12 (2984): Status Report: Elapsed Time: '72000.000000'
2019-11-11 06:08:12 (2984): Status Report: CPU Time: '165933.968750'
2019-11-11 07:48:16 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 07:48:16 (2984): Status Report: Elapsed Time: '78000.000000'
2019-11-11 07:48:16 (2984): Status Report: CPU Time: '172180.093750'
2019-11-11 09:28:19 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 09:28:19 (2984): Status Report: Elapsed Time: '84000.000000'
2019-11-11 09:28:19 (2984): Status Report: CPU Time: '178424.921875'
2019-11-11 11:08:22 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 11:08:22 (2984): Status Report: Elapsed Time: '90000.000000'
2019-11-11 11:08:22 (2984): Status Report: CPU Time: '184670.218750'
2019-11-11 12:48:26 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 12:48:26 (2984): Status Report: Elapsed Time: '96000.000000'
2019-11-11 12:48:26 (2984): Status Report: CPU Time: '190925.906250'
2019-11-11 14:28:29 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 14:28:29 (2984): Status Report: Elapsed Time: '102000.000000'
2019-11-11 14:28:29 (2984): Status Report: CPU Time: '197176.421875'
2019-11-11 16:08:33 (2984): Status Report: Job Duration: '129600.000000'
2019-11-11 16:08:33 (2984): Status Report: Elapsed Time: '108000.000000'
2019-11-11 16:08:33 (2984): Status Report: CPU Time: '203424.468750'
2019-11-11 16:31:18 (2984): VM state change detected. (old = 'Running', new = 'Paused')
2019-11-11 16:31:18 (2984): Stopping VM.
2019-11-15 16:28:03 (2984): VM did not stop when requested.
2019-11-15 16:28:03 (2984): VM was successfully terminated.
2019-11-15 16:28:05 (4960): Detected: vboxwrapper 26197
2019-11-15 16:28:05 (4960): Detected: BOINC client v7.7
2019-11-15 16:28:06 (4960): Status Report: Detected vboxsvc.exe. (PID = '6772')
2019-11-15 16:28:07 (4960): Detected: VirtualBox VboxManage Interface (Version: 5.2.8)
2019-11-15 16:28:07 (4960): Detected: Sandbox Configuration Enabled
2019-11-15 16:28:07 (4960): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2019-11-15 16:28:07 (4960): Starting VM using VBoxManage interface. (boinc_334bae1d113e7c04, slot#1)
2019-11-15 16:28:27 (4960): Successfully started VM. (PID = '7484')
2019-11-15 16:28:27 (4960): Reporting VM Process ID to BOINC.
2019-11-15 16:28:27 (4960): VM state change detected. (old = 'PoweredOff', new = 'Running')
2019-11-15 16:28:27 (4960): Detected: Web Application Enabled (http://localhost:59139)
2019-11-15 16:28:27 (4960): Status Report: Job Duration: '129600.000000'
2019-11-15 16:28:27 (4960): Status Report: Elapsed Time: '109364.000000'
2019-11-15 16:28:27 (4960): Status Report: CPU Time: '204840.937500'
2019-11-15 16:28:27 (4960): Preference change detected
2019-11-15 16:28:27 (4960): Setting CPU throttle for VM. (100%)
2019-11-15 16:28:28 (4960): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 200 seconds) or (Vbox_job.xml: 600 seconds))
2019-11-15 16:28:29 (4960): Guest Log: 30:22:59.069002 timesync vgsvcTimeSyncWorker: Radical host time change: 345 438 937 000 000ns (HostNow=1 573 831 708 853 000 000 ns HostLast=1 573 486 269 916 000 000 ns)

2019-11-15 16:28:39 (4960): Guest Log: 30:23:09.079455 timesync vgsvcTimeSyncWorker: Radical guest time change: 345 436 158 774 000ns (GuestNow=1 573 831 718 863 667 000 ns GuestLast=1 573 486 282 704 893 000 ns fSetTimeLastLoop=true )

2019-11-15 16:37:54 (4960): Stopping VM.
2019-11-15 16:37:54 (4960): Error in stop VM for VM: -2147024891
Command:
VBoxManage -q controlvm "boinc_334bae1d113e7c04" savestate
Output:
VBoxManage.exe: error: Failed to create the VirtualBox object!
VBoxManage.exe: error: The object is not ready
VBoxManage.exe: error: Details: code E_ACCESSDENIED (0x80070005), component VirtualBoxClientWrap, interface IVirtualBoxClient

2019-11-15 16:37:54 (4960): VM did not stop when requested.
2019-11-15 16:37:54 (4960): VM was successfully terminated.
2019-11-15 16:39:55 (4744): Detected: vboxwrapper 26197
2019-11-15 16:39:55 (4744): Detected: BOINC client v7.7
2019-11-15 16:39:55 (4744): Status Report: Launching vboxsvc.exe. (PID = '4732')
2019-11-15 16:39:56 (4744): Detected: VirtualBox VboxManage Interface (Version: 5.2.8)
2019-11-15 16:39:56 (4744): Detected: Sandbox Configuration Enabled
2019-11-15 16:39:56 (4744): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2019-11-15 16:39:57 (4744): Starting VM using VBoxManage interface. (boinc_334bae1d113e7c04, slot#1)
2019-11-15 16:40:03 (4744): Successfully started VM. (PID = '4544')
2019-11-15 16:40:03 (4744): Reporting VM Process ID to BOINC.
2019-11-15 16:40:03 (4744): Guest Log: BIOS: VirtualBox 5.2.8

2019-11-15 16:40:03 (4744): Guest Log: CPUID EDX: 0x178bfbff

2019-11-15 16:40:03 (4744): Guest Log: BIOS: ata0-0: PCHS=16383/16/63 LCHS=1024/255/63

2019-11-15 16:40:03 (4744): VM state change detected. (old = 'PoweredOff', new = 'Running')
2019-11-15 16:40:03 (4744): Detected: Web Application Enabled (http://localhost:59139)
2019-11-15 16:40:03 (4744): Status Report: Job Duration: '129600.000000'
2019-11-15 16:40:03 (4744): Status Report: Elapsed Time: '109930.000000'
2019-11-15 16:40:03 (4744): Status Report: CPU Time: '204895.171875'
2019-11-15 16:40:03 (4744): Preference change detected
2019-11-15 16:40:03 (4744): Setting CPU throttle for VM. (100%)
2019-11-15 16:40:04 (4744): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 200 seconds) or (Vbox_job.xml: 600 seconds))
2019-11-15 16:40:05 (4744): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032

2019-11-15 16:40:05 (4744): Guest Log: BIOS: Booting from Hard Disk...

2019-11-15 16:40:07 (4744): Guest Log: BIOS: KBD: unsupported int 16h function 03

2019-11-15 16:40:07 (4744): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 

2019-11-15 16:40:25 (4744): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds

2019-11-15 16:40:25 (4744): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)

2019-11-15 16:40:51 (4744): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000281 main     Log opened 2019-11-15T15:40:54.327461000Z

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000492 main     OS Product: Linux

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000540 main     OS Release: 4.14.44-11.cernvm.x86_64

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000581 main     OS Version: #1 SMP Mon May 28 16:49:00 CEST 2018

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000629 main     Executable: /usr/share/vboxguest52/usr/sbin/VBoxService

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000630 main     Process ID: 2966

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.000631 main     Package type: LINUX_64BITS_GENERIC

2019-11-15 16:40:51 (4744): Guest Log: 00:00:00.002566 main     5.2.6 r120293 started. Verbose level = 0

2019-11-15 16:41:16 (4744): Guest Log: [INFO] Mounting the shared directory

2019-11-15 16:41:16 (4744): Guest Log: [INFO] Shared directory mounted, enabling vboxmonitor

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] Testing network connection to cern.ch on port 80

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] Connection to cern.ch 80 port [tcp/http] succeeded!

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] 0

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] Testing VCCS connection to vccs.cern.ch on port 443

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] Connection to vccs.cern.ch 443 port [tcp/https] succeeded!

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] 0

2019-11-15 16:41:16 (4744): Guest Log: [DEBUG] Testing connection to Condor server on port 9618

2019-11-15 16:41:17 (4744): Guest Log: [DEBUG] Connection to vccondor01.cern.ch 9618 port [tcp/condor] succeeded!

2019-11-15 16:41:17 (4744): Guest Log: [DEBUG] 0

2019-11-15 16:42:23 (4744): Guest Log: [DEBUG] Probing CVMFS ...

2019-11-15 16:42:25 (4744): Guest Log: Probing /cvmfs/grid.cern.ch... OK

2019-11-15 16:42:26 (4744): 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

2019-11-15 16:42:26 (4744): Guest Log: 2.4.4.0 3660 1 27808 10749 3 1 838517 10240001 2 65024 0 3 100 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1

2019-11-15 16:42:28 (4744): Guest Log: [INFO] Reading volunteer information

2019-11-15 16:42:28 (4744): Guest Log: [INFO] Volunteer: Wildi (217981)

2019-11-15 16:42:28 (4744): Guest Log: [INFO] VMID: e5b01749-9626-457a-8945-16c64690aa2f

2019-11-15 16:42:28 (4744): Guest Log: [INFO] Requesting an X509 credential from LHC@home

2019-11-15 16:42:29 (4744): Guest Log: [INFO] Running the fast benchmark.

2019-11-15 16:43:55 (4744): Guest Log: [INFO] Machine performance 19.34 HEPSPEC06

2019-11-15 16:43:55 (4744): Guest Log: [INFO] Theory application starting. Check log files.

2019-11-15 16:43:55 (4744): Guest Log: [DEBUG] HTCondor ping

2019-11-15 16:43:56 (4744): Guest Log: [DEBUG] 0

2019-11-15 16:44:49 (4744): Guest Log: [INFO] New Job Starting in slot1

2019-11-15 16:44:49 (4744): Guest Log: [INFO] Condor JobID:  514861.80 in slot1

2019-11-15 16:44:51 (4744): Guest Log: [INFO] New Job Starting in slot2

2019-11-15 16:44:51 (4744): Guest Log: [INFO] Condor JobID:  514861.83 in slot2

2019-11-15 16:44:54 (4744): Guest Log: [INFO] MCPlots JobID: 52080476 in slot1

2019-11-15 16:44:56 (4744): Guest Log: [INFO] MCPlots JobID: 52080505 in slot2

2019-11-15 16:44:59 (4744): Guest Log: [INFO] ===> [runRivet] Fri Nov 15 16:44:51 CET 2019 [boinc pp ttbar 7000 - - pythia8 8.235 default 100000 157]

2019-11-15 16:45:02 (4744): Guest Log: [INFO] ===> [runRivet] Fri Nov 15 16:44:53 CET 2019 [boinc pp z1j 7000 100 - pythia6 6.428 364 100000 157]

2019-11-15 17:04:52 (4744): Guest Log: [INFO] New Job Starting in slot3

2019-11-15 17:04:52 (4744): Guest Log: [INFO] Condor JobID:  514869.73 in slot3

2019-11-15 17:04:58 (4744): Guest Log: [INFO] MCPlots JobID: 52081767 in slot3

2019-11-15 17:05:03 (4744): Guest Log: [INFO] ===> [runRivet] Fri Nov 15 17:04:52 CET 2019 [boinc pp zinclusive 7000 -,-,50,130 - pythia8 8.235 tune-A14-CTEQL1 100000 157]

2019-11-15 18:11:39 (4744): Guest Log: [INFO] Job finished in slot2 with 0.

2019-11-15 18:11:42 (4744): Guest Log: [INFO] New Job Starting in slot2

2019-11-15 18:11:42 (4744): Guest Log: [INFO] Condor JobID:  514864.44 in slot2

2019-11-15 18:11:48 (4744): Guest Log: [INFO] MCPlots JobID: 52080948 in slot2

2019-11-15 18:11:53 (4744): Guest Log: [INFO] ===> [runRivet] Fri Nov 15 18:11:42 CET 2019 [boinc pp jets 7000 28 - sherpa 2.2.5 default 88000 157]

2019-11-15 18:20:11 (4744): Status Report: Job Duration: '129600.000000'
2019-11-15 18:20:11 (4744): Status Report: Elapsed Time: '115930.906107'
2019-11-15 18:20:11 (4744): Status Report: CPU Time: '221630.703125'
2019-11-15 20:00:15 (4744): Status Report: Job Duration: '129600.000000'
2019-11-15 20:00:15 (4744): Status Report: Elapsed Time: '121930.906107'
2019-11-15 20:00:15 (4744): Status Report: CPU Time: '239566.437500'
2019-11-15 21:12:45 (4744): Guest Log: [INFO] Job finished in slot1 with 0.

2019-11-15 21:40:19 (4744): Status Report: Job Duration: '129600.000000'
2019-11-15 21:40:19 (4744): Status Report: Elapsed Time: '127930.906107'
2019-11-15 21:40:19 (4744): Status Report: CPU Time: '256183.265625'
2019-11-15 22:08:10 (4744): Powering off VM.
2019-11-15 22:13:11 (4744): VM did not power off when requested.
2019-11-15 22:13:11 (4744): VM was successfully terminated.
2019-11-15 22:13:11 (4744): Deregistering VM. (boinc_334bae1d113e7c04, slot#1)
2019-11-15 22:19:43 (4744): Removing network bandwidth throttle group from VM.
2019-11-15 22:20:32 (4744): Removing VM from VirtualBox.
22:21:26 (4744): called boinc_finish(0)

</stderr_txt>
]]>

©2024 CERN