Name CMS_1147660_1696153531.379276_0
Workunit 2335484
Created 1 Oct 2023, 9:45:33 UTC
Sent 5 Oct 2023, 15:47:04 UTC
Report deadline 12 Oct 2023, 15:47:04 UTC
Received 8 Oct 2023, 18:13:47 UTC
Server state Over
Outcome Computation error
Client state Compute error
Exit status -2147467259 (0x80004005) Unknown error code
Computer ID 4161
Run time 1 hours 17 min 50 sec
CPU time 2 hours 0 min 56 sec
Validate state Invalid
Credit 0.00
Device peak FLOPS 8.54 GFLOPS
Application version CMS Simulation v60.70 (vbox64_mt_mcore_cms)
windows_x86_64
Peak working set size 81.12 MB
Peak swap size 106.78 MB
Peak disk usage 765.38 MB

Stderr output

<core_client_version>7.20.2</core_client_version>
<![CDATA[
<message>
Unbekannter Fehler
 (0x80004005) - exit code 2147500037 (0x80004005)</message>
<stderr_txt>
2023-10-05 17:47:07 (16172): Detected: vboxwrapper 26206
2023-10-05 17:47:07 (16172): Detected: BOINC client v7.20.2
2023-10-05 17:47:08 (16172): Detected: VirtualBox VboxManage Interface (Version: 6.1.40)
2023-10-05 17:47:09 (16172): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-10-05 17:47:09 (16172): Successfully copied 'init_data.xml' to the shared directory.
2023-10-05 17:47:09 (16172): Create VM. (boinc_31d95543b9a66587, slot#3)
2023-10-05 17:47:10 (16172): Setting Memory Size for VM. (2792MB)
2023-10-05 17:47:10 (16172): Setting CPU Count for VM. (2)
2023-10-05 17:47:10 (16172): Setting Chipset Options for VM.
2023-10-05 17:47:10 (16172): Setting Graphics Controller Options for VM.
2023-10-05 17:47:11 (16172): Setting Boot Options for VM.
2023-10-05 17:47:11 (16172): Setting Network Configuration for NAT.
2023-10-05 17:47:11 (16172): Enabling VM Network Access.
2023-10-05 17:47:12 (16172): Disabling USB Support for VM.
2023-10-05 17:47:12 (16172): Disabling COM Port Support for VM.
2023-10-05 17:47:12 (16172): Disabling LPT Port Support for VM.
2023-10-05 17:47:12 (16172): Disabling Audio Support for VM.
2023-10-05 17:47:13 (16172): Disabling Clipboard Support for VM.
2023-10-05 17:47:13 (16172): Disabling Drag and Drop Support for VM.
2023-10-05 17:47:13 (16172): Adding storage controller(s) to VM.
2023-10-05 17:47:13 (16172): Adding virtual disk drive to VM. (CMS_2022_09_07.vdi)
2023-10-05 17:47:15 (16172): Adding VirtualBox Guest Additions to VM.
2023-10-05 17:47:15 (16172): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB)
2023-10-05 17:47:15 (16172): forwarding host port 62272 to guest port 80
2023-10-05 17:47:15 (16172): Enabling remote desktop for VM.
2023-10-05 17:47:16 (16172): Enabling shared directory for VM.
2023-10-05 17:47:17 (16172): Starting VM using VBoxManage interface. (boinc_31d95543b9a66587, slot#3)
2023-10-05 17:47:23 (16172): Successfully started VM. (PID = '5664')
2023-10-05 17:47:23 (16172): Reporting VM Process ID to BOINC.
2023-10-05 17:47:23 (16172): Guest Log: BIOS: VirtualBox 6.1.40
2023-10-05 17:47:23 (16172): Guest Log: CPUID EDX: 0x178bfbff
2023-10-05 17:47:23 (16172): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-10-05 17:47:23 (16172): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-10-05 17:47:23 (16172): VM state change detected. (old = 'poweredoff', new = 'running')
2023-10-05 17:47:23 (16172): Detected: Web Application Enabled (http://localhost:62272)
2023-10-05 17:47:23 (16172): Detected: Remote Desktop Enabled (localhost:62278)
2023-10-05 17:47:23 (16172): Preference change detected
2023-10-05 17:47:23 (16172): Setting CPU throttle for VM. (100%)
2023-10-05 17:47:23 (16172): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 120 seconds) or (Vbox_job.xml: 600 seconds))
2023-10-05 17:47:25 (16172): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-10-05 17:47:25 (16172): Guest Log: BIOS: Booting from Hard Disk...
2023-10-05 17:47:27 (16172): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-10-05 17:47:27 (16172): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-10-05 17:47:50 (16172): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-10-05 17:47:50 (16172): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-10-05 17:47:51 (16172): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000099 main     Log opened 2023-10-05T15:47:50.859364000Z
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000266 main     OS Product: Linux
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000336 main     OS Release: 4.14.232-19.cernvm.x86_64
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000383 main     OS Version: #1 SMP Fri Apr 30 17:12:25 CEST 2021
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000430 main     Executable: /usr/sbin/VBoxService
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000431 main     Process ID: 2203
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.000432 main     Package type: LINUX_64BITS_GENERIC
2023-10-05 17:47:51 (16172): Guest Log: 00:00:00.001609 main     5.2.6 r120293 started. Verbose level = 0
2023-10-05 17:48:07 (16172): Guest Log: [INFO] Mounting the shared directory
2023-10-05 17:48:07 (16172): Guest Log: [INFO] Shared directory mounted, enabling vboxmonitor
2023-10-05 17:48:07 (16172): Guest Log: [INFO] Sourcing essential functions from /cvmfs/grid.cern.ch
2023-10-05 17:48:07 (16172): Guest Log: [INFO] Testing connection to cern.ch
2023-10-05 17:48:08 (16172): Guest Log: [INFO] Testing connection to VCCS
2023-10-05 17:48:08 (16172): Guest Log: [INFO] Testing connection to HTCondor
2023-10-05 17:48:09 (16172): Guest Log: [INFO] Testing connection to WMAgent
2023-10-05 17:48:09 (16172): Guest Log: [INFO] Testing connection to EOSCMS
2023-10-05 17:48:10 (16172): Guest Log: [INFO] Testing connection to CMS-Factory
2023-10-05 17:48:10 (16172): Guest Log: [INFO] Testing connection to CMS-Frontier
2023-10-05 17:48:11 (16172): Guest Log: [INFO] Testing connection to Frontier
2023-10-05 17:48:12 (16172): Guest Log: [INFO] Could not find a local HTTP proxy
2023-10-05 17:48:12 (16172): Guest Log: [INFO] CVMFS and Frontier will have to use DIRECT connections
2023-10-05 17:48:12 (16172): Guest Log: [INFO] This makes the application less efficient
2023-10-05 17:48:12 (16172): Guest Log: [INFO] It also puts higher load on the project servers
2023-10-05 17:48:12 (16172): Guest Log: [INFO] Setting up a local HTTP proxy is highly recommended
2023-10-05 17:48:13 (16172): Guest Log: [INFO] Advice can be found in the project forum
2023-10-05 17:48:13 (16172): Guest Log: [INFO] Reloading and probing the CVMFS configuration
2023-10-05 17:48:20 (16172): Guest Log: [INFO] Probing /cvmfs/grid.cern.ch... OK
2023-10-05 17:48:23 (16172): Guest Log: [INFO] Probing /cvmfs/singularity.opensciencegrid.org... OK
2023-10-05 17:48:23 (16172): Guest Log: [INFO] Probing /cvmfs/cms.cern.ch... OK
2023-10-05 17:48:23 (16172): Guest Log: [INFO] Probing /cvmfs/cms-ib.cern.ch... OK
2023-10-05 17:48:23 (16172): Guest Log: [INFO] Probing /cvmfs/oasis.opensciencegrid.org... OK
2023-10-05 17:48:24 (16172): Guest Log: [INFO] Excerpt from "cvmfs_config stat": VERSION HOST PROXY
2023-10-05 17:48:24 (16172): Guest Log: [INFO] 2.7.2.0 http://s1cern-cvmfs.openhtc.io DIRECT
2023-10-05 17:48:24 (16172): Guest Log: [INFO] Environment HTTP proxy: not set
2023-10-05 17:48:25 (16172): Guest Log: [INFO] Reading volunteer information
2023-10-05 17:48:32 (16172): Guest Log: [INFO] Requesting an X509 credential from LHC@home
2023-10-05 17:48:32 (16172): Guest Log: [INFO] Requesting an X509 credential from vLHC@home-dev
2023-10-05 17:48:34 (16172): Guest Log: [INFO] CMS application starting. Check log files.
2023-10-05 17:48:34 (16172): Guest Log: [INFO] Requesting an idtoken from LHC@home
2023-10-05 17:48:34 (16172): Guest Log: [INFO] Requesting an idtoken from vLHC@home-dev
2023-10-05 19:27:35 (16172): Status Report: Job Duration: '64800.000000'
2023-10-05 19:27:35 (16172): Status Report: Elapsed Time: '6000.000000'
2023-10-05 19:27:35 (16172): Status Report: CPU Time: '5897.609375'
2023-10-05 19:51:20 (16172): Stopping VM.
2023-10-05 19:51:44 (16172): Successfully stopped VM.
2023-10-08 20:11:13 (1760): Detected: vboxwrapper 26206
2023-10-08 20:11:13 (1760): Detected: BOINC client v7.20.2
2023-10-08 20:11:15 (1760): Detected: VirtualBox VboxManage Interface (Version: 6.1.40)
2023-10-08 20:11:15 (1760): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-10-08 20:11:16 (1760): Register VM. (boinc_31d95543b9a66587, slot#3)
2023-10-08 20:11:22 (1760): Error in register for VM: -2147467259
Command:
VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:22 (1760): Could not register
2023-10-08 20:11:22 (1760): ERROR: VM failed to start
2023-10-08 20:11:22 (1760): Powering off VM.
2023-10-08 20:11:22 (1760): Deregistering VM. (boinc_31d95543b9a66587, slot#3)
2023-10-08 20:11:23 (1760): Removing network bandwidth throttle group from VM.
2023-10-08 20:11:23 (1760): Removing VM from VirtualBox.

    Hypervisor System Log:

00:00:02.847563          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
00:00:02.847622          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
00:00:02.988507          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
00:00:03.238187          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={The object functionality is limited}, preserve=false aResultDetail=0
00:00:03.238231          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={The object functionality is limited}, preserve=false aResultDetail=0
00:00:03.250395          Launched VM: 74012128 pid: 12876 (0x324c) frontend: headless name: boinc_b525ff946cea3eff
00:00:03.250553          Launched VM: 68414816 pid: 6612 (0x19d4) frontend: headless name: boinc_19eb447fa5936d96
00:00:03.391644          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={The object functionality is limited}, preserve=false aResultDetail=0
00:00:03.399210          Launched VM: 63791520 pid: 14636 (0x392c) frontend: headless name: boinc_753d35ca672724f7
00:00:03.622988          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:03.623195          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:03.624813          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:03.625016          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:04.914221          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:04.914441          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:04.915862          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:04.916112          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:06.147461          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:06.147704          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:06.149082          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:06.149310          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:07.400870          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:07.401057          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:07.401994          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:07.402155          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:08.658458          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:08.658699          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:08.659781          Loading settings file "C:\Users\RAT\288358\slots\3\boinc_31d95543b9a66587\boinc_31d95543b9a66587.vbox" with version "1.16-windows"
00:00:08.659995          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine}, preserve=false aResultDetail=0
00:00:08.933979          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={The object functionality is limited}, preserve=false aResultDetail=0
00:00:08.934027          ERROR [COM]: aRC=VBOX_E_OBJECT_NOT_FOUND (0x80bb0001) aIID={d0a0163f-e254-4e5b-a1f2-011cf991c38d} aComponent={VirtualBoxWrap} aText={Could not find a registered machine named 'boinc_31d95543b9a66587'}, preserve=false aResultDetail=0
00:00:09.038843          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={The object functionality is limited}, preserve=false aResultDetail=0
00:00:09.038890          ERROR [COM]: aRC=VBOX_E_OBJECT_NOT_FOUND (0x80bb0001) aIID={d0a0163f-e254-4e5b-a1f2-011cf991c38d} aComponent={VirtualBoxWrap} aText={Could not find a registered machine named 'boinc_31d95543b9a66587'}, preserve=false aResultDetail=0
00:00:09.401888          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={85632c68-b5bb-4316-a900-5eb28d3413df} aComponent={MachineWrap} aText={The object functionality is limited}, preserve=false aResultDetail=0
00:00:09.401951          ERROR [COM]: aRC=VBOX_E_OBJECT_NOT_FOUND (0x80bb0001) aIID={d0a0163f-e254-4e5b-a1f2-011cf991c38d} aComponent={VirtualBoxWrap} aText={Could not find a registered machine named 'boinc_31d95543b9a66587'}, preserve=false aResultDetail=0

    VM Execution Log:

VM/Halt/BlockInsomnia   292672 ns/call (500946318079 ticks, 1711627 times, max 207866613, min       1)
02:04:23.238430 /PROF/CPU1/VM/Halt/BlockOnTime    1428538 ns/call (266615325647 ticks,  186635 times, max 207872019, min    2125)
02:04:23.238437 /PROF/CPU1/VM/Halt/BlockOverslept   551378 ns/call (788654398813 ticks, 1430331 times, max  50597498, min   50001)
02:04:23.238443 /PROF/CPU1/VM/Halt/R0HaltBlock          0 ns/call (           0 ticks,       0 times, max         0, min      -1)
02:04:23.238450 /PROF/CPU1/VM/Halt/R0HaltBlockInsomnia        0 ns/call (           0 ticks,       0 times, max         0, min      -1)
02:04:23.238456 /PROF/CPU1/VM/Halt/R0HaltBlockOnTime        0 ns/call (           0 ticks,       0 times, max         0, min      -1)
02:04:23.238462 /PROF/CPU1/VM/Halt/R0HaltBlockOverslept        0 ns/call (           0 ticks,       0 times, max         0, min      -1)
02:04:23.238468 /PROF/CPU1/VM/Halt/R0HaltExec           0 times
02:04:23.238474 /PROF/CPU1/VM/Halt/R0HaltExec/FromBlock        0 times
02:04:23.238480 /PROF/CPU1/VM/Halt/R0HaltExec/FromSpin        0 times
02:04:23.238486 /PROF/CPU1/VM/Halt/R0HaltHistoryCounter  2813228 times
02:04:23.238492 /PROF/CPU1/VM/Halt/R0HaltHistorySucceeded        0 times
02:04:23.238498 /PROF/CPU1/VM/Halt/R0HaltHistoryToRing3       47 times
02:04:23.238509 /PROF/CPU1/VM/Halt/R0HaltToR3     2813228 times
02:04:23.238515 /PROF/CPU1/VM/Halt/R0HaltToR3/FromSpin        0 times
02:04:23.238521 /PROF/CPU1/VM/Halt/R0HaltToR3/Other  2813228 times
02:04:23.238527 /PROF/CPU1/VM/Halt/R0HaltToR3/PendingFF        0 times
02:04:23.238532 /PROF/CPU1/VM/Halt/R0HaltToR3/PostWaitNoInt        0 times
02:04:23.238538 /PROF/CPU1/VM/Halt/R0HaltToR3/PostWaitPendingFF        0 times
02:04:23.238544 /PROF/CPU1/VM/Halt/R0HaltToR3/SmallDelta        0 times
02:04:23.238550 /PROF/CPU1/VM/Halt/Timers            4013 ns/call ( 26487216606 ticks, 6600323 times, max  33642055, min       2)
02:04:23.238556 /PROF/CPU1/VM/Halt/Yield             2986 ns/call (    76391561 ticks,   25579 times, max    418850, min       1)
02:04:23.238563 /Public/NetAdapter/0/BytesReceived 256100640 bytes
02:04:23.238569 /Public/NetAdapter/0/BytesTransmitted  7891698 bytes
02:04:23.238575 /Public/NetAdapter/0/e1000              0 
02:04:23.238581 /Public/Storage/AHCI0/Port0/BytesRead 1895457280 bytes
02:04:23.238587 /Public/Storage/AHCI0/Port0/BytesWritten 829174272 bytes
02:04:23.238593 /Public/Storage/AHCI0/Port0/QueryBufAttempts        0 count
02:04:23.238599 /Public/Storage/AHCI0/Port0/QueryBufSuccess        0 count
02:04:23.238605 /Public/Storage/AHCI0/Port0/ReqsFlush     3076 count
02:04:23.238611 /Public/Storage/AHCI0/Port0/ReqsRead    45718 count
02:04:23.238617 /Public/Storage/AHCI0/Port0/ReqsSubmitted    67610 count
02:04:23.238623 /Public/Storage/AHCI0/Port0/ReqsSucceeded    67610 count
02:04:23.238628 /Public/Storage/AHCI0/Port0/ReqsWrite    18816 count
02:04:23.238634 /Public/Storage/AHCI0/Port1/BytesRead   321536 bytes
02:04:23.238640 /Public/Storage/AHCI0/Port1/QueryBufAttempts        0 count
02:04:23.238646 /Public/Storage/AHCI0/Port1/QueryBufSuccess        0 count
02:04:23.238652 /Public/Storage/AHCI0/Port1/ReqsRead       22 count
02:04:23.238658 /Public/Storage/AHCI0/Port1/ReqsSubmitted       22 count
02:04:23.238663 /Public/Storage/AHCI0/Port1/ReqsSucceeded       22 count
02:04:23.238669 /SELM/LoadHidSel/GstReadErrors          0 times
02:04:23.238676 /SELM/LoadHidSel/NoGoodGuest            0 times
02:04:23.238685 /TM/CPU/00/cNsExecuting          4346182509972 ns
02:04:23.238692 /TM/CPU/00/cNsHalted             2132464942423 ns
02:04:23.238698 /TM/CPU/00/cNsOther              960925060741 ns
02:04:23.238704 /TM/CPU/00/cNsTotal              7439572513136 ns
02:04:23.238710 /TM/CPU/00/cPeriodsExecuting     33372803 count
02:04:23.238716 /TM/CPU/00/cPeriodsHalted         2092326 count
02:04:23.238722 /TM/CPU/00/pctExecuting                75 %
02:04:23.238730 /TM/CPU/00/pctHalted                    0 %
02:04:23.238738 /TM/CPU/00/pctOther                    24 %
02:04:23.238744 /TM/CPU/01/cNsExecuting          1972889813692 ns
02:04:23.238749 /TM/CPU/01/cNsHalted             4920657669962 ns
02:04:23.238755 /TM/CPU/01/cNsOther              546025039096 ns
02:04:23.238762 /TM/CPU/01/cNsTotal              7439572522750 ns
02:04:23.238768 /TM/CPU/01/cPeriodsExecuting     28801219 count
02:04:23.238774 /TM/CPU/01/cPeriodsHalted         2707234 count
02:04:23.238781 /TM/CPU/01/pctExecuting                 4 %
02:04:23.238786 /TM/CPU/01/pctHalted                   93 %
02:04:23.238792 /TM/CPU/01/pctOther                     1 %
02:04:23.238799 /TM/CPU/pctExecuting                   39 %
02:04:23.238805 /TM/CPU/pctHalted                      47 %
02:04:23.238811 /TM/CPU/pctOther                       13 %
02:04:23.238817 /TM/MaxHzHint                           0 Hz
02:04:23.238823 /TM/PIT/Handler                         0 ticks/call (           0 ticks,       0 times, max         0, min      -1)
02:04:23.238829 /TM/PIT/Irq                             0 times
02:04:23.238836 /TM/R0/1nsSteps                     27661 times
02:04:23.238842 /TM/R3/1nsSteps                    197294 times
02:04:23.238848 /TM/TSC/offCPU0                  1954397911680178 ticks
02:04:23.238854 /TM/TSC/offCPU1                  1954397911680178 ticks
02:04:23.238860 /TM/VirtualSync/CurrentOffset    189426323 ns
02:04:23.238867 ********************* End of statistics **********************
02:04:23.276630 NAT: Zone(nm:mbuf_cluster, used:0)
02:04:23.277935 NAT: Zone(nm:mbuf_packet, used:0)
02:04:23.277967 NAT: Zone(nm:mbuf, used:1)
02:04:23.278075 NAT: Zone(nm:mbuf_jumbo_pagesize, used:0)
02:04:23.279754 NAT: Zone(nm:mbuf_jumbo_9k, used:0)
02:04:23.280394 NAT: Zone(nm:mbuf_jumbo_16k, used:0)
02:04:23.281032 NAT: Zone(nm:mbuf_ext_refcnt, used:0)
02:04:23.287065 E1000#0: Interrupt attempts: 514005
02:04:23.287095 E1000#0: Interrupts raised : 190429
02:04:23.287104 E1000#0: Interrupts lowered: 6637
02:04:23.287114 E1000#0: ICR outside ISR   : 0
02:04:23.287123 E1000#0: IMS raised ints   : 47658
02:04:23.287132 E1000#0: Interrupts skipped: 203956
02:04:23.287142 E1000#0: Masked interrupts : 119620
02:04:23.287152 E1000#0: Early interrupts  : 0
02:04:23.287178 E1000#0: Late interrupts   : 32707
02:04:23.287192 E1000#0: Lost interrupts   : 0
02:04:23.287200 E1000#0: Interrupts by RX  : 275173
02:04:23.287209 E1000#0: Interrupts by TX  : 101662
02:04:23.287218 E1000#0: Interrupts by ICS : 3623
02:04:23.287230 E1000#0: Interrupts by RDTR: 0
02:04:23.287238 E1000#0: Interrupts by RDMT: 0
02:04:23.287247 E1000#0: Interrupts by TXQE: 0
02:04:23.287255 E1000#0: TX int delay asked: 0
02:04:23.287264 E1000#0: TX delayed:         0
02:04:23.287272 E1000#0: TX delay expired:   0
02:04:23.287281 E1000#0: TX no report asked: 101822
02:04:23.287290 E1000#0: TX abs timer expd : 0
02:04:23.287299 E1000#0: TX int timer expd : 0
02:04:23.287308 E1000#0: RX abs timer expd : 0
02:04:23.287317 E1000#0: RX int timer expd : 0
02:04:23.287326 E1000#0: TX CTX descriptors: 101448
02:04:23.287336 E1000#0: TX DAT descriptors: 101810
02:04:23.287346 E1000#0: TX LEG descriptors: 226
02:04:23.287355 E1000#0: Received frames   : 275173
02:04:23.287363 E1000#0: Transmitted frames: 101662
02:04:23.287372 E1000#0: TX frames up to 1514: 101541
02:04:23.287381 E1000#0: TX frames up to 2962: 29
02:04:23.287388 E1000#0: TX frames up to 4410: 67
02:04:23.287396 E1000#0: TX frames up to 5858: 14
02:04:23.287405 E1000#0: TX frames up to 7306: 3
02:04:23.287415 E1000#0: TX frames up to 8754: 3
02:04:23.287424 E1000#0: TX frames up to 16384: 5
02:04:23.287433 E1000#0: TX frames up to 32768: 0
02:04:23.287441 E1000#0: Larger TX frames    : 0
02:04:23.287450 E1000#0: Max TX Delay        : 0
02:04:23.347332 GIM: KVM: Resetting MSRs
02:04:23.351377 Changing the VM state from 'DESTROYING' to 'TERMINATED'
02:04:23.365825 Console: Machine state changed to 'Saved'
02:04:23.370097 VBoxHeadless: processEventQueue: VERR_INTERRUPTED, termination requested
02:04:24.201329 VBoxHeadless: exiting

    VM Startup Log:


    VM Trace Log:

       1
Maximum Devices per Floppy Port: 2
Default machine folder:          X:\RAT\VirtualBox VMs
Raw-mode Supported:              no
Exclusive HW virtualization use: off
Default hard disk format:        VDI
VRDE auth library:               VBoxAuth
Webservice auth. library:        VBoxAuth
Remote desktop ExtPack:          Oracle VM VirtualBox Extension Pack
Log history count:               3
Default frontend:                
Default audio driver:            DirectSound
Autostart database path:         
Default Guest Additions ISO:     C:\Program Files\Oracle\VirtualBox/VBoxGuestAdditions.iso
Logging Level:                   all
Proxy Mode:                      System
Proxy URL:                       

2023-10-08 20:11:15 (1760): 
Command: VBoxManage -q list hostinfo 
Exit Code: 0
Output:
Host Information:

Host time: 2023-10-08T18:11:15.788000000Z
Processor online count: 12
Processor count: 12
Processor online core count: 6
Processor core count: 6
Processor supports HW virtualization: yes
Processor supports PAE: yes
Processor supports long mode: yes
Processor supports nested paging: yes
Processor supports unrestricted guest: yes
Processor supports nested HW virtualization: yes
Processor#0 speed: unknown
Processor#0 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#1 speed: unknown
Processor#1 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#2 speed: unknown
Processor#2 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#3 speed: unknown
Processor#3 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#4 speed: unknown
Processor#4 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#5 speed: unknown
Processor#5 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#6 speed: unknown
Processor#6 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#7 speed: unknown
Processor#7 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#8 speed: unknown
Processor#8 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#9 speed: unknown
Processor#9 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#10 speed: unknown
Processor#10 description: AMD Ryzen 5 1600 Six-Core Processor
Processor#11 speed: unknown
Processor#11 description: AMD Ryzen 5 1600 Six-Core Processor
Memory size: 16315 MByte
Memory available: 4705 MByte
Operating system: Windows 10
Operating system version: 10.0.19045

2023-10-08 20:11:16 (1760): 
Command: VBoxManage -q showvminfo "boinc_31d95543b9a66587" --machinereadable 
Exit Code: -2135228415
Output:
VBoxManage.exe: error: Could not find a registered machine named 'boinc_31d95543b9a66587'
VBoxManage.exe: error: Details: code VBOX_E_OBJECT_NOT_FOUND (0x80bb0001), component VirtualBoxWrap, interface IVirtualBox, callee IUnknown
VBoxManage.exe: error: Context: "FindMachine(Bstr(VMNameOrUuid).raw(), machine.asOutParam())" at line 2773 of file VBoxManageInfo.cpp

2023-10-08 20:11:16 (1760): 
Command: VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Exit Code: -2147467259
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:17 (1760): 
Command: VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Exit Code: -2147467259
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:19 (1760): 
Command: VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Exit Code: -2147467259
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:20 (1760): 
Command: VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Exit Code: -2147467259
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:21 (1760): 
Command: VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Exit Code: -2147467259
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:22 (1760): 
Command: VBoxManage -q registervm "C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox" 
Exit Code: -2147467259
Output:
VBoxManage.exe: error: Trying to open a VM config 'C:\Users\RAT\288358\slots\3/boinc_31d95543b9a66587/boinc_31d95543b9a66587.vbox' which has the same UUID as an existing virtual machine
VBoxManage.exe: error: Details: code E_FAIL (0x80004005), component MachineWrap, interface IMachine, callee IUnknown
VBoxManage.exe: error: Context: "OpenMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 86 of file VBoxManageMisc.cpp

2023-10-08 20:11:23 (1760): 
Command: VBoxManage -q snapshot "boinc_31d95543b9a66587" list 
Exit Code: -2135228415
Output:
VBoxManage.exe: error: Could not find a registered machine named 'boinc_31d95543b9a66587'
VBoxManage.exe: error: Details: code VBOX_E_OBJECT_NOT_FOUND (0x80bb0001), component VirtualBoxWrap, interface IVirtualBox, callee IUnknown
VBoxManage.exe: error: Context: "FindMachine(bstrMachine.raw(), pMachine.asOutParam())" at line 333 of file VBoxManageSnapshot.cpp

2023-10-08 20:11:23 (1760): 
Command: VBoxManage -q bandwidthctl "boinc_31d95543b9a66587" remove "boinc_31d95543b9a66587_net" 
Exit Code: -2135228415
Output:
VBoxManage.exe: error: Could not find a registered machine named 'boinc_31d95543b9a66587'
VBoxManage.exe: error: Details: code VBOX_E_OBJECT_NOT_FOUND (0x80bb0001), component VirtualBoxWrap, interface IVirtualBox, callee IUnknown
VBoxManage.exe: error: Context: "FindMachine(Bstr(a->argv[0]).raw(), machine.asOutParam())" at line 320 of file VBoxManageBandwidthControl.cpp

2023-10-08 20:11:23 (1760): 
Command: VBoxManage -q unregistervm "boinc_31d95543b9a66587" --delete 
Exit Code: -2135228415
Output:
VBoxManage.exe: error: Could not find a registered machine named 'boinc_31d95543b9a66587'
VBoxManage.exe: error: Details: code VBOX_E_OBJECT_NOT_FOUND (0x80bb0001), component VirtualBoxWrap, interface IVirtualBox, callee IUnknown
VBoxManage.exe: error: Context: "FindMachine(Bstr(VMName).raw(), machine.asOutParam())" at line 150 of file VBoxManageMisc.cpp

20:11:33 (1760): called boinc_finish(-2147467259)

</stderr_txt>
]]>


©2024 CERN