Machine state will be reset. To keep it, pass --keep-machine-state
start all VLans
(finished: start all VLans, in 0.00 seconds)
Test will time out and terminate in 3600.0 seconds
run the VM test script
additionally exposed symbols:
    cluster, custom, machine,
    vlan1,
    start_all, test_script, machines, machines_qemu, machines_nspawn, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, BaseMachine, QemuMachine, NspawnMachine, t, debug, dump_machine_ssh
??? Warning (SyntaxWarning): "\S" is an invalid escape sequence. Such sequences will not work in the future. Did you mean "\\S"? A raw string is also an option.
    File "<string>", line 5
??? Warning (SyntaxWarning): "\S" is an invalid escape sequence. Such sequences will not work in the future. Did you mean "\\S"? A raw string is also an option.
    File "<string>", line 21
machine: waiting for unit ssync.service
machine: waiting for the VM to finish booting
machine: starting vm
machine: QEMU running (pid 45)
machine # Disk image does not exist, creating the virtualisation disk image...
machine # Formatting '/build/vm-state-machine/tmp.SSskAfqwUF', fmt=raw size=1073741824
machine # mke2fs 1.47.4 (6-Mar-2025)
machine # Discarding device blocks:      0/262144             done
machine # Creating filesystem with 262144 4k blocks and 65536 inodes
machine # Filesystem UUID: 1b08101e-65cb-417a-9bf9-91addeffa642
machine # Superblock backups stored on blocks:
machine # 	32768, 98304, 163840, 229376
machine # 
machine # Allocating group tables: 0/8   done
machine # Writing inode tables: 0/8   done
machine # Creating journal (8192 blocks): done
machine # Writing superblocks and filesystem accounting information: 0/8   done
machine # 
machine # Virtualisation disk image created.
machine # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)
machine # 
machine # 
machine # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+3EFCC730+3EF2C730 CA00
machine # Press Ctrl-B to configure iPXE (PCI 00:02.0)...
machine # 
machine # 
machine # 
machine # 
machine # iPXE (http://ipxe.org) 00:08.0 CB00 PCI2.10 PnP PMM 3EFCC730 3EF2C730 CB00
machine # Press Ctrl-B to configure iPXE (PCI 00:08.0)...
machine # 
machine # 
machine # Booting from ROM...
machine # Probing EDD (edd=off to disable)... ok
machine # [    0.000000] Linux version 6.18.50 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Mon Sep  7 15:23:00 UTC 2026
machine # [    0.000000] Command line: console=ttyS0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/gia166k0mzxiqi4kx9xaip69vhp6ck2z-nixos-system-machine-test/init regInfo=/nix/store/cpljwn3lqsrp2kcyqn9s460rj2vz071n-closure-info/registration console=ttyS0,115200n8 console=tty0
machine # [    0.000000] BIOS-provided physical RAM map:
machine # [    0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable
machine # [    0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000003ffd7fff] usable
machine # [    0.000000] BIOS-e820: [mem 0x000000003ffd8000-0x000000003fffffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved
machine # [    0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved
machine # [    0.000000] NX (Execute Disable) protection: active
machine # [    0.000000] APIC: Static calls initialized
machine # [    0.000000] SMBIOS 2.8 present.
machine # [    0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/2014
machine # [    0.000000] DMI: Memory slots populated: 1/1
machine # [    0.000000] Hypervisor detected: KVM
machine # [    0.000000] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000
machine # [    0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00
machine # [    0.000002] kvm-clock: using sched offset of 524939465 cycles
machine # [    0.000005] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
machine # [    0.000009] tsc: Detected 2495.318 MHz processor
machine # [    0.000566] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000
machine # [    0.000638] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs
machine # [    0.000644] x86/PAT: Configuration [0-7]: WB  WC  UC- UC  WB  WP  UC- WT
machine # [    0.003385] found SMP MP-table at [mem 0x000f5450-0x000f545f]
machine # [    0.003407] Using GB pages for direct mapping
machine # [    0.003547] RAMDISK: [mem 0x3e367000-0x3ffcffff]
machine # [    0.003556] ACPI: Early table checksum verification disabled
machine # [    0.003561] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )
machine # [    0.003567] ACPI: RSDT 0x000000003FFE2422 000038 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003573] ACPI: FACP 0x000000003FFE221A 0000F4 (v03 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003584] ACPI: DSDT 0x000000003FFE0040 0021DA (v01 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003589] ACPI: FACS 0x000000003FFE0000 000040
machine # [    0.003591] ACPI: APIC 0x000000003FFE230E 000078 (v03 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003593] ACPI: HPET 0x000000003FFE2386 000038 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003594] ACPI: MCFG 0x000000003FFE23BE 00003C (v01 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003596] ACPI: WAET 0x000000003FFE23FA 000028 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
machine # [    0.003597] ACPI: Reserving FACP table memory at [mem 0x3ffe221a-0x3ffe230d]
machine # [    0.003598] ACPI: Reserving DSDT table memory at [mem 0x3ffe0040-0x3ffe2219]
machine # [    0.003599] ACPI: Reserving FACS table memory at [mem 0x3ffe0000-0x3ffe003f]
machine # [    0.003599] ACPI: Reserving APIC table memory at [mem 0x3ffe230e-0x3ffe2385]
machine # [    0.003600] ACPI: Reserving HPET table memory at [mem 0x3ffe2386-0x3ffe23bd]
machine # [    0.003600] ACPI: Reserving MCFG table memory at [mem 0x3ffe23be-0x3ffe23f9]
machine # [    0.003600] ACPI: Reserving WAET table memory at [mem 0x3ffe23fa-0x3ffe2421]
machine # [    0.004131] No NUMA configuration found
machine # [    0.004133] Faking a node at [mem 0x0000000000000000-0x000000003ffd7fff]
machine # [    0.004137] NODE_DATA(0) allocated [mem 0x3ffd2780-0x3ffd7cff]
machine # [    0.004301] Zone ranges:
machine # [    0.004302]   DMA      [mem 0x0000000000001000-0x0000000000ffffff]
machine # [    0.004305]   DMA32    [mem 0x0000000001000000-0x000000003ffd7fff]
machine # [    0.004306]   Normal   empty
machine # [    0.004306]   Device   empty
machine # [    0.004307] Movable zone start for each node
machine # [    0.004308] Early memory node ranges
machine # [    0.004308]   node   0: [mem 0x0000000000001000-0x000000000009efff]
machine # [    0.004309]   node   0: [mem 0x0000000000100000-0x000000003ffd7fff]
machine # [    0.004310] Initmem setup node 0 [mem 0x0000000000001000-0x000000003ffd7fff]
machine # [    0.004343] On node 0, zone DMA: 1 pages in unavailable ranges
machine # [    0.004883] On node 0, zone DMA: 97 pages in unavailable ranges
machine # [    0.041868] On node 0, zone DMA32: 40 pages in unavailable ranges
machine # [    0.043083] ACPI: PM-Timer IO Port: 0x608
machine # [    0.043103] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])
machine # [    0.043151] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23
machine # [    0.043156] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)
machine # [    0.043158] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)
machine # [    0.043160] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)
machine # [    0.043160] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)
machine # [    0.043161] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)
machine # [    0.043164] ACPI: Using ACPI (MADT) for SMP configuration information
machine # [    0.043164] ACPI: HPET id: 0x8086a201 base: 0xfed00000
machine # [    0.043171] TSC deadline timer available
machine # [    0.043175] CPU topo: Max. logical packages:   1
machine # [    0.043175] CPU topo: Max. logical dies:       1
machine # [    0.043176] CPU topo: Max. dies per package:   1
machine # [    0.043178] CPU topo: Max. threads per core:   1
machine # [    0.043178] CPU topo: Num. cores per package:     1
machine # [    0.043179] CPU topo: Num. threads per package:   1
machine # [    0.043179] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs
machine # [    0.043204] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()
machine # [    0.043251] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]
machine # [    0.043254] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]
machine # [    0.043255] [mem 0x40000000-0xafffffff] available for PCI devices
machine # [    0.043257] Booting paravirtualized kernel on KVM
machine # [    0.043262] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns
machine # [    0.047189] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1
machine # [    0.051684] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152
machine # [    0.051753] kvm-guest: PV spinlocks disabled, single CPU
machine # [    0.051757] Kernel command line: console=ttyS0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/gia166k0mzxiqi4kx9xaip69vhp6ck2z-nixos-system-machine-test/init regInfo=/nix/store/cpljwn3lqsrp2kcyqn9s460rj2vz071n-closure-info/registration console=ttyS0,115200n8 console=tty0
machine # [    0.051839] Unknown kernel command line parameters "regInfo=/nix/store/cpljwn3lqsrp2kcyqn9s460rj2vz071n-closure-info/registration", will be passed to user space.
machine # [    0.052050] random: crng init done
machine # [    0.052052] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes
machine # [    0.054318] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)
machine # [    0.054336] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)
machine # [    0.054385] Fallback order for Node 0: 0
machine # [    0.054390] Built 1 zonelists, mobility grouping on.  Total pages: 262006
machine # [    0.054391] Policy zone: DMA32
machine # [    0.059840] mem auto-init: stack:all(zero), heap alloc:on, heap free:off
machine # [    0.063477] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
machine # [    0.068100] allocated 2097152 bytes of page_ext
machine # [    0.079887] ftrace: allocating 48731 entries in 192 pages
machine # [    0.079890] ftrace: allocated 192 pages with 2 groups
machine # [    0.081193] Dynamic Preempt: lazy
machine # [    0.081564] rcu: Preemptible hierarchical RCU implementation.
machine # [    0.081565] rcu: 	RCU event tracing is enabled.
machine # [    0.081565] rcu: 	RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.
machine # [    0.081567] 	Trampoline variant of Tasks RCU enabled.
machine # [    0.081568] 	Rude variant of Tasks RCU enabled.
machine # [    0.081568] 	Tracing variant of Tasks RCU enabled.
machine # [    0.081569] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.
machine # [    0.081570] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1
machine # [    0.081600] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
machine # [    0.081602] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
machine # [    0.081603] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
machine # [    0.086146] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16
machine # [    0.086544] rcu: srcu_init: Setting srcu_struct sizes based on contention.
machine # [    0.086553] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns
machine # [    0.086765] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)
machine # [    0.095106] Console: colour VGA+ 80x25
machine # [    0.095111] printk: legacy console [tty0] enabled
machine # [    0.160270] printk: legacy console [ttyS0] enabled
machine # [    0.361717] ACPI: Core revision 20250807
machine # [    0.363319] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns
machine # [    0.366213] APIC: Switch to symmetric I/O mode setup
machine # [    0.368141] x2apic enabled
machine # [    0.369528] APIC: Switched APIC routing to: physical x2apic
machine # [    0.373023] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1
machine # [    0.374860] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x23f7f2f9526, max_idle_ns: 440795279108 ns
machine # [    0.377964] Calibrating delay loop (skipped) preset value.. 4990.63 BogoMIPS (lpj=2495318)
machine # [    0.380154] x86/cpu: User Mode Instruction Prevention (UMIP) activated
machine # [    0.381300] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127
machine # [    0.382962] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0
machine # [    0.384967] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto
machine # [    0.386962] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl
machine # [    0.388963] Spectre V2 : Mitigation: Enhanced / Automatic IBRS
machine # [    0.389962] Speculative Return Stack Overflow: Mitigation: IBPB on VMEXIT only
machine # [    0.390962] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization
machine # [    0.392974] Spectre V2 : Enabling IBPB for BPF
machine # [    0.393963] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier
machine # [    0.396008] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'
machine # [    0.396962] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'
machine # [    0.397962] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'
machine # [    0.398962] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'
machine # [    0.399962] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'
machine # [    0.401962] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'
machine # [    0.403962] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'
machine # [    0.406962] x86/fpu: Supporting XSAVE feature 0x800: 'Control-flow User registers'
machine # [    0.407962] x86/fpu: Supporting XSAVE feature 0x1000: 'Control-flow Kernel registers (KVM only)'
machine # [    0.408962] x86/fpu: xstate_offset[2]:  576, xstate_sizes[2]:  256
machine # [    0.410962] x86/fpu: xstate_offset[5]:  832, xstate_sizes[5]:   64
machine # [    0.411962] x86/fpu: xstate_offset[6]:  896, xstate_sizes[6]:  512
machine # [    0.412962] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024
machine # [    0.413962] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]:    8
machine # [    0.415962] x86/fpu: xstate_offset[11]: 2440, xstate_sizes[11]:   16
machine # [    0.417962] x86/fpu: xstate_offset[12]: 2456, xstate_sizes[12]:   24
machine # [    0.418962] x86/fpu: Enabled xstate features 0x1ae7, context size is 2480 bytes, using 'compacted' format.
machine # [    0.445346] Freeing SMP alternatives memory: 44K
machine # [    0.445962] pid_max: default: 32768 minimum: 301
machine # [    0.448030] LSM: initializing lsm=capability,landlock,yama,bpf,ima
machine # [    0.450059] landlock: Up and running.
machine # [    0.450962] Yama: becoming mindful.
machine # [    0.452102] LSM support for eBPF active
machine # [    0.453088] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
machine # [    0.455969] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
machine # [    0.458681] smpboot: CPU0: AMD Ryzen 9 9955HX 16-Core Processor (family: 0x1a, model: 0x44, stepping: 0x0)
machine # [    0.459786] Performance Events: Fam17h+ core perfctr, AMD PMU driver.
machine # [    0.460967] ... version:                   2
machine # [    0.462026] ... bit width:                 48
machine # [    0.462963] ... generic counters:          6
machine # [    0.463963] ... generic bitmap:            000000000000003f
machine # [    0.464963] ... fixed-purpose counters:    0
machine # [    0.465963] ... fixed-purpose bitmap:      0000000000000000
machine # [    0.466963] ... value mask:                0000ffffffffffff
machine # [    0.467963] ... max period:                00007fffffffffff
machine # [    0.468963] ... global_ctrl mask:          000000000000003f
machine # [    0.470062] signal: max sigframe size: 3376
machine # [    0.471077] rcu: Hierarchical SRCU implementation.
machine # [    0.471967] rcu: 	Max phase no-delay instances is 400.
machine # [    0.473941] smp: Bringing up secondary CPUs ...
machine # [    0.474981] smp: Brought up 1 node, 1 CPU
machine # [    0.475966] smpboot: Total of 1 processors activated (4990.63 BogoMIPS)
machine # [    0.477249] Memory: 942992K/1048024K available (17223K kernel code, 2726K rwdata, 13584K rodata, 3644K init, 2988K bss, 97596K reserved, 0K cma-reserved)
machine # [    0.478232] devtmpfs: initialized
machine # [    0.479257] x86/mm: Memory block size: 128MB
machine # [    0.481000] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)
machine # [    0.482007] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).
machine # [    0.483071] pinctrl core: initialized pinctrl subsystem
machine # [    0.484485] PM: RTC time: 05:57:07, date: 2026-09-13
machine # [    0.489645] NET: Registered PF_NETLINK/PF_ROUTE protocol family
machine # [    0.491362] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations
machine # [    0.491986] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
machine # [    0.493236] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
machine # [    0.493973] audit: initializing netlink subsys (disabled)
machine # [    0.495246] thermal_sys: Registered thermal governor 'fair_share'
machine # [    0.495249] thermal_sys: Registered thermal governor 'bang_bang'
machine # [    0.495964] thermal_sys: Registered thermal governor 'step_wise'
machine # [    0.496968] audit: type=2000 audit(1789279026.768:1): state=initialized audit_enabled=0 res=1
machine # [    0.498966] thermal_sys: Registered thermal governor 'user_space'
machine # [    0.498968] thermal_sys: Registered thermal governor 'power_allocator'
machine # [    0.499985] cpuidle: using governor menu
machine # [    0.503031] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5
machine # [    0.504316] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]
machine # [    0.504966] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry
machine # [    0.505972] PCI: Using configuration type 1 for base access
machine # [    0.507130] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.
machine # [    0.512351] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
machine # [    0.512964] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page
machine # [    0.513964] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
machine # [    0.520965] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page
machine # [    0.527349] ACPI: Added _OSI(Module Device)
machine # [    0.527964] ACPI: Added _OSI(Processor Device)
machine # [    0.530964] ACPI: Added _OSI(Processor Aggregator Device)
machine # [    0.535442] ACPI: 1 ACPI AML tables successfully acquired and loaded
machine # [    0.539178] ACPI: Interpreter enabled
machine # [    0.539976] ACPI: PM: (supports S0 S3 S4 S5)
machine # [    0.542964] ACPI: Using IOAPIC for interrupt routing
machine # [    0.544066] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug
machine # [    0.546186] PCI: Using E820 reservations for host bridge windows
machine # [    0.547042] ACPI: Enabled 2 GPEs in block 00 to 3F
machine # [    0.551095] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])
machine # [    0.551969] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]
machine # [    0.553006] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]
machine # [    0.554015] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]
machine # [    0.555407] PCI host bridge to bus 0000:00
machine # [    0.555969] pci_bus 0000:00: root bus resource [io  0x0000-0x0cf7 window]
machine # [    0.556964] pci_bus 0000:00: root bus resource [io  0x0d00-0xffff window]
machine # [    0.557964] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]
machine # [    0.558964] pci_bus 0000:00: root bus resource [mem 0x40000000-0xafffffff window]
machine # [    0.559964] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]
machine # [    0.560964] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]
machine # [    0.561964] pci_bus 0000:00: root bus resource [bus 00-ff]
machine # [    0.563053] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint
machine # [    0.564797] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint
machine # [    0.568091] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]
machine # [    0.568990] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]
machine # [    0.570017] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]
machine # [    0.571610] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]
machine # [    0.574411] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
machine # [    0.575978] pci 0000:00:02.0: BAR 0 [io  0xc140-0xc15f]
machine # [    0.576978] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]
machine # [    0.578014] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]
machine # [    0.578978] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]
machine # [    0.581061] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
machine # [    0.582978] pci 0000:00:03.0: BAR 0 [io  0xc160-0xc17f]
machine # [    0.583978] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]
machine # [    0.585024] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]
machine # [    0.587070] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
machine # [    0.588978] pci 0000:00:04.0: BAR 0 [io  0xc080-0xc0bf]
machine # [    0.589977] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]
machine # [    0.591014] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]
machine # [    0.593060] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
machine # [    0.594978] pci 0000:00:05.0: BAR 0 [io  0xc180-0xc19f]
machine # [    0.595978] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]
machine # [    0.597014] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]
machine # [    0.599076] pci 0000:00:06.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
machine # [    0.600978] pci 0000:00:06.0: BAR 0 [io  0xc1a0-0xc1bf]
machine # [    0.601977] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]
machine # [    0.603014] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]
machine # [    0.605060] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint
machine # [    0.606977] pci 0000:00:07.0: BAR 0 [io  0xc000-0xc07f]
machine # [    0.607978] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]
machine # [    0.609014] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]
machine # [    0.611200] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
machine # [    0.612978] pci 0000:00:08.0: BAR 0 [io  0xc1c0-0xc1df]
machine # [    0.613977] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]
machine # [    0.615020] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]
machine # [    0.615977] pci 0000:00:08.0: ROM [mem 0xfeb80000-0xfebbffff pref]
machine # [    0.618036] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint
machine # [    0.619894] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]
machine # [    0.621014] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]
machine # [    0.623078] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint
machine # [    0.624978] pci 0000:00:0a.0: BAR 0 [io  0xc0c0-0xc0ff]
machine # [    0.625978] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]
machine # [    0.627014] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]
machine # [    0.629058] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
machine # [    0.630978] pci 0000:00:0b.0: BAR 0 [io  0xc1e0-0xc1ff]
machine # [    0.631978] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]
machine # [    0.633014] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]
machine # [    0.635113] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint
machine # [    0.637871] pci 0000:00:1d.0: BAR 4 [io  0xc200-0xc21f]
machine # [    0.639284] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint
machine # [    0.641026] pci 0000:00:1d.1: BAR 4 [io  0xc220-0xc23f]
machine # [    0.642274] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint
machine # [    0.644026] pci 0000:00:1d.2: BAR 4 [io  0xc240-0xc25f]
machine # [    0.645334] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint
machine # [    0.646755] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]
machine # [    0.648430] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint
machine # [    0.649588] pci 0000:00:1f.0: quirk: [io  0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO
machine # [    0.651383] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint
machine # [    0.653718] pci 0000:00:1f.2: BAR 4 [io  0xc260-0xc27f]
machine # [    0.654977] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]
machine # [    0.656549] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint
machine # [    0.659025] pci 0000:00:1f.3: BAR 4 [io  0x0700-0x073f]
machine # [    0.666140] ACPI: PCI: Interrupt link LNKA configured for IRQ 10
machine # [    0.667092] ACPI: PCI: Interrupt link LNKB configured for IRQ 10
machine # [    0.668197] ACPI: PCI: Interrupt link LNKC configured for IRQ 11
machine # [    0.669187] ACPI: PCI: Interrupt link LNKD configured for IRQ 11
machine # [    0.670095] ACPI: PCI: Interrupt link LNKE configured for IRQ 10
machine # [    0.671090] ACPI: PCI: Interrupt link LNKF configured for IRQ 10
machine # [    0.672095] ACPI: PCI: Interrupt link LNKG configured for IRQ 11
machine # [    0.673093] ACPI: PCI: Interrupt link LNKH configured for IRQ 11
machine # [    0.674016] ACPI: PCI: Interrupt link GSIA configured for IRQ 16
machine # [    0.674976] ACPI: PCI: Interrupt link GSIB configured for IRQ 17
machine # [    0.675982] ACPI: PCI: Interrupt link GSIC configured for IRQ 18
machine # [    0.676982] ACPI: PCI: Interrupt link GSID configured for IRQ 19
machine # [    0.677982] ACPI: PCI: Interrupt link GSIE configured for IRQ 20
machine # [    0.678975] ACPI: PCI: Interrupt link GSIF configured for IRQ 21
machine # [    0.679982] ACPI: PCI: Interrupt link GSIG configured for IRQ 22
machine # [    0.680982] ACPI: PCI: Interrupt link GSIH configured for IRQ 23
machine # [    0.683489] iommu: Default domain type: Translated
machine # [    0.683974] iommu: DMA domain TLB invalidation policy: lazy mode
machine # [    0.685410] ACPI: bus type USB registered
machine # [    0.686063] usbcore: registered new interface driver usbfs
machine # [    0.686987] usbcore: registered new interface driver hub
machine # [    0.687990] usbcore: registered new device driver usb
machine # [    0.690400] NetLabel: Initializing
machine # [    0.690963] NetLabel:  domain hash size = 128
machine # [    0.691963] NetLabel:  protocols = UNLABELED CIPSOv4 CALIPSO
machine # [    0.693007] NetLabel:  unlabeled traffic allowed by default
machine # [    0.693982] PCI: Using ACPI for IRQ routing
machine # [    0.793554] pci 0000:00:01.0: vgaarb: setting as boot VGA device
machine # [    0.793958] pci 0000:00:01.0: vgaarb: bridge control possible
machine # [    0.793958] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none
machine # [    0.793964] vgaarb: loaded
machine # [    0.795140] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0
machine # [    0.795964] hpet0: 3 comparators, 64-bit 100.000000 MHz counter
machine # [    0.801095] clocksource: Switched to clocksource kvm-clock
machine # [    0.806808] VFS: Disk quotas dquot_6.6.0
machine # [    0.808129] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
machine # [    0.810671] pnp: PnP ACPI init
machine # [    0.812030] ACPI: IRQ 4 override to edge(!), high(!)
machine # [    0.813840] system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved
machine # [    0.816465] pnp: PnP ACPI: found 6 devices
machine # [    0.825338] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns
machine # [    0.827774] clocksource: Switched to clocksource acpi_pm
machine # [    0.829390] NET: Registered PF_INET protocol family
machine # [    0.831173] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)
machine # [    0.851139] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)
machine # [    0.853724] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
machine # [    0.855945] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)
machine # [    0.858171] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)
machine # [    0.860319] TCP: Hash tables configured (established 8192 bind 8192)
machine # [    0.862277] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)
machine # [    0.864475] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)
machine # [    0.866476] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)
machine # [    0.868645] NET: Registered PF_UNIX/PF_LOCAL protocol family
machine # [    0.870317] NET: Registered PF_XDP protocol family
machine # [    0.871812] pci_bus 0000:00: resource 4 [io  0x0000-0x0cf7 window]
machine # [    0.873558] pci_bus 0000:00: resource 5 [io  0x0d00-0xffff window]
machine # [    0.875315] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]
machine # [    0.877281] pci_bus 0000:00: resource 7 [mem 0x40000000-0xafffffff window]
machine # [    0.879252] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]
machine # [    0.881220] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]
machine # [    0.883861] ACPI: \_SB_.GSIA: Enabled at IRQ 16
machine # [    0.886060] ACPI: \_SB_.GSIB: Enabled at IRQ 17
machine # [    0.888109] ACPI: \_SB_.GSIC: Enabled at IRQ 18
machine # [    0.890296] ACPI: \_SB_.GSID: Enabled at IRQ 19
machine # [    0.892311] PCI: CLS 0 bytes, default 64
machine # [    0.893752] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x23f7f2f9526, max_idle_ns: 440795279108 ns
machine # [    0.896749] Trying to unpack rootfs image as initramfs...
machine # [    0.927911] Initialise system trusted keyrings
machine # [    0.931667] workingset: timestamp_bits=40 max_order=18 bucket_order=0
machine # [    0.949723] Key type asymmetric registered
machine # [    0.951064] Asymmetric key parser 'x509' registered
machine # [    0.954515] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)
machine # [    0.960496] io scheduler mq-deadline registered
machine # [    0.963467] io scheduler kyber registered
machine # [    0.968121] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
machine # [    0.970398] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A
machine # [    0.979853] Linux agpgart interface v0.103
machine # [    0.981380] ACPI: bus type drm_connector registered
machine # [    0.987201] usbcore: registered new interface driver usbserial_generic
machine # [    0.993491] usbserial: USB Serial support registered for generic
machine # [    0.995679] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.
machine # [    0.995679] Please enable it if your BIOS has the CPPC option.
machine # [    1.009486] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled
machine # [    1.012114] drop_monitor: Initializing network drop monitor service
machine # [    1.017685] NET: Registered PF_INET6 protocol family
machine # [    1.023228] Segment Routing with IPv6
machine # [    1.026480] In-situ OAM (IOAM) with IPv6
machine # [    1.029781] IPI shorthand broadcast: enabled
machine # [    1.039272] sched_clock: Marking stable (753031828, 285406530)->(1216892108, -178453750)
machine # [    1.045664] registered taskstats version 1
machine # [    1.047218] Loading compiled-in X.509 certificates
machine # [    1.067664] Demotion targets for Node 0: null
machine # [    1.072479] Key type .fscrypt registered
machine # [    1.073807] Key type fscrypt-provisioning registered
machine # [    1.077590] ima: No TPM chip found, activating TPM-bypass!
machine # [    1.079345] ima: Allocated hash algorithm: sha1
machine # [    1.085533] ima: No architecture policies found
machine # [    1.087196] PM:   Magic number: 10:964:971
machine # [    1.091233] RAS: Correctable Errors collector initialized.
machine # [    1.099796] clk: Disabling unused clocks
machine # [    1.102456] PM: genpd: Disabling unused power domains
machine # [    1.375895] Freeing initrd memory: 29092K
machine # [    1.380080] Freeing unused decrypted memory: 2028K
machine # [    1.384805] Freeing unused kernel image (initmem) memory: 3644K
machine # [    1.386767] Write protecting the kernel read-only data: 32768k
machine # [    1.389923] Freeing unused kernel image (text/rodata gap) memory: 1208K
machine # [    1.392719] Freeing unused kernel image (rodata/data gap) memory: 752K
machine # [    1.416585] x86/mm: Checked W+X mappings: passed, no W+X pages found.
machine # [    1.418505] Run /init as init process
machine # [    1.430603] systemd[1]: Inserted module 'autofs4'
machine # [    1.444928] fuse: init (API version 7.45)
machine # [    1.450149] ACPI: \_SB_.GSIG: Enabled at IRQ 22
machine # [    1.453543] ACPI: \_SB_.GSIH: Enabled at IRQ 23
machine # [    1.457756] ACPI: \_SB_.GSIE: Enabled at IRQ 20
machine # [    1.461094] ACPI: \_SB_.GSIF: Enabled at IRQ 21
machine # [    1.495001] systemd[1]: Successfully made /usr/ read-only.
machine # [    1.831955] systemd[1]: systemd 261.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)
machine # [    1.840649] systemd[1]: Detected virtualization kvm.
machine # [    1.842170] systemd[1]: Detected architecture x86-64.
machine # [    1.843736] systemd[1]: Running in initrd.
machine # [    1.845310] systemd[1]: Initializing machine ID from random generator.
machine # [    1.847364] systemd[1]: Hostname set to <machine>.
machine # [    2.012048] systemd[1]: bpf-restrict-fs: LSM BPF program attached
machine # [    2.038883] systemd[1]: Queued start job for default target Initrd Default Target.
machine # [    2.043781] systemd[1]: Created slice Slice /system/modprobe.
machine # [    2.045809] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
machine # [    2.048236] systemd[1]: Expecting device /dev/disk/by-label/nixos...
machine # [    2.050304] systemd[1]: Reached target Path Units.
machine # [    2.051906] systemd[1]: Reached target Slice Units.
machine # [    2.053489] systemd[1]: Reached target Swaps.
machine # [    2.054910] systemd[1]: Reached target Timer Units.
machine # [    2.056590] systemd[1]: Listening on D-Bus System Message Bus Socket.
machine # [    2.058636] systemd[1]: Listening on Journal Socket (/dev/log).
machine # [    2.060661] systemd[1]: Listening on Journal Sockets.
machine # [    2.062352] systemd[1]: Listening on udev Control Socket.
machine # [    2.064132] systemd[1]: Listening on udev Kernel Socket.
machine # [    2.065837] systemd[1]: Reached target Socket Units.
machine # [    2.068131] systemd[1]: Starting Create List of Static Device Nodes...
machine # [    2.081621] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
machine # [    2.089993] systemd[1]: Starting Load Kernel Module configfs...
machine # [    2.100569] systemd[1]: Starting Journal Service...
machine # [    2.111744] systemd[1]: Starting Load Kernel Modules...
machine # [    2.113989] netfs: FS-Cache loaded
machine # [    2.119586] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
machine # [    2.132086] 9pnet: Installing 9P2000 support
machine # [    2.133728] systemd[1]: Starting Coldplug All udev Devices...
machine # [    2.136380] systemd-journald[67]: Collecting audit messages is disabled.
machine # [    2.153875] systemd[1]: Finished Create List of Static Device Nodes.
machine # [    2.160185] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
machine # [    2.167072] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
machine # [    2.175022] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
machine # [    2.178656] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev
machine # [    2.184981] systemd[1]: modprobe@configfs.service: Deactivated successfully.
machine # [    2.195022] systemd[1]: Finished Load Kernel Module configfs.
machine # [    2.205197] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config
machine # [    2.218632] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
machine # [    2.235542] systemd[1]: Finished Load Kernel Modules.
machine # [    2.247661] systemd[1]: Starting Apply Kernel Variables...
machine # [    2.262595] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
machine # [    2.275591] systemd[1]: Finished Apply Kernel Variables.
machine # [    2.284601] systemd[1]: Starting Create Static Device Nodes in /dev...
machine # [    2.305509] systemd[1]: Finished Coldplug All udev Devices.
machine # [    2.022657] systemd-modules-load[68]: Inserted module 'dm_mod'
machine # [    2.025516] systemd-modules-load[68]: Inserted module 'virtio_balloon'
machine # [    2.312805] systemd[1]: Started Journal Service.
machine # [    2.029231] systemd-modules-load[68]: Inserted module 'virtio_gpu'
machine # [    2.033926] systemd[1]: Finished Create Static Device Nodes in /dev.
machine # [    2.039461] systemd[1]: Reached target Preparation for Local File Systems.
machine # [    2.042190] systemd[1]: Reached target Local File Systems.
machine # [    2.043938] systemd[1]: Starting Create System Files and Directories...
machine # [    2.049275] systemd[1]: Starting Rule-based Manager for Device Events and Files...
machine # [    2.058704] systemd[1]: Finished Create System Files and Directories.
machine # [    2.071939] systemd-udevd[84]: Using default interface naming scheme 'v261'.
machine # [    2.088102] systemd[1]: Started Rule-based Manager for Device Events and Files.
machine # [    2.090742] systemd[1]: Reached target System Initialization.
machine # [    2.093421] systemd[1]: Reached target Basic System.
machine # [    2.606142] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12
machine # [    2.623136] virtio_blk virtio5: 1/0/0 default/read/poll queues
machine # [    2.638030] ehci-pci 0000:00:1d.7: EHCI Host Controller
machine # [    2.639290] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 1
machine # [    2.642858] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb000
machine # [    2.648238] serio: i8042 KBD port at 0x60,0x64 irq 1
machine # [    2.652456] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.00
machine # [    2.654820] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.18
machine # [    2.656663] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1
machine # [    2.660111] serio: i8042 AUX port at 0x60,0x64 irq 12
machine # [    2.663436] usb usb1: Product: EHCI Host Controller
machine # [    2.664730] usb usb1: Manufacturer: Linux 6.18.50 ehci_hcd
machine # [    2.667596] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)
machine # [    2.669370] usb usb1: SerialNumber: 0000:00:1d.7
machine # [    2.671067] hub 1-0:1.0: USB hub found
machine # [    2.672455] hub 1-0:1.0: 6 ports detected
machine # [    2.679695] uhci_hcd 0000:00:1d.0: UHCI Host Controller
machine # [    2.680931] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 2
machine # [    2.699813] uhci_hcd 0000:00:1d.0: detected 2 ports
machine # [    2.710297] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c200
machine # [    2.722114] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
machine # [    2.732017] SCSI subsystem initialized
machine # [    2.736054] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
machine # [    2.459386] systemd[1]: Starting Virtual Console Setup...
machine # [    2.465362] (udev-worker)[90]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
machine # [    2.470155] (udev-worker)[90]: Network interface NamePolicy= disabled on kernel command line.
machine # [    2.477278] (udev-worker)[93]: Network interface NamePolicy= disabled on kernel command line.
machine # [    2.771657] usb usb2: Product: UHCI Host Controller
machine # [    2.488380] systemd-vconsole-setup[99]: Configuration of first virtual console was skipped, ignoring remaining ones.
machine # [    2.494121] systemd[1]: Finished Virtual Console Setup.
machine # [    2.788326] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input0
machine # [    2.792161] usb usb2: Manufacturer: Linux 6.18.50 uhci_hcd
machine # [    2.803439] usb usb2: SerialNumber: 0000:00:1d.0
machine # [    2.809564] hub 2-0:1.0: USB hub found
machine # [    2.814109] hub 2-0:1.0: 2 ports detected
machine # [    2.817372] uhci_hcd 0000:00:1d.1: UHCI Host Controller
machine # [    2.823440] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 3
machine # [    2.830539] uhci_hcd 0000:00:1d.1: detected 2 ports
machine # [    2.547599] systemd[1]: Found device /dev/disk/by-label/nixos.
machine # [    2.550769] systemd[1]: Reached target Initrd Root Device.
machine # [    2.837882] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c220
machine # [    2.555302] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...
machine # [    2.850491] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
machine # [    2.852419] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=1
machine # [    2.577202] systemd-fsck[107]: nixos: clean, 12/65536 files, 13019/262144 blocks
machine # [    2.866656] usb usb3: Product: UHCI Host Controller
machine # [    2.867985] usb usb3: Manufacturer: Linux 6.18.50 uhci_hcd
machine # [    2.869573] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode
machine # [    2.871429] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)
machine # [    2.873344] usb usb3: SerialNumber: 0000:00:1d.1
machine # [    2.874901] hub 3-0:1.0: USB hub found
machine # [    2.876235] hub 3-0:1.0: 2 ports detected
machine # [    2.877589] ahci 0000:00:1f.2: flags: 64bit ncq only
machine # [    2.880315] uhci_hcd 0000:00:1d.2: UHCI Host Controller
machine # [    2.884074] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 4
machine # [    2.886311] scsi host0: ahci
machine # [    2.888616] scsi host1: ahci
machine # [    2.889808] uhci_hcd 0000:00:1d.2: detected 2 ports
machine # [    2.892450] scsi host2: ahci
machine # [    2.894580] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c240
machine # [    2.896187] scsi host3: ahci
machine # [    2.898873] scsi host4: ahci
machine # [    2.900296] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
machine # [    2.902864] scsi host5: ahci
machine # [    2.904717] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 44 lpm-pol 1
machine # [    2.906893] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=1
machine # [    2.908705] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 44 lpm-pol 1
machine # [    2.910666] usb usb4: Product: UHCI Host Controller
machine # [    2.911955] usb usb4: Manufacturer: Linux 6.18.50 uhci_hcd
machine # [    2.913359] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 44 lpm-pol 1
machine # [    2.915340] usb usb4: SerialNumber: 0000:00:1d.2
machine # [    2.916624] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 44 lpm-pol 1
machine # [    2.918621] usb 1-1: new high-speed USB device number 2 using ehci-pci
machine # [    2.920801] hub 4-0:1.0: USB hub found
machine # [    2.921905] hub 4-0:1.0: 2 ports detected
machine # [    2.923309] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 44 lpm-pol 1
machine # [    2.933572] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 44 lpm-pol 1
machine # [    2.672693] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.
machine # [    3.047684] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.00
machine # [    3.049540] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=10
machine # [    3.051559] usb 1-1: Product: QEMU USB Tablet
machine # [    3.052766] usb 1-1: Manufacturer: QEMU
machine # [    3.053870] usb 1-1: SerialNumber: 28754-0000:00:1d.7-1
machine # [    3.064615] hid: raw HID events driver (C) Jiri Kosina
machine # [    2.862471] systemd[1]: Mounting /sysroot...
machine # [    3.253730] ata1: SATA link down (SStatus 0 SControl 300)
machine # [    3.255598] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
machine # [    3.257748] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/100
machine # [    3.259307] ata3.00: applying bridge limits
machine # [    3.260959] ata3.00: configured for UDMA/100
machine # [    3.262760] ata5: SATA link down (SStatus 0 SControl 300)
machine # [    3.264755] ata2: SATA link down (SStatus 0 SControl 300)
machine # [    3.266785] ata4: SATA link down (SStatus 0 SControl 300)
machine # [    3.268816] ata6: SATA link down (SStatus 0 SControl 300)
machine # [    3.271129] scsi 2:0:0:0: CD-ROM            QEMU     QEMU DVD-ROM     2.5+ PQ: 0 ANSI: 5
machine # [    3.326766] usbcore: registered new interface driver usbhid
machine # [    3.328105] usbhid: USB HID core driver
machine # [    3.350073] input: QEMU QEMU USB Tablet as /devices/pci0000:00/0000:00:1d.7/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input2
machine # [    3.355865] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input0
machine # [    3.362576] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray
machine # [    3.374597] cdrom: Uniform CD-ROM driver Revision: 3.20
machine # [    3.400846] EXT4-fs (vda): mounted filesystem 1b08101e-65cb-417a-9bf9-91addeffa642 r/w with ordered data mode. Quota mode: none.
machine # [    3.122604] systemd[1]: Mounted /sysroot.
machine # [    3.124756] systemd[1]: Reached target Initrd Root File System.
machine # [    3.127759] systemd[1]: Mounting /sysroot/nix/.ro-store...
machine # [    3.134761] systemd[1]: Mounting /sysroot/nix/.rw-store...
machine # [    3.138268] systemd[1]: Mounting /sysroot/run...
machine # [    3.144910] systemd[1]: Mounting /sysroot/tmp/shared...
machine # [    3.149442] systemd[1]: Mounting /sysroot/tmp/xchg...
machine # [    3.156211] systemd[1]: Starting Mountpoints Configured in the Real Root...
machine # [    3.170410] systemd-sysroot-fstab-check[147]: /sysroot should be mounted in the initrd, will request daemon-reload.
machine # [    3.463153] 9p: Installing v9fs 9p2000 file system support
machine # [    3.190801] systemd[1]: Mounted /sysroot/nix/.ro-store.
machine # [    3.195602] systemd[1]: Mounted /sysroot/nix/.rw-store.
machine # [    3.198231] systemd[1]: Mounted /sysroot/run.
machine # [    3.199536] systemd[1]: Mounted /sysroot/tmp/shared.
machine # [    3.200964] systemd[1]: Mounted /sysroot/tmp/xchg.
machine # [    3.208167] systemd[1]: Starting rw-sysroot-nix-store.service...
machine # [    3.210343] systemd[1]: Reload requested from client PID 147 ('systemd-sysroot') (unit initrd-parse-etc.service)...
machine # [    3.213951] systemd[1]: Reloading...
machine # [    3.264102] systemd[1]: Reloading finished in 50 ms.
machine # [    3.272114] systemd-sysroot-fstab-check[147]: Requesting initrd-fs.target/start/replace...
machine # [    3.275761] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
machine # [    3.278397] systemd[1]: Finished rw-sysroot-nix-store.service.
machine # [    3.281948] systemd-sysroot-fstab-check[147]: Requesting swap.target/start/replace...
machine # [    3.287246] systemd[1]: initrd-parse-etc.service: Deactivated successfully.
machine # [    3.289319] systemd[1]: Finished Mountpoints Configured in the Real Root.
machine # [    3.291238] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.
machine # [    3.294286] systemd[1]: Starting rw-sysroot-nix-store.service...
machine # [    3.302893] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
machine # [    3.305439] systemd[1]: Finished rw-sysroot-nix-store.service.
machine # [    3.862901] systemd[1]: Mounting /sysroot/nix/store...
machine # [    3.879569] systemd[1]: Mounted /sysroot/nix/store.
machine # [    3.881409] systemd[1]: Reached target Initrd File Systems.
machine # [    3.883630] systemd[1]: Starting Find NixOS closure...
machine # [    3.886754] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...
machine # [    3.902121] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.
machine # [    3.904683] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.
machine # [    3.910347] systemd[1]: Finished Find NixOS closure.
machine # [    3.912272] systemd[1]: Reached target Initrd Default Target.
machine # [    3.914326] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...
machine # [    3.925309] systemd[1]: Stopped target Initrd Default Target.
machine # [    3.927115] systemd[1]: Stopped target Basic System.
machine # [    3.929209] systemd[1]: Stopped target Initrd Root Device.
machine # [    3.930597] systemd[1]: Stopped target Path Units.
machine # [    3.931944] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.
machine # [    3.934190] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.
machine # [    3.936488] systemd[1]: Stopped target Slice Units.
machine # [    3.939206] systemd[1]: Stopped target Socket Units.
machine # [    3.940493] systemd[1]: Stopped target System Initialization.
machine # [    3.941915] systemd[1]: Stopped target Swaps.
machine # [    3.943242] systemd[1]: Stopped target Timer Units.
machine # [    3.944814] systemd[1]: dbus.socket: Deactivated successfully.
machine # [    3.947252] systemd[1]: Closed D-Bus System Message Bus Socket.
machine # [    3.948711] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.
machine # [    3.950506] systemd[1]: Stopped Find NixOS closure.
machine # [    3.952325] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio
machine # [    3.955199] systemd[1]: Starting rw-sysroot-nix-store.service...
machine # [    3.957206] systemd[1]: systemd-sysctl.service: Deactivated successfully.
machine # [    3.959559] systemd[1]: Stopped Apply Kernel Variables.
machine # [    3.960897] systemd[1]: systemd-modules-load.service: Deactivated successfully.
machine # [    3.962642] systemd[1]: Stopped Load Kernel Modules.
machine # [    3.965236] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.
machine # [    3.968992] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.
machine # [    3.971039] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.
machine # [    3.974075] systemd[1]: Stopped Create System Files and Directories.
machine # [    3.976342] systemd[1]: Stopped target Local File Systems.
machine # [    3.978986] systemd[1]: Stopped target Preparation for Local File Systems.
machine # [    3.981693] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.
machine # [    3.983493] systemd[1]: Stopped Coldplug All udev Devices.
machine # [    3.985958] systemd[1]: Stopping Rule-based Manager for Device Events and Files...
machine # [    3.988191] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
machine # [    3.990210] systemd[1]: Stopped Virtual Console Setup.
machine # [    3.992214] systemd[1]: initrd-cleanup.service: Deactivated successfully.
machine # [    3.994306] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.
machine # [    3.996450] systemd[1]: systemd-udevd.service: Deactivated successfully.
machine # [    3.998215] systemd[1]: Stopped Rule-based Manager for Device Events and Files.
machine # [    4.000514] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
machine # [    4.002841] systemd[1]: Finished rw-sysroot-nix-store.service.
machine # [    4.006696] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.
machine # [    4.009095] systemd[1]: Closed udev Control Socket.
machine # [    4.010535] systemd[1]: Starting Cleanup udev Database...
machine # [    4.012226] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.
machine # [    4.014223] systemd[1]: Stopped Create Static Device Nodes in /dev.
machine # [    4.016201] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.
machine # [    4.018202] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.
machine # [    4.020374] systemd[1]: kmod-static-nodes.service: Deactivated successfully.
machine # [    4.023130] systemd[1]: Stopped Create List of Static Device Nodes.
machine # [    4.031204] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.
machine # [    4.034246] systemd[1]: Finished Cleanup udev Database.
machine # [    4.036121] systemd[1]: Reached target Switch Root.
machine # [    4.037847] systemd[1]: Starting NixOS Activation...
machine # [    4.121389] initrd-nixos-activation-start[195]: booting system configuration /nix/store/gia166k0mzxiqi4kx9xaip69vhp6ck2z-nixos-system-machine-test
machine # [    4.154948] initrd-nixos-activation-start[195]: running activation script...
machine # [    4.374365] initrd-nixos-activation-start[218]: setting up /etc...
machine # [    4.539955] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.
machine # [    4.542889] systemd[1]: Finished NixOS Activation.
machine # [    4.545097] systemd[1]: Starting Switch Root...
machine # [    4.556133] systemd[1]: Switching root.
machine # [    4.968057] systemd-journald[67]: Received SIGTERM from PID 1 (systemd).
machine # [    5.074678] NET: Registered PF_VSOCK protocol family
machine # [    5.440102] systemd[1]: systemd 261.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)
machine # [    5.447453] systemd[1]: Detected virtualization kvm.
machine # [    5.448868] systemd[1]: Detected architecture x86-64.
machine # [    5.450457] systemd[1]: Detected first boot.
machine # [    5.454447] systemd[1]: Initializing machine ID from random generator.
machine # [    5.661360] systemd[1]: bpf-restrict-fs: LSM BPF program attached
machine # [    5.764251] systemd[1]: Applying preset policy.
machine # [    6.094474] systemd[1]: Populated /etc with preset unit settings.
machine # [    6.411798] systemd[1]: initrd-switch-root.service: Deactivated successfully.
machine # [    6.414550] systemd[1]: Stopped initrd-switch-root.service.
machine # [    6.418468] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.
machine # [    6.421986] systemd[1]: Created slice Slice /system/getty.
machine # [    6.424326] systemd[1]: Created slice User and Session Slice.
machine # [    6.426299] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
machine # [    6.428832] systemd[1]: Started Forward Password Requests to Wall Directory Watch.
machine # [    6.431176] systemd[1]: Expecting device /dev/hvc0...
machine # [    6.432863] systemd[1]: Expecting device /dev/ttyS0...
machine # [    6.434583] systemd[1]: Reached target Local Encrypted Volumes.
machine # [    6.436483] systemd[1]: Stopped target initrd-fs.target.
machine # [    6.438151] systemd[1]: Stopped target initrd-root-fs.target.
machine # [    6.447985] systemd[1]: Stopped target initrd-switch-root.target.
machine # [    6.449882] systemd[1]: Reached target Virtual Machines and Containers.
machine # [    6.451898] systemd[1]: Reached target Path Units.
machine # [    6.453493] systemd[1]: Reached target Remote File Systems.
machine # [    6.455225] systemd[1]: Reached target Slice Units.
machine # [    6.456864] systemd[1]: Reached target Swaps.
machine # [    6.460051] systemd[1]: Listening on Query the User Interactively for a Password.
machine # [    6.464210] systemd[1]: Listening on Process Core Dump Socket.
machine # [    6.467288] systemd[1]: Listening on Credential Encryption/Decryption.
machine # [    6.470649] systemd[1]: Listening on Factory Reset Management.
machine # [    6.472568] systemd[1]: Listening on Hostname Service Socket.
machine # [    6.476357] systemd[1]: Starting Journal Log Access Socket...
machine # [    6.478685] systemd[1]: Listening on Journal Audit Socket.
machine # [    6.482605] systemd[1]: Listening on Console Output Muting Service Socket.
machine # [    6.484748] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.
machine # [    6.487126] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os
machine # [    6.489836] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki
machine # [    6.497318] systemd[1]: Listening on Disk Repartitioning Service Socket.
machine # [    6.499512] systemd[1]: Listening on udev Control Socket.
machine # [    6.501297] systemd[1]: Listening on udev Varlink Socket.
machine # [    6.505139] systemd[1]: Mounting Huge Pages File System...
machine # [    6.511146] systemd[1]: Mounting POSIX Message Queue File System...
machine # [    6.519264] systemd[1]: Mounting Kernel Debug File System...
machine # [    6.528243] systemd[1]: Mounting Kernel Trace File System...
machine # [    6.537066] systemd[1]: Starting Create List of Static Device Nodes...
machine # [    6.545475] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio
machine # [    6.569158] systemd[1]: Starting Load Kernel Module configfs...
machine # [    6.577661] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm
machine # [    6.582088] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
machine # [    6.585262] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse
machine # [    6.594595] systemd[1]: Mounting FUSE Control File System...
machine # [    6.597609] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67
machine # [    6.610619] systemd[1]: Starting Journal Service...
machine # [    6.630417] systemd[1]: Starting Load Kernel Modules...
machine # [    6.645635] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...
machine # [    6.664753] systemd[1]: Starting Remount Root and Kernel File Systems...
machine # [    6.669865] systemd-journald[288]: Collecting audit messages is enabled.
machine # [    6.671815] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
machine # [    6.695958] systemd[1]: Starting Coldplug All udev Devices...
machine # [    6.727230] systemd[1]: Started Journal Service.
machine # [    6.729346] loop: module loaded
machine # [    6.445157] systemd[1]: Queued start job for default target Multi-User System.
machine # [    6.448704] systemd[1]: systemd-journald.service: Deactivated successfully.
machine # [    6.461404] systemd-modules-load[289]: Inserted module 'loop'
machine # [    6.464573] systemd[1]: Listening on Journal Log Access Socket.
machine # [    6.755450] EXT4-fs (vda): re-mounted 1b08101e-65cb-417a-9bf9-91addeffa642.
machine # [    6.473225] systemd[1]: Mounted Huge Pages File System.
machine # [    6.477639] systemd[1]: Mounted POSIX Message Queue File System.
machine # [    6.479846] systemd[1]: Mounted Kernel Debug File System.
machine # [    6.486405] systemd[1]: Mounted Kernel Trace File System.
machine # [    6.490550] systemd[1]: Finished Create List of Static Device Nodes.
machine # [    6.494545] systemd[1]: modprobe@configfs.service: Deactivated successfully.
machine # [    6.498330] systemd[1]: Finished Load Kernel Module configfs.
machine # [    6.501365] systemd[1]: Mounted FUSE Control File System.
machine # [    6.503419] systemd[1]: Finished Load Kernel Modules.
machine # [    6.509224] systemd[1]: Finished Remount Root and Kernel File Systems.
machine # [    6.514811] systemd-oomd[291]: No swap; memory pressure usage will be degraded
machine # [    6.524137] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.
machine # [    6.530206] systemd[1]: Listening on Disk Image Download Service Socket.
machine # [    6.534935] systemd[1]: Mounting Kernel Configuration File System...
machine # [    6.538868] systemd[1]: Starting Firewall...
machine # [    6.551129] systemd[1]: Starting Flush Journal to Persistent Storage...
machine # [    6.553284] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
machine # [    6.564811] systemd[1]: Starting Load/Save OS Random Seed...
machine # [    6.582925] systemd[1]: Starting Apply Kernel Variables...
machine # [    6.603648] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
machine # [    6.606825] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
machine # [    6.907787] systemd-journald[288]: Received client request to flush runtime journal.
machine # [    6.937199] systemd[1]: Mounted Kernel Configuration File System.
machine # [    6.940929] systemd[1]: Finished Load/Save OS Random Seed.
machine # [    6.945498] systemd[1]: Reached target First Boot Complete.
machine # [    6.950185] systemd[1]: Finished Apply Kernel Variables.
machine # [    6.955308] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
machine # [    6.959490] systemd[1]: Starting Create Static Device Nodes in /dev...
machine # [    6.962477] systemd[1]: Finished Coldplug All udev Devices.
machine # [    6.964889] systemd[1]: Finished Create Static Device Nodes in /dev.
machine # [    6.967806] systemd[1]: Reached target Preparation for Local File Systems.
machine # [    6.970461] systemd[1]: Starting Rule-based Manager for Device Events and Files...
machine # [    6.973585] systemd[1]: Finished Flush Journal to Persistent Storage.
machine # [    6.975952] systemd-udevd[326]: Using default interface naming scheme 'v261'.
machine # [    7.092253] systemd[1]: Started Rule-based Manager for Device Events and Files.
machine # [    7.133421] systemd[1]: Mounting /run/wrappers...
machine # [    7.170650] systemd[1]: Mounted /run/wrappers.
machine # [    7.176129] systemd[1]: Reached target Local File Systems.
machine # [    7.182480] systemd[1]: Listening on Boot Loader Control Service Socket.
machine # [    7.190206] systemd[1]: Starting register-nix-paths.service...
machine # [    7.197774] systemd[1]: Starting Create SUID/SGID Wrappers...
machine # [    7.204154] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.
machine # [    7.215872] systemd[1]: Starting Save Transient machine-id to Disk...
machine # [    7.240715] systemd[1]: Starting Create System Files and Directories...
machine # [    7.328787] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
machine # [    7.339744] systemd[1]: Finished Save Transient machine-id to Disk.
machine # [    7.416164] systemd[1]: Finished Create System Files and Directories.
machine # [    7.434543] systemd[1]: Starting Rebuild Journal Catalog...
machine # [    7.448322] systemd[1]: Starting Record System Boot/Shutdown in UTMP...
machine # [    7.615314] systemd[1]: Finished Record System Boot/Shutdown in UTMP.
machine # [    7.683995] systemd[1]: Finished Rebuild Journal Catalog.
machine # [    7.696196] systemd[1]: Starting Update is Completed...
machine # [    7.738799] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse
machine # [    7.842616] systemd[1]: Finished Update is Completed.
machine # [    8.015547] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.
machine # [    8.022152] systemd[1]: Finished Create SUID/SGID Wrappers.
machine # [    8.027562] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.
machine # [    8.102224] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.
machine # [    8.147202] (udev-worker)[394]: Network interface NamePolicy= disabled on kernel command line.
machine # [    8.160901] (udev-worker)[401]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
machine # [    8.181275] (udev-worker)[401]: Network interface NamePolicy= disabled on kernel command line.
machine # [    8.340433] systemd[1]: Finished Firewall.
machine # [    8.382667] systemd[1]: Condition check resulted in Virtio network device being skipped.
machine # [    8.387491] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
machine # [    8.402172] systemd[1]: Starting Create SUID/SGID Wrappers...
machine # [    8.406069] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.
machine # [    8.411321] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67
machine # [    8.418728] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
machine # [    8.425449] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
machine # [    8.431831] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
machine # [    8.568603] systemd[1]: Finished register-nix-paths.service.
machine # [    9.021183] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console
machine # [    9.035348] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input3
machine # [    9.077762] mousedev: PS/2 mouse device common for all mice
machine # [    9.145645] ACPI: button: Power Button [PWRF]
machine # [    9.567704] Console: switching to colour dummy device 80x25
machine # [    9.581289] rtc_cmos 00:04: RTC can wake from S4
machine # [    9.666264] rtc_cmos 00:04: registered as rtc0
machine # [    9.678137] rtc_cmos 00:04: setting system clock to 2026-09-13T05:57:16 UTC (1789279036)
machine # [    9.681234] rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs
machine # [    9.683221] parport_pc 00:02: reported by Plug and Play ACPI
machine # [    9.683761] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]
machine # [    9.851298] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized
machine # [    9.911740] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:09.0/virtio7/input/input4
machine # [   10.004802] [drm] Found bochs VGA, ID 0xb0c5.
machine # [   10.007788] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.
machine # [   10.119032] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic
machine # [   10.233753] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 0
machine # [   10.252318] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt
machine # [   10.258287] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD
machine # [   10.327001] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input6
machine # [   10.370297] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input5
machine # [   10.475874] Console: switching to colour frame buffer device 160x50
machine # [   10.486838] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device
machine # [   11.281951] kvm_amd: TSC scaling supported
machine # [   11.290585] kvm_amd: Nested Virtualization enabled
machine # [   11.303665] kvm_amd: Nested Paging enabled
machine # [   11.310543] kvm_amd: LBR virtualization supported
machine # [   11.355887] kvm_amd: Virtual VMLOAD VMSAVE supported
machine # [   11.412558] kvm_amd: Virtual GIF supported
machine # [   11.437607] kvm_amd: Virtual NMI enabled
machine # [   11.645136] systemd[1]: Starting Virtual Console Setup...
machine # [   12.046743] EDAC MC: Ver: 3.0.0
machine # [   11.810785] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
machine # [   11.848204] systemd[1]: Stopped Virtual Console Setup.
machine # [   11.902790] systemd[1]: Starting Virtual Console Setup...
machine # [   12.388718] ppdev: user-space parallel port driver
machine # [   12.529802] iTCO_wdt iTCO_wdt.1.auto: Found a ICH9 TCO device (Version=2, TCOBASE=0x0660)
machine # [   12.310560] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.
machine # [   12.348805] systemd[1]: Finished Create SUID/SGID Wrappers.
machine # [   12.699470] iTCO_wdt iTCO_wdt.1.auto: initialized. heartbeat=30 sec (nowayout=0)
machine # [   12.558973] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
machine # [   12.577293] systemd[1]: Stopped Virtual Console Setup.
machine # [   12.644425] systemd[1]: Starting Virtual Console Setup...
machine # [   15.319731] systemd-vconsole-setup[590]: Configuration of first virtual console was skipped, ignoring remaining ones.
machine # [   15.332734] systemd[1]: Finished Virtual Console Setup.
machine # [   15.338959] systemd[1]: Reached target System Initialization.
machine # [   15.343275] systemd[1]: Started Discard unused filesystem blocks once a week.
machine # [   15.348574] systemd[1]: Started ssync-cleanup.timer.
machine # [   15.352640] systemd[1]: Started Daily Cleanup of Temporary Directories.
machine # [   15.359255] systemd[1]: Reached target Timer Units.
machine # [   15.362421] systemd[1]: Listening on D-Bus System Message Bus Socket.
machine # [   15.367495] systemd[1]: Listening on Nix Daemon Socket.
machine # [   15.370459] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
machine # [   15.374959] systemd[1]: Reached target Socket Units.
machine # [   15.378287] systemd[1]: Reached target Basic System.
machine # [   15.382721] systemd[1]: Started backdoor.service.
machine # [   15.393319] systemd[1]: Starting Import lastlog data into lastlog2 database...
machine # [   15.408112] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
machine # [   15.432501] systemd[1]: Starting Post-Boot Actions...
machine # [   15.461992] systemd[1]: Started Reset console on configuration changes.
machine # [   15.514753] systemd[1]: Starting resolvconf update...
machine # connecting to host...
machine # [   15.654739] nsncd[595]: Sep 13 05:57:22.756 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
machine # [   15.672561] systemd[1]: Starting D-Bus System Message Bus...
machine: Guest shell says: b'Spawning backdoor root shell...\n'
machine # [   15.681892] systemd[1]: Started Name Service Cache Daemon (nsncd).
machine: connected to guest root shell
machine: (connecting took 16.69 seconds)
machine # [   15.699255] systemd[1]: Finished Post-Boot Actions.
machine: (finished: waiting for the VM to finish booting, in 16.78 seconds)
machine # [   15.712921] systemd[1]: Reached target Host and Network Name Lookups.
machine # [   15.722347] systemd[1]: Reached target User and Group Name Lookups.
machine # [   15.749296] systemd[1]: Starting User Login Management...
machine # [   15.816471] systemd[1]: Finished Import lastlog data into lastlog2 database.
machine # [   16.295159] systemd-logind[620]: New seat seat0.
machine # [   16.321328] systemd-logind[620]: Watching system buttons on /dev/input/event2 (Power Button)
machine # [   16.326668] systemd-logind[620]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)
machine # [   16.336859] systemd-logind[620]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard)
machine # [   16.347825] systemd[1]: Started User Login Management.
machine # [   16.379357] systemd[1]: Starting linger-users.service...
machine # [   16.447576] dbus-broker-launch[608]: Looking up NSS user entry for 'systemd-timesync'...
machine # [   16.516465] dbus-broker-launch[608]: NSS returned no entry for 'systemd-timesync'
machine # [   16.526807] dbus-broker-launch[608]: Invalid user-name in /nix/store/qvkh1mrrn18ns63xsx7zr0ksq8621bla-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
machine # [   16.572385] systemd[1]: linger-users.service: Deactivated successfully.
machine # [   16.581797] systemd[1]: Finished linger-users.service.
machine # [   16.625282] systemd[1]: Stopped target Host and Network Name Lookups.
machine # [   16.634279] systemd[1]: Stopping Host and Network Name Lookups...
machine # [   16.643206] systemd[1]: Stopped target User and Group Name Lookups.
machine # [   16.647698] systemd[1]: Stopping User and Group Name Lookups...
machine # [   16.656406] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...
machine # [   16.664190] systemd[1]: nscd.service: Deactivated successfully.
machine # [   16.675389] systemd[1]: Stopped Name Service Cache Daemon (nsncd).
machine # [   16.698617] systemd[1]: Started D-Bus System Message Bus.
machine # [   16.765441] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
machine # [   16.879942] dbus-broker-launch[608]: Ready
machine # [   16.977805] nsncd[683]: Sep 13 05:57:24.083 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
machine # [   16.994703] systemd[1]: Finished resolvconf update.
machine # [   17.000695] systemd[1]: Started Name Service Cache Daemon (nsncd).
machine # [   17.011988] systemd[1]: Reached target Preparation for Network.
machine # [   17.020290] systemd[1]: Reached target Host and Network Name Lookups.
machine # [   17.024937] systemd[1]: Reached target User and Group Name Lookups.
machine # [   17.045323] systemd[1]: Starting DHCP Client...
machine # [   17.086767] systemd[1]: Starting Address configuration of eth1...
machine # [   17.149513] systemd[1]: Starting Extra networking commands....
machine # [   17.618622] network-addresses-eth1-start[714]: adding address 192.168.1.3/24... done
machine # [   17.677785] network-addresses-eth1-start[714]: adding address 2001:db8:1::3/64... done
machine # [   17.824337] systemd[1]: Finished Address configuration of eth1.
machine # [   18.241645] systemd[1]: Finished Extra networking commands..
machine # [   18.258421] systemd[1]: Reached target Network.
machine # [   18.264593] dhcpcd[723]: dhcpcd-10.3.2 starting
machine # [   18.298455] systemd[1]: Starting Permit User Sessions...
machine # [   18.367540] dhcpcd[788]: dev: loaded udev
machine # [   18.515459] systemd[1]: Finished Permit User Sessions.
machine # [   18.809103] 8021q: 802.1Q VLAN Support v1.8
machine # [   18.817181] 8021q: adding VLAN 0 to HW filter on device eth1
machine # [   18.553736] systemd[1]: Started Getty on tty1.
machine # [   18.579788] systemd[1]: Reached target Login Prompts.
machine # [   18.738832] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.
machine # [   19.492214] cfg80211: Loading compiled-in X.509 certificates for regulatory database
machine # [   20.279050] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
machine # [   20.290185] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'
machine # [   20.326950] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2
machine # [   20.344020] cfg80211: failed to load regulatory.db
machine # [   21.867093] 8021q: adding VLAN 0 to HW filter on device eth0
machine # [   21.636428] dhcpcd[788]: eth0: waiting for carrier
machine # [   21.662344] dhcpcd[788]: eth0: carrier acquired
machine # [   21.847698] dhcpcd[788]: DUID 00:01:00:01:32:38:f7:c8:52:54:00:12:34:56
machine # [   21.855810] dhcpcd[788]: eth0: IAID 00:12:34:56
machine # [   21.865844] dhcpcd[788]: eth0: adding address fe80::5054:ff:fe12:3456
machine # [   23.189755] dhcpcd[788]: eth0: soliciting a DHCP lease
machine # [   23.872839] NET: Registered PF_PACKET protocol family
machine # [   23.730774] dhcpcd[788]: eth0: offered 10.0.2.15 from 10.0.2.2
machine # [   23.752938] dhcpcd[788]: eth0: probing address 10.0.2.15/24
machine # [   24.733691] dhcpcd[788]: eth0: soliciting an IPv6 router
machine # [   24.759218] dhcpcd[788]: eth0: Router Advertisement from fe80::2
machine # [   24.773799] dhcpcd[788]: eth0: adding address fec0::5054:ff:fe12:3456/64
machine # [   24.782918] dhcpcd[788]: eth0: adding route to fec0::/64
machine # [   24.815558] dhcpcd[788]: eth0: adding default route via fe80::2
machine # [   29.182682] dhcpcd[788]: eth0: leased 10.0.2.15 for 86400 seconds
machine # [   29.205812] dhcpcd[788]: eth0: adding route to 10.0.2.0/24
machine # [   29.242848] dhcpcd[788]: eth0: adding default route via 10.0.2.2
machine # [   32.008942] systemd[1]: Started DHCP Client.
machine # [   32.100532] systemd[1]: Reached target Network is Online.
machine # [   32.189587] systemd[1]: Started ssync coding-agent session sync.
machine # [   32.249712] systemd[1]: Reached target Multi-User System.
machine # [   32.330992] systemd[1]: Startup finished in 1.136s (kernel) + 3.616s (initrd) + 27.568s (userspace) = 32.321s.
machine: (finished: waiting for unit ssync.service, in 34.84 seconds)
machine: waiting for file '/var/lib/ssync/age.key'
machine # [   36.294782] ssync[917]: ssync: generated age identity /var/lib/ssync/age.key; add this recipient via `ssync cluster add` (recommended) or to the peers' `recipients`
machine: (finished: waiting for file '/var/lib/ssync/age.key', in 3.76 seconds)
machine: waiting for file '/var/lib/ssync/ticket'
machine # [   38.668605] hrtimer: interrupt took 8274795 ns
machine # [   41.937724] ssync[917]: created namespace fc88ef509417c893f9ea1380c637589a1467addb7f33eb657afc3833b69e0a60
machine # [   42.963540] ssync[917]: ssync daemon watching /root/.pi/agent/sessions (pi)
machine # [   42.978533] ssync[917]: ssync daemon watching /root/.omp/agent/sessions (omp)
machine # [   43.015888] ssync[917]: ssync daemon watching /root/.omp/agent/blobs (omp-blobs)
machine: (finished: waiting for file '/var/lib/ssync/ticket', in 5.86 seconds)
machine: must succeed: test -s /var/lib/ssync/ticket
machine: (finished: must succeed: test -s /var/lib/ssync/ticket, in 0.41 seconds)
machine: must succeed: systemctl cat ssync | grep -oP '(?<=--config )\S+'
machine: (finished: must succeed: systemctl cat ssync | grep -oP '(?<=--config )\S+', in 1.03 seconds)
machine: must succeed: grep -q 'recipients = ' /nix/store/3kgaapgh7ps5ignc6q3jnpcqhl9ibnb4-ssync-config.toml
machine: (finished: must succeed: grep -q 'recipients = ' /nix/store/3kgaapgh7ps5ignc6q3jnpcqhl9ibnb4-ssync-config.toml, in 0.86 seconds)
machine: waiting for unit ssync-cleanup.timer
machine: (finished: waiting for unit ssync-cleanup.timer, in 1.39 seconds)
machine: must succeed: systemctl list-timers ssync-cleanup.timer | grep -q ssync-cleanup
machine: (finished: must succeed: systemctl list-timers ssync-cleanup.timer | grep -q ssync-cleanup, in 0.68 seconds)
machine: must succeed: systemctl cat ssync-cleanup.service | grep ExecStart
machine: (finished: must succeed: systemctl cat ssync-cleanup.service | grep ExecStart, in 0.70 seconds)
machine: must succeed: systemctl start ssync-cleanup.service
machine # [   49.119929] systemd[1]: Starting ssync scheduled session cleanup...
machine # [   50.484706] ssync[991]: nothing to delete
machine # [   50.542527] systemd[1]: ssync-cleanup.service: Deactivated successfully.
machine # [   50.554918] systemd[1]: Finished ssync scheduled session cleanup.
machine: (finished: must succeed: systemctl start ssync-cleanup.service, in 2.24 seconds)
cluster: waiting for unit ssync.service
cluster: waiting for the VM to finish booting
cluster: starting vm
cluster # Disk image does not exist, creating the virtualisation disk image...
cluster # Formatting '/build/vm-state-cluster/tmp.yM2Zt8cCEo', fmt=raw size=1073741824
cluster # mke2fs 1.47.4 (6-Mar-2025)
cluster # Discarding device blocks:      0/262144             done
cluster # Creating filesystem with 262144 4k blocks and 65536 inodes
cluster # Filesystem UUID: 4a28c79f-0f92-488b-803a-5c6fb32de618
cluster # Superblock backups stored on blocks:
cluster # 	32768, 98304, 163840, 229376
cluster # 
cluster # Allocating group tables: 0/8   done
cluster # Writing inode tables: 0/8   done
cluster # Creating journal (8192 blocks): done
cluster # Writing superblocks and filesystem accounting information: 0/8   done
cluster # 
cluster # Virtualisation disk image created.
cluster: QEMU running (pid 105)
cluster # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)
cluster # 
cluster # 
cluster # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+3EFD15C0+3EF315C0 CA00
cluster # Press Ctrl-B to configure iPXE (PCI 00:02.0)...
cluster # 
cluster # 
cluster # 
cluster # 
cluster # iPXE (http://ipxe.org) 00:08.0 CB00 PCI2.10 PnP PMM 3EFD15C0 3EF315C0 CB00
cluster # Press Ctrl-B to configure iPXE (PCI 00:08.0)...
cluster # 
cluster # 
cluster # Booting from ROM...
cluster # Probing EDD (edd=off to disable)... ok
cluster # [    0.000000] Linux version 6.18.50 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Mon Sep  7 15:23:00 UTC 2026
cluster # [    0.000000] Command line: console=ttyS0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/ffk07qnyzxd5fbxs664i3nag1cqzpy7m-nixos-system-cluster-test/init regInfo=/nix/store/qj9693k9cszwaf0zcsjwdd5ihryy04nm-closure-info/registration console=ttyS0,115200n8 console=tty0
cluster # [    0.000000] BIOS-provided physical RAM map:
cluster # [    0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable
cluster # [    0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000003ffd7fff] usable
cluster # [    0.000000] BIOS-e820: [mem 0x000000003ffd8000-0x000000003fffffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved
cluster # [    0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved
cluster # [    0.000000] NX (Execute Disable) protection: active
cluster # [    0.000000] APIC: Static calls initialized
cluster # [    0.000000] SMBIOS 2.8 present.
cluster # [    0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/2014
cluster # [    0.000000] DMI: Memory slots populated: 1/1
cluster # [    0.000000] Hypervisor detected: KVM
cluster # [    0.000000] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000
cluster # [    0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00
cluster # [    0.000015] kvm-clock: using sched offset of 2465769163 cycles
cluster # [    0.000035] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
cluster # [    0.000063] tsc: Detected 2495.318 MHz processor
cluster # [    0.006719] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000
cluster # [    0.007241] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs
cluster # [    0.007282] x86/PAT: Configuration [0-7]: WB  WC  UC- UC  WB  WP  UC- WT
cluster # [    0.028953] found SMP MP-table at [mem 0x000f5450-0x000f545f]
cluster # [    0.029116] Using GB pages for direct mapping
cluster # [    0.029901] RAMDISK: [mem 0x3e366000-0x3ffcffff]
cluster # [    0.029979] ACPI: Early table checksum verification disabled
cluster # [    0.030007] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )
cluster # [    0.030046] ACPI: RSDT 0x000000003FFE2422 000038 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030087] ACPI: FACP 0x000000003FFE221A 0000F4 (v03 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030167] ACPI: DSDT 0x000000003FFE0040 0021DA (v01 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030216] ACPI: FACS 0x000000003FFE0000 000040
cluster # [    0.030238] ACPI: APIC 0x000000003FFE230E 000078 (v03 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030260] ACPI: HPET 0x000000003FFE2386 000038 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030277] ACPI: MCFG 0x000000003FFE23BE 00003C (v01 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030357] ACPI: WAET 0x000000003FFE23FA 000028 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
cluster # [    0.030400] ACPI: Reserving FACP table memory at [mem 0x3ffe221a-0x3ffe230d]
cluster # [    0.030414] ACPI: Reserving DSDT table memory at [mem 0x3ffe0040-0x3ffe2219]
cluster # [    0.030421] ACPI: Reserving FACS table memory at [mem 0x3ffe0000-0x3ffe003f]
cluster # [    0.030427] ACPI: Reserving APIC table memory at [mem 0x3ffe230e-0x3ffe2385]
cluster # [    0.030431] ACPI: Reserving HPET table memory at [mem 0x3ffe2386-0x3ffe23bd]
cluster # [    0.030436] ACPI: Reserving MCFG table memory at [mem 0x3ffe23be-0x3ffe23f9]
cluster # [    0.030440] ACPI: Reserving WAET table memory at [mem 0x3ffe23fa-0x3ffe2421]
cluster # [    0.033288] No NUMA configuration found
cluster # [    0.033351] Faking a node at [mem 0x0000000000000000-0x000000003ffd7fff]
cluster # [    0.033383] NODE_DATA(0) allocated [mem 0x3ffd2780-0x3ffd7cff]
cluster # [    0.034496] Zone ranges:
cluster # [    0.034503]   DMA      [mem 0x0000000000001000-0x0000000000ffffff]
cluster # [    0.034514]   DMA32    [mem 0x0000000001000000-0x000000003ffd7fff]
cluster # [    0.034520]   Normal   empty
cluster # [    0.034523]   Device   empty
cluster # [    0.034526] Movable zone start for each node
cluster # [    0.034528] Early memory node ranges
cluster # [    0.034530]   node   0: [mem 0x0000000000001000-0x000000000009efff]
cluster # [    0.034535]   node   0: [mem 0x0000000000100000-0x000000003ffd7fff]
cluster # [    0.034540] Initmem setup node 0 [mem 0x0000000000001000-0x000000003ffd7fff]
cluster # [    0.034660] On node 0, zone DMA: 1 pages in unavailable ranges
cluster # [    0.036676] On node 0, zone DMA: 97 pages in unavailable ranges
cluster # [    0.204506] On node 0, zone DMA32: 40 pages in unavailable ranges
cluster # [    0.210045] ACPI: PM-Timer IO Port: 0x608
cluster # [    0.210124] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])
cluster # [    0.210317] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23
cluster # [    0.210340] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)
cluster # [    0.210348] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)
cluster # [    0.210352] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)
cluster # [    0.210355] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)
cluster # [    0.210359] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)
cluster # [    0.210374] ACPI: Using ACPI (MADT) for SMP configuration information
cluster # [    0.210378] ACPI: HPET id: 0x8086a201 base: 0xfed00000
cluster # [    0.210396] TSC deadline timer available
cluster # [    0.210411] CPU topo: Max. logical packages:   1
cluster # [    0.210414] CPU topo: Max. logical dies:       1
cluster # [    0.210417] CPU topo: Max. dies per package:   1
cluster # [    0.210429] CPU topo: Max. threads per core:   1
cluster # [    0.210431] CPU topo: Num. cores per package:     1
cluster # [    0.210433] CPU topo: Num. threads per package:   1
cluster # [    0.210435] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs
cluster # [    0.210516] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()
cluster # [    0.210682] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]
cluster # [    0.210693] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]
cluster # [    0.210700] [mem 0x40000000-0xafffffff] available for PCI devices
cluster # [    0.210705] Booting paravirtualized kernel on KVM
cluster # [    0.210715] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns
cluster # [    0.226285] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1
cluster # [    0.241969] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152
cluster # [    0.242201] kvm-guest: PV spinlocks disabled, single CPU
cluster # [    0.242214] Kernel command line: console=ttyS0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/ffk07qnyzxd5fbxs664i3nag1cqzpy7m-nixos-system-cluster-test/init regInfo=/nix/store/qj9693k9cszwaf0zcsjwdd5ihryy04nm-closure-info/registration console=ttyS0,115200n8 console=tty0
cluster # [    0.242599] Unknown kernel command line parameters "regInfo=/nix/store/qj9693k9cszwaf0zcsjwdd5ihryy04nm-closure-info/registration", will be passed to user space.
cluster # [    0.242831] random: crng init done
cluster # [    0.242835] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes
cluster # [    0.250610] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)
cluster # [    0.250683] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)
cluster # [    0.250844] Fallback order for Node 0: 0
cluster # [    0.250859] Built 1 zonelists, mobility grouping on.  Total pages: 262006
cluster # [    0.250865] Policy zone: DMA32
cluster # [    0.268068] mem auto-init: stack:all(zero), heap alloc:on, heap free:off
cluster # [    0.292136] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
cluster # [    0.327608] allocated 2097152 bytes of page_ext
cluster # [    0.384181] ftrace: allocating 48731 entries in 192 pages
cluster # [    0.384194] ftrace: allocated 192 pages with 2 groups
cluster # [    0.388764] Dynamic Preempt: lazy
cluster # [    0.389721] rcu: Preemptible hierarchical RCU implementation.
cluster # [    0.389727] rcu: 	RCU event tracing is enabled.
cluster # [    0.389729] rcu: 	RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.
cluster # [    0.389736] 	Trampoline variant of Tasks RCU enabled.
cluster # [    0.389737] 	Rude variant of Tasks RCU enabled.
cluster # [    0.389739] 	Tracing variant of Tasks RCU enabled.
cluster # [    0.389741] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.
cluster # [    0.389744] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1
cluster # [    0.389853] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
cluster # [    0.389862] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
cluster # [    0.389866] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
cluster # [    0.434830] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16
cluster # [    0.437366] rcu: srcu_init: Setting srcu_struct sizes based on contention.
cluster # [    0.437423] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns
cluster # [    0.438550] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)
cluster # [    0.494162] Console: colour VGA+ 80x25
cluster # [    0.494196] printk: legacy console [tty0] enabled
cluster # [    0.768370] printk: legacy console [ttyS0] enabled
cluster # [    1.970685] ACPI: Core revision 20250807
cluster # [    1.980302] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns
cluster # [    1.991549] APIC: Switch to symmetric I/O mode setup
cluster # [    2.000187] x2apic enabled
cluster # [    2.012732] APIC: Switched APIC routing to: physical x2apic
cluster # [    2.041689] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1
cluster # [    2.053466] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x23f7f2f9526, max_idle_ns: 440795279108 ns
cluster # [    2.067689] Calibrating delay loop (skipped) preset value.. 4990.63 BogoMIPS (lpj=2495318)
cluster # [    2.070660] x86/cpu: User Mode Instruction Prevention (UMIP) activated
cluster # [    2.074601] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127
cluster # [    2.075682] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0
cluster # [    2.076748] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto
cluster # [    2.078713] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl
cluster # [    2.080693] Spectre V2 : Mitigation: Enhanced / Automatic IBRS
cluster # [    2.082713] Speculative Return Stack Overflow: Mitigation: IBPB on VMEXIT only
cluster # [    2.084713] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization
cluster # [    2.087792] Spectre V2 : Enabling IBPB for BPF
cluster # [    2.088732] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier
cluster # [    2.091060] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'
cluster # [    2.092687] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'
cluster # [    2.094685] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'
cluster # [    2.096660] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'
cluster # [    2.097660] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'
cluster # [    2.097687] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'
cluster # [    2.098687] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'
cluster # [    2.100710] x86/fpu: Supporting XSAVE feature 0x800: 'Control-flow User registers'
cluster # [    2.103688] x86/fpu: Supporting XSAVE feature 0x1000: 'Control-flow Kernel registers (KVM only)'
cluster # [    2.105687] x86/fpu: xstate_offset[2]:  576, xstate_sizes[2]:  256
cluster # [    2.106660] x86/fpu: xstate_offset[5]:  832, xstate_sizes[5]:   64
cluster # [    2.106686] x86/fpu: xstate_offset[6]:  896, xstate_sizes[6]:  512
cluster # [    2.107660] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024
cluster # [    2.107686] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]:    8
cluster # [    2.109660] x86/fpu: xstate_offset[11]: 2440, xstate_sizes[11]:   16
cluster # [    2.110660] x86/fpu: xstate_offset[12]: 2456, xstate_sizes[12]:   24
cluster # [    2.111681] x86/fpu: Enabled xstate features 0x1ae7, context size is 2480 bytes, using 'compacted' format.
cluster # [    2.170660] Freeing SMP alternatives memory: 44K
cluster # [    2.171739] pid_max: default: 32768 minimum: 301
cluster # [    2.173099] LSM: initializing lsm=capability,landlock,yama,bpf,ima
cluster # [    2.175000] landlock: Up and running.
cluster # [    2.175703] Yama: becoming mindful.
cluster # [    2.179546] LSM support for eBPF active
cluster # [    2.181660] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
cluster # [    2.183833] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
cluster # [    2.187660] smpboot: CPU0: AMD Ryzen 9 9955HX 16-Core Processor (family: 0x1a, model: 0x44, stepping: 0x0)
cluster # [    2.192907] Performance Events: Fam17h+ core perfctr, AMD PMU driver.
cluster # [    2.194754] ... version:                   2
cluster # [    2.196684] ... bit width:                 48
cluster # [    2.198685] ... generic counters:          6
cluster # [    2.200684] ... generic bitmap:            000000000000003f
cluster # [    2.202689] ... fixed-purpose counters:    0
cluster # [    2.204685] ... fixed-purpose bitmap:      0000000000000000
cluster # [    2.206685] ... value mask:                0000ffffffffffff
cluster # [    2.208684] ... max period:                00007fffffffffff
cluster # [    2.210683] ... global_ctrl mask:          000000000000003f
cluster # [    2.213103] signal: max sigframe size: 3376
cluster # [    2.215553] rcu: Hierarchical SRCU implementation.
cluster # [    2.216705] rcu: 	Max phase no-delay instances is 400.
cluster # [    2.222579] smp: Bringing up secondary CPUs ...
cluster # [    2.223728] smp: Brought up 1 node, 1 CPU
cluster # [    2.225710] smpboot: Total of 1 processors activated (4990.63 BogoMIPS)
cluster # [    2.229151] Memory: 943004K/1048024K available (17223K kernel code, 2726K rwdata, 13584K rodata, 3644K init, 2988K bss, 97600K reserved, 0K cma-reserved)
cluster # [    2.233351] devtmpfs: initialized
cluster # [    2.237943] x86/mm: Memory block size: 128MB
cluster # [    2.249429] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)
cluster # [    2.251036] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).
cluster # [    2.253542] pinctrl core: initialized pinctrl subsystem
cluster # [    2.257700] PM: RTC time: 05:58:04, date: 2026-09-13
cluster # [    2.279580] NET: Registered PF_NETLINK/PF_ROUTE protocol family
cluster # [    2.283272] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations
cluster # [    2.284766] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
cluster # [    2.287730] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
cluster # [    2.289739] audit: initializing netlink subsys (disabled)
cluster # [    2.293230] thermal_sys: Registered thermal governor 'fair_share'
cluster # [    2.293239] thermal_sys: Registered thermal governor 'bang_bang'
cluster # [    2.294709] audit: type=2000 audit(1789279082.209:1): state=initialized audit_enabled=0 res=1
cluster # [    2.298752] thermal_sys: Registered thermal governor 'step_wise'
cluster # [    2.298768] thermal_sys: Registered thermal governor 'user_space'
cluster # [    2.300799] thermal_sys: Registered thermal governor 'power_allocator'
cluster # [    2.302911] cpuidle: using governor menu
cluster # [    2.312075] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5
cluster # [    2.315353] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]
cluster # [    2.316703] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry
cluster # [    2.318728] PCI: Using configuration type 1 for base access
cluster # [    2.321629] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.
cluster # [    2.334037] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
cluster # [    2.339688] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page
cluster # [    2.345691] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
cluster # [    2.351687] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page
cluster # [    2.385595] ACPI: Added _OSI(Module Device)
cluster # [    2.390717] ACPI: Added _OSI(Processor Device)
cluster # [    2.396721] ACPI: Added _OSI(Processor Aggregator Device)
cluster # [    2.448550] ACPI: 1 ACPI AML tables successfully acquired and loaded
cluster # [    2.460697] ACPI: Interpreter enabled
cluster # [    2.466755] ACPI: PM: (supports S0 S3 S4 S5)
cluster # [    2.474718] ACPI: Using IOAPIC for interrupt routing
cluster # [    2.480145] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug
cluster # [    2.483726] PCI: Using E820 reservations for host bridge windows
cluster # [    2.489611] ACPI: Enabled 2 GPEs in block 00 to 3F
cluster # [    2.537535] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])
cluster # [    2.540719] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]
cluster # [    2.546184] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]
cluster # [    2.548393] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]
cluster # [    2.554650] PCI host bridge to bus 0000:00
cluster # [    2.557764] pci_bus 0000:00: root bus resource [io  0x0000-0x0cf7 window]
cluster # [    2.561694] pci_bus 0000:00: root bus resource [io  0x0d00-0xffff window]
cluster # [    2.565722] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]
cluster # [    2.567726] pci_bus 0000:00: root bus resource [mem 0x40000000-0xafffffff window]
cluster # [    2.571745] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]
cluster # [    2.573726] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]
cluster # [    2.578732] pci_bus 0000:00: root bus resource [bus 00-ff]
cluster # [    2.584237] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint
cluster # [    2.601113] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint
cluster # [    2.614359] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]
cluster # [    2.615809] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]
cluster # [    2.617922] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]
cluster # [    2.622089] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]
cluster # [    2.631704] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
cluster # [    2.638837] pci 0000:00:02.0: BAR 0 [io  0xc140-0xc15f]
cluster # [    2.640882] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]
cluster # [    2.642904] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]
cluster # [    2.644754] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]
cluster # [    2.651452] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
cluster # [    2.656744] pci 0000:00:03.0: BAR 0 [io  0xc160-0xc17f]
cluster # [    2.658755] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]
cluster # [    2.661185] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]
cluster # [    2.673148] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
cluster # [    2.677745] pci 0000:00:04.0: BAR 0 [io  0xc080-0xc0bf]
cluster # [    2.679754] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]
cluster # [    2.681887] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]
cluster # [    2.688254] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
cluster # [    2.692737] pci 0000:00:05.0: BAR 0 [io  0xc180-0xc19f]
cluster # [    2.694959] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]
cluster # [    2.696868] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]
cluster # [    2.702940] pci 0000:00:06.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
cluster # [    2.707752] pci 0000:00:06.0: BAR 0 [io  0xc1a0-0xc1bf]
cluster # [    2.709852] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]
cluster # [    2.712194] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]
cluster # [    2.723714] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint
cluster # [    2.730752] pci 0000:00:07.0: BAR 0 [io  0xc000-0xc07f]
cluster # [    2.732760] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]
cluster # [    2.735147] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]
cluster # [    2.742316] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
cluster # [    2.746740] pci 0000:00:08.0: BAR 0 [io  0xc1c0-0xc1df]
cluster # [    2.748742] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]
cluster # [    2.750883] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]
cluster # [    2.752942] pci 0000:00:08.0: ROM [mem 0xfeb80000-0xfebbffff pref]
cluster # [    2.758848] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint
cluster # [    2.763773] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]
cluster # [    2.766075] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]
cluster # [    2.772318] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint
cluster # [    2.776732] pci 0000:00:0a.0: BAR 0 [io  0xc0c0-0xc0ff]
cluster # [    2.778735] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]
cluster # [    2.780871] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]
cluster # [    2.786619] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
cluster # [    2.790731] pci 0000:00:0b.0: BAR 0 [io  0xc1e0-0xc1ff]
cluster # [    2.792731] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]
cluster # [    2.794837] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]
cluster # [    2.801005] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint
cluster # [    2.805984] pci 0000:00:1d.0: BAR 4 [io  0xc200-0xc21f]
cluster # [    2.809475] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint
cluster # [    2.814974] pci 0000:00:1d.1: BAR 4 [io  0xc220-0xc23f]
cluster # [    2.819097] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint
cluster # [    2.825954] pci 0000:00:1d.2: BAR 4 [io  0xc240-0xc25f]
cluster # [    2.831465] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint
cluster # [    2.839841] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]
cluster # [    2.846944] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint
cluster # [    2.855715] pci 0000:00:1f.0: quirk: [io  0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO
cluster # [    2.859689] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint
cluster # [    2.864957] pci 0000:00:1f.2: BAR 4 [io  0xc260-0xc27f]
cluster # [    2.866763] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]
cluster # [    2.871355] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint
cluster # [    2.876923] pci 0000:00:1f.3: BAR 4 [io  0x0700-0x073f]
cluster # [    2.902292] ACPI: PCI: Interrupt link LNKA configured for IRQ 10
cluster # [    2.904454] ACPI: PCI: Interrupt link LNKB configured for IRQ 10
cluster # [    2.906184] ACPI: PCI: Interrupt link LNKC configured for IRQ 11
cluster # [    2.908241] ACPI: PCI: Interrupt link LNKD configured for IRQ 11
cluster # [    2.910243] ACPI: PCI: Interrupt link LNKE configured for IRQ 10
cluster # [    2.912236] ACPI: PCI: Interrupt link LNKF configured for IRQ 10
cluster # [    2.914213] ACPI: PCI: Interrupt link LNKG configured for IRQ 11
cluster # [    2.916439] ACPI: PCI: Interrupt link LNKH configured for IRQ 11
cluster # [    2.917933] ACPI: PCI: Interrupt link GSIA configured for IRQ 16
cluster # [    2.919751] ACPI: PCI: Interrupt link GSIB configured for IRQ 17
cluster # [    2.921777] ACPI: PCI: Interrupt link GSIC configured for IRQ 18
cluster # [    2.923796] ACPI: PCI: Interrupt link GSID configured for IRQ 19
cluster # [    2.926061] ACPI: PCI: Interrupt link GSIE configured for IRQ 20
cluster # [    2.927756] ACPI: PCI: Interrupt link GSIF configured for IRQ 21
cluster # [    2.929956] ACPI: PCI: Interrupt link GSIG configured for IRQ 22
cluster # [    2.931782] ACPI: PCI: Interrupt link GSIH configured for IRQ 23
cluster # [    2.940100] iommu: Default domain type: Translated
cluster # [    2.941813] iommu: DMA domain TLB invalidation policy: lazy mode
cluster # [    2.948898] ACPI: bus type USB registered
cluster # [    2.952034] usbcore: registered new interface driver usbfs
cluster # [    2.953925] usbcore: registered new interface driver hub
cluster # [    2.956799] usbcore: registered new device driver usb
cluster # [    2.969898] NetLabel: Initializing
cluster # [    2.971688] NetLabel:  domain hash size = 128
cluster # [    2.973688] NetLabel:  protocols = UNLABELED CIPSOv4 CALIPSO
cluster # [    2.976707] NetLabel:  unlabeled traffic allowed by default
cluster # [    2.978955] PCI: Using ACPI for IRQ routing
cluster # [    3.507490] pci 0000:00:01.0: vgaarb: setting as boot VGA device
cluster # [    3.507660] pci 0000:00:01.0: vgaarb: bridge control possible
cluster # [    3.507660] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none
cluster # [    3.507734] vgaarb: loaded
cluster # [    3.512338] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0
cluster # [    3.513709] hpet0: 3 comparators, 64-bit 100.000000 MHz counter
cluster # [    3.519660] clocksource: Switched to clocksource kvm-clock
cluster # [    3.568874] VFS: Disk quotas dquot_6.6.0
cluster # [    3.579642] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
cluster # [    3.601056] pnp: PnP ACPI init
cluster # [    3.611705] ACPI: IRQ 4 override to edge(!), high(!)
cluster # [    3.626104] system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved
cluster # [    3.647914] pnp: PnP ACPI: found 6 devices
cluster # [    3.693583] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns
cluster # [    3.715433] clocksource: Switched to clocksource acpi_pm
cluster # [    3.728951] NET: Registered PF_INET protocol family
cluster # [    3.742755] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)
cluster # [    3.878046] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)
cluster # [    3.896769] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
cluster # [    3.907467] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)
cluster # [    3.925770] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)
cluster # [    3.944660] TCP: Hash tables configured (established 8192 bind 8192)
cluster # [    3.962156] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)
cluster # [    3.983152] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)
cluster # [    4.001628] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)
cluster # [    4.022231] NET: Registered PF_UNIX/PF_LOCAL protocol family
cluster # [    4.040911] NET: Registered PF_XDP protocol family
cluster # [    4.056602] pci_bus 0000:00: resource 4 [io  0x0000-0x0cf7 window]
cluster # [    4.074597] pci_bus 0000:00: resource 5 [io  0x0d00-0xffff window]
cluster # [    4.091066] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]
cluster # [    4.110115] pci_bus 0000:00: resource 7 [mem 0x40000000-0xafffffff window]
cluster # [    4.127558] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]
cluster # [    4.145576] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]
cluster # [    4.171147] ACPI: \_SB_.GSIA: Enabled at IRQ 16
cluster # [    4.195623] pci 0000:00:1d.0: quirk_usb_early_handoff+0x0/0x7c0 took 27394 usecs
cluster # [    4.219113] ACPI: \_SB_.GSIB: Enabled at IRQ 17
cluster # [    4.242756] pci 0000:00:1d.1: quirk_usb_early_handoff+0x0/0x7c0 took 26266 usecs
cluster # [    4.265142] ACPI: \_SB_.GSIC: Enabled at IRQ 18
cluster # [    4.285975] pci 0000:00:1d.2: quirk_usb_early_handoff+0x0/0x7c0 took 23242 usecs
cluster # [    4.316049] ACPI: \_SB_.GSID: Enabled at IRQ 19
cluster # [    4.328935] pci 0000:00:1d.7: quirk_usb_early_handoff+0x0/0x7c0 took 14699 usecs
cluster # [    4.341554] PCI: CLS 0 bytes, default 64
cluster # [    4.348614] Trying to unpack rootfs image as initramfs...
cluster # [    4.364457] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x23f7f2f9526, max_idle_ns: 440795279108 ns
cluster # [    4.646939] Initialise system trusted keyrings
cluster # [    4.684878] workingset: timestamp_bits=40 max_order=18 bucket_order=0
cluster # [    4.873863] Key type asymmetric registered
cluster # [    4.910515] Asymmetric key parser 'x509' registered
cluster # [    4.929628] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)
cluster # [    4.964194] io scheduler mq-deadline registered
cluster # [    5.002645] io scheduler kyber registered
cluster # [    5.038107] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
cluster # [    5.061603] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A
cluster # [    5.116023] Linux agpgart interface v0.103
cluster # [    5.132788] ACPI: bus type drm_connector registered
cluster # [    5.153634] usbcore: registered new interface driver usbserial_generic
cluster # [    5.175583] usbserial: USB Serial support registered for generic
cluster # [    5.192463] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.
cluster # [    5.192463] Please enable it if your BIOS has the CPPC option.
cluster # [    5.231439] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled
cluster # [    5.293130] drop_monitor: Initializing network drop monitor service
cluster # [    5.331789] NET: Registered PF_INET6 protocol family
cluster # [    5.402937] Segment Routing with IPv6
cluster # [    5.437802] In-situ OAM (IOAM) with IPv6
cluster # [    5.483046] IPI shorthand broadcast: enabled
cluster # [    5.557213] sched_clock: Marking stable (3934297815, 1622242576)->(8581076625, -3024536234)
cluster # [    5.644926] registered taskstats version 1
cluster # [    5.668091] Loading compiled-in X.509 certificates
cluster # [    5.877798] Demotion targets for Node 0: null
cluster # [    5.905961] Key type .fscrypt registered
cluster # [    5.917400] Key type fscrypt-provisioning registered
cluster # [    5.934941] ima: No TPM chip found, activating TPM-bypass!
cluster # [    5.971599] ima: Allocated hash algorithm: sha1
cluster # [    6.002965] ima: No architecture policies found
cluster # [    6.026069] PM:   Magic number: 10:964:971
cluster # [    6.049943] RAS: Correctable Errors collector initialized.
cluster # [    6.133873] clk: Disabling unused clocks
cluster # [    6.160639] PM: genpd: Disabling unused power domains
cluster # [    9.724652] Freeing initrd memory: 29096K
cluster # [    9.756714] Freeing unused decrypted memory: 2028K
cluster # [    9.809012] Freeing unused kernel image (initmem) memory: 3644K
cluster # [    9.827202] Write protecting the kernel read-only data: 32768k
cluster # [    9.859630] Freeing unused kernel image (text/rodata gap) memory: 1208K
cluster # [    9.883170] Freeing unused kernel image (rodata/data gap) memory: 752K
cluster # [   10.114577] x86/mm: Checked W+X mappings: passed, no W+X pages found.
cluster # [   10.131839] Run /init as init process
cluster # [   10.275565] systemd[1]: Inserted module 'autofs4'
cluster # [   10.421028] fuse: init (API version 7.45)
cluster # [   10.452148] ACPI: \_SB_.GSIG: Enabled at IRQ 22
cluster # [   10.489163] ACPI: \_SB_.GSIH: Enabled at IRQ 23
cluster # [   10.544149] ACPI: \_SB_.GSIE: Enabled at IRQ 20
cluster # [   10.575061] ACPI: \_SB_.GSIF: Enabled at IRQ 21
cluster # [   11.015169] systemd[1]: Successfully made /usr/ read-only.
cluster # [   11.397087] systemd[1]: systemd 261.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)
cluster # [   11.496701] systemd[1]: Detected virtualization kvm.
cluster # [   11.522165] systemd[1]: Detected architecture x86-64.
cluster # [   11.549977] systemd[1]: Running in initrd.
cluster # [   11.586723] systemd[1]: Initializing machine ID from random generator.
cluster # [   11.622113] systemd[1]: Hostname set to <cluster>.
cluster # [   12.368947] systemd[1]: bpf-restrict-fs: LSM BPF program attached
cluster # [   12.541953] systemd[1]: Queued start job for default target Initrd Default Target.
cluster # [   12.560010] systemd[1]: Created slice Slice /system/modprobe.
cluster # [   12.568557] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
cluster # [   12.587148] systemd[1]: Expecting device /dev/disk/by-label/nixos...
cluster # [   12.609496] systemd[1]: Reached target Path Units.
cluster # [   12.625817] systemd[1]: Reached target Slice Units.
cluster # [   12.640602] systemd[1]: Reached target Swaps.
cluster # [   12.721943] systemd[1]: Reached target Timer Units.
cluster # [   12.740588] systemd[1]: Listening on D-Bus System Message Bus Socket.
cluster # [   12.762549] systemd[1]: Listening on Journal Socket (/dev/log).
cluster # [   12.781872] systemd[1]: Listening on Journal Sockets.
cluster # [   12.793177] systemd[1]: Listening on udev Control Socket.
cluster # [   12.805838] systemd[1]: Listening on udev Kernel Socket.
cluster # [   12.814789] systemd[1]: Reached target Socket Units.
cluster # [   12.828718] systemd[1]: Starting Create List of Static Device Nodes...
cluster # [   12.897159] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
cluster # [   12.988973] systemd[1]: Starting Load Kernel Module configfs...
cluster # [   13.382741] systemd[1]: Starting Journal Service...
cluster # [   13.624076] systemd[1]: Starting Load Kernel Modules...
cluster # [   13.658038] netfs: FS-Cache loaded
cluster # [   13.744002] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
cluster # [   13.886906] 9pnet: Installing 9P2000 support
cluster # [   13.949464] systemd[1]: Starting Coldplug All udev Devices...
cluster # [   14.295105] systemd[1]: Finished Create List of Static Device Nodes.
cluster # [   14.309580] systemd-journald[69]: Collecting audit messages is disabled.
cluster # [   14.388098] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
cluster # [   14.526998] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
cluster # [   14.634806] systemd[1]: modprobe@configfs.service: Deactivated successfully.
cluster # [   14.649416] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
cluster # [   14.691852] systemd[1]: Finished Load Kernel Module configfs.
cluster # [   14.716904] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev
cluster # [   14.791670] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config
cluster # [   14.987654] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
cluster # [   15.167147] systemd[1]: Finished Load Kernel Modules.
cluster # [   15.275665] systemd[1]: Starting Apply Kernel Variables...
cluster # [   15.379543] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
cluster # [   15.515636] systemd[1]: Starting Create Static Device Nodes in /dev...
cluster # [   15.671810] systemd[1]: Finished Apply Kernel Variables.
cluster # [   15.817855] systemd[1]: Finished Create Static Device Nodes in /dev.
cluster # [   15.849809] systemd[1]: Reached target Preparation for Local File Systems.
cluster # [   15.883017] systemd[1]: Reached target Local File Systems.
cluster # [   15.981468] systemd[1]: Starting Rule-based Manager for Device Events and Files...
cluster # [   14.351988] systemd-modules-load[70]: Inserted module 'dm_mod'
cluster # [   14.408851] systemd-modules-load[70]: Inserted module 'virtio_balloon'
cluster # [   14.435725] systemd-modules-load[70]: Inserted module 'virtio_gpu'
cluster # [   16.141555] systemd[1]: Started Journal Service.
cluster # [   14.601286] systemd[1]: Starting Create System Files and Directories...
cluster # [   14.798535] systemd-udevd[76]: Using default interface naming scheme 'v261'.
cluster # [   14.828393] systemd[1]: Finished Create System Files and Directories.
cluster # [   14.928973] systemd[1]: Finished Coldplug All udev Devices.
cluster # [   15.064627] systemd[1]: Started Rule-based Manager for Device Events and Files.
cluster # [   15.080582] systemd[1]: Reached target System Initialization.
cluster # [   15.089664] systemd[1]: Reached target Basic System.
cluster # [   18.554569] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12
cluster # [   18.620911] virtio_blk virtio5: 1/0/0 default/read/poll queues
cluster # [   18.687920] serio: i8042 KBD port at 0x60,0x64 irq 1
cluster # [   18.751046] serio: i8042 AUX port at 0x60,0x64 irq 12
cluster # [   18.771050] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)
cluster # [   18.819265] ehci-pci 0000:00:1d.7: EHCI Host Controller
cluster # [   18.829360] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 1
cluster # [   18.850660] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb000
cluster # [   18.872401] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.00
cluster # [   18.893493] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.18
cluster # [   18.943557] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1
cluster # [   18.983497] usb usb1: Product: EHCI Host Controller
cluster # [   19.012507] usb usb1: Manufacturer: Linux 6.18.50 ehci_hcd
cluster # [   19.042496] usb usb1: SerialNumber: 0000:00:1d.7
cluster # [   19.068818] hub 1-0:1.0: USB hub found
cluster # [   19.089337] hub 1-0:1.0: 6 ports detected
cluster # [   19.118676] uhci_hcd 0000:00:1d.0: UHCI Host Controller
cluster # [   19.177321] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 2
cluster # [   19.241809] uhci_hcd 0000:00:1d.0: detected 2 ports
cluster # [   19.365548] usb 1-1: new high-speed USB device number 2 using ehci-pci
cluster # [   19.398905] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c200
cluster # [   19.457845] SCSI subsystem initialized
cluster # [   19.498906] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
cluster # [   19.592361] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.00
cluster # [   19.628283] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=10
cluster # [   19.700549] usb 1-1: Product: QEMU USB Tablet
cluster # [   19.743465] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
cluster # [   19.768125] usb 1-1: Manufacturer: QEMU
cluster # [   19.787542] usb 1-1: SerialNumber: 28754-0000:00:1d.7-1
cluster # [   19.882910] usb usb2: Product: UHCI Host Controller
cluster # [   19.905325] usb usb2: Manufacturer: Linux 6.18.50 uhci_hcd
cluster # [   19.950622] usb usb2: SerialNumber: 0000:00:1d.0
cluster # [   20.006044] hub 2-0:1.0: USB hub found
cluster # [   20.049517] hub 2-0:1.0: 2 ports detected
cluster # [   20.105306] uhci_hcd 0000:00:1d.1: UHCI Host Controller
cluster # [   20.134437] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 3
cluster # [   20.161381] uhci_hcd 0000:00:1d.1: detected 2 ports
cluster # [   20.179935] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c220
cluster # [   20.208395] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
cluster # [   20.296020] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=1
cluster # [   20.468340] usb usb3: Product: UHCI Host Controller
cluster # [   20.494534] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode
cluster # [   20.557326] usb usb3: Manufacturer: Linux 6.18.50 uhci_hcd
cluster # [   20.643370] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)
cluster # [   19.045422] systemd[1]: Starting Virtual Console Setup...
cluster # [   19.157361] (udev-worker)[105]: Network interface NamePolicy= disabled on kernel command line.
cluster # [   20.795310] ahci 0000:00:1f.2: flags: 64bit ncq only
cluster # [   20.833283] usb usb3: SerialNumber: 0000:00:1d.1
cluster # [   19.269719] systemd-vconsole-setup[107]: Configuration of first virtual console was skipped, ignoring remaining ones.
cluster # [   19.297466] systemd[1]: Finished Virtual Console Setup.
cluster # [   20.938800] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input0
cluster # [   20.967876] hub 3-0:1.0: USB hub found
cluster # [   19.356875] (udev-worker)[102]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
cluster # [   19.376662] (udev-worker)[102]: Network interface NamePolicy= disabled on kernel command line.
cluster # [   21.039283] hub 3-0:1.0: 2 ports detected
cluster # [   21.205472] uhci_hcd 0000:00:1d.2: UHCI Host Controller
cluster # [   21.308914] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 4
cluster # [   21.334627] scsi host0: ahci
cluster # [   21.378042] scsi host1: ahci
cluster # [   21.398789] uhci_hcd 0000:00:1d.2: detected 2 ports
cluster # [   21.461546] scsi host2: ahci
cluster # [   21.531558] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c240
cluster # [   21.568922] scsi host3: ahci
cluster # [   21.715094] scsi host4: ahci
cluster # [   21.742904] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
cluster # [   21.798624] scsi host5: ahci
cluster # [   21.853740] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 44 lpm-pol 1
cluster # [   20.342863] systemd[1]: Found device /dev/disk/by-label/nixos.
cluster # [   20.410715] systemd[1]: Reached target Initrd Root Device.
cluster # [   20.516551] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...
cluster # [   22.165534] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=1
cluster # [   22.356538] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 44 lpm-pol 1
cluster # [   22.439474] usb usb4: Product: UHCI Host Controller
cluster # [   22.508523] usb usb4: Manufacturer: Linux 6.18.50 uhci_hcd
cluster # [   22.551463] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 44 lpm-pol 1
cluster # [   22.649312] usb usb4: SerialNumber: 0000:00:1d.2
cluster # [   22.721055] hub 4-0:1.0: USB hub found
cluster # [   22.751295] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 44 lpm-pol 1
cluster # [   21.145825] systemd-fsck[126]: nixos: clean, 12/65536 files, 13019/262144 blocks
cluster # [   22.788537] hub 4-0:1.0: 2 ports detected
cluster # [   22.794991] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 44 lpm-pol 1
cluster # [   21.214572] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.
cluster # [   22.849407] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 44 lpm-pol 1
cluster # [   21.249583] systemd[1]: Mounting /sysroot...
cluster # [   23.215745] ata2: SATA link down (SStatus 0 SControl 300)
cluster # [   23.278501] ata5: SATA link down (SStatus 0 SControl 300)
cluster # [   23.338850] ata6: SATA link down (SStatus 0 SControl 300)
cluster # [   23.369524] ata1: SATA link down (SStatus 0 SControl 300)
cluster # [   23.407750] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
cluster # [   23.444649] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/100
cluster # [   23.480475] ata3.00: applying bridge limits
cluster # [   23.514447] ata4: SATA link down (SStatus 0 SControl 300)
cluster # [   23.551087] ata3.00: configured for UDMA/100
cluster # [   23.600703] scsi 2:0:0:0: CD-ROM            QEMU     QEMU DVD-ROM     2.5+ PQ: 0 ANSI: 5
cluster: Guest root shell did not produce any data yet...
cluster:   To debug, enter the VM and run 'systemctl status backdoor.service'.
cluster # [   25.502711] EXT4-fs (vda): mounted filesystem 4a28c79f-0f92-488b-803a-5c6fb32de618 r/w with ordered data mode. Quota mode: none.
cluster # [   24.052667] systemd[1]: Mounted /sysroot.
cluster # [   24.092592] systemd[1]: Reached target Initrd Root File System.
cluster # [   25.749683] hid: raw HID events driver (C) Jiri Kosina
cluster # [   24.141683] systemd[1]: Mounting /sysroot/nix/.ro-store...
cluster # [   24.169386] systemd[1]: Mounting /sysroot/nix/.rw-store...
cluster # [   24.204430] systemd[1]: Mounting /sysroot/run...
cluster # [   25.850637] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray
cluster # [   24.254636] systemd[1]: Mounting /sysroot/tmp/shared...
cluster # [   25.898903] cdrom: Uniform CD-ROM driver Revision: 3.20
cluster # [   25.912712] usbcore: registered new interface driver usbhid
cluster # [   25.925759] usbhid: USB HID core driver
cluster # [   24.314772] systemd[1]: Mounting /sysroot/tmp/xchg...
cluster # [   24.527741] systemd[1]: Starting Mountpoints Configured in the Real Root...
cluster # [   24.773401] systemd-sysroot-fstab-check[155]: /sysroot should be mounted in the initrd, will request daemon-reload.
cluster # [   26.450503] 9p: Installing v9fs 9p2000 file system support
cluster # [   25.111450] systemd[1]: Mounted /sysroot/nix/.ro-store.
cluster # [   25.218386] systemd[1]: Mounted /sysroot/nix/.rw-store.
cluster # [   25.272871] systemd[1]: Mounted /sysroot/run.
cluster # [   25.327662] systemd[1]: Mounted /sysroot/tmp/shared.
cluster # [   25.380695] systemd[1]: Mounted /sysroot/tmp/xchg.
cluster # [   25.559304] systemd[1]: Reload requested from client PID 155 ('systemd-sysroot') (unit initrd-parse-etc.service)...
cluster # [   25.595896] systemd[1]: Reloading...
cluster # [   26.456926] systemd[1]: Reloading finished in 840 ms.
cluster # [   26.533761] systemd-sysroot-fstab-check[155]: Requesting initrd-fs.target/start/replace...
cluster # [   26.580841] systemd-sysroot-fstab-check[155]: Requesting swap.target/start/replace...
cluster # [   26.599283] systemd[1]: initrd-parse-etc.service: Deactivated successfully.
cluster # [   26.622765] systemd[1]: Finished Mountpoints Configured in the Real Root.
cluster # [   26.640718] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.
cluster # [   26.700833] systemd[1]: Starting rw-sysroot-nix-store.service...
cluster # [   26.817512] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
cluster # [   26.835427] systemd[1]: Finished rw-sysroot-nix-store.service.
cluster # [   26.858726] systemd[1]: Mounting /sysroot/nix/store...
cluster # [   27.140401] systemd[1]: Mounted /sysroot/nix/store.
cluster # [   27.177783] systemd[1]: Reached target Initrd File Systems.
cluster # [   27.214935] systemd[1]: Starting Find NixOS closure...
cluster # [   27.247775] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...
cluster # [   27.374618] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.
cluster # [   27.386208] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.
cluster # [   27.574704] systemd[1]: Finished Find NixOS closure.
cluster # [   27.591285] systemd[1]: Reached target Initrd Default Target.
cluster # [   27.610315] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...
cluster # [   29.508682] input: QEMU QEMU USB Tablet as /devices/pci0000:00/0000:00:1d.7/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input2
cluster # [   27.945282] systemd[1]: Stopped target Initrd Default Target.
cluster # [   27.958457] systemd[1]: Stopped target Basic System.
cluster # [   27.965628] systemd[1]: Stopped target Initrd Root Device.
cluster # [   27.972786] systemd[1]: Stopped target Path Units.
cluster # [   27.980154] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.
cluster # [   27.991337] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.
cluster # [   28.017891] systemd[1]: Stopped target Slice Units.
cluster # [   28.048931] systemd[1]: Stopped target Socket Units.
cluster # [   28.071701] systemd[1]: Stopped target System Initialization.
cluster # [   28.097434] systemd[1]: Stopped target Swaps.
cluster # [   28.115711] systemd[1]: Stopped target Timer Units.
cluster # [   28.134999] systemd[1]: dbus.socket: Deactivated successfully.
cluster # [   28.162856] systemd[1]: Closed D-Bus System Message Bus Socket.
cluster # [   28.192310] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.
cluster # [   28.226964] systemd[1]: Stopped Find NixOS closure.
cluster # [   28.249380] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio
cluster # [   28.282375] systemd[1]: Starting rw-sysroot-nix-store.service...
cluster # [   28.305838] systemd[1]: systemd-sysctl.service: Deactivated successfully.
cluster # [   28.330409] systemd[1]: Stopped Apply Kernel Variables.
cluster # [   28.361723] systemd[1]: systemd-modules-load.service: Deactivated successfully.
cluster # [   28.378331] systemd[1]: Stopped Load Kernel Modules.
cluster # [   28.390995] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.
cluster # [   28.410871] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.
cluster # [   28.422719] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.
cluster # [   28.430717] systemd[1]: Stopped Create System Files and Directories.
cluster # [   28.440423] systemd[1]: Stopped target Local File Systems.
cluster # [   28.451930] systemd[1]: Stopped target Preparation for Local File Systems.
cluster # [   30.090852] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input0
cluster # [   28.501370] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.
cluster # [   28.525521] systemd[1]: Stopped Coldplug All udev Devices.
cluster # [   28.557899] systemd[1]: Stopping Rule-based Manager for Device Events and Files...
cluster # [   28.585377] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
cluster # [   28.618810] systemd[1]: Stopped Virtual Console Setup.
cluster # [   28.715444] systemd[1]: initrd-cleanup.service: Deactivated successfully.
cluster # [   28.735913] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.
cluster # [   28.770514] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
cluster # [   28.803959] systemd[1]: Finished rw-sysroot-nix-store.service.
cluster # [   28.987397] systemd[1]: systemd-udevd.service: Deactivated successfully.
cluster # [   29.001581] systemd[1]: Stopped Rule-based Manager for Device Events and Files.
cluster # [   29.022955] systemd[1]: systemd-udevd.service: Consumed 4.608s CPU time over 14.627s wall clock time, 20.9M memory peak.
cluster # [   29.062645] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.
cluster # [   29.084388] systemd[1]: Closed udev Control Socket.
cluster # [   29.106993] systemd[1]: Starting Cleanup udev Database...
cluster # [   29.124961] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.
cluster # [   29.140692] systemd[1]: Stopped Create Static Device Nodes in /dev.
cluster # [   29.153314] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.
cluster # [   29.162319] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.
cluster # [   29.172815] systemd[1]: kmod-static-nodes.service: Deactivated successfully.
cluster # [   29.191378] systemd[1]: Stopped Create List of Static Device Nodes.
cluster # [   29.425658] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.
cluster # [   29.492524] systemd[1]: Finished Cleanup udev Database.
cluster # [   29.523752] systemd[1]: Reached target Switch Root.
cluster # [   29.546496] systemd[1]: Starting NixOS Activation...
cluster # [   32.451286] initrd-nixos-activation-start[221]: booting system configuration /nix/store/ffk07qnyzxd5fbxs664i3nag1cqzpy7m-nixos-system-cluster-test
cluster # [   33.198367] initrd-nixos-activation-start[221]: running activation script...
cluster # [   36.824261] hrtimer: interrupt took 2630501 ns
cluster # [   37.565307] initrd-nixos-activation-start[244]: setting up /etc...
cluster # [   40.598818] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.
cluster # [   40.624971] systemd[1]: Finished NixOS Activation.
cluster # [   40.640976] systemd[1]: initrd-nixos-activation.service: Consumed 1.915s CPU time over 11.049s wall clock time, 20M memory peak.
cluster # [   40.685799] systemd[1]: Starting Switch Root...
cluster # [   40.750764] systemd[1]: Switching root.
cluster # [   42.597881] systemd-journald[69]: Received SIGTERM from PID 1 (systemd).
cluster # [   44.358552] NET: Registered PF_VSOCK protocol family
cluster # [   44.904356] systemd[1]: systemd 261.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)
cluster # [   44.965663] systemd[1]: Detected virtualization kvm.
cluster # [   44.977596] systemd[1]: Detected architecture x86-64.
cluster # [   45.006638] systemd[1]: Detected first boot.
cluster # [   45.069802] systemd[1]: Initializing machine ID from random generator.
cluster # [   46.007708] systemd[1]: bpf-restrict-fs: LSM BPF program attached
cluster # [   46.672703] systemd[1]: Applying preset policy.
cluster # [   48.487293] systemd[1]: Populated /etc with preset unit settings.
cluster # [   49.107330] systemd[1]: initrd-switch-root.service: Deactivated successfully.
cluster # [   49.113456] systemd[1]: Stopped initrd-switch-root.service.
cluster # [   49.140812] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.
cluster # [   49.149205] systemd[1]: Created slice Slice /system/getty.
cluster # [   49.154846] systemd[1]: Created slice User and Session Slice.
cluster # [   49.159404] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
cluster # [   49.165091] systemd[1]: Started Forward Password Requests to Wall Directory Watch.
cluster # [   49.170494] systemd[1]: Expecting device /dev/hvc0...
cluster # [   49.174521] systemd[1]: Expecting device /dev/ttyS0...
cluster # [   49.179094] systemd[1]: Reached target Local Encrypted Volumes.
cluster # [   49.184690] systemd[1]: Stopped target initrd-fs.target.
cluster # [   49.193397] systemd[1]: Stopped target initrd-root-fs.target.
cluster # [   49.204468] systemd[1]: Stopped target initrd-switch-root.target.
cluster # [   49.218614] systemd[1]: Reached target Virtual Machines and Containers.
cluster # [   49.232813] systemd[1]: Reached target Path Units.
cluster # [   49.243438] systemd[1]: Reached target Remote File Systems.
cluster # [   49.254586] systemd[1]: Reached target Slice Units.
cluster # [   49.264853] systemd[1]: Reached target Swaps.
cluster # [   49.291488] systemd[1]: Listening on Query the User Interactively for a Password.
cluster # [   49.325302] systemd[1]: Listening on Process Core Dump Socket.
cluster # [   49.356558] systemd[1]: Listening on Credential Encryption/Decryption.
cluster # [   49.389427] systemd[1]: Listening on Factory Reset Management.
cluster # [   49.401513] systemd[1]: Listening on Hostname Service Socket.
cluster # [   49.433812] systemd[1]: Starting Journal Log Access Socket...
cluster # [   49.459734] systemd[1]: Listening on Journal Audit Socket.
cluster # [   49.489548] systemd[1]: Listening on Console Output Muting Service Socket.
cluster # [   49.504294] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.
cluster # [   49.520264] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os
cluster # [   49.537210] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki
cluster # [   49.582286] systemd[1]: Listening on Disk Repartitioning Service Socket.
cluster # [   49.589855] systemd[1]: Listening on udev Control Socket.
cluster # [   49.597740] systemd[1]: Listening on udev Varlink Socket.
cluster # [   49.610794] systemd[1]: Mounting Huge Pages File System...
cluster # [   49.628267] systemd[1]: Mounting POSIX Message Queue File System...
cluster # [   49.651998] systemd[1]: Mounting Kernel Debug File System...
cluster # [   49.678642] systemd[1]: Mounting Kernel Trace File System...
cluster # [   49.708712] systemd[1]: Starting Create List of Static Device Nodes...
cluster # [   49.715659] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio
cluster # [   49.760064] systemd[1]: Starting Load Kernel Module configfs...
cluster # [   49.782377] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm
cluster # [   49.819290] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
cluster # [   49.829600] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse
cluster # [   49.852677] systemd[1]: Mounting FUSE Control File System...
cluster # [   49.856590] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67
cluster # [   49.885758] systemd[1]: Starting Journal Service...
cluster # [   49.913330] systemd[1]: Starting Load Kernel Modules...
cluster # [   49.941794] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...
cluster # [   49.977093] systemd[1]: Starting Remount Root and Kernel File Systems...
cluster # [   49.998778] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
cluster # [   50.004704] systemd-journald[315]: Collecting audit messages is enabled.
cluster # [   50.030588] systemd[1]: Starting Coldplug All udev Devices...
cluster # [   50.091536] systemd[1]: Listening on Journal Log Access Socket.
cluster # [   50.096234] loop: module loaded
cluster # [   50.109323] systemd[1]: Started Journal Service.
cluster # [   50.113189] EXT4-fs (vda): re-mounted 4a28c79f-0f92-488b-803a-5c6fb32de618.
cluster # [   48.498386] systemd[1]: Queued start job for default target Multi-User System.
cluster # [   48.505287] systemd[1]: systemd-journald.service: Deactivated successfully.
cluster # [   48.522337] systemd-modules-load[316]: Inserted module 'loop'
cluster # [   48.527928] systemd[1]: Mounted Huge Pages File System.
cluster # [   48.539440] systemd[1]: Mounted POSIX Message Queue File System.
cluster # [   48.548834] systemd[1]: Mounted Kernel Debug File System.
cluster # [   48.557768] systemd[1]: Mounted Kernel Trace File System.
cluster # [   48.568312] systemd[1]: Finished Create List of Static Device Nodes.
cluster # [   48.572830] systemd[1]: modprobe@configfs.service: Deactivated successfully.
cluster # [   48.587210] systemd[1]: Finished Load Kernel Module configfs.
cluster # [   48.592357] systemd[1]: Mounted FUSE Control File System.
cluster # [   48.600131] systemd[1]: Finished Load Kernel Modules.
cluster # [   48.604507] systemd[1]: Finished Remount Root and Kernel File Systems.
cluster # [   48.633554] systemd-oomd[318]: No swap; memory pressure usage will be degraded
cluster # [   48.643225] systemd[1]: Listening on Disk Image Download Service Socket.
cluster # [   48.654734] systemd[1]: Mounting Kernel Configuration File System...
cluster # [   48.671890] systemd[1]: Starting Firewall...
cluster # [   48.692536] systemd[1]: Starting Flush Journal to Persistent Storage...
cluster # [   48.698137] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
cluster # [   48.726268] systemd[1]: Starting Load/Save OS Random Seed...
cluster # [   48.760292] systemd[1]: Starting Apply Kernel Variables...
cluster # [   48.811231] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
cluster # [   48.817390] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
cluster # [   48.837349] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.
cluster # [   50.484837] systemd-journald[315]: Received client request to flush runtime journal.
cluster # [   51.392773] systemd[1]: Mounted Kernel Configuration File System.
cluster # [   51.420831] systemd[1]: Finished Apply Kernel Variables.
cluster # [   51.440758] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
cluster # [   51.456882] systemd[1]: Starting Create Static Device Nodes in /dev...
cluster # [   51.517423] systemd[1]: Finished Load/Save OS Random Seed.
cluster # [   51.575687] systemd[1]: Reached target First Boot Complete.
cluster # [   51.636375] systemd[1]: Finished Coldplug All udev Devices.
cluster # [   51.699711] systemd[1]: Finished Create Static Device Nodes in /dev.
cluster # [   51.765462] systemd[1]: Reached target Preparation for Local File Systems.
cluster # [   51.783841] systemd[1]: Starting Rule-based Manager for Device Events and Files...
cluster # [   51.803639] systemd[1]: Mounting /run/wrappers...
cluster # [   51.819881] systemd[1]: Mounted /run/wrappers.
cluster # [   51.830815] systemd[1]: Reached target Local File Systems.
cluster # [   51.849759] systemd[1]: Listening on Boot Loader Control Service Socket.
cluster # [   51.865397] systemd[1]: Starting register-nix-paths.service...
cluster # [   51.883887] systemd[1]: Starting Create SUID/SGID Wrappers...
cluster # [   51.895917] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.
cluster # [   51.913377] systemd[1]: Starting Save Transient machine-id to Disk...
cluster # [   51.967453] systemd-udevd[356]: Using default interface naming scheme 'v261'.
cluster # [   51.987770] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
cluster # [   52.004902] systemd[1]: Finished Save Transient machine-id to Disk.
cluster # [   52.047740] systemd[1]: Finished Flush Journal to Persistent Storage.
cluster # [   52.084394] systemd[1]: Starting Create System Files and Directories...
cluster # [   52.137782] systemd[1]: Started Rule-based Manager for Device Events and Files.
cluster # [   52.534749] systemd[1]: Finished Create System Files and Directories.
cluster # [   52.566230] systemd[1]: Starting Rebuild Journal Catalog...
cluster # [   52.608976] systemd[1]: Starting Record System Boot/Shutdown in UTMP...
cluster # [   53.062944] systemd[1]: Finished Record System Boot/Shutdown in UTMP.
cluster: Guest root shell did not produce any data yet...
cluster:   To debug, enter the VM and run 'systemctl status backdoor.service'.
cluster # [   53.205414] systemd[1]: Finished Rebuild Journal Catalog.
cluster # [   53.227987] systemd[1]: Starting Update is Completed...
cluster # [   53.389586] systemd[1]: Finished Update is Completed.
cluster # [   53.497528] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.
cluster # [   53.507619] systemd[1]: Finished Create SUID/SGID Wrappers.
cluster # [   56.505359] mousedev: PS/2 mouse device common for all mice
cluster # [   55.649667] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse
cluster # [   56.190664] systemd[1]: Finished Firewall.
cluster # [   57.130596] systemd[1]: Finished register-nix-paths.service.
cluster # [   57.170701] systemd[1]: Reached target System Initialization.
cluster # [   57.202988] systemd[1]: Started Discard unused filesystem blocks once a week.
cluster # [   57.248455] systemd[1]: Started Daily Cleanup of Temporary Directories.
cluster # [   57.284373] systemd[1]: Reached target Timer Units.
cluster # [   57.309798] systemd[1]: Listening on D-Bus System Message Bus Socket.
cluster # [   57.344737] systemd[1]: Listening on Nix Daemon Socket.
cluster # [   57.392992] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
cluster # [   57.423964] systemd[1]: Reached target Socket Units.
cluster # [   57.446821] systemd[1]: Reached target Basic System.
cluster # [   57.533627] systemd[1]: Starting Import lastlog data into lastlog2 database...
cluster # [   57.725387] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
cluster # [   57.860944] systemd[1]: Starting Post-Boot Actions...
cluster # [   58.097751] systemd[1]: Started Reset console on configuration changes.
cluster # [   58.222348] systemd[1]: Starting resolvconf update...
cluster # [   58.405820] systemd[1]: Starting D-Bus System Message Bus...
cluster # [   59.148903] systemd[1]: Finished Post-Boot Actions.
cluster # [   59.481926] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.
cluster # [   59.703431] nsncd[543]: Sep 13 05:59:01.198 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
cluster # [   59.732900] systemd[1]: Started Name Service Cache Daemon (nsncd).
cluster # [   59.757451] systemd[1]: Reached target Host and Network Name Lookups.
cluster # [   59.768990] systemd[1]: Reached target User and Group Name Lookups.
cluster # [   60.032428] systemd[1]: Starting User Login Management...
cluster # [   60.253509] systemd[1]: Finished Import lastlog data into lastlog2 database.
cluster # [   61.863404] dbus-broker-launch[552]: Looking up NSS user entry for 'systemd-timesync'...
cluster # [   62.311926] systemd-logind[569]: New seat seat0.
cluster # [   62.365427] systemd[1]: Started User Login Management.
cluster # [   62.378571] dbus-broker-launch[552]: NSS returned no entry for 'systemd-timesync'
cluster # [   62.388415] dbus-broker-launch[552]: Invalid user-name in /nix/store/qvkh1mrrn18ns63xsx7zr0ksq8621bla-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
cluster # [   62.592956] systemd[1]: Starting linger-users.service...
cluster # [   62.755953] systemd[1]: Stopped target Host and Network Name Lookups.
cluster # [   62.943695] systemd[1]: Stopping Host and Network Name Lookups...
cluster # [   63.039959] systemd[1]: Stopped target User and Group Name Lookups.
cluster # [   63.198579] systemd[1]: Stopping User and Group Name Lookups...
cluster # [   63.347391] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...
cluster # [   63.471754] systemd[1]: nscd.service: Deactivated successfully.
cluster # [   63.520426] systemd[1]: Stopped Name Service Cache Daemon (nsncd).
cluster # [   63.807363] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
cluster # [   63.888411] systemd[1]: Started D-Bus System Message Bus.
cluster # [   64.217944] systemd[1]: linger-users.service: Deactivated successfully.
cluster # [   64.281784] systemd[1]: Finished linger-users.service.
cluster # [   64.566672] dbus-broker-launch[552]: Ready
cluster # [   64.777858] nsncd[630]: Sep 13 05:59:06.290 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
cluster # [   64.859639] systemd[1]: Started Name Service Cache Daemon (nsncd).
cluster # [   64.924849] systemd[1]: Reached target Host and Network Name Lookups.
cluster # [   64.942892] systemd[1]: Reached target User and Group Name Lookups.
cluster # [   65.092636] systemd[1]: Finished resolvconf update.
cluster # [   65.116828] systemd[1]: Reached target Preparation for Network.
cluster # [   65.151772] systemd[1]: Starting DHCP Client...
cluster # [   65.184703] systemd[1]: Starting Extra networking commands....
cluster # [   65.629454] (udev-worker)[657]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
cluster # [   65.677369] (udev-worker)[656]: Network interface NamePolicy= disabled on kernel command line.
cluster # [   65.706855] (udev-worker)[657]: Network interface NamePolicy= disabled on kernel command line.
cluster # [   66.370423] systemd[1]: Condition check resulted in Virtio network device being skipped.
cluster # [   66.427709] systemd[1]: Starting Address configuration of eth1...
cluster # [   67.772510] dhcpcd[673]: dhcpcd-10.3.2 starting
cluster # [   68.083982] dhcpcd[733]: dev: loaded udev
cluster # [   68.125204] systemd[1]: Finished Extra networking commands..
cluster # [   68.153932] systemd[1]: Reached target Network.
cluster # [   68.239576] systemd[1]: Starting Permit User Sessions...
cluster # [   68.556667] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.
cluster # [   69.000637] systemd[1]: Started backdoor.service.
cluster # [   70.858623] 8021q: 802.1Q VLAN Support v1.8
cluster # [   70.919437] 8021q: adding VLAN 0 to HW filter on device eth1
cluster # [   69.395215] network-addresses-eth1-start[677]: adding address 192.168.1.1/24... done
cluster # [   69.666556] network-addresses-eth1-start[677]: adding address 2001:db8:1::1/64... done
cluster # [   69.917856] systemd[1]: Finished Address configuration of eth1.
cluster # [   69.936833] systemd[1]: Finished Permit User Sessions.
cluster # [   70.100874] systemd[1]: Started Getty on tty1.
cluster # [   70.186632] systemd[1]: Reached target Login Prompts.
cluster # connecting to host...
cluster # [   72.860082] cfg80211: Loading compiled-in X.509 certificates for regulatory database
cluster: Guest shell says: b'Spawning backdoor root shell...\n'
cluster: connected to guest root shell
cluster: (connecting took 78.47 seconds)
cluster: (finished: waiting for the VM to finish booting, in 79.88 seconds)
cluster # [   73.814299] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
cluster # [   73.925003] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'
cluster # [   74.020469] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2
cluster # [   74.052465] cfg80211: failed to load regulatory.db
cluster # [   75.474086] 8021q: adding VLAN 0 to HW filter on device eth0
cluster # [   73.926966] dhcpcd[733]: eth0: waiting for carrier
cluster # [   73.953439] dhcpcd[733]: eth0: carrier acquired
cluster # [   74.128726] dhcpcd[733]: DUID 00:01:00:01:32:38:f8:33:52:54:00:12:34:56
cluster # [   74.150781] dhcpcd[733]: eth0: IAID 00:12:34:56
cluster # [   74.182405] dhcpcd[733]: eth0: adding address fe80::5054:ff:fe12:3456
cluster # [   75.782697] dhcpcd[733]: eth0: soliciting a DHCP lease
cluster # [   75.937430] dhcpcd[733]: eth0: soliciting an IPv6 router
cluster # [   75.958795] dhcpcd[733]: eth0: offered 10.0.2.15 from 10.0.2.2
cluster # [   75.981978] dhcpcd[733]: eth0: Router Advertisement from fe80::2
cluster # [   75.998544] dhcpcd[733]: eth0: adding address fec0::5054:ff:fe12:3456/64
cluster # [   76.013599] dhcpcd[733]: eth0: adding route to fec0::/64
cluster # [   76.020744] dhcpcd[733]: eth0: adding default route via fe80::2
cluster # [   76.029502] dhcpcd[733]: eth0: probing address 10.0.2.15/24
cluster # [   77.532524] NET: Registered PF_PACKET protocol family
cluster # [   78.235288] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input3
cluster # [   78.260827] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console
cluster # [   78.305848] ACPI: button: Power Button [PWRF]
cluster # [   78.431604] Console: switching to colour dummy device 80x25
cluster # [   78.436546] rtc_cmos 00:04: RTC can wake from S4
cluster # [   78.468400] rtc_cmos 00:04: registered as rtc0
cluster # [   78.476927] rtc_cmos 00:04: setting system clock to 2026-09-13T05:59:22 UTC (1789279162)
cluster # [   78.477356] rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs
cluster # [   78.495943] parport_pc 00:02: reported by Plug and Play ACPI
cluster # [   78.496301] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]
cluster # [   78.765301] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized
cluster # [   78.890377] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:09.0/virtio7/input/input4
cluster # [   78.919328] [drm] Found bochs VGA, ID 0xb0c5.
cluster # [   79.018992] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.
cluster # [   79.145008] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic
cluster # [   79.148973] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 0
cluster # [   79.324275] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt
cluster # [   79.327326] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD
cluster # [   79.391492] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input6
cluster # [   77.921439] systemd[1]: Starting Virtual Console Setup...
cluster # [   79.392384] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input5
cluster # [   77.956643] systemd-logind[569]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard)
cluster # [   79.501401] Console: switching to colour frame buffer device 160x50
cluster # [   79.635435] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device
cluster # [   79.402937] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.
cluster # [   79.574118] systemd-vconsole-setup[833]: Configuration of first virtual console was skipped, ignoring remaining ones.
cluster # [   79.603390] systemd[1]: Finished Virtual Console Setup.
cluster # [   79.636355] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
cluster # [   79.656670] systemd[1]: Stopped Virtual Console Setup.
cluster # [   79.675381] systemd[1]: Stopping Virtual Console Setup...
cluster # [   79.720817] systemd[1]: Starting Virtual Console Setup...
cluster # [   79.824388] systemd-logind[569]: Watching system buttons on /dev/input/event2 (Power Button)
cluster # [   81.668593] ppdev: user-space parallel port driver
cluster # [   82.451925] iTCO_wdt iTCO_wdt.1.auto: Found a ICH9 TCO device (Version=2, TCOBASE=0x0660)
cluster # [   82.676550] iTCO_wdt iTCO_wdt.1.auto: initialized. heartbeat=30 sec (nowayout=0)
cluster # [   81.158819] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
cluster # [   81.200861] systemd[1]: Stopped Virtual Console Setup.
cluster # [   81.354938] dhcpcd[733]: eth0: leased 10.0.2.15 for 86400 seconds
cluster # [   81.403714] systemd-logind[569]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)
cluster # [   81.444657] dhcpcd[733]: eth0: adding route to 10.0.2.0/24
cluster # [   81.485783] dhcpcd[733]: eth0: adding default route via 10.0.2.2
cluster # [   81.569819] systemd[1]: Starting Virtual Console Setup...
cluster # [   83.552589] kvm_amd: TSC scaling supported
cluster # [   83.556440] kvm_amd: Nested Virtualization enabled
cluster # [   83.565108] kvm_amd: Nested Paging enabled
cluster # [   83.574930] kvm_amd: LBR virtualization supported
cluster # [   83.580974] kvm_amd: Virtual VMLOAD VMSAVE supported
cluster # [   83.589284] kvm_amd: Virtual GIF supported
cluster # [   83.608285] kvm_amd: Virtual NMI enabled
cluster # [   84.298512] EDAC MC: Ver: 3.0.0
cluster # [   83.537522] systemd[1]: Started DHCP Client.
cluster # [   83.575847] systemd[1]: Reached target Network is Online.
cluster # [   83.766798] systemd[1]: Starting ssync coding-agent session sync...
cluster # [   86.236564] systemd[1]: Started ssync coding-agent session sync.
cluster # [   86.335570] systemd[1]: Reached target Multi-User System.
cluster # [   86.445731] systemd-vconsole-setup[870]: Configuration of first virtual console was skipped, ignoring remaining ones.
cluster # [   86.519568] systemd[1]: Finished Virtual Console Setup.
cluster # [   86.532934] systemd[1]: Startup finished in 8.550s (kernel) + 33.823s (initrd) + 44.154s (userspace) = 1min 26.528s.
cluster: (finished: waiting for unit ssync.service, in 95.08 seconds)
cluster: waiting for file '/run/ssync/cluster.toml'
cluster: (finished: waiting for file '/run/ssync/cluster.toml', in 0.24 seconds)
cluster: must succeed: test $(stat -c%a /run/ssync/cluster.toml) = 600
cluster: (finished: must succeed: test $(stat -c%a /run/ssync/cluster.toml) = 600, in 0.58 seconds)
cluster: must succeed: systemctl cat ssync | grep -oP '(?<=--config )\S+'
cluster # [   87.724763] ssync[968]: ssync: generated age identity /var/lib/ssync/age.key
cluster: (finished: must succeed: systemctl cat ssync | grep -oP '(?<=--config )\S+', in 0.34 seconds)
cluster: must succeed: grep -q 'cluster_path = ' /nix/store/mlasl8a0fyrlgya8pwv7fdvbxinrp4m7-ssync-config.toml
cluster: (finished: must succeed: grep -q 'cluster_path = ' /nix/store/mlasl8a0fyrlgya8pwv7fdvbxinrp4m7-ssync-config.toml, in 0.32 seconds)
cluster: must succeed: ! grep -q 'recipients = ' /nix/store/mlasl8a0fyrlgya8pwv7fdvbxinrp4m7-ssync-config.toml
cluster: (finished: must succeed: ! grep -q 'recipients = ' /nix/store/mlasl8a0fyrlgya8pwv7fdvbxinrp4m7-ssync-config.toml, in 0.22 seconds)
??? Warning (UserWarning): wait_until_succeeds(): passing a bare int/float as a duration is deprecated. Use datetime.timedelta instead.
    File "/nix/store/3gycnalwgpix76jjky7ljgh88gwgdb0l-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/duration.py", line 39
cluster: waiting for success: journalctl -u ssync | grep -q 'cluster namespace'
??? Warning (UserWarning): execute(): passing a bare int/float as a duration is deprecated. Use datetime.timedelta instead.
    File "/nix/store/3gycnalwgpix76jjky7ljgh88gwgdb0l-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/duration.py", line 39
cluster # [   89.275898] ssync[968]: ssync: bad peer node-id "ee9d0d54bd6d0f24b56784927a4ef7f7f65b1b6a9d1b8fef9a94ea8c8f4a2f2a": data is not a valid public key
cluster # [   89.322745] ssync[968]: ssync: cluster namespace 871e80742ee6d4e11fcfc9825d42e5e09cb7d07494df7cbe34e69bdf9c47be85, syncing with 1 peer(s)
cluster # [   89.628795] ssync[968]: ssync daemon watching /root/.pi/agent/sessions (pi)
cluster # [   89.651390] ssync[968]: ssync daemon watching /root/.omp/agent/sessions (omp)
cluster # [   89.677621] ssync[968]: ssync daemon watching /root/.omp/agent/blobs (omp-blobs)
cluster: (finished: waiting for success: journalctl -u ssync | grep -q 'cluster namespace', in 2.95 seconds)
cluster: must succeed: ! test -e /var/lib/ssync/ticket
cluster: (finished: must succeed: ! test -e /var/lib/ssync/ticket, in 0.51 seconds)
custom: waiting for unit ssync.service
custom: waiting for the VM to finish booting
custom: starting vm
custom: QEMU running (pid 137)
custom # Disk image does not exist, creating the virtualisation disk image...
custom # Formatting '/build/vm-state-custom/tmp.HDndFsGiKo', fmt=raw size=1073741824
custom # mke2fs 1.47.4 (6-Mar-2025)
custom # Discarding device blocks:      0/262144             done
custom # Creating filesystem with 262144 4k blocks and 65536 inodes
custom # Filesystem UUID: 2616b8f1-8aba-45ba-b7c1-a6347cd0b0c7
custom # Superblock backups stored on blocks:
custom # 	32768, 98304, 163840, 229376
custom # 
custom # Allocating group tables: 0/8   done
custom # Writing inode tables: 0/8   done
custom # Creating journal (8192 blocks): done
custom # Writing superblocks and filesystem accounting information: 0/8   done
custom # 
custom # Virtualisation disk image created.
custom # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)
custom # 
custom # 
custom # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+3EFD15C0+3EF315C0 CA00
custom # Press Ctrl-B to configure iPXE (PCI 00:02.0)...
custom # 
custom # 
custom # 
custom # 
custom # iPXE (http://ipxe.org) 00:08.0 CB00 PCI2.10 PnP PMM 3EFD15C0 3EF315C0 CB00
custom # Press Ctrl-B to configure iPXE (PCI 00:08.0)...
custom # 
custom # 
custom # Booting from ROM...
custom # Probing EDD (edd=off to disable)... ok
custom # [    0.000000] Linux version 6.18.50 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Mon Sep  7 15:23:00 UTC 2026
custom # [    0.000000] Command line: console=ttyS0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/6pmh5brqmkpf2j6rb51mnz9lmgxkz38n-nixos-system-custom-test/init regInfo=/nix/store/m4hfbvkq6bzqh71jf25qyn0d0d0g7nfj-closure-info/registration console=ttyS0,115200n8 console=tty0
custom # [    0.000000] BIOS-provided physical RAM map:
custom # [    0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable
custom # [    0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000003ffd7fff] usable
custom # [    0.000000] BIOS-e820: [mem 0x000000003ffd8000-0x000000003fffffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved
custom # [    0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved
custom # [    0.000000] NX (Execute Disable) protection: active
custom # [    0.000000] APIC: Static calls initialized
custom # [    0.000000] SMBIOS 2.8 present.
custom # [    0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/2014
custom # [    0.000000] DMI: Memory slots populated: 1/1
custom # [    0.000000] Hypervisor detected: KVM
custom # [    0.000000] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000
custom # [    0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00
custom # [    0.000015] kvm-clock: using sched offset of 2544641142 cycles
custom # [    0.000035] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
custom # [    0.000062] tsc: Detected 2495.318 MHz processor
custom # [    0.006658] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000
custom # [    0.007227] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs
custom # [    0.007268] x86/PAT: Configuration [0-7]: WB  WC  UC- UC  WB  WP  UC- WT
custom # [    0.029768] found SMP MP-table at [mem 0x000f5450-0x000f545f]
custom # [    0.029971] Using GB pages for direct mapping
custom # [    0.031177] RAMDISK: [mem 0x3e367000-0x3ffcffff]
custom # [    0.031260] ACPI: Early table checksum verification disabled
custom # [    0.031288] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )
custom # [    0.031325] ACPI: RSDT 0x000000003FFE2422 000038 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031362] ACPI: FACP 0x000000003FFE221A 0000F4 (v03 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031444] ACPI: DSDT 0x000000003FFE0040 0021DA (v01 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031491] ACPI: FACS 0x000000003FFE0000 000040
custom # [    0.031513] ACPI: APIC 0x000000003FFE230E 000078 (v03 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031533] ACPI: HPET 0x000000003FFE2386 000038 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031552] ACPI: MCFG 0x000000003FFE23BE 00003C (v01 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031569] ACPI: WAET 0x000000003FFE23FA 000028 (v01 BOCHS  BXPC     00000001 BXPC 00000001)
custom # [    0.031584] ACPI: Reserving FACP table memory at [mem 0x3ffe221a-0x3ffe230d]
custom # [    0.031597] ACPI: Reserving DSDT table memory at [mem 0x3ffe0040-0x3ffe2219]
custom # [    0.031604] ACPI: Reserving FACS table memory at [mem 0x3ffe0000-0x3ffe003f]
custom # [    0.031609] ACPI: Reserving APIC table memory at [mem 0x3ffe230e-0x3ffe2385]
custom # [    0.031614] ACPI: Reserving HPET table memory at [mem 0x3ffe2386-0x3ffe23bd]
custom # [    0.031617] ACPI: Reserving MCFG table memory at [mem 0x3ffe23be-0x3ffe23f9]
custom # [    0.031621] ACPI: Reserving WAET table memory at [mem 0x3ffe23fa-0x3ffe2421]
custom # [    0.035664] No NUMA configuration found
custom # [    0.035683] Faking a node at [mem 0x0000000000000000-0x000000003ffd7fff]
custom # [    0.035714] NODE_DATA(0) allocated [mem 0x3ffd2780-0x3ffd7cff]
custom # [    0.037024] Zone ranges:
custom # [    0.037037]   DMA      [mem 0x0000000000001000-0x0000000000ffffff]
custom # [    0.037058]   DMA32    [mem 0x0000000001000000-0x000000003ffd7fff]
custom # [    0.037069]   Normal   empty
custom # [    0.037076]   Device   empty
custom # [    0.037082] Movable zone start for each node
custom # [    0.037086] Early memory node ranges
custom # [    0.037090]   node   0: [mem 0x0000000000001000-0x000000000009efff]
custom # [    0.037099]   node   0: [mem 0x0000000000100000-0x000000003ffd7fff]
custom # [    0.037108] Initmem setup node 0 [mem 0x0000000000001000-0x000000003ffd7fff]
custom # [    0.037349] On node 0, zone DMA: 1 pages in unavailable ranges
custom # [    0.041540] On node 0, zone DMA: 97 pages in unavailable ranges
custom # [    0.313262] On node 0, zone DMA32: 40 pages in unavailable ranges
custom # [    0.322398] ACPI: PM-Timer IO Port: 0x608
custom # [    0.322552] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])
custom # [    0.322917] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23
custom # [    0.322963] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)
custom # [    0.322977] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)
custom # [    0.322985] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)
custom # [    0.322992] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)
custom # [    0.322998] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)
custom # [    0.323026] ACPI: Using ACPI (MADT) for SMP configuration information
custom # [    0.323033] ACPI: HPET id: 0x8086a201 base: 0xfed00000
custom # [    0.323066] TSC deadline timer available
custom # [    0.323093] CPU topo: Max. logical packages:   1
custom # [    0.323099] CPU topo: Max. logical dies:       1
custom # [    0.323103] CPU topo: Max. dies per package:   1
custom # [    0.323127] CPU topo: Max. threads per core:   1
custom # [    0.323132] CPU topo: Num. cores per package:     1
custom # [    0.323135] CPU topo: Num. threads per package:   1
custom # [    0.323138] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs
custom # [    0.323290] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()
custom # [    0.323610] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]
custom # [    0.323633] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]
custom # [    0.323647] [mem 0x40000000-0xafffffff] available for PCI devices
custom # [    0.323657] Booting paravirtualized kernel on KVM
custom # [    0.323675] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns
custom # [    0.356360] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1
custom # [    0.390060] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152
custom # [    0.390303] kvm-guest: PV spinlocks disabled, single CPU
custom # [    0.390318] Kernel command line: console=ttyS0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/6pmh5brqmkpf2j6rb51mnz9lmgxkz38n-nixos-system-custom-test/init regInfo=/nix/store/m4hfbvkq6bzqh71jf25qyn0d0d0g7nfj-closure-info/registration console=ttyS0,115200n8 console=tty0
custom # [    0.390692] Unknown kernel command line parameters "regInfo=/nix/store/m4hfbvkq6bzqh71jf25qyn0d0d0g7nfj-closure-info/registration", will be passed to user space.
custom # [    0.390990] random: crng init done
custom # [    0.391004] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes
custom # [    0.404802] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)
custom # [    0.404849] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)
custom # [    0.405014] Fallback order for Node 0: 0
custom # [    0.405029] Built 1 zonelists, mobility grouping on.  Total pages: 262006
custom # [    0.405035] Policy zone: DMA32
custom # [    0.424560] mem auto-init: stack:all(zero), heap alloc:on, heap free:off
custom # [    0.437171] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
custom # [    0.453492] allocated 2097152 bytes of page_ext
custom # [    0.486338] ftrace: allocating 48731 entries in 192 pages
custom # [    0.486354] ftrace: allocated 192 pages with 2 groups
custom # [    0.490747] Dynamic Preempt: lazy
custom # [    0.491960] rcu: Preemptible hierarchical RCU implementation.
custom # [    0.491965] rcu: 	RCU event tracing is enabled.
custom # [    0.491967] rcu: 	RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.
custom # [    0.491974] 	Trampoline variant of Tasks RCU enabled.
custom # [    0.491976] 	Rude variant of Tasks RCU enabled.
custom # [    0.491977] 	Tracing variant of Tasks RCU enabled.
custom # [    0.491979] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.
custom # [    0.491982] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1
custom # [    0.492126] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
custom # [    0.492135] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
custom # [    0.492139] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
custom # [    0.513983] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16
custom # [    0.515118] rcu: srcu_init: Setting srcu_struct sizes based on contention.
custom # [    0.515146] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns
custom # [    0.515720] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)
custom # [    0.549805] Console: colour VGA+ 80x25
custom # [    0.549827] printk: legacy console [tty0] enabled
custom # [    0.847177] printk: legacy console [ttyS0] enabled
custom # [    1.583337] ACPI: Core revision 20250807
custom # [    1.589413] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns
custom # [    1.599917] APIC: Switch to symmetric I/O mode setup
custom # [    1.608761] x2apic enabled
custom # [    1.614052] APIC: Switched APIC routing to: physical x2apic
custom # [    1.627451] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1
custom # [    1.635535] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x23f7f2f9526, max_idle_ns: 440795279108 ns
custom # [    1.651425] Calibrating delay loop (skipped) preset value.. 4990.63 BogoMIPS (lpj=2495318)
custom # [    1.654992] x86/cpu: User Mode Instruction Prevention (UMIP) activated
custom # [    1.658992] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127
custom # [    1.660446] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0
custom # [    1.662449] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto
custom # [    1.664449] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl
custom # [    1.666448] Spectre V2 : Mitigation: Enhanced / Automatic IBRS
custom # [    1.669441] Speculative Return Stack Overflow: Mitigation: IBPB on VMEXIT only
custom # [    1.671449] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization
custom # [    1.673475] Spectre V2 : Enabling IBPB for BPF
custom # [    1.676472] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier
custom # [    1.678603] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'
custom # [    1.680430] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'
custom # [    1.682431] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'
custom # [    1.685430] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'
custom # [    1.687426] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'
custom # [    1.689428] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'
custom # [    1.691428] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'
custom # [    1.693429] x86/fpu: Supporting XSAVE feature 0x800: 'Control-flow User registers'
custom # [    1.696430] x86/fpu: Supporting XSAVE feature 0x1000: 'Control-flow Kernel registers (KVM only)'
custom # [    1.698431] x86/fpu: xstate_offset[2]:  576, xstate_sizes[2]:  256
custom # [    1.700430] x86/fpu: xstate_offset[5]:  832, xstate_sizes[5]:   64
custom # [    1.702430] x86/fpu: xstate_offset[6]:  896, xstate_sizes[6]:  512
custom # [    1.704447] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024
custom # [    1.706429] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]:    8
custom # [    1.708428] x86/fpu: xstate_offset[11]: 2440, xstate_sizes[11]:   16
custom # [    1.710429] x86/fpu: xstate_offset[12]: 2456, xstate_sizes[12]:   24
custom # [    1.712429] x86/fpu: Enabled xstate features 0x1ae7, context size is 2480 bytes, using 'compacted' format.
custom # [    1.785410] Freeing SMP alternatives memory: 44K
custom # [    1.786433] pid_max: default: 32768 minimum: 301
custom # [    1.789813] LSM: initializing lsm=capability,landlock,yama,bpf,ima
custom # [    1.793755] landlock: Up and running.
custom # [    1.795410] Yama: becoming mindful.
custom # [    1.797355] LSM support for eBPF active
custom # [    1.799410] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
custom # [    1.800614] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
custom # [    1.806410] smpboot: CPU0: AMD Ryzen 9 9955HX 16-Core Processor (family: 0x1a, model: 0x44, stepping: 0x0)
custom # [    1.812747] Performance Events: Fam17h+ core perfctr, AMD PMU driver.
custom # [    1.815126] ... version:                   2
custom # [    1.816465] ... bit width:                 48
custom # [    1.818465] ... generic counters:          6
custom # [    1.820464] ... generic bitmap:            000000000000003f
custom # [    1.822444] ... fixed-purpose counters:    0
custom # [    1.824438] ... fixed-purpose bitmap:      0000000000000000
custom # [    1.826438] ... value mask:                0000ffffffffffff
custom # [    1.828437] ... max period:                00007fffffffffff
custom # [    1.830438] ... global_ctrl mask:          000000000000003f
custom # [    1.832867] signal: max sigframe size: 3376
custom # [    1.835736] rcu: Hierarchical SRCU implementation.
custom # [    1.837493] rcu: 	Max phase no-delay instances is 400.
custom # [    1.843701] smp: Bringing up secondary CPUs ...
custom # [    1.845481] smp: Brought up 1 node, 1 CPU
custom # [    1.847463] smpboot: Total of 1 processors activated (4990.63 BogoMIPS)
custom # [    1.850598] Memory: 943008K/1048024K available (17223K kernel code, 2726K rwdata, 13584K rodata, 3644K init, 2988K bss, 97596K reserved, 0K cma-reserved)
custom # [    1.854680] devtmpfs: initialized
custom # [    1.858236] x86/mm: Memory block size: 128MB
custom # [    1.866865] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)
custom # [    1.868602] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).
custom # [    1.870876] pinctrl core: initialized pinctrl subsystem
custom # [    1.875450] PM: RTC time: 05:59:43, date: 2026-09-13
custom # [    1.906747] NET: Registered PF_NETLINK/PF_ROUTE protocol family
custom # [    1.911086] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations
custom # [    1.912612] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
custom # [    1.916743] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
custom # [    1.918543] audit: initializing netlink subsys (disabled)
custom # [    1.922470] audit: type=2000 audit(1789279182.352:1): state=initialized audit_enabled=0 res=1
custom # [    1.925327] thermal_sys: Registered thermal governor 'fair_share'
custom # [    1.925337] thermal_sys: Registered thermal governor 'bang_bang'
custom # [    1.926460] thermal_sys: Registered thermal governor 'step_wise'
custom # [    1.928434] thermal_sys: Registered thermal governor 'user_space'
custom # [    1.930436] thermal_sys: Registered thermal governor 'power_allocator'
custom # [    1.932513] cpuidle: using governor menu
custom # [    1.940981] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5
custom # [    1.944370] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]
custom # [    1.945444] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry
custom # [    1.947469] PCI: Using configuration type 1 for base access
custom # [    1.950200] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.
custom # [    1.961608] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
custom # [    1.965460] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page
custom # [    1.971444] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
custom # [    1.977441] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page
custom # [    2.014617] ACPI: Added _OSI(Module Device)
custom # [    2.022471] ACPI: Added _OSI(Processor Device)
custom # [    2.027100] ACPI: Added _OSI(Processor Aggregator Device)
custom # [    2.073109] ACPI: 1 ACPI AML tables successfully acquired and loaded
custom # [    2.100620] ACPI: Interpreter enabled
custom # [    2.110579] ACPI: PM: (supports S0 S3 S4 S5)
custom # [    2.115438] ACPI: Using IOAPIC for interrupt routing
custom # [    2.117800] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug
custom # [    2.121441] PCI: Using E820 reservations for host bridge windows
custom # [    2.126898] ACPI: Enabled 2 GPEs in block 00 to 3F
custom # [    2.160394] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])
custom # [    2.163462] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]
custom # [    2.167658] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]
custom # [    2.172015] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]
custom # [    2.179873] PCI host bridge to bus 0000:00
custom # [    2.182747] pci_bus 0000:00: root bus resource [io  0x0000-0x0cf7 window]
custom # [    2.184442] pci_bus 0000:00: root bus resource [io  0x0d00-0xffff window]
custom # [    2.186448] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]
custom # [    2.188465] pci_bus 0000:00: root bus resource [mem 0x40000000-0xafffffff window]
custom # [    2.190442] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]
custom # [    2.192443] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]
custom # [    2.194526] pci_bus 0000:00: root bus resource [bus 00-ff]
custom # [    2.196862] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint
custom # [    2.206461] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint
custom # [    2.214958] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]
custom # [    2.216742] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]
custom # [    2.218665] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]
custom # [    2.221905] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]
custom # [    2.232876] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
custom # [    2.239498] pci 0000:00:02.0: BAR 0 [io  0xc140-0xc15f]
custom # [    2.241506] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]
custom # [    2.243962] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]
custom # [    2.245506] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]
custom # [    2.260148] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
custom # [    2.267709] pci 0000:00:03.0: BAR 0 [io  0xc160-0xc17f]
custom # [    2.269630] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]
custom # [    2.272322] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]
custom # [    2.284137] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
custom # [    2.291584] pci 0000:00:04.0: BAR 0 [io  0xc080-0xc0bf]
custom # [    2.293598] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]
custom # [    2.295919] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]
custom # [    2.307900] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
custom # [    2.315581] pci 0000:00:05.0: BAR 0 [io  0xc180-0xc19f]
custom # [    2.317638] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]
custom # [    2.319959] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]
custom # [    2.332035] pci 0000:00:06.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
custom # [    2.340462] pci 0000:00:06.0: BAR 0 [io  0xc1a0-0xc1bf]
custom # [    2.342598] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]
custom # [    2.345328] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]
custom # [    2.357680] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint
custom # [    2.365588] pci 0000:00:07.0: BAR 0 [io  0xc000-0xc07f]
custom # [    2.367600] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]
custom # [    2.369920] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]
custom # [    2.383002] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
custom # [    2.391593] pci 0000:00:08.0: BAR 0 [io  0xc1c0-0xc1df]
custom # [    2.393612] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]
custom # [    2.395964] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]
custom # [    2.397642] pci 0000:00:08.0: ROM [mem 0xfeb80000-0xfebbffff pref]
custom # [    2.408726] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint
custom # [    2.415550] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]
custom # [    2.417669] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]
custom # [    2.424351] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint
custom # [    2.428507] pci 0000:00:0a.0: BAR 0 [io  0xc0c0-0xc0ff]
custom # [    2.430512] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]
custom # [    2.433682] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]
custom # [    2.442380] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
custom # [    2.446611] pci 0000:00:0b.0: BAR 0 [io  0xc1e0-0xc1ff]
custom # [    2.448612] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]
custom # [    2.450663] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]
custom # [    2.460309] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint
custom # [    2.466029] pci 0000:00:1d.0: BAR 4 [io  0xc200-0xc21f]
custom # [    2.469974] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint
custom # [    2.477711] pci 0000:00:1d.1: BAR 4 [io  0xc220-0xc23f]
custom # [    2.483266] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint
custom # [    2.489923] pci 0000:00:1d.2: BAR 4 [io  0xc240-0xc25f]
custom # [    2.494185] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint
custom # [    2.498496] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]
custom # [    2.503385] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint
custom # [    2.508241] pci 0000:00:1f.0: quirk: [io  0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO
custom # [    2.514304] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint
custom # [    2.522013] pci 0000:00:1f.2: BAR 4 [io  0xc260-0xc27f]
custom # [    2.524658] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]
custom # [    2.531178] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint
custom # [    2.539060] pci 0000:00:1f.3: BAR 4 [io  0x0700-0x073f]
custom # [    2.588450] ACPI: PCI: Interrupt link LNKA configured for IRQ 10
custom # [    2.592566] ACPI: PCI: Interrupt link LNKB configured for IRQ 10
custom # [    2.596308] ACPI: PCI: Interrupt link LNKC configured for IRQ 11
custom # [    2.599280] ACPI: PCI: Interrupt link LNKD configured for IRQ 11
custom # [    2.601700] ACPI: PCI: Interrupt link LNKE configured for IRQ 10
custom # [    2.605001] ACPI: PCI: Interrupt link LNKF configured for IRQ 10
custom # [    2.608255] ACPI: PCI: Interrupt link LNKG configured for IRQ 11
custom # [    2.610577] ACPI: PCI: Interrupt link LNKH configured for IRQ 11
custom # [    2.612703] ACPI: PCI: Interrupt link GSIA configured for IRQ 16
custom # [    2.614557] ACPI: PCI: Interrupt link GSIB configured for IRQ 17
custom # [    2.616552] ACPI: PCI: Interrupt link GSIC configured for IRQ 18
custom # [    2.618526] ACPI: PCI: Interrupt link GSID configured for IRQ 19
custom # [    2.620553] ACPI: PCI: Interrupt link GSIE configured for IRQ 20
custom # [    2.622554] ACPI: PCI: Interrupt link GSIF configured for IRQ 21
custom # [    2.624558] ACPI: PCI: Interrupt link GSIG configured for IRQ 22
custom # [    2.626524] ACPI: PCI: Interrupt link GSIH configured for IRQ 23
custom # [    2.640236] iommu: Default domain type: Translated
custom # [    2.641463] iommu: DMA domain TLB invalidation policy: lazy mode
custom # [    2.645811] ACPI: bus type USB registered
custom # [    2.648370] usbcore: registered new interface driver usbfs
custom # [    2.649568] usbcore: registered new interface driver hub
custom # [    2.651828] usbcore: registered new device driver usb
custom # [    2.662186] NetLabel: Initializing
custom # [    2.663452] NetLabel:  domain hash size = 128
custom # [    2.665435] NetLabel:  protocols = UNLABELED CIPSOv4 CALIPSO
custom # [    2.667841] NetLabel:  unlabeled traffic allowed by default
custom # [    2.669728] PCI: Using ACPI for IRQ routing
custom # [    3.177410] pci 0000:00:01.0: vgaarb: setting as boot VGA device
custom # [    3.177410] pci 0000:00:01.0: vgaarb: bridge control possible
custom # [    3.177410] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none
custom # [    3.177485] vgaarb: loaded
custom # [    3.182008] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0
custom # [    3.183456] hpet0: 3 comparators, 64-bit 100.000000 MHz counter
custom # [    3.190302] clocksource: Switched to clocksource kvm-clock
custom # [    3.222600] VFS: Disk quotas dquot_6.6.0
custom # [    3.233672] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
custom # [    3.251253] pnp: PnP ACPI init
custom # [    3.262988] ACPI: IRQ 4 override to edge(!), high(!)
custom # [    3.275095] system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved
custom # [    3.288351] pnp: PnP ACPI: found 6 devices
custom # [    3.320420] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns
custom # [    3.332716] clocksource: Switched to clocksource acpi_pm
custom # [    3.340832] NET: Registered PF_INET protocol family
custom # [    3.349537] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)
custom # [    3.512227] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)
custom # [    3.526779] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
custom # [    3.542441] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)
custom # [    3.558675] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)
custom # [    3.576864] TCP: Hash tables configured (established 8192 bind 8192)
custom # [    3.592646] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)
custom # [    3.613027] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)
custom # [    3.631835] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)
custom # [    3.652013] NET: Registered PF_UNIX/PF_LOCAL protocol family
custom # [    3.669959] NET: Registered PF_XDP protocol family
custom # [    3.684690] pci_bus 0000:00: resource 4 [io  0x0000-0x0cf7 window]
custom # [    3.701190] pci_bus 0000:00: resource 5 [io  0x0d00-0xffff window]
custom # [    3.718070] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]
custom # [    3.736967] pci_bus 0000:00: resource 7 [mem 0x40000000-0xafffffff window]
custom # [    3.755247] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]
custom # [    3.773663] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]
custom # [    3.800101] ACPI: \_SB_.GSIA: Enabled at IRQ 16
custom # [    3.824659] pci 0000:00:1d.0: quirk_usb_early_handoff+0x0/0x7c0 took 27374 usecs
custom # [    3.848262] ACPI: \_SB_.GSIB: Enabled at IRQ 17
custom # [    3.872186] pci 0000:00:1d.1: quirk_usb_early_handoff+0x0/0x7c0 took 26679 usecs
custom # [    3.894962] ACPI: \_SB_.GSIC: Enabled at IRQ 18
custom # [    3.917877] pci 0000:00:1d.2: quirk_usb_early_handoff+0x0/0x7c0 took 25340 usecs
custom # [    3.940925] ACPI: \_SB_.GSID: Enabled at IRQ 19
custom # [    3.960231] pci 0000:00:1d.7: quirk_usb_early_handoff+0x0/0x7c0 took 20997 usecs
custom # [    3.974545] PCI: CLS 0 bytes, default 64
custom # [    3.990152] Trying to unpack rootfs image as initramfs...
custom # [    4.012836] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x23f7f2f9526, max_idle_ns: 440795279108 ns
custom # [    4.190062] Initialise system trusted keyrings
custom # [    4.227759] workingset: timestamp_bits=40 max_order=18 bucket_order=0
custom # [    4.389133] Key type asymmetric registered
custom # [    4.422830] Asymmetric key parser 'x509' registered
custom # [    4.471010] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)
custom # [    4.516755] io scheduler mq-deadline registered
custom # [    4.536512] io scheduler kyber registered
custom # [    4.558601] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
custom # [    4.591694] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A
custom # [    4.679181] Linux agpgart interface v0.103
custom # [    4.717251] ACPI: bus type drm_connector registered
custom # [    4.770914] usbcore: registered new interface driver usbserial_generic
custom # [    4.827897] usbserial: USB Serial support registered for generic
custom # [    4.882806] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.
custom # [    4.882806] Please enable it if your BIOS has the CPPC option.
custom # [    5.001644] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled
custom # [    5.064149] drop_monitor: Initializing network drop monitor service
custom # [    5.123843] NET: Registered PF_INET6 protocol family
custom # [    5.179210] Segment Routing with IPv6
custom # [    5.201549] In-situ OAM (IOAM) with IPv6
custom # [    5.220637] IPI shorthand broadcast: enabled
custom # [    5.266991] sched_clock: Marking stable (4140157769, 1126266466)->(7840526881, -2574102646)
custom # [    5.298500] registered taskstats version 1
custom # [    5.310477] Loading compiled-in X.509 certificates
custom # [    5.390053] Demotion targets for Node 0: null
custom # [    5.401847] Key type .fscrypt registered
custom # [    5.413440] Key type fscrypt-provisioning registered
custom # [    5.427865] ima: No TPM chip found, activating TPM-bypass!
custom # [    5.441428] ima: Allocated hash algorithm: sha1
custom # [    5.453631] ima: No architecture policies found
custom # [    5.467473] PM:   Magic number: 10:964:971
custom # [    5.484599] RAS: Correctable Errors collector initialized.
custom # [    5.532910] clk: Disabling unused clocks
custom # [    5.545520] PM: genpd: Disabling unused power domains
custom # [    6.824747] Freeing initrd memory: 29092K
custom # [    6.842027] Freeing unused decrypted memory: 2028K
custom # [    6.862718] Freeing unused kernel image (initmem) memory: 3644K
custom # [    6.875163] Write protecting the kernel read-only data: 32768k
custom # [    6.889902] Freeing unused kernel image (text/rodata gap) memory: 1208K
custom # [    6.915921] Freeing unused kernel image (rodata/data gap) memory: 752K
custom # [    7.051718] x86/mm: Checked W+X mappings: passed, no W+X pages found.
custom # [    7.060171] Run /init as init process
custom # [    7.137842] systemd[1]: Inserted module 'autofs4'
custom # [    7.248688] fuse: init (API version 7.45)
custom # [    7.273722] ACPI: \_SB_.GSIG: Enabled at IRQ 22
custom # [    7.289983] ACPI: \_SB_.GSIH: Enabled at IRQ 23
custom # [    7.310484] ACPI: \_SB_.GSIE: Enabled at IRQ 20
custom # [    7.327667] ACPI: \_SB_.GSIF: Enabled at IRQ 21
custom # [    7.538049] systemd[1]: Successfully made /usr/ read-only.
custom # [    7.892885] systemd[1]: systemd 261.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)
custom # [    7.954872] systemd[1]: Detected virtualization kvm.
custom # [    7.968830] systemd[1]: Detected architecture x86-64.
custom # [    7.983073] systemd[1]: Running in initrd.
custom # [    7.997228] systemd[1]: Initializing machine ID from random generator.
custom # [    8.011245] systemd[1]: Hostname set to <custom>.
custom # [    8.520800] systemd[1]: bpf-restrict-fs: LSM BPF program attached
custom # [    8.860204] systemd[1]: Queued start job for default target Initrd Default Target.
custom # [    8.880611] systemd[1]: Created slice Slice /system/modprobe.
custom # [    8.889670] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
custom # [    8.902633] systemd[1]: Expecting device /dev/disk/by-label/nixos...
custom # [    8.912005] systemd[1]: Reached target Path Units.
custom # [    8.919942] systemd[1]: Reached target Slice Units.
custom # [    8.926584] systemd[1]: Reached target Swaps.
custom # [    8.976051] systemd[1]: Reached target Timer Units.
custom # [    8.991003] systemd[1]: Listening on D-Bus System Message Bus Socket.
custom # [    9.011844] systemd[1]: Listening on Journal Socket (/dev/log).
custom # [    9.031662] systemd[1]: Listening on Journal Sockets.
custom # [    9.047765] systemd[1]: Listening on udev Control Socket.
custom # [    9.064672] systemd[1]: Listening on udev Kernel Socket.
custom # [    9.080143] systemd[1]: Reached target Socket Units.
custom # [    9.103224] systemd[1]: Starting Create List of Static Device Nodes...
custom # [    9.168586] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
custom # [    9.268593] systemd[1]: Starting Load Kernel Module configfs...
custom # [    9.352122] systemd[1]: Starting Journal Service...
custom # [    9.420714] systemd[1]: Starting Load Kernel Modules...
custom # [    9.466764] netfs: FS-Cache loaded
custom # [    9.475847] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
custom # [    9.534156] systemd[1]: Starting Coldplug All udev Devices...
custom # [    9.547431] 9pnet: Installing 9P2000 support
custom # [    9.570052] systemd-journald[68]: Collecting audit messages is disabled.
custom # [    9.646999] systemd[1]: Finished Create List of Static Device Nodes.
custom # [    9.720008] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
custom # [    9.780510] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
custom # [    9.799039] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
custom # [    9.833424] systemd[1]: modprobe@configfs.service: Deactivated successfully.
custom # [    9.862921] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev
custom # [    9.917102] systemd[1]: Finished Load Kernel Module configfs.
custom # [   10.014754] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config
custom # [   10.165704] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
custom # [   10.299020] systemd[1]: Finished Load Kernel Modules.
custom # [   10.390718] systemd[1]: Starting Apply Kernel Variables...
custom # [   10.463715] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
custom # [   10.557114] systemd[1]: Starting Create Static Device Nodes in /dev...
custom # [   10.763867] systemd[1]: Finished Apply Kernel Variables.
custom # [   10.881754] systemd[1]: Finished Create Static Device Nodes in /dev.
custom # [   10.922886] systemd[1]: Reached target Preparation for Local File Systems.
custom # [   10.957997] systemd[1]: Reached target Local File Systems.
custom # [   11.053048] systemd[1]: Starting Rule-based Manager for Device Events and Files...
custom # [    9.961778] systemd-modules-load[69]: Inserted module 'dm_mod'
custom # [    9.988694] systemd-modules-load[69]: Inserted module 'virtio_balloon'
custom # [   10.009393] systemd-modules-load[69]: Inserted module 'virtio_gpu'
custom # [   11.223831] systemd[1]: Started Journal Service.
custom # [   10.236625] systemd[1]: Starting Create System Files and Directories...
custom # [   10.352449] systemd[1]: Finished Create System Files and Directories.
custom # [   10.367878] systemd-udevd[75]: Using default interface naming scheme 'v261'.
custom # [   10.380417] systemd[1]: Finished Coldplug All udev Devices.
custom # [   10.448636] systemd[1]: Started Rule-based Manager for Device Events and Files.
custom # [   10.463312] systemd[1]: Reached target System Initialization.
custom # [   10.474507] systemd[1]: Reached target Basic System.
custom # [   13.997888] virtio_blk virtio5: 1/0/0 default/read/poll queues
custom # [   14.008417] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12
custom # [   14.107919] serio: i8042 KBD port at 0x60,0x64 irq 1
custom # [   14.132809] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)
custom # [   14.183587] serio: i8042 AUX port at 0x60,0x64 irq 12
custom # [   14.228532] ehci-pci 0000:00:1d.7: EHCI Host Controller
custom # [   14.244423] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 1
custom # [   14.267801] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb000
custom # [   14.286494] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.00
custom # [   14.305028] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.18
custom # [   14.346445] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1
custom # [   14.381621] usb usb1: Product: EHCI Host Controller
custom # [   14.407573] usb usb1: Manufacturer: Linux 6.18.50 ehci_hcd
custom # [   14.435569] usb usb1: SerialNumber: 0000:00:1d.7
custom # [   14.451738] hub 1-0:1.0: USB hub found
custom # [   14.465734] hub 1-0:1.0: 6 ports detected
custom # [   14.489379] uhci_hcd 0000:00:1d.0: UHCI Host Controller
custom # [   14.511416] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 2
custom # [   14.541665] uhci_hcd 0000:00:1d.0: detected 2 ports
custom # [   14.573742] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c200
custom # [   14.587891] SCSI subsystem initialized
custom # [   14.626939] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
custom # [   14.706565] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
custom # [   14.727188] usb 1-1: new high-speed USB device number 2 using ehci-pci
custom # [   14.796014] usb usb2: Product: UHCI Host Controller
custom # [   14.841108] usb usb2: Manufacturer: Linux 6.18.50 uhci_hcd
custom # [   14.900847] usb usb2: SerialNumber: 0000:00:1d.0
custom # [   14.928546] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.00
custom # [   14.963361] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=10
custom # [   14.979534] hub 2-0:1.0: USB hub found
custom # [   14.984391] usb 1-1: Product: QEMU USB Tablet
custom # [   14.997546] usb 1-1: Manufacturer: QEMU
custom # [   15.017699] hub 2-0:1.0: 2 ports detected
custom # [   15.024040] usb 1-1: SerialNumber: 28754-0000:00:1d.7-1
custom # [   15.080467] uhci_hcd 0000:00:1d.1: UHCI Host Controller
custom # [   15.113847] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 3
custom # [   15.163472] uhci_hcd 0000:00:1d.1: detected 2 ports
custom # [   15.217681] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c220
custom # [   15.280883] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
custom # [   15.364679] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode
custom # [   15.395874] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=1
custom # [   15.435407] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)
custom # [   15.450662] usb usb3: Product: UHCI Host Controller
custom # [   15.483506] ahci 0000:00:1f.2: flags: 64bit ncq only
custom # [   15.495432] usb usb3: Manufacturer: Linux 6.18.50 uhci_hcd
custom # [   14.413500] systemd[1]: Starting Virtual Console Setup...
custom # [   15.631593] usb usb3: SerialNumber: 0000:00:1d.1
custom # [   14.737986] systemd-vconsole-setup[106]: Configuration of first virtual console was skipped, ignoring remaining ones.
custom # [   14.790955] (udev-worker)[102]: Network interface NamePolicy= disabled on kernel command line.
custom # [   14.825888] systemd[1]: Finished Virtual Console Setup.
custom # [   15.966693] hub 3-0:1.0: USB hub found
custom # [   15.992907] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input0
custom # [   14.926744] (udev-worker)[99]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
custom # [   14.967428] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.
custom # [   16.158786] hub 3-0:1.0: 2 ports detected
custom # [   16.166921] scsi host0: ahci
custom # [   16.201543] uhci_hcd 0000:00:1d.2: UHCI Host Controller
custom # [   16.207618] scsi host1: ahci
custom # [   16.224474] scsi host2: ahci
custom # [   16.232389] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 4
custom # [   16.251504] scsi host3: ahci
custom # [   16.282430] scsi host4: ahci
custom # [   16.286911] uhci_hcd 0000:00:1d.2: detected 2 ports
custom # [   16.316835] scsi host5: ahci
custom # [   16.335722] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c240
custom # [   16.350999] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 44 lpm-pol 1
custom # [   16.422886] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.18
custom # [   15.349516] systemd[1]: Found device /dev/disk/by-label/nixos.
custom # [   15.370614] systemd[1]: Reached target Initrd Root Device.
custom # [   15.392808] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...
custom # [   16.549541] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 44 lpm-pol 1
custom # [   16.616765] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 44 lpm-pol 1
custom # [   16.662538] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=1
custom # [   16.699540] usb usb4: Product: UHCI Host Controller
custom # [   16.714430] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 44 lpm-pol 1
custom # [   16.731571] usb usb4: Manufacturer: Linux 6.18.50 uhci_hcd
custom # [   16.749593] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 44 lpm-pol 1
custom # [   16.772534] usb usb4: SerialNumber: 0000:00:1d.2
custom # [   16.811842] hub 4-0:1.0: USB hub found
custom # [   16.838609] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 44 lpm-pol 1
custom # [   16.892601] hub 4-0:1.0: 2 ports detected
custom # [   15.858371] systemd-fsck[125]: nixos: clean, 12/65536 files, 13019/262144 blocks
custom # [   16.019877] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.
custom # [   17.234175] hid: raw HID events driver (C) Jiri Kosina
custom # [   16.133704] systemd[1]: Mounting /sysroot...
custom # [   17.282766] hrtimer: interrupt took 515987 ns
custom # [   17.349558] ata2: SATA link down (SStatus 0 SControl 300)
custom # [   17.404806] ata5: SATA link down (SStatus 0 SControl 300)
custom # [   17.494657] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
custom # [   17.575608] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/100
custom # [   17.613532] ata3.00: applying bridge limits
custom # [   17.653122] ata1: SATA link down (SStatus 0 SControl 300)
custom # [   17.700755] ata6: SATA link down (SStatus 0 SControl 300)
custom # [   17.751748] ata4: SATA link down (SStatus 0 SControl 300)
custom # [   17.783861] ata3.00: configured for UDMA/100
custom # [   17.819722] scsi 2:0:0:0: CD-ROM            QEMU     QEMU DVD-ROM     2.5+ PQ: 0 ANSI: 5
custom # [   18.001560] usbcore: registered new interface driver usbhid
custom # [   18.031575] usbhid: USB HID core driver
custom # [   18.888131] input: QEMU QEMU USB Tablet as /devices/pci0000:00/0000:00:1d.7/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input2
custom # [   18.918598] EXT4-fs (vda): mounted filesystem 2616b8f1-8aba-45ba-b7c1-a6347cd0b0c7 r/w with ordered data mode. Quota mode: none.
custom # [   17.883923] systemd[1]: Mounted /sysroot.
custom # [   17.905194] systemd[1]: Reached target Initrd Root File System.
custom # [   19.058977] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input0
custom # [   17.951429] systemd[1]: Mounting /sysroot/nix/.ro-store...
custom # [   18.004901] systemd[1]: Mounting /sysroot/nix/.rw-store...
custom # [   18.066422] systemd[1]: Mounting /sysroot/run...
custom # [   18.125818] systemd[1]: Mounting /sysroot/tmp/shared...
custom # [   19.305529] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray
custom # [   18.236844] systemd[1]: Mounting /sysroot/tmp/xchg...
custom # [   19.449585] cdrom: Uniform CD-ROM driver Revision: 3.20
custom # [   18.395374] systemd[1]: Starting Mountpoints Configured in the Real Root...
custom # [   19.641887] 9p: Installing v9fs 9p2000 file system support
custom # [   18.982758] systemd-sysroot-fstab-check[156]: /sysroot should be mounted in the initrd, will request daemon-reload.
custom # [   19.078902] systemd[1]: Mounted /sysroot/nix/.ro-store.
custom # [   19.095380] systemd[1]: Mounted /sysroot/nix/.rw-store.
custom # [   19.104395] systemd[1]: Mounted /sysroot/run.
custom # [   19.111940] systemd[1]: Mounted /sysroot/tmp/shared.
custom # [   19.123485] systemd[1]: Mounted /sysroot/tmp/xchg.
custom # [   19.216920] systemd[1]: Reload requested from client PID 156 ('systemd-sysroot') (unit initrd-parse-etc.service)...
custom # [   19.233553] systemd[1]: Reloading...
custom # [   19.539547] systemd[1]: Reloading finished in 310 ms.
custom # [   19.559853] systemd-sysroot-fstab-check[156]: Requesting initrd-fs.target/start/replace...
custom # [   19.576683] systemd-sysroot-fstab-check[156]: Requesting swap.target/start/replace...
custom # [   19.592384] systemd[1]: Starting rw-sysroot-nix-store.service...
custom # [   19.601792] systemd[1]: initrd-parse-etc.service: Deactivated successfully.
custom # [   19.613810] systemd[1]: Finished Mountpoints Configured in the Real Root.
custom # [   19.621352] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.
custom # [   19.654216] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
custom # [   19.661219] systemd[1]: Finished rw-sysroot-nix-store.service.
custom # [   19.671799] systemd[1]: Mounting /sysroot/nix/store...
custom # [   19.742993] systemd[1]: Mounted /sysroot/nix/store.
custom # [   19.765617] systemd[1]: Reached target Initrd File Systems.
custom # [   19.779483] systemd[1]: Starting Find NixOS closure...
custom # [   19.790746] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...
custom # [   19.887641] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.
custom # [   19.897879] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.
custom # [   19.927983] systemd[1]: Finished Find NixOS closure.
custom # [   19.939334] systemd[1]: Reached target Initrd Default Target.
custom # [   19.949309] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...
custom # [   19.999194] systemd[1]: Stopped target Initrd Default Target.
custom # [   20.004703] systemd[1]: Stopped target Basic System.
custom # [   20.010658] systemd[1]: Stopped target Initrd Root Device.
custom # [   20.016832] systemd[1]: Stopped target Path Units.
custom # [   20.022943] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.
custom # [   20.030575] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.
custom # [   20.036582] systemd[1]: Stopped target Slice Units.
custom # [   20.043577] systemd[1]: Stopped target Socket Units.
custom # [   20.048923] systemd[1]: Stopped target System Initialization.
custom # [   20.055281] systemd[1]: Stopped target Swaps.
custom # [   20.059735] systemd[1]: Stopped target Timer Units.
custom # [   20.064755] systemd[1]: dbus.socket: Deactivated successfully.
custom # [   20.070774] systemd[1]: Closed D-Bus System Message Bus Socket.
custom # [   20.076834] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.
custom # [   20.082889] systemd[1]: Stopped Find NixOS closure.
custom # [   20.087974] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio
custom # [   20.096661] systemd[1]: Starting rw-sysroot-nix-store.service...
custom # [   20.102558] systemd[1]: systemd-sysctl.service: Deactivated successfully.
custom # [   20.108597] systemd[1]: Stopped Apply Kernel Variables.
custom # [   20.112909] systemd[1]: systemd-modules-load.service: Deactivated successfully.
custom # [   20.120232] systemd[1]: Stopped Load Kernel Modules.
custom # [   20.124127] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.
custom # [   20.130471] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.
custom # [   20.137588] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.
custom # [   20.146245] systemd[1]: Stopped Create System Files and Directories.
custom # [   20.152926] systemd[1]: Stopped target Local File Systems.
custom # [   20.161826] systemd[1]: Stopped target Preparation for Local File Systems.
custom # [   20.168614] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.
custom # [   20.176169] systemd[1]: Stopped Coldplug All udev Devices.
custom # [   20.182543] systemd[1]: Stopping Rule-based Manager for Device Events and Files...
custom # [   20.187557] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
custom # [   20.194723] systemd[1]: Stopped Virtual Console Setup.
custom # [   20.199657] systemd[1]: systemd-udevd.service: Deactivated successfully.
custom # [   20.206469] systemd[1]: Stopped Rule-based Manager for Device Events and Files.
custom # [   20.212653] systemd[1]: systemd-udevd.service: Consumed 4.358s CPU time over 10.253s wall clock time, 20.6M memory peak.
custom # [   20.219449] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
custom # [   20.225587] systemd[1]: Finished rw-sysroot-nix-store.service.
custom # [   20.233883] systemd[1]: initrd-cleanup.service: Deactivated successfully.
custom # [   20.240415] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.
custom # [   20.251271] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.
custom # [   20.256546] systemd[1]: Closed udev Control Socket.
custom # [   20.262236] systemd[1]: Starting Cleanup udev Database...
custom # [   20.266533] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.
custom # [   20.271547] systemd[1]: Stopped Create Static Device Nodes in /dev.
custom # [   20.276625] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.
custom # [   20.282617] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.
custom # [   20.288577] systemd[1]: kmod-static-nodes.service: Deactivated successfully.
custom # [   20.293204] systemd[1]: Stopped Create List of Static Device Nodes.
custom # [   20.343592] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.
custom # [   20.365647] systemd[1]: Finished Cleanup udev Database.
custom # [   20.380948] systemd[1]: Reached target Switch Root.
custom # [   20.399661] systemd[1]: Starting NixOS Activation...
custom # [   21.040670] initrd-nixos-activation-start[206]: booting system configuration /nix/store/6pmh5brqmkpf2j6rb51mnz9lmgxkz38n-nixos-system-custom-test
custom # [   21.145211] initrd-nixos-activation-start[206]: running activation script...
custom # [   23.309416] initrd-nixos-activation-start[229]: setting up /etc...
custom: Guest root shell did not produce any data yet...
custom:   To debug, enter the VM and run 'systemctl status backdoor.service'.
custom # [   24.598864] initrd-nixos-activation-start[255]: Public key: age1pq1dtf6e7p8cx9aen2qwdwelfvc43qvyyyy99g0ca52aq045eqk0gygdw5nr8gppjw65zx46unzh4w2w3lcncmq9wmvzvlfgygluhm9h42nnl27v7szdfs94qv4q2nplwhepzss3gu4rxxxd2wdk34p2ajgz2xdc9ycwxvs0mphy05y95jf8a9dkxjv33lchwzl5ampl7qcdftxq6wyc23sqpp305pkeqam5kvfww7hdqmw0fx2h392xjxnjcm3zqgzms453753rx967y3ttlmhkhle9zrlc9qny9ggfyskfy3e9pwwjxwy7hy4pr6h5jtp4hewz8nd8fmpaw2adl337nx5svjv9puhssxk9afl3vm5aqxr4yewfv253g7kqkxrj0kqljlpg6v7qhah5y2a8ueqmsamuy2vyeeddp0hepypwryjzsvp2d7rrkaz29cj7hpdkgryrj9mdgrtjd5cytata3ykpxflknwxa4azs7npyfyl5pufjeqgpwy3cey9rwwqg66csyajcj5ky39q2w4cnrt0tducxvldc72sp5v56xfnnctjz84dcqd7axgl3cczlzjz5p6k3srqfztly7sjwws9szvkpjg5cl3p029d0sq2hqrteyf3jvjwzw37yw7e5zej36es68mmj9jwjjuawa7f0wqupr389n2jc5dnke72np8a4ywq98njsdetvp4jev7kqe4gxefz32v38f26yswu27z5dy7zxksa0l3r7vf4q48cvg8y230pqpzefj7yay6jgzw0k63g6zcjkscwujkg22ln4q7lcalgwu7x7fsexjs5xwlpxwytztsserr9ase5vhnyxzanwaeq05qwnf3rsuepz5mm8uq4j68gjyuk5v7zvnpcp8akkx8ts2jgjdexddpzlhzmxxkg9vpv4guqdvgmtjts8a6v6ekg3ncpp3ezgucfsq0zdg52zq7tkcy93k87s4lzaw7gmcwrlgf66ds5elgqjpgpupx00zcngwv4j7hsvkr3gteve9rkr2d2fu63w308dsqtq7wq327qtkfyycn30j3cp6ydnjujddqk3yumznrxt64epctuzazkrw6smeap695pj55gklahwap3jsv0ugywuafg884kxl8esr09cyk9cpvt4gf9ud5640h4rwjshy6zudrfwkpve3ukdzupwjru2p4k95c7v4asf2xt8a694sp9m28jtnq7jq454thgw7urnyzfnxl8scqt7nv2asce9hwas7zc6kqagdf8jz9jwdkhffrah0ca2w2exatdagp6vj36hfzdky7nqj4cn4sxye6kphuxkn24stxlz9muxcckg93gkdt69vc8wx8cdgnnhvsnd9ktqj790nck3s98ts0kskjrgqtn9lhhefq33wt3xk8plkca8petfrx8r64j8jwa8wqrfvzg4y25s2nzzum4rvdpg436lpmnntmqcau28xsjgtt92gvd84u9d3u5ydak4qt48rzu549sdgd0u2a46p3rpmw3cjye6ge8vgkdugdrmdfg5awa0s77wwtpwyc6v0anpajg4u5exkhwkae5zaqxcgmgzsle2zzmyj42hn9jw3k0984qajzg0mjzjw2ptq002zcvv9u89dqewh3ds9hucfdkv7vg5g9yyqt22dhecdtcuju0j0z643cg3ve6x4ms2h78t360pzymf39vjy329v5lvvm0dwavkmzmzyvghzx4rcjq90ppc2q452xvvjyv6f72fu3r80qmgz7hp62r2jv49eys3symvzjla38esmrd96z4lmhnq2jzxyc3w0xs576huh38vtw6j8hzk0yq5tqmt7ssfuswzqv9ls2gudpy7nc3jgwd7pcf0u5cc8ysn2qlhwu9te204v5cxpczslndftme5l23t8dnfvfdm90fuxf7afxt665gvf5u852vpper
custom # [   24.800916] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.
custom # [   24.807600] systemd[1]: Finished NixOS Activation.
custom # [   24.811640] systemd[1]: initrd-nixos-activation.service: Consumed 1.445s CPU time over 4.406s wall clock time, 20M memory peak.
custom # [   24.820290] systemd[1]: Starting Switch Root...
custom # [   24.844371] systemd[1]: Switching root.
custom # [   26.103933] systemd-journald[68]: Received SIGTERM from PID 1 (systemd).
custom # [   26.252678] NET: Registered PF_VSOCK protocol family
custom # [   26.797199] systemd[1]: systemd 261.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)
custom # [   26.810355] systemd[1]: Detected virtualization kvm.
custom # [   26.812801] systemd[1]: Detected architecture x86-64.
custom # [   26.815420] systemd[1]: Detected first boot.
custom # [   26.821437] systemd[1]: Initializing machine ID from random generator.
custom # [   27.106632] systemd[1]: bpf-restrict-fs: LSM BPF program attached
custom # [   27.949443] systemd[1]: Applying preset policy.
custom # [   28.787432] systemd[1]: Populated /etc with preset unit settings.
custom # [   29.270873] systemd[1]: initrd-switch-root.service: Deactivated successfully.
custom # [   29.274501] systemd[1]: Stopped initrd-switch-root.service.
custom # [   29.289261] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.
custom # [   29.293549] systemd[1]: Created slice Slice /system/getty.
custom # [   29.296413] systemd[1]: Created slice User and Session Slice.
custom # [   29.298608] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
custom # [   29.301559] systemd[1]: Started Forward Password Requests to Wall Directory Watch.
custom # [   29.304194] systemd[1]: Expecting device /dev/hvc0...
custom # [   29.306024] systemd[1]: Expecting device /dev/ttyS0...
custom # [   29.307948] systemd[1]: Reached target Local Encrypted Volumes.
custom # [   29.310061] systemd[1]: Stopped target initrd-fs.target.
custom # [   29.312004] systemd[1]: Stopped target initrd-root-fs.target.
custom # [   29.314130] systemd[1]: Stopped target initrd-switch-root.target.
custom # [   29.316296] systemd[1]: Reached target Virtual Machines and Containers.
custom # [   29.318587] systemd[1]: Reached target Path Units.
custom # [   29.320449] systemd[1]: Reached target Remote File Systems.
custom # [   29.322514] systemd[1]: Reached target Slice Units.
custom # [   29.324312] systemd[1]: Reached target Swaps.
custom # [   29.327892] systemd[1]: Listening on Query the User Interactively for a Password.
custom # [   29.332580] systemd[1]: Listening on Process Core Dump Socket.
custom # [   29.336311] systemd[1]: Listening on Credential Encryption/Decryption.
custom # [   29.340128] systemd[1]: Listening on Factory Reset Management.
custom # [   29.342328] systemd[1]: Listening on Hostname Service Socket.
custom # [   29.346872] systemd[1]: Starting Journal Log Access Socket...
custom # [   29.349659] systemd[1]: Listening on Journal Audit Socket.
custom # [   29.353650] systemd[1]: Listening on Console Output Muting Service Socket.
custom # [   29.356245] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.
custom # [   29.358954] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os
custom # [   29.362011] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki
custom # [   29.370528] systemd[1]: Listening on Disk Repartitioning Service Socket.
custom # [   29.372924] systemd[1]: Listening on udev Control Socket.
custom # [   29.375015] systemd[1]: Listening on udev Varlink Socket.
custom # [   29.379431] systemd[1]: Mounting Huge Pages File System...
custom # [   29.386215] systemd[1]: Mounting POSIX Message Queue File System...
custom # [   29.394821] systemd[1]: Mounting Kernel Debug File System...
custom # [   29.404503] systemd[1]: Mounting Kernel Trace File System...
custom # [   29.417435] systemd[1]: Starting Create List of Static Device Nodes...
custom # [   29.425009] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio
custom # [   29.447210] systemd[1]: Starting Load Kernel Module configfs...
custom # [   29.462321] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm
custom # [   29.480265] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
custom # [   29.490572] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse
custom # [   29.497558] systemd[1]: Mounting FUSE Control File System...
custom # [   29.500277] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67
custom # [   29.516618] systemd[1]: Starting Journal Service...
custom # [   29.533834] systemd[1]: Starting Load Kernel Modules...
custom # [   29.552660] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...
custom # [   29.572500] systemd[1]: Starting Remount Root and Kernel File Systems...
custom # [   29.580909] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
custom # [   29.588060] systemd-journald[306]: Collecting audit messages is enabled.
custom # [   29.610210] systemd[1]: Starting Coldplug All udev Devices...
custom # [   29.650390] loop: module loaded
custom # [   29.655287] systemd[1]: Listening on Journal Log Access Socket.
custom # [   28.535534] systemd[1]: Queued start job for default target Multi-User System.
custom # [   28.539707] systemd[1]: systemd-journald.service: Deactivated successfully.
custom # [   29.668538] systemd[1]: Started Journal Service.
custom # [   28.548622] systemd-modules-load[307]: Inserted module 'loop'
custom # [   29.680272] EXT4-fs (vda): re-mounted 2616b8f1-8aba-45ba-b7c1-a6347cd0b0c7.
custom # [   28.558608] systemd[1]: Mounted Huge Pages File System.
custom # [   28.564751] systemd[1]: Mounted POSIX Message Queue File System.
custom # [   28.571617] systemd[1]: Mounted Kernel Debug File System.
custom # [   28.576561] systemd[1]: Mounted Kernel Trace File System.
custom # [   28.581494] systemd[1]: Finished Create List of Static Device Nodes.
custom # [   28.587376] systemd[1]: modprobe@configfs.service: Deactivated successfully.
custom # [   28.591539] systemd[1]: Finished Load Kernel Module configfs.
custom # [   28.594855] systemd[1]: Mounted FUSE Control File System.
custom # [   28.601526] systemd[1]: Finished Load Kernel Modules.
custom # [   28.607291] systemd[1]: Finished Remount Root and Kernel File Systems.
custom # [   28.611826] systemd-oomd[309]: No swap; memory pressure usage will be degraded
custom # [   28.627197] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.
custom # [   28.636144] systemd[1]: Listening on Disk Image Download Service Socket.
custom # [   28.643136] systemd[1]: Mounting Kernel Configuration File System...
custom # [   28.649640] systemd[1]: Starting Firewall...
custom # [   28.662190] systemd[1]: Starting Flush Journal to Persistent Storage...
custom # [   28.664548] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
custom # [   28.683266] systemd[1]: Starting Load/Save OS Random Seed...
custom # [   28.704178] systemd[1]: Starting Apply Kernel Variables...
custom # [   28.734721] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
custom # [   28.739299] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
custom # [   29.894765] systemd-journald[306]: Received client request to flush runtime journal.
custom # [   29.181345] systemd[1]: Mounted Kernel Configuration File System.
custom # [   29.187452] systemd[1]: Finished Load/Save OS Random Seed.
custom # [   29.193220] systemd[1]: Reached target First Boot Complete.
custom # [   29.197652] systemd[1]: Finished Apply Kernel Variables.
custom # [   29.201765] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
custom # [   29.206364] systemd[1]: Starting Create Static Device Nodes in /dev...
custom # [   29.209651] systemd[1]: Finished Coldplug All udev Devices.
custom # [   29.213215] systemd[1]: Finished Create Static Device Nodes in /dev.
custom # [   29.215731] systemd[1]: Reached target Preparation for Local File Systems.
custom # [   29.219165] systemd[1]: Starting Rule-based Manager for Device Events and Files...
custom # [   29.222685] systemd-udevd[344]: Using default interface naming scheme 'v261'.
custom # [   29.226567] systemd[1]: Mounting /run/wrappers...
custom # [   29.230383] systemd[1]: Finished Flush Journal to Persistent Storage.
custom # [   29.234148] systemd[1]: Mounted /run/wrappers.
custom # [   29.238179] systemd[1]: Reached target Local File Systems.
custom # [   29.244308] systemd[1]: Listening on Boot Loader Control Service Socket.
custom # [   29.253161] systemd[1]: Starting register-nix-paths.service...
custom # [   29.260174] systemd[1]: Starting Create SUID/SGID Wrappers...
custom # [   29.262286] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.
custom # [   29.271397] systemd[1]: Starting Save Transient machine-id to Disk...
custom # [   29.287785] systemd[1]: Starting Create System Files and Directories...
custom # [   29.377679] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
custom # [   29.388434] systemd[1]: Finished Save Transient machine-id to Disk.
custom # [   29.468555] systemd[1]: Finished Create System Files and Directories.
custom # [   29.478908] systemd[1]: Started Rule-based Manager for Device Events and Files.
custom # [   29.493371] systemd[1]: Starting Rebuild Journal Catalog...
custom # [   29.509931] systemd[1]: Starting Record System Boot/Shutdown in UTMP...
custom # [   29.636164] systemd[1]: Finished Record System Boot/Shutdown in UTMP.
custom # [   29.718761] systemd[1]: Finished Rebuild Journal Catalog.
custom # [   29.733199] systemd[1]: Starting Update is Completed...
custom # [   29.832684] systemd[1]: Finished Update is Completed.
custom # [   30.174655] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.
custom # [   30.187782] systemd[1]: Finished Create SUID/SGID Wrappers.
custom # [   30.317369] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse
custom # [   30.674564] systemd[1]: Finished Firewall.
custom # [   30.693367] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.
custom # [   30.799476] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.
custom # [   30.866958] (udev-worker)[458]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
custom # [   30.880580] (udev-worker)[460]: Network interface NamePolicy= disabled on kernel command line.
custom # [   30.886616] (udev-worker)[458]: Network interface NamePolicy= disabled on kernel command line.
custom # [   30.916551] systemd[1]: Finished register-nix-paths.service.
custom # [   30.923258] systemd[1]: Reached target System Initialization.
custom # [   30.927320] systemd[1]: Started Discard unused filesystem blocks once a week.
custom # [   30.932522] systemd[1]: Started Daily Cleanup of Temporary Directories.
custom # [   30.938520] systemd[1]: Reached target Timer Units.
custom # [   30.942517] systemd[1]: Listening on D-Bus System Message Bus Socket.
custom # [   30.947527] systemd[1]: Listening on Nix Daemon Socket.
custom # [   30.952590] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
custom # [   30.959323] systemd[1]: Reached target Socket Units.
custom # [   30.964282] systemd[1]: Reached target Basic System.
custom # [   30.970214] systemd[1]: Started backdoor.service.
custom # [   30.986168] systemd[1]: Starting Import lastlog data into lastlog2 database...
custom # [   31.002810] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
custom # [   31.029363] systemd[1]: Starting Post-Boot Actions...
custom # [   31.055445] systemd[1]: Started Reset console on configuration changes.
custom # [   31.094510] systemd[1]: Starting resolvconf update...
custom # [   31.133680] systemd[1]: Starting Create ssync custom data directory...
custom # connecting to host...
custom: Guest shell says: b'Spawning backdoor root shell...\n'
custom: connected to guest root shell
custom: (connecting took 37.44 seconds)
custom: (finished: waiting for the VM to finish booting, in 38.52 seconds)
custom # [   31.223407] systemd[1]: Finished Post-Boot Actions.
custom # [   31.227872] nsncd[526]: Sep 13 06:00:12.776 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
custom # [   31.239574] systemd[1]: Started Name Service Cache Daemon (nsncd).
custom # [   31.312717] systemd[1]: Reached target Host and Network Name Lookups.
custom # [   31.321820] systemd[1]: Reached target User and Group Name Lookups.
custom # [   31.344252] systemd[1]: Starting D-Bus System Message Bus...
custom # [   31.404593] systemd[1]: Starting User Login Management...
custom # [   31.416830] systemd[1]: ssync-data-dir.service: Deactivated successfully.
custom # [   31.441838] systemd[1]: Finished Create ssync custom data directory.
custom # [   31.494363] systemd[1]: Finished Import lastlog data into lastlog2 database.
custom # [   31.696962] systemd[1]: Condition check resulted in Virtio network device being skipped.
custom # [   31.926995] dbus-broker-launch[559]: Looking up NSS user entry for 'systemd-timesync'...
custom # [   31.998758] dbus-broker-launch[559]: NSS returned no entry for 'systemd-timesync'
custom # [   32.011245] dbus-broker-launch[559]: Invalid user-name in /nix/store/y6n8fva5yi0zgsw0yk6f54z9b9vjxiv1-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
custom # [   32.021859] systemd[1]: Stopped target Host and Network Name Lookups.
custom # [   32.035489] systemd[1]: Stopping Host and Network Name Lookups...
custom # [   32.044714] systemd[1]: Stopped target User and Group Name Lookups.
custom # [   32.052725] systemd[1]: Stopping User and Group Name Lookups...
custom # [   32.062550] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...
custom # [   32.072149] systemd[1]: nscd.service: Deactivated successfully.
custom # [   32.078974] systemd[1]: Stopped Name Service Cache Daemon (nsncd).
custom # [   32.112246] systemd[1]: Started D-Bus System Message Bus.
custom # [   32.164331] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
custom # [   32.196834] systemd-logind[561]: New seat seat0.
custom # [   32.213530] systemd[1]: Started User Login Management.
custom # [   32.238775] systemd[1]: Starting linger-users.service...
custom # [   32.255401] dbus-broker-launch[559]: Ready
custom # [   32.328676] systemd[1]: Started Name Service Cache Daemon (nsncd).
custom # [   32.334557] nsncd[611]: Sep 13 06:00:13.889 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
custom # [   32.367745] systemd[1]: linger-users.service: Deactivated successfully.
custom # [   32.372386] systemd[1]: Finished linger-users.service.
custom # [   32.387839] systemd[1]: Finished resolvconf update.
custom # [   32.400635] systemd[1]: Reached target Preparation for Network.
custom # [   32.403512] systemd[1]: Reached target Host and Network Name Lookups.
custom # [   32.407501] systemd[1]: Reached target User and Group Name Lookups.
custom # [   32.415178] systemd[1]: Starting DHCP Client...
custom # [   32.422170] systemd[1]: Starting Address configuration of eth1...
custom # [   32.433177] systemd[1]: Starting Extra networking commands....
custom # [   32.613381] network-addresses-eth1-start[640]: adding address 192.168.1.2/24... done
custom # [   32.646972] network-addresses-eth1-start[640]: adding address 2001:db8:1::2/64... done
custom # [   32.693516] systemd[1]: Finished Address configuration of eth1.
custom # [   32.801423] dhcpcd[650]: dhcpcd-10.3.2 starting
custom # [   32.820748] dhcpcd[714]: dev: loaded udev
custom # [   32.825780] systemd[1]: Finished Extra networking commands..
custom # [   32.831647] systemd[1]: Reached target Network.
custom # [   32.844267] systemd[1]: Starting Permit User Sessions...
custom # [   33.990499] mousedev: PS/2 mouse device common for all mice
custom # [   34.001007] 8021q: 802.1Q VLAN Support v1.8
custom # [   34.009825] 8021q: adding VLAN 0 to HW filter on device eth1
custom # [   32.925194] systemd[1]: Finished Permit User Sessions.
custom # [   32.941600] systemd[1]: Started Getty on tty1.
custom # [   32.947476] systemd[1]: Reached target Login Prompts.
custom # [   34.083676] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console
custom # [   34.131422] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input3
custom # [   34.234152] ACPI: button: Power Button [PWRF]
custom # [   34.325806] cfg80211: Loading compiled-in X.509 certificates for regulatory database
custom # [   34.360915] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
custom # [   33.389574] dhcpcd[714]: eth0: waiting for carrier
custom # [   33.396808] dhcpcd[714]: libudev: received NULL device
custom # [   33.401447] dhcpcd[714]: libudev: received NULL device
custom # [   33.406432] dhcpcd[714]: eth0: carrier acquired
custom # [   34.361167] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'
custom # [   33.432390] dhcpcd[714]: DUID 00:01:00:01:32:38:f8:71:52:54:00:12:34:56
custom # [   33.436774] dhcpcd[714]: eth0: IAID 00:12:34:56
custom # [   33.442104] dhcpcd[714]: eth0: adding address fe80::5054:ff:fe12:3456
custom # [   34.362911] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2
custom # [   34.362920] cfg80211: failed to load regulatory.db
custom # [   34.372964] rtc_cmos 00:04: RTC can wake from S4
custom # [   34.395578] Console: switching to colour dummy device 80x25
custom # [   34.426415] rtc_cmos 00:04: registered as rtc0
custom # [   34.426705] rtc_cmos 00:04: setting system clock to 2026-09-13T06:00:17 UTC (1789279217)
custom # [   34.426937] rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs
custom # [   34.473860] parport_pc 00:02: reported by Plug and Play ACPI
custom # [   34.493621] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]
custom # [   34.513913] 8021q: adding VLAN 0 to HW filter on device eth0
custom # [   34.543663] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:09.0/virtio7/input/input4
custom # [   34.606871] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized
custom # [   34.703833] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt
custom # [   34.704715] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD
custom # [   34.759260] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input6
custom # [   34.760150] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input5
custom # [   33.731880] systemd[1]: Starting Virtual Console Setup...
custom # [   34.903688] [drm] Found bochs VGA, ID 0xb0c5.
custom # [   34.942974] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.
custom # [   33.864581] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.
custom # [   35.001731] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic
custom # [   35.034944] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 0
custom # [   33.922987] systemd-logind[561]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard)
custom # [   33.951222] systemd-logind[561]: Watching system buttons on /dev/input/event2 (Power Button)
custom # [   34.008817] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
custom # [   34.015667] systemd[1]: Stopped Virtual Console Setup.
custom # [   34.037287] systemd[1]: Starting Virtual Console Setup...
custom # [   35.227645] ppdev: user-space parallel port driver
custom # [   34.178852] systemd-logind[561]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)
custom # [   35.328355] iTCO_wdt iTCO_wdt.1.auto: Found a ICH9 TCO device (Version=2, TCOBASE=0x0660)
custom # [   35.351410] iTCO_wdt iTCO_wdt.1.auto: initialized. heartbeat=30 sec (nowayout=0)
custom # [   35.418907] Console: switching to colour frame buffer device 160x50
custom # [   35.507805] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device
custom # [   34.397520] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
custom # [   34.402396] systemd[1]: Stopped Virtual Console Setup.
custom # [   34.420716] systemd[1]: Starting Virtual Console Setup...
custom # [   35.740575] kvm_amd: TSC scaling supported
custom # [   35.742234] kvm_amd: Nested Virtualization enabled
custom # [   35.749697] kvm_amd: Nested Paging enabled
custom # [   35.752818] kvm_amd: LBR virtualization supported
custom # [   35.754702] kvm_amd: Virtual VMLOAD VMSAVE supported
custom # [   35.756820] kvm_amd: Virtual GIF supported
custom # [   35.762551] kvm_amd: Virtual NMI enabled
custom # [   35.819808] EDAC MC: Ver: 3.0.0
custom # [   34.841955] systemd-vconsole-setup[753]: Configuration of first virtual console was skipped, ignoring remaining ones.
custom # [   34.851157] systemd[1]: Finished Virtual Console Setup.
custom # [   35.281850] dhcpcd[714]: eth0: soliciting a DHCP lease
custom # [   36.434717] NET: Registered PF_PACKET protocol family
custom # [   35.318411] dhcpcd[714]: eth0: soliciting an IPv6 router
custom # [   35.322546] dhcpcd[714]: eth0: offered 10.0.2.15 from 10.0.2.2
custom # [   35.327399] dhcpcd[714]: eth0: Router Advertisement from fe80::2
custom # [   35.332271] dhcpcd[714]: eth0: adding address fec0::5054:ff:fe12:3456/64
custom # [   35.336714] dhcpcd[714]: eth0: adding route to fec0::/64
custom # [   35.340342] dhcpcd[714]: eth0: adding default route via fe80::2
custom # [   35.344335] dhcpcd[714]: eth0: probing address 10.0.2.15/24
custom # [   40.080867] dhcpcd[714]: eth0: leased 10.0.2.15 for 86400 seconds
custom # [   40.113528] dhcpcd[714]: eth0: adding route to 10.0.2.0/24
custom # [   40.136856] dhcpcd[714]: eth0: adding default route via 10.0.2.2
custom # [   42.339827] systemd[1]: Started DHCP Client.
custom # [   42.389702] systemd[1]: Reached target Network is Online.
custom # [   42.548784] systemd[1]: Started ssync coding-agent session sync.
custom # [   42.644971] systemd[1]: Reached target Multi-User System.
custom # [   42.687378] systemd[1]: Startup finished in 5.951s (kernel) + 19.107s (initrd) + 17.613s (userspace) = 42.672s.
custom # [   45.773840] ssync[872]: ssync: shared-identity mode (`recipients` empty); per-machine keys enable revocation, see docs/setup.md
custom: (finished: waiting for unit ssync.service, in 54.29 seconds)
custom: waiting for file '/run/ssync-test-key/age.key'
custom: (finished: waiting for file '/run/ssync-test-key/age.key', in 0.64 seconds)
custom: waiting for file '/srv/ssync-data/ticket'
custom # [   49.111986] ssync[872]: created namespace b26122598f79a0805a46c7d89faf70759ad440b384d1cf206e9d943eaf8e196c
custom # [   49.521852] ssync[872]: ssync daemon watching /var/empty/.pi/agent/sessions (pi)
custom # [   49.543892] ssync[872]: ssync daemon watching /var/empty/.omp/agent/sessions (omp)
custom # [   49.573964] ssync[872]: ssync daemon watching /var/empty/.omp/agent/blobs (omp-blobs)
custom: (finished: waiting for file '/srv/ssync-data/ticket', in 2.95 seconds)
custom: must succeed: test $(stat -c%a /srv/ssync-data) = 750
custom: (finished: must succeed: test $(stat -c%a /srv/ssync-data) = 750, in 0.78 seconds)
custom: must succeed: test $(stat -c%U:%G /srv/ssync-data) = ssync-test:ssync-test
custom: (finished: must succeed: test $(stat -c%U:%G /srv/ssync-data) = ssync-test:ssync-test, in 1.07 seconds)
custom: must succeed: systemctl show ssync -p ReadWritePaths --value | grep -q /srv/ssync-data
custom: (finished: must succeed: systemctl show ssync -p ReadWritePaths --value | grep -q /srv/ssync-data, in 1.38 seconds)
custom: must succeed: systemctl show ssync -p ReadWritePaths --value | grep -qv /run/ssync-test-key
custom: (finished: must succeed: systemctl show ssync -p ReadWritePaths --value | grep -qv /run/ssync-test-key, in 1.54 seconds)
custom: must succeed: test -z "$(systemctl show ssync -p StateDirectory --value)"
custom: (finished: must succeed: test -z "$(systemctl show ssync -p StateDirectory --value)", in 1.06 seconds)
(finished: run the VM test script, in 215.73 seconds)
test script finished in 218.45s
cleanup
kill QemuMachine (pid 105)
cluster # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/b5bpi6zfajzzrwwpgba2q6li3nnya4bs-python3-3.14.7/bin/python3.14)
kill QemuMachine (pid 137)
custom # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/b5bpi6zfajzzrwwpgba2q6li3nnya4bs-python3-3.14.7/bin/python3.14)
kill QemuMachine (pid 45)
machine # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/b5bpi6zfajzzrwwpgba2q6li3nnya4bs-python3-3.14.7/bin/python3.14)
(finished: cleanup, in 0.84 seconds)