tribuchet: building on eliza
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
start all VMs
client: starting vm
server: starting vm
server # Disk image does not exist, creating the virtualisation disk image...
server: QEMU running (pid 48)
server # Formatting '/build/vm-state-server/tmp.x8q2Lnt23L', fmt=raw size=1073741824
client # Disk image does not exist, creating the virtualisation disk image...
server # mke2fs 1.47.4 (6-Mar-2025)
client # Formatting '/build/vm-state-client/tmp.2fkDeY1D0w', fmt=raw size=1073741824
server # Discarding device blocks:      0/262144             done
client # mke2fs 1.47.4 (6-Mar-2025)
server # Creating filesystem with 262144 4k blocks and 65536 inodes
client # Discarding device blocks:      0/262144             done
server # Filesystem UUID: 5e3fc69d-e35a-4362-bc6d-985e424ddf25
client # Creating filesystem with 262144 4k blocks and 65536 inodes
server # Superblock backups stored on blocks:
client # Filesystem UUID: 31fa4821-14a7-4efe-b6ef-0d98be37e42c
server # 	32768, 98304, 163840, 229376
client # Superblock backups stored on blocks:
server # 
client # 	32768, 98304, 163840, 229376
server # Allocating group tables: 0/8   done
client # 
server # Writing inode tables: 0/8   done
client # Allocating group tables: 0/8   done
server # Creating journal (8192 blocks): done
client # Writing inode tables: 0/8   done
server # Writing superblocks and filesystem accounting information: 0/8   done
client # Creating journal (8192 blocks): done
server # 
client # Writing superblocks and filesystem accounting information: 0/8   done
server # Virtualisation disk image created.
client # 
client: QEMU running (pid 47)
client # Virtualisation disk image created.
(finished: start all VMs, in 0.45 seconds)
client: waiting for unit network.target
client: waiting for the VM to finish booting
server # [    0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]
client # [    0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]
server # [    0.000000] Linux version 6.18.49 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Wed Sep  2 12:31:51 UTC 2026
server # [    0.000000] KASLR enabled
server # [    0.000000] random: crng init done
client # [    0.000000] Linux version 6.18.49 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Wed Sep  2 12:31:51 UTC 2026
server # [    0.000000] Machine model: linux,dummy-virt
client # [    0.000000] KASLR enabled
server # [    0.000000] efi: UEFI not found.
client # [    0.000000] random: crng init done
client # [    0.000000] Machine model: linux,dummy-virt
server # [    0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT
client # [    0.000000] efi: UEFI not found.
server # [    0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]
client # [    0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT
server # [    0.000000] NODE_DATA(0) allocated [mem 0x7fded700-0x7fdf0e7f]
server # [    0.000000] Zone ranges:
client # [    0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]
server # [    0.000000]   DMA      [mem 0x0000000040000000-0x000000007fffffff]
client # [    0.000000] NODE_DATA(0) allocated [mem 0x7fded700-0x7fdf0e7f]
server # [    0.000000]   DMA32    empty
client # [    0.000000] Zone ranges:
server # [    0.000000]   Normal   empty
server # [    0.000000]   Device   empty
client # [    0.000000]   DMA      [mem 0x0000000040000000-0x000000007fffffff]
client # [    0.000000]   DMA32    empty
server # [    0.000000] Movable zone start for each node
client # [    0.000000]   Normal   empty
server # [    0.000000] Early memory node ranges
client # [    0.000000]   Device   empty
server # [    0.000000]   node   0: [mem 0x0000000040000000-0x000000007fffffff]
client # [    0.000000] Movable zone start for each node
client # [    0.000000] Early memory node ranges
server # [    0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]
client # [    0.000000]   node   0: [mem 0x0000000040000000-0x000000007fffffff]
server # [    0.000000] cma: Reserved 32 MiB at 0x000000007cc00000
server # [    0.000000] psci: probing for conduit method from DT.
client # [    0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]
server # [    0.000000] psci: PSCIv1.3 detected in firmware.
client # [    0.000000] cma: Reserved 32 MiB at 0x000000007cc00000
server # [    0.000000] psci: Using standard PSCI v0.2 function IDs
client # [    0.000000] psci: probing for conduit method from DT.
server # [    0.000000] psci: Trusted OS migration not required
client # [    0.000000] psci: PSCIv1.3 detected in firmware.
server # [    0.000000] psci: SMC Calling Convention v1.1
client # [    0.000000] psci: Using standard PSCI v0.2 function IDs
client # [    0.000000] psci: Trusted OS migration not required
server # [    0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)
client # [    0.000000] psci: SMC Calling Convention v1.1
server # [    0.000000] percpu: Embedded 76 pages/cpu s186648 r8192 d116456 u311296
server # [    0.000000] Detected PIPT I-cache on CPU0
client # [    0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)
client # [    0.000000] percpu: Embedded 76 pages/cpu s186648 r8192 d116456 u311296
server # [    0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)
client # [    0.000000] Detected PIPT I-cache on CPU0
server # [    0.000000] CPU features: detected: GICv3 CPU interface
server # [    0.000000] CPU features: detected: Spectre-v4
client # [    0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)
server # [    0.000000] CPU features: detected: Spectre-BHB
client # [    0.000000] CPU features: detected: GICv3 CPU interface
server # [    0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_38
client # [    0.000000] CPU features: detected: Spectre-v4
server # [    0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_23
client # [    0.000000] CPU features: detected: Spectre-BHB
server # [    0.000000] alternatives: applying boot alternatives
client # [    0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_38
client # [    0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_23
client # [    0.000000] alternatives: applying boot alternatives
server # [    0.000000] Kernel command line: console=ttyAMA0 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/anr1c8ppp714pa42kac7sv37mj52pjwc-nixos-system-server-test/init regInfo=/nix/store/ki50xys0jmdwwa05xxfvfh7v6mdvw80n-closure-info/registration console=ttyAMA0,115200n8 console=tty0
client # [    0.000000] Kernel command line: console=ttyAMA0 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/gymi1qmis3hy2k8bvhnyfm9cid39h9cz-nixos-system-client-test/init regInfo=/nix/store/c0pv8jpmz2ygmyiy3g1p4aqbs0j4fhxd-closure-info/registration console=ttyAMA0,115200n8 console=tty0
server # [    0.000000] Unknown kernel command line parameters "regInfo=/nix/store/ki50xys0jmdwwa05xxfvfh7v6mdvw80n-closure-info/registration", will be passed to user space.
server # [    0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes
client # [    0.000000] Unknown kernel command line parameters "regInfo=/nix/store/c0pv8jpmz2ygmyiy3g1p4aqbs0j4fhxd-closure-info/registration", will be passed to user space.
server # [    0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)
client # [    0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes
server # [    0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)
client # [    0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)
server # [    0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB
server # [    0.000000] software IO TLB: area num 1.
client # [    0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)
server # [    0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB)
client # [    0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB
server # [    0.000000] Fallback order for Node 0: 0
client # [    0.000000] software IO TLB: area num 1.
server # [    0.000000] Built 1 zonelists, mobility grouping on.  Total pages: 262144
client # [    0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB)
server # [    0.000000] Policy zone: DMA
client # [    0.000000] Fallback order for Node 0: 0
server # [    0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off
client # [    0.000000] Built 1 zonelists, mobility grouping on.  Total pages: 262144
client # [    0.000000] Policy zone: DMA
server # [    0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
server # [    0.000000] allocated 2097152 bytes of page_ext
client # [    0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off
server # [    0.000000] ftrace: allocating 74886 entries in 294 pages
client # [    0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
server # [    0.000000] ftrace: allocated 294 pages with 4 groups
client # [    0.000000] allocated 2097152 bytes of page_ext
server # [    0.000000] rcu: Hierarchical RCU implementation.
client # [    0.000000] ftrace: allocating 74886 entries in 294 pages
server # [    0.000000] rcu: 	RCU event tracing is enabled.
client # [    0.000000] ftrace: allocated 294 pages with 4 groups
server # [    0.000000] rcu: 	RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.
client # [    0.000000] rcu: Hierarchical RCU implementation.
server # [    0.000000] 	Trampoline variant of Tasks RCU enabled.
client # [    0.000000] rcu: 	RCU event tracing is enabled.
server # [    0.000000] 	Rude variant of Tasks RCU enabled.
client # [    0.000000] rcu: 	RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.
server # [    0.000000] 	Tracing variant of Tasks RCU enabled.
client # [    0.000000] 	Trampoline variant of Tasks RCU enabled.
server # [    0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.
client # [    0.000000] 	Rude variant of Tasks RCU enabled.
server # [    0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1
client # [    0.000000] 	Tracing variant of Tasks RCU enabled.
client # [    0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.
server # [    0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
client # [    0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1
server # [    0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
client # [    0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
server # [    0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
server # [    0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0
client # [    0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
server # [    0.000000] GICv3: 256 SPIs implemented
server # [    0.000000] GICv3: 0 Extended SPIs implemented
client # [    0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.
server # [    0.000000] Root IRQ handler: gic_handle_irq
client # [    0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0
server # [    0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI
client # [    0.000000] GICv3: 256 SPIs implemented
server # [    0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0
client # [    0.000000] GICv3: 0 Extended SPIs implemented
client # [    0.000000] Root IRQ handler: gic_handle_irq
server # [    0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000
client # [    0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI
server # [    0.000000] ITS [mem 0x08080000-0x0809ffff]
client # [    0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0
server # [    0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44ce0000 (indirect, esz 8, psz 64K, shr 1)
client # [    0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000
client # [    0.000000] ITS [mem 0x08080000-0x0809ffff]
server # [    0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44cf0000 (flat, esz 8, psz 64K, shr 1)
client # [    0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)
server # [    0.000000] GICv3: using LPI property table @0x0000000044d10000
server # [    0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000
client # [    0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)
server # [    0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.
client # [    0.000000] GICv3: using LPI property table @0x0000000044d10000
client # [    0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000
server # [    0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns
client # [    0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.
server # [    0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).
client # [    0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns
server # [    0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
client # [    0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).
server # [    0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns
server # [    0.000030] arm-pv: using stolen time PV
client # [    0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
server # [    0.000369] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)
client # [    0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns
server # [    0.000519] Console: colour dummy device 80x25
client # [    0.000028] arm-pv: using stolen time PV
server # [    0.000527] printk: legacy console [tty0] enabled
client # [    0.000409] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)
server # [    0.000715] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)
client # [    0.000575] Console: colour dummy device 80x25
server # [    0.000721] pid_max: default: 32768 minimum: 301
client # [    0.000584] printk: legacy console [tty0] enabled
server # [    0.000823] LSM: initializing lsm=capability,landlock,yama,bpf,ima
server # [    0.000946] landlock: Up and running.
client # [    0.000771] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)
server # [    0.000949] Yama: becoming mindful.
client # [    0.000779] pid_max: default: 32768 minimum: 301
server # [    0.001367] LSM support for eBPF active
client # [    0.000847] LSM: initializing lsm=capability,landlock,yama,bpf,ima
server # [    0.001490] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
client # [    0.000988] landlock: Up and running.
client # [    0.000991] Yama: becoming mindful.
server # [    0.001509] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
client # [    0.001436] LSM support for eBPF active
server # [    0.002554] cacheinfo: Unable to detect cache hierarchy for CPU 0
client # [    0.001553] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
server # [    0.003259] rcu: Hierarchical SRCU implementation.
server # [    0.003263] rcu: 	Max phase no-delay instances is 1000.
client # [    0.001587] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)
server # [    0.004436] fsl-mc MSI: its@8080000 domain created
client # [    0.002709] cacheinfo: Unable to detect cache hierarchy for CPU 0
server # [    0.004523] EFI services will not be available.
client # [    0.003456] rcu: Hierarchical SRCU implementation.
server # [    0.004599] smp: Bringing up secondary CPUs ...
client # [    0.003460] rcu: 	Max phase no-delay instances is 1000.
server # [    0.004607] smp: Brought up 1 node, 1 CPU
client # [    0.004627] fsl-mc MSI: its@8080000 domain created
server # [    0.004610] SMP: Total of 1 processors activated.
client # [    0.004717] EFI services will not be available.
server # [    0.004613] CPU: All CPU(s) started at EL1
client # [    0.004793] smp: Bringing up secondary CPUs ...
server # [    0.004626] CPU features: detected: Branch Target Identification
client # [    0.004801] smp: Brought up 1 node, 1 CPU
server # [    0.004631] CPU features: detected: ARMv8.4 Translation Table Level
client # [    0.004804] SMP: Total of 1 processors activated.
client # [    0.004807] CPU: All CPU(s) started at EL1
server # [    0.004634] CPU features: detected: Instruction cache invalidation not required for I/D coherence
client # [    0.004819] CPU features: detected: Branch Target Identification
client # [    0.004823] CPU features: detected: ARMv8.4 Translation Table Level
server # [    0.004638] CPU features: detected: Data cache clean to the PoU not required for I/D coherence
server # [    0.004642] CPU features: detected: Common not Private translations
client # [    0.004826] CPU features: detected: Instruction cache invalidation not required for I/D coherence
server # [    0.004645] CPU features: detected: CRC32 instructions
client # [    0.004830] CPU features: detected: Data cache clean to the PoU not required for I/D coherence
server # [    0.004648] CPU features: detected: Data cache clean to Point of Deep Persistence
client # [    0.004834] CPU features: detected: Common not Private translations
server # [    0.004651] CPU features: detected: Data cache clean to Point of Persistence
client # [    0.004837] CPU features: detected: CRC32 instructions
server # [    0.004655] CPU features: detected: Data independent timing control (DIT)
client # [    0.004840] CPU features: detected: Data cache clean to Point of Deep Persistence
server # [    0.004658] CPU features: detected: E0PD
server # [    0.004660] CPU features: detected: Enhanced Counter Virtualization
client # [    0.004843] CPU features: detected: Data cache clean to Point of Persistence
server # [    0.004663] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)
client # [    0.004847] CPU features: detected: Data independent timing control (DIT)
client # [    0.004850] CPU features: detected: E0PD
server # [    0.004667] CPU features: detected: Enhanced Virtualization Traps
client # [    0.004852] CPU features: detected: Enhanced Counter Virtualization
server # [    0.004669] CPU features: detected: Fine Grained Traps
client # [    0.004855] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)
server # [    0.004673] CPU features: detected: Generic authentication (architected QARMA5 algorithm)
client # [    0.004859] CPU features: detected: Enhanced Virtualization Traps
server # [    0.004677] CPU features: detected: RCpc load-acquire (LDAPR)
client # [    0.004862] CPU features: detected: Fine Grained Traps
server # [    0.004680] CPU features: detected: LSE atomic instructions
server # [    0.004683] CPU features: detected: Privileged Access Never
client # [    0.004866] CPU features: detected: Generic authentication (architected QARMA5 algorithm)
server # [    0.004686] CPU features: detected: PMUv3
client # [    0.004870] CPU features: detected: RCpc load-acquire (LDAPR)
server # [    0.004688] CPU features: detected: RAS Extension Support
client # [    0.004873] CPU features: detected: LSE atomic instructions
server # [    0.004691] CPU features: detected: RASv1p1 Extension Support
client # [    0.004876] CPU features: detected: Privileged Access Never
server # [    0.004694] CPU features: detected: Random Number Generator
client # [    0.004879] CPU features: detected: PMUv3
server # [    0.004697] CPU features: detected: Speculation barrier (SB)
server # [    0.004699] CPU features: detected: Stage-2 Force Write-Back
client # [    0.004882] CPU features: detected: RAS Extension Support
server # [    0.004702] CPU features: detected: TLB range maintenance instructions
client # [    0.004885] CPU features: detected: RASv1p1 Extension Support
client # [    0.004887] CPU features: detected: Random Number Generator
server # [    0.004707] CPU features: detected: Speculative Store Bypassing Safe (SSBS)
client # [    0.004890] CPU features: detected: Speculation barrier (SB)
server # [    0.004744] alternatives: applying system-wide alternatives
client # [    0.004892] CPU features: detected: Stage-2 Force Write-Back
server # [    0.007627] CPU features: detected: BBM Level 2 without TLB conflict abort
client # [    0.004895] CPU features: detected: TLB range maintenance instructions
client # [    0.004900] CPU features: detected: Speculative Store Bypassing Safe (SSBS)
server # [    0.007801] Memory: 893028K/1048576K available (24448K kernel code, 7090K rwdata, 26344K rodata, 4736K init, 1107K bss, 114268K reserved, 32768K cma-reserved)
client # [    0.004937] alternatives: applying system-wide alternatives
server # [    0.008159] devtmpfs: initialized
client # [    0.007812] CPU features: detected: BBM Level 2 without TLB conflict abort
server # [    0.009833] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)
client # [    0.007955] Memory: 894308K/1048576K available (24448K kernel code, 7090K rwdata, 26344K rodata, 4736K init, 1107K bss, 112964K reserved, 32768K cma-reserved)
server # [    0.009855] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).
client # [    0.008287] devtmpfs: initialized
server # [    0.010035] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL
client # [    0.009994] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)
server # [    0.010040] 0 pages in range for non-PLT usage
server # [    0.010041] 508288 pages in range for PLT usage
client # [    0.010016] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).
server # [    0.010159] pinctrl core: initialized pinctrl subsystem
client # [    0.010204] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL
server # [    0.010877] DMI not present or invalid.
client # [    0.010209] 0 pages in range for non-PLT usage
server # [    0.013858] NET: Registered PF_NETLINK/PF_ROUTE protocol family
client # [    0.010210] 508288 pages in range for PLT usage
server # [    0.016074] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations
client # [    0.010318] pinctrl core: initialized pinctrl subsystem
client # [    0.011063] DMI not present or invalid.
server # [    0.016230] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
client # [    0.014399] NET: Registered PF_NETLINK/PF_ROUTE protocol family
server # [    0.016386] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
client # [    0.016577] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations
server # [    0.016408] audit: initializing netlink subsys (disabled)
client # [    0.016708] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
server # [    0.016964] thermal_sys: Registered thermal governor 'fair_share'
server # [    0.016966] thermal_sys: Registered thermal governor 'bang_bang'
client # [    0.016863] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
server # [    0.016970] thermal_sys: Registered thermal governor 'step_wise'
client # [    0.016883] audit: initializing netlink subsys (disabled)
server # [    0.016973] thermal_sys: Registered thermal governor 'user_space'
client # [    0.017386] thermal_sys: Registered thermal governor 'fair_share'
server # [    0.016977] thermal_sys: Registered thermal governor 'power_allocator'
client # [    0.017388] thermal_sys: Registered thermal governor 'bang_bang'
client # [    0.017392] thermal_sys: Registered thermal governor 'step_wise'
server # [    0.017006] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1
server # [    0.017016] cpuidle: using governor ladder
client # [    0.017394] thermal_sys: Registered thermal governor 'user_space'
server # [    0.017021] cpuidle: using governor menu
client # [    0.017399] thermal_sys: Registered thermal governor 'power_allocator'
server # [    0.017205] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.
client # [    0.017442] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1
server # [    0.017221] ASID allocator initialised with 65536 entries
client # [    0.017452] cpuidle: using governor ladder
server # [    0.018383] Serial: AMBA PL011 UART driver
client # [    0.017458] cpuidle: using governor menu
server # [    0.023475] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1
client # [    0.017661] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.
server # [    0.023595] printk: console [ttyAMA0] enabled
client # [    0.017675] ASID allocator initialised with 65536 entries
client # [    0.018844] Serial: AMBA PL011 UART driver
client # [    0.023991] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1
client # [    0.024136] printk: console [ttyAMA0] enabled
server # [    0.146292] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
server # [    0.146308] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page
server # [    0.146314] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages
client # [    0.147990] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
server # [    0.146319] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page
client # [    0.148004] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page
server # [    0.146323] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
server # [    0.146327] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page
client # [    0.148009] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages
client # [    0.148014] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page
server # [    0.146331] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages
server # [    0.146336] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page
client # [    0.148018] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
client # [    0.148022] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page
client # [    0.148026] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages
server # [    0.153711] fbcon: Taking over console
client # [    0.148030] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page
server # [    0.153726] ACPI: Interpreter disabled.
server # [    0.155597] iommu: Default domain type: Translated
server # [    0.155607] iommu: DMA domain TLB invalidation policy: strict mode
client # [    0.155670] fbcon: Taking over console
server # [    0.157240] SCSI subsystem initialized
client # [    0.155686] ACPI: Interpreter disabled.
client # [    0.157535] iommu: Default domain type: Translated
client # [    0.157545] iommu: DMA domain TLB invalidation policy: strict mode
server # [    0.162657] usbcore: registered new interface driver usbfs
server # [    0.162687] usbcore: registered new interface driver hub
server # [    0.162704] usbcore: registered new device driver usb
server # [    0.162979] pps_core: LinuxPPS API ver. 1 registered
client # [    0.164670] SCSI subsystem initialized
server # [    0.162985] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
client # [    0.165356] usbcore: registered new interface driver usbfs
server # [    0.162995] PTP clock support registered
server # [    0.163050] EDAC MC: Ver: 3.0.0
client # [    0.165385] usbcore: registered new interface driver hub
client # [    0.165408] usbcore: registered new device driver usb
server # [    0.167632] scmi_core: SCMI protocol bus registered
client # [    0.165682] pps_core: LinuxPPS API ver. 1 registered
server # [    0.168578] FPGA manager framework
client # [    0.165688] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
server # [    0.169857] vgaarb: loaded
client # [    0.165698] PTP clock support registered
client # [    0.165744] EDAC MC: Ver: 3.0.0
server # [    0.170475] clocksource: Switched to clocksource arch_sys_counter
client # [    0.170445] scmi_core: SCMI protocol bus registered
client # [    0.171407] FPGA manager framework
client # [    0.172343] vgaarb: loaded
client # [    0.172989] clocksource: Switched to clocksource arch_sys_counter
server # [    0.176657] VFS: Disk quotas dquot_6.6.0
client # [    0.176503] VFS: Disk quotas dquot_6.6.0
server # [    0.176701] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
client # [    0.176539] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
server # [    0.178340] netfs: FS-Cache loaded
server # [    0.178457] pnp: PnP ACPI: disabled
client # [    0.180219] netfs: FS-Cache loaded
client # [    0.180339] pnp: PnP ACPI: disabled
server # [    0.182293] NET: Registered PF_INET protocol family
server # [    0.182459] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)
client # [    0.184250] NET: Registered PF_INET protocol family
client # [    0.184402] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)
server # [    0.210927] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)
server # [    0.210964] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
server # [    0.210989] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)
server # [    0.211029] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)
client # [    0.213134] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)
server # [    0.211105] TCP: Hash tables configured (established 8192 bind 8192)
client # [    0.213173] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
server # [    0.211174] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)
client # [    0.213196] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)
server # [    0.211230] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)
client # [    0.213236] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)
server # [    0.211286] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)
server # [    0.211365] NET: Registered PF_UNIX/PF_LOCAL protocol family
client # [    0.213311] TCP: Hash tables configured (established 8192 bind 8192)
server # [    0.211386] NET: Registered PF_XDP protocol family
client # [    0.213387] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)
server # [    0.211405] PCI: CLS 0 bytes, default 64
client # [    0.213443] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)
server # [    0.211630] Trying to unpack rootfs image as initramfs...
client # [    0.213469] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)
client # [    0.213544] NET: Registered PF_UNIX/PF_LOCAL protocol family
client # [    0.213622] NET: Registered PF_XDP protocol family
client # [    0.213642] PCI: CLS 0 bytes, default 64
server # [    0.227936] kvm [1]: HYP mode not available
client # [    0.213873] Trying to unpack rootfs image as initramfs...
client # [    0.230684] kvm [1]: HYP mode not available
server # [    0.321087] Initialise system trusted keyrings
server # [    0.321844] workingset: timestamp_bits=42 max_order=18 bucket_order=0
server # [    0.323152] squashfs: version 4.0 (2009/01/31) Phillip Lougher
client # [    0.323296] Initialise system trusted keyrings
client # [    0.324025] workingset: timestamp_bits=42 max_order=18 bucket_order=0
client # [    0.325294] squashfs: version 4.0 (2009/01/31) Phillip Lougher
server # [    0.323895] 9p: Installing v9fs 9p2000 file system support
client # [    0.326074] 9p: Installing v9fs 9p2000 file system support
server # [    0.347839] Key type asymmetric registered
server # [    0.347864] Asymmetric key parser 'x509' registered
server # [    0.347929] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)
server # [    0.350002] io scheduler mq-deadline registered
server # [    0.350012] io scheduler kyber registered
client # [    0.350029] Key type asymmetric registered
client # [    0.350052] Asymmetric key parser 'x509' registered
client # [    0.350117] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)
client # [    0.352253] io scheduler mq-deadline registered
client # [    0.352264] io scheduler kyber registered
server # [    0.363124] pl061_gpio 9030000.pl061: PL061 GPIO chip registered
server # [    0.363679] ledtrig-cpu: registered to indicate activity on CPUs
server # [    0.364044] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:
server # [    0.364061] pci-host-generic 4010000000.pcie:       IO 0x003eff0000..0x003effffff -> 0x0000000000
client # [    0.365257] pl061_gpio 9030000.pl061: PL061 GPIO chip registered
server # [    0.364078] pci-host-generic 4010000000.pcie:      MEM 0x0010000000..0x003efeffff -> 0x0010000000
client # [    0.365913] ledtrig-cpu: registered to indicate activity on CPUs
client # [    0.366283] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:
server # [    0.364087] pci-host-generic 4010000000.pcie:      MEM 0x8000000000..0xffffffffff -> 0x8000000000
client # [    0.366300] pci-host-generic 4010000000.pcie:       IO 0x003eff0000..0x003effffff -> 0x0000000000
server # [    0.364109] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits
client # [    0.366316] pci-host-generic 4010000000.pcie:      MEM 0x0010000000..0x003efeffff -> 0x0010000000
server # [    0.364131] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]
server # [    0.364201] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00
client # [    0.366325] pci-host-generic 4010000000.pcie:      MEM 0x8000000000..0xffffffffff -> 0x8000000000
server # [    0.364210] pci_bus 0000:00: root bus resource [bus 00-ff]
client # [    0.366346] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits
server # [    0.364217] pci_bus 0000:00: root bus resource [io  0x0000-0xffff]
server # [    0.364223] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]
client # [    0.366375] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]
server # [    0.364229] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]
client # [    0.366450] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00
client # [    0.366459] pci_bus 0000:00: root bus resource [bus 00-ff]
server # [    0.364287] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint
client # [    0.366466] pci_bus 0000:00: root bus resource [io  0x0000-0xffff]
server # [    0.364716] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
client # [    0.366471] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]
server # [    0.364897] pci 0000:00:01.0: BAR 0 [io  0x0000-0x001f]
client # [    0.366476] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]
server # [    0.364913] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.364943] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.366569] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint
server # [    0.364958] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]
client # [    0.367015] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
server # [    0.365400] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
client # [    0.367201] pci 0000:00:01.0: BAR 0 [io  0x0000-0x001f]
server # [    0.365579] pci 0000:00:02.0: BAR 0 [io  0x0000-0x001f]
client # [    0.367218] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.365596] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.367249] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.365625] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.367265] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]
server # [    0.366067] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
client # [    0.367720] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
server # [    0.366266] pci 0000:00:03.0: BAR 0 [io  0x0000-0x003f]
client # [    0.367903] pci 0000:00:02.0: BAR 0 [io  0x0000-0x001f]
server # [    0.366282] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.367919] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.366311] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.367949] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.366777] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
client # [    0.368421] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
server # [    0.366954] pci 0000:00:04.0: BAR 0 [io  0x0000-0x001f]
client # [    0.368603] pci 0000:00:03.0: BAR 0 [io  0x0000-0x003f]
server # [    0.366970] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.368619] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.366999] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.368649] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.367464] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
client # [    0.369126] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
server # [    0.367655] pci 0000:00:05.0: BAR 0 [io  0x0000-0x001f]
client # [    0.369308] pci 0000:00:04.0: BAR 0 [io  0x0000-0x001f]
server # [    0.367670] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.369324] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.367700] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.369354] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.368156] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint
client # [    0.369834] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint
server # [    0.368337] pci 0000:00:06.0: BAR 0 [io  0x0000-0x007f]
client # [    0.370021] pci 0000:00:05.0: BAR 0 [io  0x0000-0x001f]
server # [    0.368353] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.370045] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.368383] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.370073] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.368873] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
client # [    0.370528] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint
server # [    0.369054] pci 0000:00:07.0: BAR 0 [io  0x0000-0x001f]
client # [    0.370712] pci 0000:00:06.0: BAR 0 [io  0x0000-0x007f]
server # [    0.369070] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.370728] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.369100] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.370758] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.369115] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref]
client # [    0.371213] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint
server # [    0.369564] pci 0000:00:08.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint
client # [    0.371397] pci 0000:00:07.0: BAR 0 [io  0x0000-0x001f]
server # [    0.369749] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.371413] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.369779] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.371443] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.371459] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref]
server # [    0.370239] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint
server # [    0.370423] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.371916] pci 0000:00:08.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint
server # [    0.370452] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.372104] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.372134] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.372584] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint
client # [    0.372777] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.372807] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.418917] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint
server # [    0.419111] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff]
server # [    0.419365] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint
server # [    0.419620] pci 0000:00:0b.0: BAR 0 [io  0x0000-0x003f]
client # [    0.421282] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint
server # [    0.419636] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.421487] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff]
server # [    0.419666] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
client # [    0.421783] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint
server # [    0.420109] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
client # [    0.422086] pci 0000:00:0b.0: BAR 0 [io  0x0000-0x003f]
server # [    0.420284] pci 0000:00:0c.0: BAR 0 [io  0x0000-0x001f]
client # [    0.422104] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.420300] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]
client # [    0.422134] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.420329] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.420898] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned
client # [    0.422593] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint
client # [    0.422777] pci 0000:00:0c.0: BAR 0 [io  0x0000-0x001f]
server # [    0.420910] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned
client # [    0.422793] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]
server # [    0.420916] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned
client # [    0.422823] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
server # [    0.420960] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned
client # [    0.423398] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned
server # [    0.421006] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned
client # [    0.423411] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned
server # [    0.421051] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned
client # [    0.423416] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned
server # [    0.421097] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned
client # [    0.423463] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned
server # [    0.421143] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned
client # [    0.423511] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned
server # [    0.421189] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned
client # [    0.423558] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned
server # [    0.421235] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned
client # [    0.423604] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned
server # [    0.421281] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned
client # [    0.423654] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned
server # [    0.421327] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned
client # [    0.423701] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned
server # [    0.421387] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned
client # [    0.423749] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned
server # [    0.421431] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned
client # [    0.423796] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned
server # [    0.421453] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned
client # [    0.423843] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned
server # [    0.421474] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned
server # [    0.421498] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned
client # [    0.423912] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned
server # [    0.421520] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned
client # [    0.423959] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned
server # [    0.421545] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned
client # [    0.423980] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned
server # [    0.421572] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned
client # [    0.424001] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned
server # [    0.421597] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned
client # [    0.424023] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned
client # [    0.424045] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned
server # [    0.421619] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned
client # [    0.424069] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned
server # [    0.421641] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned
server # [    0.421664] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned
client # [    0.424091] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned
server # [    0.421686] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned
client # [    0.424113] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned
server # [    0.421710] pci 0000:00:06.0: BAR 0 [io  0x1000-0x107f]: assigned
client # [    0.424135] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned
server # [    0.421731] pci 0000:00:03.0: BAR 0 [io  0x1080-0x10bf]: assigned
client # [    0.424156] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned
server # [    0.421752] pci 0000:00:0b.0: BAR 0 [io  0x10c0-0x10ff]: assigned
client # [    0.424178] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned
server # [    0.421773] pci 0000:00:01.0: BAR 0 [io  0x1100-0x111f]: assigned
client # [    0.424200] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned
server # [    0.421794] pci 0000:00:02.0: BAR 0 [io  0x1120-0x113f]: assigned
client # [    0.424222] pci 0000:00:06.0: BAR 0 [io  0x1000-0x107f]: assigned
server # [    0.421815] pci 0000:00:04.0: BAR 0 [io  0x1140-0x115f]: assigned
client # [    0.424243] pci 0000:00:03.0: BAR 0 [io  0x1080-0x10bf]: assigned
server # [    0.421837] pci 0000:00:05.0: BAR 0 [io  0x1160-0x117f]: assigned
client # [    0.424264] pci 0000:00:0b.0: BAR 0 [io  0x10c0-0x10ff]: assigned
server # [    0.421860] pci 0000:00:07.0: BAR 0 [io  0x1180-0x119f]: assigned
client # [    0.424285] pci 0000:00:01.0: BAR 0 [io  0x1100-0x111f]: assigned
server # [    0.421882] pci 0000:00:0c.0: BAR 0 [io  0x11a0-0x11bf]: assigned
client # [    0.424306] pci 0000:00:02.0: BAR 0 [io  0x1120-0x113f]: assigned
server # [    0.421908] pci_bus 0000:00: resource 4 [io  0x0000-0xffff]
client # [    0.424328] pci 0000:00:04.0: BAR 0 [io  0x1140-0x115f]: assigned
server # [    0.421918] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]
client # [    0.424349] pci 0000:00:05.0: BAR 0 [io  0x1160-0x117f]: assigned
server # [    0.421923] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]
client # [    0.424370] pci 0000:00:07.0: BAR 0 [io  0x1180-0x119f]: assigned
client # [    0.424392] pci 0000:00:0c.0: BAR 0 [io  0x11a0-0x11bf]: assigned
client # [    0.424418] pci_bus 0000:00: resource 4 [io  0x0000-0xffff]
client # [    0.424427] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]
client # [    0.424432] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]
server # [    0.467152] pci 0000:00:0a.0: enabling device (0000 -> 0002)
client # [    0.469646] pci 0000:00:0a.0: enabling device (0000 -> 0002)
server # [    0.487604] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)
server # [    0.489781] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)
client # [    0.494974] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)
client # [    0.497974] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)
server # [    0.501256] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)
client # [    0.500378] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)
server # [    0.507317] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)
server # [    0.509530] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)
client # [    0.510447] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)
client # [    0.512504] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)
server # [    0.519736] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003)
server # [    0.521848] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003)
client # [    0.523137] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003)
server # [    0.533778] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)
client # [    0.526231] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003)
client # [    0.528178] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)
client # [    0.530324] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)
client # [    0.532204] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)
server # [    0.536686] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)
server # [    0.538475] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)
client # [    0.546468] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)
server # [    0.548790] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)
server # [    0.557910] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
client # [    0.562221] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
client # [    0.564737] msm_serial: driver initialized
client # [    0.564868] SuperH (H)SCI(F) driver initialized
server # [    0.563744] msm_serial: driver initialized
client # [    0.564921] STM32 USART driver initialized
server # [    0.563888] SuperH (H)SCI(F) driver initialized
server # [    0.563941] STM32 USART driver initialized
server # [    0.595048] loop: module loaded
server # [    0.595205] virtio_blk virtio5: 1/0/0 default/read/poll queues
client # [    0.595761] loop: module loaded
server # [    0.595909] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)
client # [    0.595938] virtio_blk virtio5: 1/0/0 default/read/poll queues
client # [    0.596713] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)
client # [    0.601722] megasas: 07.734.00.00-rc1
client # [    0.602460] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]
client # [    0.604590] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000
client # [    0.604608] Intel/Sharp Extended Query Table at 0x0031
server # [    0.607030] megasas: 07.734.00.00-rc1
server # [    0.607742] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]
server # [    0.609775] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000
server # [    0.609801] Intel/Sharp Extended Query Table at 0x0031
server # [    0.611511] Using buffer write method
client # [    0.613993] Using buffer write method
server # [    0.611578] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]
client # [    0.614063] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]
client # [    0.616552] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000
client # [    0.616576] Intel/Sharp Extended Query Table at 0x0031
server # [    0.613189] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000
server # [    0.613212] Intel/Sharp Extended Query Table at 0x0031
client # [    0.630105] Using buffer write method
client # [    0.630138] Concatenating MTD devices:
client # [    0.630142] (0): "0.flash"
client # [    0.630146] (1): "0.flash"
server # [    0.632104] Using buffer write method
client # [    0.630150] into device "0.flash"
server # [    0.632140] Concatenating MTD devices:
server # [    0.632144] (0): "0.flash"
server # [    0.632148] (1): "0.flash"
server # [    0.632152] into device "0.flash"
client # [    0.855219] Freeing initrd memory: 26104K
client # [    0.861188] tun: Universal TUN/TAP device driver, 1.6
client # [    0.864868] thunder_xcv, ver 1.0
client # [    0.864910] thunder_bgx, ver 1.0
client # [    0.864932] nicpf, ver 1.0
client # [    0.866684] e1000: Intel(R) PRO/1000 Network Driver
client # [    0.866696] e1000: Copyright (c) 1999-2006 Intel Corporation.
client # [    0.866725] e1000e: Intel(R) PRO/1000 Network Driver
client # [    0.866733] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.
client # [    0.866764] igb: Intel(R) Gigabit Ethernet Network Driver
client # [    0.866769] igb: Copyright (c) 2007-2014 Intel Corporation.
client # [    0.866791] igbvf: Intel(R) Gigabit Virtual Function Network Driver
client # [    0.866797] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.
client # [    0.866930] sky2: driver version 1.30
client # [    0.868445] usbcore: registered new interface driver usb-storage
client # [    0.868564] usbcore: registered new interface driver usbserial_generic
server # [    0.878162] Freeing initrd memory: 27408K
client # [    0.868577] usbserial: USB Serial support registered for generic
client # [    0.869807] ehci-pci 0000:00:0a.0: EHCI Host Controller
client # [    0.869834] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1
client # [    0.870041] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000
client # [    0.881053] hv_vmbus: registering driver hyperv_keyboard
client # [    0.882462] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00
client # [    0.883494] hub 1-0:1.0: USB hub found
server # [    0.884162] tun: Universal TUN/TAP device driver, 1.6
client # [    0.884007] hub 1-0:1.0: 6 ports detected
client # [    0.885083] rtc-pl031 9010000.pl031: registered as rtc0
client # [    0.885107] rtc-pl031 9010000.pl031: setting system clock to 2026-09-06T02:32:49 UTC (1788661969)
client # [    0.885419] i2c_dev: i2c /dev entries driver
server # [    0.887989] thunder_xcv, ver 1.0
server # [    0.888030] thunder_bgx, ver 1.0
server # [    0.888053] nicpf, ver 1.0
server # [    0.888586] e1000: Intel(R) PRO/1000 Network Driver
server # [    0.888594] e1000: Copyright (c) 1999-2006 Intel Corporation.
client # [    0.890312] sdhci: Secure Digital Host Controller Interface driver
server # [    0.888623] e1000e: Intel(R) PRO/1000 Network Driver
client # [    0.890329] sdhci: Copyright(c) Pierre Ossman
server # [    0.888633] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.
client # [    0.890589] Synopsys Designware Multimedia Card Interface Driver
server # [    0.888661] igb: Intel(R) Gigabit Ethernet Network Driver
client # [    0.890954] sdhci-pltfm: SDHCI platform and OF driver helper
server # [    0.888667] igb: Copyright (c) 2007-2014 Intel Corporation.
client # [    0.892568] hid: raw HID events driver (C) Jiri Kosina
server # [    0.888689] igbvf: Intel(R) Gigabit Virtual Function Network Driver
client # [    0.892843] usbcore: registered new interface driver usbhid
server # [    0.888695] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.
client # [    0.892850] usbhid: USB HID core driver
server # [    0.888825] sky2: driver version 1.30
server # [    0.890387] usbcore: registered new interface driver usb-storage
server # [    0.890432] usbcore: registered new interface driver usbserial_generic
server # [    0.890445] usbserial: USB Serial support registered for generic
server # [    0.891176] ehci-pci 0000:00:0a.0: EHCI Host Controller
client # [    0.898476] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available
server # [    0.891203] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1
client # [    0.899909] drop_monitor: Initializing network drop monitor service
server # [    0.891430] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000
client # [    0.900040] NET: Registered PF_INET6 protocol family
server # [    0.902910] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00
client # [    0.903151] Segment Routing with IPv6
server # [    0.903226] hub 1-0:1.0: USB hub found
client # [    0.903170] In-situ OAM (IOAM) with IPv6
server # [    0.903246] hub 1-0:1.0: 6 ports detected
client # [    0.903197] NET: Registered PF_PACKET protocol family
client # [    0.904867] 9pnet: Installing 9P2000 support
server # [    0.905812] hv_vmbus: registering driver hyperv_keyboard
server # [    0.907377] rtc-pl031 9010000.pl031: registered as rtc0
server # [    0.907400] rtc-pl031 9010000.pl031: setting system clock to 2026-09-06T02:32:49 UTC (1788661969)
client # [    0.907736] Key type dns_resolver registered
server # [    0.907696] i2c_dev: i2c /dev entries driver
server # [    0.912452] sdhci: Secure Digital Host Controller Interface driver
server # [    0.912466] sdhci: Copyright(c) Pierre Ossman
server # [    0.912724] Synopsys Designware Multimedia Card Interface Driver
server # [    0.913085] sdhci-pltfm: SDHCI platform and OF driver helper
client # [    0.914468] registered taskstats version 1
client # [    0.914622] Loading compiled-in X.509 certificates
server # [    0.917410] hid: raw HID events driver (C) Jiri Kosina
server # [    0.917657] usbcore: registered new interface driver usbhid
server # [    0.917664] usbhid: USB HID core driver
server # [    0.920471] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available
server # [    0.921961] drop_monitor: Initializing network drop monitor service
server # [    0.922134] NET: Registered PF_INET6 protocol family
client # [    0.923265] Demotion targets for Node 0: null
client # [    0.923363] Key type .fscrypt registered
server # [    0.925156] Segment Routing with IPv6
client # [    0.923370] Key type fscrypt-provisioning registered
server # [    0.925176] In-situ OAM (IOAM) with IPv6
client # [    0.923464] ima: No TPM chip found, activating TPM-bypass!
server # [    0.925205] NET: Registered PF_PACKET protocol family
client # [    0.923483] ima: Allocated hash algorithm: sha1
client # [    0.923503] ima: No architecture policies found
client # [    0.927610] input: gpio-keys as /devices/platform/gpio-keys/input/input0
server # [    0.927027] 9pnet: Installing 9P2000 support
server # [    0.929109] Key type dns_resolver registered
server # [    0.935911] registered taskstats version 1
server # [    0.936053] Loading compiled-in X.509 certificates
server # [    0.944396] Demotion targets for Node 0: null
server # [    0.944499] Key type .fscrypt registered
server # [    0.944506] Key type fscrypt-provisioning registered
server # [    0.944607] ima: No TPM chip found, activating TPM-bypass!
server # [    0.944627] ima: Allocated hash algorithm: sha1
client # [    0.945066] clk: Disabling unused clocks
server # [    0.944645] ima: No architecture policies found
client # [    0.945087] PM: genpd: Disabling unused power domains
server # [    0.948865] input: gpio-keys as /devices/platform/gpio-keys/input/input0
client # [    0.949342] Freeing unused kernel memory: 4736K
client # [    0.949521] Run /init as init process
server # [    0.965788] clk: Disabling unused clocks
server # [    0.965816] PM: genpd: Disabling unused power domains
client # [    0.967172] systemd[1]: Successfully made /usr/ read-only.
server # [    0.970011] Freeing unused kernel memory: 4736K
server # [    0.970208] Run /init as init process
server # [    0.984653] systemd[1]: Successfully made /usr/ read-only.
client # [    1.129058] usb 1-1: new high-speed USB device number 2 using ehci-pci
server # [    1.150554] usb 1-1: new high-speed USB device number 2 using ehci-pci
client # [    1.281365] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1
server # [    1.303124] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1
client # [    1.302211] systemd[1]: systemd 262-9457f81 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP -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)
client # [    1.314499] systemd[1]: Detected virtualization qemu.
client # [    1.316495] systemd[1]: Detected architecture arm64.
client # [    1.318499] systemd[1]: Running in initrd.
client # [    1.321195] systemd[1]: Initializing machine ID from random generator.
client # [    1.324046] systemd[1]: Hostname set to <client>.
server # [    1.319174] systemd[1]: systemd 262-9457f81 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP -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)
server # [    1.331060] systemd[1]: Detected virtualization qemu.
server # [    1.333131] systemd[1]: Detected architecture arm64.
server # [    1.335069] systemd[1]: Running in initrd.
server # [    1.337560] systemd[1]: Initializing machine ID from random generator.
server # [    1.340595] systemd[1]: Hostname set to <server>.
client # [    1.369336] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0
server # [    1.390724] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0
client # [    1.470653] systemd[1]: bpf-restrict-fs: LSM BPF program attached
server # [    1.482086] systemd[1]: bpf-restrict-fs: LSM BPF program attached
client # [    1.497219] usb 1-2: new high-speed USB device number 3 using ehci-pci
server # [    1.514552] usb 1-2: new high-speed USB device number 3 using ehci-pci
client # [    1.524459] systemd[1]: Queued start job for default target Initrd Default Target.
client # [    1.535195] systemd[1]: Created slice Slice /system/modprobe.
client # [    1.536342] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
client # [    1.537588] systemd[1]: Expecting device /dev/disk/by-label/nixos...
client # [    1.538530] systemd[1]: Reached target Path Units.
client # [    1.539247] systemd[1]: Reached target Slice Units.
client # [    1.539986] systemd[1]: Reached target Swaps.
client # [    1.540640] systemd[1]: Reached target Timer Units.
server # [    1.541639] systemd[1]: Queued start job for default target Initrd Default Target.
client # [    1.541671] systemd[1]: Listening on D-Bus System Message Bus Socket.
client # [    1.542822] systemd[1]: Listening on Journal Socket (/dev/log).
client # [    1.543833] systemd[1]: Listening on Journal Sockets.
client # [    1.544678] systemd[1]: Listening on udev Kernel Socket.
client # [    1.545536] systemd[1]: Reached target Socket Units.
server # [    1.548551] systemd[1]: Created slice Slice /system/modprobe.
client # [    1.547793] systemd[1]: Starting Create List of Static Device Nodes...
server # [    1.549599] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
server # [    1.550775] systemd[1]: Expecting device /dev/disk/by-label/nixos...
server # [    1.551664] systemd[1]: Expecting device /dev/hvc0...
server # [    1.552387] systemd[1]: Expecting device /dev/ttyAMA0...
server # [    1.553283] systemd[1]: Reached target Path Units.
server # [    1.553307] systemd[1]: Reached target Slice Units.
client # [    1.554478] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
server # [    1.553327] systemd[1]: Reached target Swaps.
server # [    1.553347] systemd[1]: Reached target Timer Units.
client # [    1.555519] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs
server # [    1.553504] systemd[1]: Listening on D-Bus System Message Bus Socket.
server # [    1.553659] systemd[1]: Listening on Journal Socket (/dev/log).
server # [    1.553794] systemd[1]: Listening on Journal Sockets.
server # [    1.553978] systemd[1]: Listening on Network Management Metrics Varlink Socket.
server # [    1.554235] systemd[1]: Listening on Network Management Varlink Socket.
server # [    1.554379] systemd[1]: Listening on Network Management Netlink Socket.
server # [    1.562295] systemd[1]: Listening on Resolve Monitor Varlink Socket.
server # [    1.563377] systemd[1]: Listening on Resolve Service Varlink Socket.
server # [    1.563458] systemd[1]: Listening on udev Kernel Socket.
client # [    1.565133] systemd[1]: Mounting Kernel Configuration File System...
server # [    1.563477] systemd[1]: Reached target Socket Units.
server # [    1.567186] systemd[1]: Starting Copy secrets into place...
server # [    1.573442] systemd[1]: Starting Create List of Static Device Nodes...
server # [    1.578898] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
server # [    1.579808] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs
client # [    1.579698] systemd[1]: Starting Journal Service...
server # [    1.591611] systemd[1]: Mounting Kernel Configuration File System...
client # [    1.593476] systemd[1]: Starting Load Kernel Modules...
client # [    1.594334] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
client # [    1.601277] systemd[1]: Starting Coldplug All udev Devices...
server # [    1.619673] systemd[1]: Starting Journal Service...
client # [    1.621110] systemd[1]: Finished Create List of Static Device Nodes.
client # [    1.622290] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
client # [    1.622578] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
client # [    1.622832] systemd[1]: Mounted Kernel Configuration File System.
server # [    1.631535] systemd[1]: Starting Load Kernel Modules...
client # [    1.641566] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
server # [    1.647662] systemd[1]: Starting Generate Network Units from Kernel Command Line...
server # [    1.647783] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
client # [    1.651820] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2
client # [    1.651985] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0
client # [    1.672173] systemd-journald[73]: Collecting audit messages is disabled.
client # [    1.676205] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
server # [    1.682825] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2
server # [    1.683030] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0
server # [    1.689556] systemd[1]: Starting Coldplug All udev Devices...
client # [    1.689047] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev
server # [    1.695819] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
client # [    1.693582] [drm] pci: virtio-gpu-pci detected at 0000:00:08.0
client # [    1.693809] [drm] features: -virgl +edid -resource_blob -host_visible
client # [    1.693819] [drm] features: -context_init
client # [    1.694513] [drm] number of scanouts: 1
client # [    1.694531] [drm] number of cap sets: 0
server # [    1.698601] systemd[1]: Finished Copy secrets into place.
server # [    1.699537] systemd[1]: Finished Create List of Static Device Nodes.
client # [    1.699579] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
server # [    1.700018] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
server # [    1.700311] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
server # [    1.700536] systemd[1]: Mounted Kernel Configuration File System.
server # [    1.706355] systemd-journald[74]: Collecting audit messages is disabled.
client # [    1.702252] systemd[1]: Starting Create Static Device Nodes in /dev...
client # [    1.713977] virtio-pci 0000:00:08.0: [drm] Registered 1 planes with drm panic
client # [    1.713994] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:08.0 on minor 0
server # [    1.714648] systemd[1]: Finished Generate Network Units from Kernel Command Line.
server # [    1.715135] systemd[1]: Reached target Preparation for Network.
server # [    1.715338] systemd[1]: Listening on Network Management Resolve Hook Socket.
server # [    1.716263] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev
server # [    1.722526] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
server # [    1.732913] [drm] pci: virtio-gpu-pci detected at 0000:00:08.0
server # [    1.733150] [drm] features: -virgl +edid -resource_blob -host_visible
server # [    1.733160] [drm] features: -context_init
server # [    1.733911] [drm] number of scanouts: 1
server # [    1.733930] [drm] number of cap sets: 0
server # [    1.744416] virtio-pci 0000:00:08.0: [drm] Registered 1 planes with drm panic
server # [    1.744432] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:08.0 on minor 0
client # [    1.749702] systemd[1]: Finished Create Static Device Nodes in /dev.
client # [    1.749913] systemd[1]: Reached target Preparation for Local File Systems.
client # [    1.749940] systemd[1]: Reached target Local File Systems.
client # [    1.753850] Console: switching to colour frame buffer device 160x50
client # [    1.760460] virtio-pci 0000:00:08.0: [drm] fb0: virtio_gpudrmfb frame buffer device
client # [    1.765331] systemd[1]: Starting Rule-based Manager for Device Events and Files...
server # [    1.770783] Console: switching to colour frame buffer device 160x50
client # [    1.793264] systemd[1]: Finished Load Kernel Modules.
server # [    1.795113] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
server # [    1.797647] systemd[1]: Starting Create Static Device Nodes in /dev...
client # [    1.796349] systemd[1]: Starting Apply Kernel Variables...
server # [    1.807176] virtio-pci 0000:00:08.0: [drm] fb0: virtio_gpudrmfb frame buffer device
server # [    1.822895] systemd[1]: Finished Load Kernel Modules.
server # [    1.826058] systemd[1]: Starting Apply Kernel Variables...
server # [    1.846638] systemd[1]: Finished Create Static Device Nodes in /dev.
server # [    1.846838] systemd[1]: Reached target Preparation for Local File Systems.
server # [    1.846873] systemd[1]: Reached target Local File Systems.
server # [    1.851889] systemd[1]: Starting Rule-based Manager for Device Events and Files...
client # [    1.853725] systemd[1]: Finished Apply Kernel Variables.
client # [    1.857482] systemd[1]: Started Journal Service.
client # [    1.847616] systemd-modules-load[74]: Inserted module 'dm_mod'
client # [    1.860236] systemd-modules-load[74]: Module 'virtio_balloon' is built in
client # [    1.861437] systemd-modules-load[74]: Module 'virtio_console' is built in
client # [    1.862497] systemd-modules-load[74]: Inserted module 'virtio_gpu'
client # [    1.872346] systemd-modules-load[74]: Module 'virtio_rng' is built in
server # [    1.887112] systemd[1]: Finished Apply Kernel Variables.
client # [    1.877143] systemd[1]: Starting Create System Files and Directories...
client # [    1.880130] systemd-udevd[80]: Using default interface naming scheme 'v261'.
server # [    1.894873] systemd[1]: Starting Network Name Resolution...
server # [    1.885383] systemd-modules-load[78]: Module 'af_packet' is built in
server # [    1.886649] systemd-modules-load[78]: Inserted module 'dm_mod'
server # [    1.906163] systemd[1]: Started Journal Service.
client # [    1.897822] systemd[1]: Finished Create System Files and Directories.
server # [    1.895199] systemd-modules-load[78]: Module 'virtio_balloon' is built in
server # [    1.900351] systemd-modules-load[78]: Module 'virtio_console' is built in
server # [    1.901442] systemd-modules-load[78]: Inserted module 'virtio_gpu'
server # [    1.902397] systemd-modules-load[78]: Module 'virtio_rng' is built in
client # [    1.915710] systemd[1]: Started Rule-based Manager for Device Events and Files.
server # [    1.938103] systemd-udevd[87]: Using default interface naming scheme 'v261'.
server # [    1.944171] systemd[1]: Starting Create System Files and Directories...
server # [    1.997357] systemd[1]: Finished Create System Files and Directories.
client # [    2.012099] systemd[1]: Starting Virtual Console Setup...
server # [    2.007842] systemd-resolved[88]: Positive Trust Anchors:
server # [    2.011180] systemd[1]: Started Rule-based Manager for Device Events and Files.
server # [    2.020120] systemd[1]: Starting Network Management...
server # [    2.028108] systemd-resolved[88]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
server # [    2.029529] systemd-resolved[88]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
server # [    2.033571] systemd-resolved[88]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test
client # [    2.072514] systemd-vconsole-setup[103]: Configuration of first virtual console was skipped, ignoring remaining ones.
server # [    2.068685] systemd-resolved[88]: Using system hostname 'server'.
server # [    2.069606] systemd[1]: Started Network Name Resolution.
server # [    2.070485] systemd[1]: Reached target Host and Network Name Lookups.
client # [    2.075925] systemd[1]: Finished Virtual Console Setup.
server # [    2.071467] systemd[1]: Starting D-Bus System Message Bus...
server # [    2.096725] dbus-daemon[108]: dbus[108]: Unknown username "systemd-timesync" in message bus configuration file
server # [    2.108096] dbus-daemon[108]: dbus[108]: Unknown username "systemd-oom" in message bus configuration file
server # [    2.113637] systemd[1]: Started D-Bus System Message Bus.
server # [    2.143820] systemd[1]: Starting Virtual Console Setup...
server # [    2.156385] systemd-networkd[101]: Failed to open nftables netlink socket. IPMasquerade= and NFTSet= settings will not be applied. Ignoring: Protocol not supported
server # [    2.173461] systemd-networkd[101]: lo: Link UP
server # [    2.175270] systemd-networkd[101]: lo: Gained carrier
server # [    2.180351] systemd[1]: Started Network Management.
server # [    2.184189] systemd[1]: Reached target Network.
server # [    2.189583] systemd[1]: Starting SSH Daemon...
server # [    2.228484] systemd-vconsole-setup[117]: Configuration of first virtual console was skipped, ignoring remaining ones.
server # [    2.232080] systemd[1]: Finished Virtual Console Setup.
server # [    2.239694] systemd[1]: Started SSH Daemon.
server # [    2.274990] sshd[125]: Server listening on 0.0.0.0 port 22.
server # [    2.277151] sshd[125]: Server listening on :: port 22.
client # [    2.668172] systemd[1]: Finished Coldplug All udev Devices.
client # [    2.670104] systemd[1]: Reached target System Initialization.
client # [    2.670988] systemd[1]: Reached target Basic System.
client # [    2.800195] (udev-worker)[92]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
client # [    2.831218] (udev-worker)[93]: Network interface NamePolicy= disabled on kernel command line.
client # [    2.838431] (udev-worker)[92]: Network interface NamePolicy= disabled on kernel command line.
client # [    2.885054] systemd[1]: Found device /dev/disk/by-label/nixos.
client # [    2.886624] systemd[1]: Reached target Initrd Root Device.
client # [    2.890499] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...
server # [    2.890340] systemd[1]: Finished Coldplug All udev Devices.
server # [    2.891301] systemd[1]: Reached target System Initialization.
server # [    2.896554] systemd[1]: Reached target Basic System.
client # [    2.941552] systemd-fsck[112]: nixos: clean, 12/65536 files, 13019/262144 blocks
client # [    2.951297] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.
client # [    2.963181] systemd[1]: Mounting /sysroot...
client # [    3.011080] EXT4-fs (vda): mounted filesystem 31fa4821-14a7-4efe-b6ef-0d98be37e42c r/w with ordered data mode. Quota mode: none.
client # [    3.003161] systemd[1]: Mounted /sysroot.
client # [    3.005756] systemd[1]: Reached target Initrd Root File System.
client # [    3.010868] systemd[1]: Starting Mountpoints Configured in the Real Root...
server # [    3.021730] systemd[1]: Found device /dev/hvc0.
client # [    3.040324] systemd-sysroot-fstab-check[120]: /sysroot should be mounted in the initrd, will request daemon-reload.
server # [    3.038659] systemd[1]: Found device /dev/ttyAMA0.
server # [    3.042644] systemd[1]: Started backdoor.service.
client # [    3.047434] systemd[1]: Reload requested from client PID 120 ('systemd-sysroot') (unit initrd-parse-etc.service)...
client # [    3.051340] systemd[1]: Reloading...
server # [    3.065306] backdoor-start[129]: /nix/store/5ch6a58ajz4w5gxfgjlb1n2jy5qxi4va-unit-script-backdoor-start/bin/backdoor-start: line 10: grep: command not found
server # connecting to host...
server # [    3.072119] (udev-worker)[110]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
server # [    3.078960] (udev-worker)[115]: Network interface NamePolicy= disabled on kernel command line.
server # [    3.097797] (udev-worker)[110]: Network interface NamePolicy= disabled on kernel command line.
server # [    3.118127] systemd-networkd[101]: eth0: Configuring with /etc/systemd/network/99-ethernet-default-dhcp.network.
server # [    3.124740] systemd-networkd[101]: eth0: Link UP
server # [    3.126830] systemd-networkd[101]: eth0: Gained carrier
server # [    3.140662] systemd-networkd[101]: eth0: DHCPv4 address 10.0.2.15/24, gateway 10.0.2.2 acquired from 10.0.2.2
server # [    3.152704] systemd-networkd[101]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network
server # [    3.161273] systemd-networkd[101]: eth1: Configuring with /etc/systemd/network/40-eth1.network.
server # [    3.162514] systemd-networkd[101]: eth1: Link UP
server # [    3.163156] systemd-networkd[101]: eth1: Gained carrier
server # [    3.163881] systemd-networkd[101]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network
server # [    3.195964] systemd[1]: Found device /dev/disk/by-label/nixos.
server # [    3.199255] systemd[1]: Reached target Initrd Root Device.
server # [    3.201463] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...
client # [    3.247646] systemd[1]: Reloading finished in 196 ms.
server # [    3.253765] systemd-fsck[136]: nixos: clean, 12/65536 files, 13019/262144 blocks
server # [    3.263306] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.
server # [    3.268180] systemd[1]: Mounting /sysroot...
client # [    3.282226] systemd-sysroot-fstab-check[120]: Requesting initrd-fs.target/start/replace...
client # [    3.286426] systemd-sysroot-fstab-check[120]: Requesting swap.target/start/replace...
client # [    3.292908] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
client # [    3.298997] systemd[1]: initrd-parse-etc.service: Deactivated successfully.
client # [    3.302707] systemd[1]: Finished Mountpoints Configured in the Real Root.
client # [    3.307365] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.
server # [    3.321123] EXT4-fs (vda): mounted filesystem 5e3fc69d-e35a-4362-bc6d-985e424ddf25 r/w with ordered data mode. Quota mode: none.
server # [    3.307828] systemd[1]: Mounted /sysroot.
server # [    3.312120] systemd[1]: Reached target Initrd Root File System.
client # [    3.324767] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
server # [    3.315647] systemd[1]: Starting Mountpoints Configured in the Real Root...
client # [    3.328279] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
server # [    3.347248] systemd-sysroot-fstab-check[144]: /sysroot should be mounted in the initrd, will request daemon-reload.
server # [    3.352417] systemd[1]: Reload requested from client PID 144 ('systemd-sysroot') (unit initrd-parse-etc.service)...
server # [    3.356100] systemd[1]: Reloading...
server # [    3.582663] systemd[1]: Reloading finished in 226 ms.
client # [    3.609787] systemd[1]: Mounting /sysroot/nix/.ro-store...
client # [    3.621566] systemd[1]: Mounting /sysroot/nix/.rw-store...
server # [    3.624160] systemd-sysroot-fstab-check[144]: Requesting initrd-fs.target/start/replace...
server # [    3.627144] systemd-sysroot-fstab-check[144]: Requesting swap.target/start/replace...
server # [    3.636105] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
client # [    3.649504] systemd[1]: Mounting /sysroot/run...
server # [    3.645635] systemd[1]: initrd-parse-etc.service: Deactivated successfully.
server # [    3.648917] systemd[1]: Finished Mountpoints Configured in the Real Root.
server # [    3.649883] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.
client # [    3.668112] systemd[1]: Mounting /sysroot/tmp/shared...
server # [    3.672604] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
server # [    3.674231] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
server # [    3.678505] systemd[1]: Mounting /sysroot/nix/.ro-store...
client # [    3.691596] systemd[1]: Mounting /sysroot/tmp/xchg...
server # [    3.689041] systemd[1]: Mounting /sysroot/nix/.rw-store...
client # [    3.707010] systemd[1]: Mounted /sysroot/nix/.rw-store.
server # [    3.709639] systemd[1]: Mounting /sysroot/run...
server # [    3.724141] systemd[1]: Mounting /sysroot/tmp/shared...
client # [    3.734501] systemd[1]: Starting rw-sysroot-nix-store.service...
server # [    3.741531] systemd[1]: Mounting /sysroot/tmp/xchg...
client # [    3.749052] systemd[1]: Mounted /sysroot/nix/.ro-store.
client # [    3.751530] systemd[1]: Mounted /sysroot/run.
client # [    3.779898] systemd[1]: Mounted /sysroot/tmp/shared.
client # [    3.784765] systemd[1]: Mounted /sysroot/tmp/xchg.
client # [    3.786812] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
server # [    3.785327] systemd[1]: Mounted /sysroot/nix/.ro-store.
client # [    3.790314] systemd[1]: Finished rw-sysroot-nix-store.service.
client # [    3.796398] systemd[1]: Mounting /sysroot/nix/store...
server # [    3.809770] systemd[1]: Mounted /sysroot/nix/.rw-store.
server # [    3.812695] systemd[1]: Mounted /sysroot/run.
server # [    3.825518] systemd[1]: Starting rw-sysroot-nix-store.service...
client # [    3.838675] systemd[1]: Mounted /sysroot/nix/store.
client # [    3.839924] systemd[1]: Reached target Initrd File Systems.
server # [    3.836661] systemd[1]: Mounted /sysroot/tmp/shared.
server # [    3.837488] systemd[1]: Mounted /sysroot/tmp/xchg.
client # [    3.844145] systemd[1]: Starting Find NixOS closure...
client # [    3.852196] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...
server # [    3.862827] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
server # [    3.865626] systemd[1]: Finished rw-sysroot-nix-store.service.
server # [    3.867774] systemd[1]: Mounting /sysroot/nix/store...
client # [    3.893687] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.
client # [    3.913338] systemd[1]: Finished Find NixOS closure.
client # [    3.916458] systemd[1]: Reached target Initrd Default Target.
client # [    3.920481] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...
server # [    3.916326] systemd[1]: Mounted /sysroot/nix/store.
server # [    3.918322] systemd[1]: Reached target Initrd File Systems.
server # [    3.920989] systemd[1]: Starting Find NixOS closure...
server # [    3.932102] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...
client # [    3.955815] systemd[1]: Stopped target Initrd Default Target.
client # [    3.959099] systemd[1]: Stopped target Basic System.
client # [    3.960205] systemd[1]: Stopped target Initrd Root Device.
client # [    3.965465] systemd[1]: Stopped target Path Units.
client # [    3.966255] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.
client # [    3.969801] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.
server # [    3.965405] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.
client # [    3.973462] systemd[1]: Stopped target Slice Units.
client # [    3.974903] systemd[1]: Stopped target Socket Units.
client # [    3.981245] systemd[1]: Stopped target System Initialization.
client # [    3.983292] systemd[1]: Stopped target Swaps.
client # [    3.983962] systemd[1]: Stopped target Timer Units.
client # [    3.986157] systemd[1]: dbus.socket: Deactivated successfully.
server # [    3.985310] systemd[1]: Finished Find NixOS closure.
client # [    3.992147] systemd[1]: Closed D-Bus System Message Bus Socket.
server # [    3.988126] systemd[1]: Reached target Initrd Default Target.
client # [    3.994218] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.
client # [    3.996115] systemd[1]: Stopped Find NixOS closure.
server # [    3.990918] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...
client # [    3.997971] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
client # [    4.000262] systemd[1]: Starting rw-sysroot-nix-store.service...
client # [    4.003091] systemd[1]: systemd-sysctl.service: Deactivated successfully.
client # [    4.008665] systemd[1]: Stopped Apply Kernel Variables.
client # [    4.010392] systemd[1]: systemd-modules-load.service: Deactivated successfully.
client # [    4.013348] systemd[1]: Stopped Load Kernel Modules.
client # [    4.017903] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.
server # [    4.015564] systemd[1]: initrd-cleanup.service: Deactivated successfully.
server # [    4.017944] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.
server # [    4.019000] systemd[1]: Startup finished in 956ms (kernel) + 0 (initrd) + 3.062s (userspace) = 4.018s.
client # [    4.029136] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.
client # [    4.033768] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.
client # [    4.037683] systemd[1]: Stopped Create System Files and Directories.
client # [    4.042938] systemd[1]: Stopped target Local File Systems.
client # [    4.048366] systemd[1]: Stopped target Preparation for Local File Systems.
client # [    4.051216] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.
client # [    4.054392] systemd[1]: Stopped Coldplug All udev Devices.
client # [    4.056731] systemd[1]: Stopping Rule-based Manager for Device Events and Files...
client # [    4.059094] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
client # [    4.062503] systemd[1]: Stopped Virtual Console Setup.
client # [    4.063283] systemd[1]: initrd-cleanup.service: Deactivated successfully.
client # [    4.064480] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.
client # [    4.065406] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
client # [    4.066402] systemd[1]: Finished rw-sysroot-nix-store.service.
client # [    4.067209] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
client # [    4.073615] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
client # [    4.076223] systemd[1]: systemd-udevd.service: Deactivated successfully.
client # [    4.079554] systemd[1]: Stopped Rule-based Manager for Device Events and Files.
client # [    4.081249] systemd[1]: systemd-udevd.service: Consumed 1.113s CPU time over 2.318s wall clock time, 17.3M memory peak.
client # [    4.082666] systemd[1]: Starting Cleanup udev Database...
client # [    4.083436] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.
client # [    4.084655] systemd[1]: Stopped Create Static Device Nodes in /dev.
client # [    4.085527] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.
client # [    4.086660] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.
client # [    4.087645] systemd[1]: kmod-static-nodes.service: Deactivated successfully.
client # [    4.093076] systemd[1]: Stopped Create List of Static Device Nodes.
client # [    4.121338] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.
client # [    4.124000] systemd[1]: Finished Cleanup udev Database.
client # [    4.125718] systemd[1]: Reached target Switch Root.
client # [    4.128529] systemd[1]: Starting NixOS Activation...
client # [    4.301497] initrd-nixos-activation-start[172]: booting system configuration /nix/store/gymi1qmis3hy2k8bvhnyfm9cid39h9cz-nixos-system-client-test
client # [    4.368137] initrd-nixos-activation-start[172]: running activation script...
server # [    4.513979] systemd-networkd[101]: eth1: Gained IPv6LL
server # [    4.650816] (udev-worker)[111]: mtd0ro: Failed to find and pin callout binary "/nix/store/x4i8f5p0japrw9j9zrdx7z9lf5387qn3-systemd-262-9457f81/lib/udev/mtd_probe": No such file or directory
server # [    4.656424] (udev-worker)[111]: mtd0ro: /nix/store/x4i8f5p0japrw9j9zrdx7z9lf5387qn3-systemd-262-9457f81/lib/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory
server # [    4.687180] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
server # [    4.688842] systemd[1]: Stopped Virtual Console Setup.
server # [    4.690692] systemd[1]: Stopping Virtual Console Setup...
server # [    4.692297] systemd[1]: Starting Virtual Console Setup...
server # [    4.726133] systemd-vconsole-setup[196]: Configuration of first virtual console was skipped, ignoring remaining ones.
server # [    4.729338] systemd[1]: Finished Virtual Console Setup.
server # [    4.731111] systemd[1]: sysroot-run-credentials-systemd\x2dvconsole\x2dsetup.service.mount: Deactivated successfully.
client # [    4.819199] initrd-nixos-activation-start[195]: setting up /etc...
server # [    5.025118] systemd-networkd[101]: eth0: Gained IPv6LL
client # [    5.110033] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.
client # [    5.112896] systemd[1]: Finished NixOS Activation.
client # [    5.116166] systemd[1]: Starting Switch Root...
client # [    5.135802] systemd[1]: Switching root.
client # [    5.333278] systemd-journald[73]: Received SIGTERM from PID 1 (systemd).
client # [    5.946323] systemd[1]: systemd 262-9457f81 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP -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)
client # [    5.959483] systemd[1]: Detected virtualization qemu.
client # [    5.962749] systemd[1]: Detected architecture arm64.
client # [    5.966813] systemd[1]: Detected first boot.
client # [    5.973474] systemd[1]: Initializing machine ID from random generator.
client # [    6.148469] systemd[1]: bpf-restrict-fs: LSM BPF program attached
client # [    6.311396] systemd[1]: Applying preset policy.
client # [    6.829381] systemd[1]: Populated /etc with preset unit settings.
client # [    7.357625] systemd[1]: initrd-switch-root.service: Deactivated successfully.
client # [    7.358934] systemd[1]: Stopped initrd-switch-root.service.
client # [    7.362157] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.
client # [    7.364923] systemd[1]: Created slice Slice /system/getty.
client # [    7.367475] systemd[1]: Created slice User and Session Slice.
client # [    7.368424] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
client # [    7.371350] systemd[1]: Started Forward Password Requests to Wall Directory Watch.
client # [    7.372711] systemd[1]: Expecting device /dev/hvc0...
client # [    7.374318] systemd[1]: Expecting device /dev/ttyAMA0...
client # [    7.376670] systemd[1]: Reached target Local Encrypted Volumes.
client # [    7.377897] systemd[1]: Stopped target initrd-fs.target.
client # [    7.378206] systemd[1]: Stopped target initrd-root-fs.target.
client # [    7.378463] systemd[1]: Stopped target initrd-switch-root.target.
client # [    7.378725] systemd[1]: Reached target Virtual Machines and Containers.
client # [    7.378980] systemd[1]: Reached target Path Units.
client # [    7.379221] systemd[1]: Reached target Remote File Systems.
client # [    7.379450] systemd[1]: Reached target Slice Units.
client # [    7.379682] systemd[1]: Reached target Swaps.
client # [    7.388369] systemd[1]: Listening on Query the User Interactively for a Password.
client # [    7.393417] systemd[1]: Listening on Process Core Dump Socket.
client # [    7.397427] systemd[1]: Listening on Credential Encryption/Decryption.
client # [    7.401257] systemd[1]: Listening on Factory Reset Management.
client # [    7.402503] systemd[1]: Listening on Hostname Service Socket.
client # [    7.408139] systemd[1]: Starting Journal Log Access Socket...
client # [    7.410246] systemd[1]: Listening on Journal Audit Socket.
client # [    7.414406] systemd[1]: Listening on Console Output Muting Service Socket.
client # [    7.416776] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.
client # [    7.419040] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os
client # [    7.421786] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki
client # [    7.433285] systemd[1]: Listening on Disk Repartitioning Service Socket.
client # [    7.435576] systemd[1]: Listening on udev Varlink Socket.
client # [    7.440537] systemd[1]: Mounting Huge Pages File System...
client # [    7.445826] systemd[1]: Mounting POSIX Message Queue File System...
client # [    7.453828] systemd[1]: Mounting Kernel Debug File System...
client # [    7.469116] systemd[1]: Mounting Kernel Trace File System...
client # [    7.478376] systemd[1]: Starting Create List of Static Device Nodes...
client # [    7.491879] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
client # [    7.494254] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs
client # [    7.508149] systemd[1]: Mounting Kernel Configuration File System...
client # [    7.510665] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm
client # [    7.515338] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
client # [    7.530324] systemd[1]: Starting Load Kernel Module fuse...
client # [    7.531802] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67
client # [    7.597689] systemd[1]: Starting Journal Service...
client # [    7.631030] systemd[1]: Starting Load Kernel Modules...
client # [    7.647139] fuse: init (API version 7.45)
client # [    7.681135] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...
client # [    7.687292] systemd[1]: Starting Remount Root and Kernel File Systems...
client # [    7.697163] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
client # [    7.708427] systemd[1]: Starting Coldplug All udev Devices...
client # [    7.719436] systemd[1]: Listening on Journal Log Access Socket.
client # [    7.731554] systemd-journald[268]: Collecting audit messages is enabled.
client # [    7.727524] systemd[1]: Queued start job for default target Multi-User System.
client # [    7.743749] systemd[1]: Started Journal Service.
client # [    7.735118] systemd[1]: systemd-journald.service: Deactivated successfully.
client # [    7.746202] systemd[1]: Mounted Huge Pages File System.
client # [    7.752340] systemd[1]: Mounted POSIX Message Queue File System.
client # [    7.762922] systemd[1]: Mounted Kernel Debug File System.
client # [    7.766878] systemd[1]: Mounted Kernel Trace File System.
client # [    7.774051] systemd[1]: Finished Create List of Static Device Nodes.
client # [    7.780679] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
client # [    7.781869] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
client # [    7.782942] systemd-modules-load[269]: Module 'atkbd' is built in
client # [    7.783915] systemd[1]: Mounted Kernel Configuration File System.
client # [    7.802866] systemd[1]: modprobe@fuse.service: Deactivated successfully.
client # [    7.803954] systemd[1]: Finished Load Kernel Module fuse.
client # [    7.806638] systemd-modules-load[269]: Module 'loop' is built in
client # [    7.816214] systemd[1]: Finished Load Kernel Modules.
client # [    7.824817] systemd[1]: Mounting FUSE Control File System...
client # [    7.841415] EXT4-fs (vda): re-mounted 31fa4821-14a7-4efe-b6ef-0d98be37e42c.
client # [    7.837884] systemd[1]: Starting Firewall...
client # [    7.862300] systemd[1]: Starting Apply Kernel Variables...
client # [    7.880684] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
client # [    7.885820] systemd-oomd[271]: No swap; memory pressure usage will be degraded
client # [    7.909554] systemd[1]: Finished Remount Root and Kernel File Systems.
client # [    7.915246] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.
client # [    7.923342] systemd[1]: Listening on Disk Image Download Service Socket.
client # [    7.945148] systemd[1]: Starting Flush Journal to Persistent Storage...
client # [    7.949662] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
client # [    7.970650] systemd[1]: Starting Load/Save OS Random Seed...
client # [    7.974436] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
client # [    8.038709] systemd[1]: Mounted FUSE Control File System.
client # [    8.048338] systemd[1]: Finished Apply Kernel Variables.
client # [    8.099089] systemd-journald[268]: Received client request to flush runtime journal.
client # [    8.160451] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
client # [    8.163161] systemd[1]: Starting Create Static Device Nodes in /dev...
client # [    8.165099] systemd[1]: Finished Load/Save OS Random Seed.
client # [    8.168001] systemd[1]: Reached target First Boot Complete.
client # [    8.172468] systemd[1]: Finished Flush Journal to Persistent Storage.
client # [    8.258437] systemd[1]: Finished Create Static Device Nodes in /dev.
client # [    8.259908] systemd[1]: Reached target Preparation for Local File Systems.
client # [    8.265943] systemd[1]: Starting Rule-based Manager for Device Events and Files...
client # [    8.350322] systemd[1]: Mounting /run/wrappers...
client # [    8.416901] systemd[1]: Mounted /run/wrappers.
client # [    8.418000] systemd[1]: Reached target Local File Systems.
client # [    8.431442] systemd[1]: Listening on Boot Loader Control Service Socket.
client # [    8.435349] systemd[1]: Starting register-nix-paths.service...
client # [    8.439102] systemd[1]: Starting Create SUID/SGID Wrappers...
client # [    8.440236] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.
client # [    8.458242] systemd[1]: Starting Save Transient machine-id to Disk...
client # [    8.499856] systemd[1]: Starting Create System Files and Directories...
client # [    8.626680] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
client # [    8.630072] systemd[1]: Finished Save Transient machine-id to Disk.
client # [    8.650356] systemd-udevd[314]: Using default interface naming scheme 'v261'.
client # [    8.733332] systemd[1]: Finished Create System Files and Directories.
client # [    8.747279] systemd[1]: Starting Rebuild Journal Catalog...
client # [    8.752987] systemd[1]: Starting Record System Boot/Shutdown in UTMP...
client # [    8.897262] systemd[1]: Finished Record System Boot/Shutdown in UTMP.
client # [    8.956306] systemd[1]: Finished Rebuild Journal Catalog.
client # [    8.977058] systemd[1]: Starting Update is Completed...
client # [    8.980251] systemd[1]: Started Rule-based Manager for Device Events and Files.
client # [    9.092408] systemd[1]: Finished Update is Completed.
client # [    9.644397] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.
client # [    9.647808] systemd[1]: Finished Create SUID/SGID Wrappers.
client # [    9.889436] systemd[1]: Finished register-nix-paths.service.
client # [   10.111139] systemd[1]: Finished Coldplug All udev Devices.
client # [   10.115405] systemd[1]: Reached target System Initialization.
client # [   10.124423] systemd[1]: Started Discard unused filesystem blocks once a week.
client # [   10.125454] systemd[1]: Started Daily Cleanup of Temporary Directories.
client # [   10.126381] systemd[1]: Reached target Timer Units.
client # [   10.127090] systemd[1]: Listening on D-Bus System Message Bus Socket.
client # [   10.127990] systemd[1]: Listening on Nix Daemon Socket.
client # [   10.137185] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
client # [   10.143534] systemd[1]: Reached target Socket Units.
client # [   10.151804] systemd[1]: Reached target Basic System.
client # [   10.152798] systemd[1]: Starting Import lastlog data into lastlog2 database...
client # [   10.153826] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
client # [   10.154723] systemd[1]: Starting Post-Boot Actions...
client # [   10.177031] systemd[1]: Started Reset console on configuration changes.
client # [   10.212653] systemd[1]: Starting resolvconf update...
client # [   10.219134] systemd[1]: Finished Firewall.
client # [   10.281180] systemd[1]: Finished Post-Boot Actions.
client # [   10.309427] systemd[1]: Starting D-Bus System Message Bus...
client # [   10.313636] systemd[1]: Started Name Service Cache Daemon (nsncd).
client # [   10.321303] nsncd[480]: Sep 06 02:32:58.939 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
client # [   10.332520] systemd[1]: Reached target Host and Network Name Lookups.
client # [   10.334889] systemd[1]: Reached target User and Group Name Lookups.
client # [   10.348253] systemd[1]: Starting User Login Management...
client # [   10.376957] systemd[1]: Finished Import lastlog data into lastlog2 database.
client # [   10.510092] systemd-logind[507]: New seat seat0.
client # [   10.518096] systemd[1]: Started User Login Management.
client # [   10.526673] dbus-broker-launch[496]: Looking up NSS user entry for 'systemd-timesync'...
client # [   10.533236] dbus-broker-launch[496]: NSS returned no entry for 'systemd-timesync'
client # [   10.540996] dbus-broker-launch[496]: Invalid user-name in /nix/store/v3mlfznwlfywigxsg9va44lq8gsrcg44-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
client # [   10.546465] systemd[1]: Starting linger-users.service...
client # [   10.559002] systemd[1]: Stopped target Host and Network Name Lookups.
client # [   10.566043] systemd[1]: Stopping Host and Network Name Lookups...
client # [   10.572957] systemd[1]: Stopped target User and Group Name Lookups.
client # [   10.579177] systemd[1]: Stopping User and Group Name Lookups...
client # [   10.587941] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...
client # [   10.596203] systemd[1]: nscd.service: Deactivated successfully.
client # [   10.601459] systemd[1]: Stopped Name Service Cache Daemon (nsncd).
client # [   10.607054] systemd[1]: Started D-Bus System Message Bus.
client # [   10.620246] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
client # [   10.649165] systemd[1]: linger-users.service: Deactivated successfully.
client # [   10.654811] systemd[1]: Finished linger-users.service.
client # [   10.661516] dbus-broker-launch[496]: Ready
client # [   10.702930] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:09.0/virtio8/input/input3
client # [   10.708358] systemd[1]: Started Name Service Cache Daemon (nsncd).
client # [   10.713539] systemd[1]: Reached target Host and Network Name Lookups.
client # [   10.715333] nsncd[559]: Sep 06 02:32:59.337 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
client # [   10.720263] systemd[1]: Reached target User and Group Name Lookups.
client # [   10.734532] systemd[1]: Finished resolvconf update.
client # [   10.739775] systemd[1]: Reached target Preparation for Network.
client # [   10.744483] systemd[1]: Starting DHCP Client...
client # [   10.756300] systemd[1]: Starting Extra networking commands....
client # [   10.966312] dhcpcd[588]: dhcpcd-10.3.2 starting
client # [   10.985142] dhcpcd[616]: dev: loaded udev
client # [   10.989179] dhcpcd[616]: no valid interfaces found
client # [   10.991989] dhcpcd[616]: no valid interfaces found
client # [   11.068631] systemd[1]: Finished Extra networking commands..
client # [   11.071041] systemd[1]: Reached target Network.
client # [   11.076740] systemd[1]: Starting Permit User Sessions...
client # [   11.128305] systemd[1]: Finished Permit User Sessions.
client # [   11.134809] systemd[1]: Started Getty on tty1.
client # [   11.138976] systemd[1]: Reached target Login Prompts.
client # [   11.261125] systemd[1]: Starting Virtual Console Setup...
client # [   11.288350] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
client # [   11.290180] systemd[1]: Stopped Virtual Console Setup.
client # [   11.296531] systemd[1]: Starting Virtual Console Setup...
client # [   11.300402] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs
client # [   11.467265] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.
client # [   11.504674] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.
client # [   11.512943] systemd[1]: Started backdoor.service.
client # [   11.600824] 8021q: 802.1Q VLAN Support v1.8
client # connecting to host...
client # [   11.653685] (udev-worker)[380]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
client # [   11.660464] (udev-worker)[380]: Network interface NamePolicy= disabled on kernel command line.
client: Guest shell says: b'Spawning backdoor root shell...\n'
client # [   11.672585] (udev-worker)[397]: Network interface NamePolicy= disabled on kernel command line.
client: connected to guest root shell
client: (connecting took 12.02 seconds)
client: (finished: waiting for the VM to finish booting, in 12.02 seconds)
client # [   11.734191] cfg80211: Loading compiled-in X.509 certificates for regulatory database
client # [   11.774876] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
client # [   11.775370] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'
client # [   11.780270] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2
client # [   11.780589] cfg80211: failed to load regulatory.db
client # [   11.807806] systemd[1]: Condition check resulted in Virtio network device being skipped.
client: (finished: waiting for unit network.target, in 12.14 seconds)
client: waiting for SSH server to come up
client # [   11.825574] systemd[1]: Starting Address configuration of eth1...
client # [   11.908774] 8021q: adding VLAN 0 to HW filter on device eth0
client # [   11.899044] dhcpcd[616]: eth0: waiting for carrier
client # [   11.903514] dhcpcd[616]: eth0: carrier acquired
client # [   11.923398] dhcpcd[616]: DUID 00:01:00:01:32:2f:8d:5c:52:54:00:12:34:56
client # [   11.928454] dhcpcd[616]: eth0: IAID 00:12:34:56
client # [   11.931611] dhcpcd[616]: eth0: adding address fe80::5054:ff:fe12:3456
client # [   11.943249] systemd-vconsole-setup[646]: Configuration of first virtual console was skipped, ignoring remaining ones.
client # [   11.951225] systemd[1]: Finished Virtual Console Setup.
client # [   11.967817] 8021q: adding VLAN 0 to HW filter on device eth1
client # [   11.975639] network-addresses-eth1-start[672]: adding address 192.168.1.1/24... done
client # [   11.990430] network-addresses-eth1-start[672]: adding address 2001:db8:1::1/64... done
client # [   12.009369] systemd[1]: Finished Address configuration of eth1.
client # [   12.154369] systemd-logind[507]: Watching system buttons on /dev/input/event0 (gpio-keys)
client # [   12.226042] mousedev: PS/2 mouse device common for all mice
client # [   12.317027] systemd-logind[507]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)
client # Connection to server (2001:db8:1::2) 22 port [tcp/ssh] succeeded!
client: (finished: waiting for SSH server to come up, in 1.21 seconds)
client: must succeed: ssh -i /etc/sshKey -o UserKnownHostsFile=/etc/knownHosts server 'cat /etc/msg'
server # [   13.045280] sshd-session[199]: Connection closed by 2001:db8:1::1 port 35624 [preauth]
server # [   13.209186] sshd-session[201]: Accepted publickey for root from 2001:db8:1::1 port 35628 ssh2: ED25519 SHA256:Du3JdgNSW22b+NOGBZzlhBt3FKLjV6HeV/QEF2L7Xg4
client: (finished: must succeed: ssh -i /etc/sshKey -o UserKnownHostsFile=/etc/knownHosts server 'cat /etc/msg', in 0.22 seconds)
server: waiting for unit initrd.target
server: waiting for the VM to finish booting
server: Guest shell says: b'Spawning backdoor root shell...\n'
server: connected to guest root shell
server: (connecting took 0.00 seconds)
server: (finished: waiting for the VM to finish booting, in 0.00 seconds)
server # [   13.236920] sshd-session[203]: Received disconnect from 2001:db8:1::1 port 35628:11: disconnected by user
server # [   13.244770] sshd-session[203]: Disconnected from user root 2001:db8:1::1 port 35628
server: (finished: waiting for unit initrd.target, in 0.04 seconds)
server: waiting for the VM to finish booting
server # [   13.313301] systemd[1]: Stopped target Initrd Default Target.
server # [   13.314717] systemd[1]: Stopped target Basic System.
server # [   13.315897] systemd[1]: Stopped target Initrd Root Device.
client # [   13.323989] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
client # [   13.328978] systemd[1]: Stopped Virtual Console Setup.
server # [   13.324201] systemd[1]: Stopped target Host and Network Name Lookups.
client # [   13.329771] systemd[1]: Stopping Virtual Console Setup...
server # [   13.325514] systemd[1]: Stopped target Path Units.
server # [   13.326494] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.
client # [   13.333006] systemd[1]: Starting Virtual Console Setup...
server # [   13.327965] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.
server # [   13.336265] systemd[1]: Stopped target Slice Units.
server # [   13.337216] systemd[1]: Stopped target Socket Units.
server # [   13.338130] systemd[1]: Stopped target System Initialization.
server # [   13.339157] systemd[1]: Stopped target Swaps.
server # [   13.339981] systemd[1]: Stopped target Timer Units.
server # [   13.345018] systemd[1]: Stopping backdoor.service...
server # [   13.345963] systemd[1]: Stopping D-Bus System Message Bus...
server # [   13.348176] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...
server # [   13.349582] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.
client # [   13.355625] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
server # [   13.353562] systemd[1]: Stopped Find NixOS closure.
client # [   13.360600] systemd[1]: Stopped Virtual Console Setup.
server # [   13.356458] sshd[125]: Received signal 15; terminating.
server # [   13.357734] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
server # [   13.359872] systemd[1]: Starting rw-sysroot-nix-store.service...
server # [   13.362193] systemd[1]: Stopping SSH Daemon...
server # [   13.368321] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.
client # [   13.373495] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.
server # [   13.370290] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.
client # [   13.381097] systemd[1]: Starting Virtual Console Setup...
server # [   13.381665] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.
server # [   13.385157] systemd[1]: Stopped Create System Files and Directories.
server # [   13.388834] systemd[1]: Stopped target Local File Systems.
server # [   13.392177] systemd[1]: Stopped target Preparation for Local File Systems.
server # [   13.394842] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.
server # [   13.398632] systemd[1]: Stopped Coldplug All udev Devices.
server # [   13.399453] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
server # [   13.402135] systemd[1]: Stopped Virtual Console Setup.
server # [   13.403138] systemd[1]: dbus.service: Deactivated successfully.
server # [   13.405564] systemd[1]: Stopped D-Bus System Message Bus.
server # [   13.406455] systemd[1]: sshd.service: Deactivated successfully.
server # [   13.407282] systemd[1]: Stopped SSH Daemon.
server # [   13.407917] systemd[1]: backdoor.service: Deactivated successfully.
server # [   13.409230] systemd[1]: Stopped backdoor.service.
server # [   13.409907] systemd[1]: initrd-cleanup.service: Deactivated successfully.
client # [   13.414594] systemd-logind[507]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)
server # [   13.410824] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.
server # [   13.411720] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.
server # [   13.412851] systemd[1]: Finished rw-sysroot-nix-store.service.
server # [   13.413641] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
server # [   13.414617] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
server # [   13.415451] systemd[1]: Stopped target Network.
server # [   13.417308] systemd[1]: dbus.socket: Deactivated successfully.
server # [   13.418130] systemd[1]: Closed D-Bus System Message Bus Socket.
server # [   13.418938] systemd[1]: initrd-nixos-copy-secrets.service: Deactivated successfully.
server # [   13.419972] systemd[1]: Stopped Copy secrets into place.
server # [   13.421179] systemd[1]: Stopping Network Management...
server # [   13.421917] systemd[1]: Stopping Network Name Resolution...
server # [   13.426479] systemd[1]: systemd-networkd.service: Deactivated successfully.
server # [   13.429237] systemd[1]: Stopped Network Management.
server # [   13.431741] systemd[1]: sysroot-run-credentials-systemd\x2dnetworkd.service.mount: Deactivated successfully.
server # [   13.435399] systemd[1]: systemd-resolved.service: Deactivated successfully.
server # [   13.436792] systemd[1]: Stopped Network Name Resolution.
server # [   13.437820] systemd[1]: sysroot-run-credentials-systemd\x2dresolved.service.mount: Deactivated successfully.
server # [   13.440621] systemd[1]: systemd-networkd-resolve-hook.socket: Deactivated successfully.
server # [   13.443727] systemd[1]: Closed Network Management Resolve Hook Socket.
server # [   13.445572] systemd[1]: Stopped target Preparation for Network.
server # [   13.446411] systemd[1]: systemd-networkd-varlink-metrics.socket: Deactivated successfully.
server # [   13.447487] systemd[1]: Closed Network Management Metrics Varlink Socket.
server # [   13.448521] systemd[1]: systemd-networkd-varlink.socket: Deactivated successfully.
server # [   13.449531] systemd[1]: Closed Network Management Varlink Socket.
server # [   13.450352] systemd[1]: systemd-networkd.socket: Deactivated successfully.
server # [   13.451275] systemd[1]: Closed Network Management Netlink Socket.
server # [   13.456190] systemd[1]: systemd-resolved-monitor.socket: Deactivated successfully.
server # [   13.460244] systemd[1]: Closed Resolve Monitor Varlink Socket.
server # [   13.461103] systemd[1]: systemd-resolved-varlink.socket: Deactivated successfully.
server # [   13.463850] systemd[1]: Closed Resolve Service Varlink Socket.
server # [   13.465192] systemd[1]: systemd-sysctl.service: Deactivated successfully.
server # [   13.466100] systemd[1]: Stopped Apply Kernel Variables.
server # [   13.466820] systemd[1]: systemd-modules-load.service: Deactivated successfully.
server # [   13.467784] systemd[1]: Stopped Load Kernel Modules.
server # [   13.468608] systemd[1]: Stopping Rule-based Manager for Device Events and Files...
server # [   13.469592] systemd[1]: systemd-udevd.service: Deactivated successfully.
server # [   13.470469] systemd[1]: Stopped Rule-based Manager for Device Events and Files.
server # [   13.471415] systemd[1]: systemd-udevd.service: Consumed 1.516s CPU time over 11.621s wall clock time, 22.1M memory peak.
server # [   13.476215] systemd[1]: Starting Cleanup udev Database...
server # [   13.477018] systemd[1]: systemd-network-generator.service: Deactivated successfully.
server # [   13.478753] systemd[1]: Stopped Generate Network Units from Kernel Command Line.
server # [   13.484190] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.
server # [   13.485285] systemd[1]: Stopped Create Static Device Nodes in /dev.
server # [   13.486138] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.
server # [   13.487234] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.
server # [   13.492259] systemd[1]: kmod-static-nodes.service: Deactivated successfully.
server # [   13.493210] systemd[1]: Stopped Create List of Static Device Nodes.
server # [   13.518825] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.
server # [   13.520762] systemd[1]: Finished Cleanup udev Database.
server # [   13.524256] systemd[1]: Reached target Switch Root.
server # [   13.525020] systemd[1]: Starting NixOS Activation...
server # [   13.685760] initrd-nixos-activation-start[230]: booting system configuration /nix/store/anr1c8ppp714pa42kac7sv37mj52pjwc-nixos-system-server-test
client # [   13.691205] systemd-vconsole-setup[714]: Configuration of first virtual console was skipped, ignoring remaining ones.
client # [   13.694838] systemd[1]: Finished Virtual Console Setup.
server # [   13.748112] initrd-nixos-activation-start[230]: running activation script...
client # [   13.801171] dhcpcd[616]: eth0: soliciting a DHCP lease
client # [   13.804972] dhcpcd[616]: eth0: offered 10.0.2.15 from 10.0.2.2
client # [   13.812449] dhcpcd[616]: eth0: probing address 10.0.2.15/24
client # [   14.096429] dhcpcd[616]: eth0: soliciting an IPv6 router
client # [   14.100080] dhcpcd[616]: eth0: Router Advertisement from fe80::2
client # [   14.102684] dhcpcd[616]: eth0: adding address fec0::5054:ff:fe12:3456/64
client # [   14.105547] dhcpcd[616]: eth0: adding route to fec0::/64
client # [   14.107839] dhcpcd[616]: eth0: adding default route via fe80::2
server # [   14.163581] initrd-nixos-activation-start[253]: setting up /etc...
server # [   14.434682] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.
server # [   14.437567] systemd[1]: Finished NixOS Activation.
server # [   14.438856] systemd[1]: Starting Switch Root...
server # [   14.460357] systemd[1]: Switching root.
server # [   14.645628] systemd-journald[74]: Received SIGTERM from PID 1 (systemd).
server # [   15.245380] systemd[1]: systemd 262-9457f81 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP -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)
server # [   15.258462] systemd[1]: Detected virtualization qemu.
server # [   15.261702] systemd[1]: Detected architecture arm64.
server # [   15.265056] systemd[1]: Detected first boot.
server # [   15.273379] systemd[1]: Initializing machine ID from random generator.
server # [   15.438022] systemd[1]: bpf-restrict-fs: LSM BPF program attached
server # [   15.612920] systemd[1]: Applying preset policy.
server # [   16.122275] systemd[1]: Populated /etc with preset unit settings.
server # [   16.629927] systemd[1]: initrd-switch-root.service: Deactivated successfully.
server # [   16.631853] systemd[1]: Stopped initrd-switch-root.service.
server # [   16.633501] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.
server # [   16.637206] systemd[1]: Created slice Slice /system/getty.
server # [   16.640068] systemd[1]: Created slice User and Session Slice.
server # [   16.642149] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
server # [   16.644461] systemd[1]: Started Forward Password Requests to Wall Directory Watch.
server # [   16.646617] systemd[1]: Expecting device /dev/hvc0...
server # [   16.648405] systemd[1]: Expecting device /dev/ttyAMA0...
server # [   16.650238] systemd[1]: Reached target Local Encrypted Volumes.
server # [   16.652205] systemd[1]: Stopped target initrd-fs.target.
server # [   16.653215] systemd[1]: Stopped target initrd-root-fs.target.
server # [   16.654778] systemd[1]: Stopped target initrd-switch-root.target.
server # [   16.657100] systemd[1]: Reached target Virtual Machines and Containers.
server # [   16.658277] systemd[1]: Reached target Path Units.
server # [   16.659660] systemd[1]: Reached target Remote File Systems.
server # [   16.661158] systemd[1]: Reached target Slice Units.
server # [   16.663457] systemd[1]: Reached target Swaps.
server # [   16.667457] systemd[1]: Listening on Query the User Interactively for a Password.
server # [   16.672017] systemd[1]: Listening on Process Core Dump Socket.
server # [   16.675708] systemd[1]: Listening on Credential Encryption/Decryption.
server # [   16.679269] systemd[1]: Listening on Factory Reset Management.
server # [   16.680498] systemd[1]: Listening on Hostname Service Socket.
server # [   16.686052] systemd[1]: Starting Journal Log Access Socket...
server # [   16.688891] systemd[1]: Listening on Journal Audit Socket.
server # [   16.692813] systemd[1]: Listening on Console Output Muting Service Socket.
server # [   16.695192] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.
server # [   16.697524] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os
server # [   16.700041] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki
server # [   16.710902] systemd[1]: Listening on Disk Repartitioning Service Socket.
server # [   16.711360] systemd[1]: Listening on udev Varlink Socket.
server # [   16.716535] systemd[1]: Mounting Huge Pages File System...
server # [   16.720537] systemd[1]: Mounting POSIX Message Queue File System...
server # [   16.727623] systemd[1]: Mounting Kernel Debug File System...
server # [   16.740958] systemd[1]: Mounting Kernel Trace File System...
server # [   16.754200] systemd[1]: Starting Create List of Static Device Nodes...
server # [   16.766593] systemd[1]: Starting Load Kernel Module 9pnet_virtio...
server # [   16.768981] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs
server # [   16.784553] systemd[1]: Mounting Kernel Configuration File System...
server # [   16.790642] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm
server # [   16.793250] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
server # [   16.802289] systemd[1]: Starting Load Kernel Module fuse...
server # [   16.804449] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67
server # [   16.861753] systemd[1]: Starting Journal Service...
server # [   16.901980] systemd[1]: Starting Load Kernel Modules...
server # [   16.923368] fuse: init (API version 7.45)
server # [   16.940650] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...
server # [   16.968333] systemd[1]: Starting Remount Root and Kernel File Systems...
server # [   16.972078] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
server # [   16.993074] systemd[1]: Starting Coldplug All udev Devices...
server # [   17.000169] systemd-journald[325]: Collecting audit messages is enabled.
server # [   17.005402] systemd[1]: Listening on Journal Log Access Socket.
server # [   16.997909] systemd[1]: Queued start job for default target Multi-User System.
server # [   17.000170] systemd[1]: systemd-journald.service: Deactivated successfully.
server # [   17.009462] systemd-modules-load[326]: Module 'atkbd' is built in
server # [   17.010478] systemd-modules-load[326]: Module 'loop' is built in
server # [   17.033290] systemd[1]: Started Journal Service.
server # [   17.022528] systemd[1]: Mounted Huge Pages File System.
server # [   17.023936] systemd[1]: Mounted POSIX Message Queue File System.
server # [   17.026948] systemd[1]: Mounted Kernel Debug File System.
server # [   17.033501] systemd[1]: Mounted Kernel Trace File System.
server # [   17.038397] systemd[1]: Finished Create List of Static Device Nodes.
server # [   17.043596] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.
server # [   17.050173] systemd[1]: Finished Load Kernel Module 9pnet_virtio.
server # [   17.055784] systemd[1]: Mounted Kernel Configuration File System.
server # [   17.060262] systemd[1]: modprobe@fuse.service: Deactivated successfully.
server # [   17.064632] systemd[1]: Finished Load Kernel Module fuse.
server # [   17.066853] systemd[1]: Finished Load Kernel Modules.
server # [   17.078791] systemd-oomd[328]: No swap; memory pressure usage will be degraded
server # [   17.085627] systemd[1]: Mounting FUSE Control File System...
server # [   17.089200] systemd[1]: Starting Firewall...
server # [   17.118657] EXT4-fs (vda): re-mounted 5e3fc69d-e35a-4362-bc6d-985e424ddf25.
server # [   17.116537] systemd[1]: Starting Apply Kernel Variables...
server # [   17.132108] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...
server # [   17.134541] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.
server # [   17.146218] systemd[1]: Finished Remount Root and Kernel File Systems.
server # [   17.168710] systemd[1]: Listening on Disk Image Download Service Socket.
server # [   17.190058] systemd[1]: Starting Flush Journal to Persistent Storage...
server # [   17.197244] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
server # [   17.218072] systemd[1]: Starting Load/Save OS Random Seed...
server # [   17.226272] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os
server # [   17.247237] systemd[1]: Mounted FUSE Control File System.
server # [   17.259951] systemd[1]: Finished Apply Kernel Variables.
server # [   17.319648] systemd-journald[325]: Received client request to flush runtime journal.
server # [   17.380962] systemd[1]: Finished Load/Save OS Random Seed.
server # [   17.382275] systemd[1]: Reached target First Boot Complete.
server # [   17.387375] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
server # [   17.393399] systemd[1]: Starting Create Static Device Nodes in /dev...
server # [   17.396338] systemd[1]: Finished Flush Journal to Persistent Storage.
server # [   17.453883] systemd[1]: Finished Create Static Device Nodes in /dev.
server # [   17.455226] systemd[1]: Reached target Preparation for Local File Systems.
server # [   17.463049] systemd[1]: Starting Rule-based Manager for Device Events and Files...
server # [   17.573846] systemd-udevd[368]: Using default interface naming scheme 'v261'.
server # [   17.614812] systemd[1]: Mounting /run/wrappers...
server # [   17.672558] systemd[1]: Mounted /run/wrappers.
server # [   17.674364] systemd[1]: Reached target Local File Systems.
server # [   17.678744] systemd[1]: Listening on Boot Loader Control Service Socket.
server # [   17.689381] systemd[1]: Starting register-nix-paths.service...
server # [   17.697671] systemd[1]: Starting Create SUID/SGID Wrappers...
server # [   17.698817] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.
server # [   17.711646] systemd[1]: Starting Save Transient machine-id to Disk...
server # [   17.744621] systemd[1]: Starting Create System Files and Directories...
server # [   17.834348] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
server # [   17.838427] systemd[1]: Finished Save Transient machine-id to Disk.
server # [   17.893267] systemd[1]: Started Rule-based Manager for Device Events and Files.
server # [   17.972368] systemd[1]: Finished Create System Files and Directories.
server # [   17.993431] systemd[1]: Starting Rebuild Journal Catalog...
server # [   18.003192] systemd[1]: Starting Record System Boot/Shutdown in UTMP...
server # [   18.122131] systemd[1]: Finished Record System Boot/Shutdown in UTMP.
server # [   18.187969] systemd[1]: Finished Rebuild Journal Catalog.
server # [   18.202413] systemd[1]: Starting Update is Completed...
server # [   18.280347] systemd[1]: Finished Update is Completed.
server # [   18.657181] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.
server # [   18.659660] systemd[1]: Finished Create SUID/SGID Wrappers.
server # [   18.986177] systemd[1]: Finished register-nix-paths.service.
server # [   19.141098] systemd[1]: Finished Firewall.
server # [   19.149435] systemd[1]: Finished Coldplug All udev Devices.
server # [   19.150340] systemd[1]: Reached target System Initialization.
server # [   19.152447] systemd[1]: Started Discard unused filesystem blocks once a week.
server # [   19.154473] systemd[1]: Started Daily Cleanup of Temporary Directories.
server # [   19.156352] systemd[1]: Reached target Timer Units.
server # [   19.160251] systemd[1]: Listening on D-Bus System Message Bus Socket.
server # [   19.163440] systemd[1]: Listening on Nix Daemon Socket.
server # [   19.172290] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
server # [   19.173467] systemd[1]: Reached target Socket Units.
server # [   19.174195] systemd[1]: Reached target Basic System.
server # [   19.174905] systemd[1]: Starting Import lastlog data into lastlog2 database...
server # [   19.175907] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
server # [   19.184251] systemd[1]: Starting Post-Boot Actions...
server # [   19.195835] systemd[1]: Started Reset console on configuration changes.
server # [   19.215583] systemd[1]: Starting resolvconf update...
server # [   19.273742] systemd[1]: Starting D-Bus System Message Bus...
server # [   19.291103] nsncd[542]: Sep 06 02:33:07.898 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
server # [   19.298305] systemd[1]: Started Name Service Cache Daemon (nsncd).
server # [   19.303490] systemd[1]: Finished Post-Boot Actions.
server # [   19.320814] systemd[1]: Reached target Host and Network Name Lookups.
server # [   19.324719] systemd[1]: Reached target User and Group Name Lookups.
server # [   19.325627] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs
server # [   19.356009] systemd[1]: Starting User Login Management...
server # [   19.395140] systemd[1]: Finished Import lastlog data into lastlog2 database.
client # [   19.468950] dhcpcd[616]: eth0: leased 10.0.2.15 for 86400 seconds
client # [   19.472303] dhcpcd[616]: eth0: adding route to 10.0.2.0/24
client # [   19.474608] dhcpcd[616]: eth0: adding default route via 10.0.2.2
server # [   19.475750] dbus-broker-launch[547]: Looking up NSS user entry for 'systemd-timesync'...
server # [   19.482689] dbus-broker-launch[547]: NSS returned no entry for 'systemd-timesync'
server # [   19.486484] dbus-broker-launch[547]: Invalid user-name in /nix/store/v3mlfznwlfywigxsg9va44lq8gsrcg44-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
server # [   19.525327] systemd[1]: Started D-Bus System Message Bus.
server # [   19.534840] systemd-logind[563]: New seat seat0.
server # [   19.542339] systemd[1]: Started User Login Management.
server # [   19.551623] systemd[1]: Starting linger-users.service...
server # [   19.563188] systemd[1]: Stopped target Host and Network Name Lookups.
server # [   19.569789] systemd[1]: Stopping Host and Network Name Lookups...
server # [   19.570661] systemd[1]: Stopped target User and Group Name Lookups.
server # [   19.571527] systemd[1]: Stopping User and Group Name Lookups...
server # [   19.576887] dbus-broker-launch[547]: Ready
server # [   19.579911] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...
server # [   19.582816] systemd[1]: nscd.service: Deactivated successfully.
server # [   19.583685] systemd[1]: Stopped Name Service Cache Daemon (nsncd).
server # [   19.617104] systemd[1]: Starting Name Service Cache Daemon (nsncd)...
client # [   19.631986] systemd[1]: Started DHCP Client.
client # [   19.634082] systemd[1]: Reached target Multi-User System.
client # [   19.635271] systemd[1]: Startup finished in 941ms (kernel) + 4.508s (initrd) + 14.185s (userspace) = 19.635s.
server # [   19.649793] systemd[1]: linger-users.service: Deactivated successfully.
server # [   19.655119] systemd[1]: Finished linger-users.service.
server # [   19.689404] systemd[1]: Started Name Service Cache Daemon (nsncd).
server # [   19.692977] nsncd[613]: Sep 06 02:33:08.299 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
server # [   19.699520] systemd[1]: Reached target Host and Network Name Lookups.
server # [   19.702418] systemd[1]: Reached target User and Group Name Lookups.
server # [   19.727132] systemd[1]: Finished resolvconf update.
server # [   19.731890] systemd[1]: Reached target Preparation for Network.
server # [   19.738946] systemd[1]: Starting DHCP Client...
server # [   19.743270] systemd[1]: Starting Extra networking commands....
server # [   19.753577] systemd[1]: Found device /dev/hvc0.
server # [   19.821888] systemd[1]: Found device /dev/ttyAMA0.
server # [   19.831153] systemd[1]: Started backdoor.service.
server # connecting to host...
server: Guest shell says: b'Spawning backdoor root shell...\n'
server: connected to guest root shell
server: (connecting took 6.73 seconds)
server: (finished: waiting for the VM to finish booting, in 6.73 seconds)
server: waiting for unit multi-user.target
server # [   20.031068] dhcpcd[644]: dhcpcd-10.3.2 starting
server # [   20.052551] dhcpcd[690]: dev: loaded udev
server # [   20.118118] 8021q: 802.1Q VLAN Support v1.8
server # [   20.121708] 8021q: adding VLAN 0 to HW filter on device eth0
server # [   20.122090] 8021q: adding VLAN 0 to HW filter on device eth1
server # [   20.192713] systemd[1]: Finished Extra networking commands..
server # [   20.219406] systemd[1]: Reached target Network.
server # [   20.232161] systemd[1]: Starting Permit User Sessions...
server # [   20.260269] cfg80211: Loading compiled-in X.509 certificates for regulatory database
server # [   20.303796] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
server # [   20.304270] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'
server # [   20.309820] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2
server # [   20.310167] cfg80211: failed to load regulatory.db
server # [   20.299096] dhcpcd[690]: no valid interfaces found
server # [   20.303598] dhcpcd[690]: no valid interfaces found
server # [   20.307207] dhcpcd[690]: libudev: received NULL device
server # [   20.310859] dhcpcd[690]: libudev: received NULL device
server # [   20.315307] (udev-worker)[415]: Network interface NamePolicy= disabled on kernel command line.
server # [   20.319430] (udev-worker)[412]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.
server # [   20.330236] (udev-worker)[412]: Network interface NamePolicy= disabled on kernel command line.
server # [   20.331385] systemd[1]: Finished Permit User Sessions.
server # [   20.337869] systemd[1]: Started Getty on tty1.
server # [   20.338537] systemd[1]: Reached target Login Prompts.
server # [   20.409894] systemd-logind[563]: Watching system buttons on /dev/input/event0 (gpio-keys)
server # [   20.457678] systemd[1]: Condition check resulted in Virtio network device being skipped.
server # [   20.466402] systemd[1]: Starting Address configuration of eth1...
server # [   20.495231] dhcpcd[690]: DUID 00:01:00:01:32:2f:8d:65:52:54:00:12:34:56
server # [   20.497119] dhcpcd[690]: eth0: IAID 00:12:34:56
server # [   20.499186] dhcpcd[690]: eth0: adding address fe80::5054:ff:fe12:3456
server # [   20.574233] mousedev: PS/2 mouse device common for all mice
server # [   20.580988] network-addresses-eth1-start[722]: adding address 192.168.1.2/24... done
server # [   20.597685] network-addresses-eth1-start[722]: adding address 2001:db8:1::2/64... done
server # [   20.610696] systemd-logind[563]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)
server # [   20.617945] systemd[1]: Finished Address configuration of eth1.
server # [   20.966030] dhcpcd[690]: eth0: soliciting an IPv6 router
server # [   20.968652] dhcpcd[690]: eth0: Router Advertisement from fe80::2
server # [   20.969513] dhcpcd[690]: eth0: adding address fec0::5054:ff:fe12:3456/64
server # [   20.970425] dhcpcd[690]: eth0: adding route to fec0::/64
server # [   20.971148] dhcpcd[690]: eth0: adding default route via fe80::2
server # [   21.444264] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:09.0/virtio8/input/input3
server # [   21.750668] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.
server # [   21.759519] systemd[1]: Starting Virtual Console Setup...
server # [   21.785635] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
server # [   21.790343] systemd[1]: Stopped Virtual Console Setup.
server # [   21.799611] systemd[1]: Starting Virtual Console Setup...
server # [   21.848339] systemd-logind[563]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)
server # [   22.213701] systemd-vconsole-setup[764]: Configuration of first virtual console was skipped, ignoring remaining ones.
server # [   22.217630] systemd[1]: Finished Virtual Console Setup.
server # [   22.303129] dhcpcd[690]: eth0: soliciting a DHCP lease
server # [   22.308720] dhcpcd[690]: eth0: offered 10.0.2.15 from 10.0.2.2
server # [   22.312483] dhcpcd[690]: eth0: probing address 10.0.2.15/24
server # [   27.778261] dhcpcd[690]: eth0: leased 10.0.2.15 for 86400 seconds
server # [   27.782308] dhcpcd[690]: eth0: adding route to 10.0.2.0/24
server # [   27.782703] dhcpcd[690]: eth0: adding default route via 10.0.2.2
server # [   27.981453] systemd[1]: Started DHCP Client.
server # [   27.986131] dhcpcd[690]: eth0: pid 0 deleted route to 10.0.2.0/24
server # [   27.987486] systemd[1]: Reached target Multi-User System.
server # [   27.988485] systemd[1]: Startup finished in 956ms (kernel) + 13.796s (initrd) + 13.232s (userspace) = 27.985s.
server: (finished: waiting for unit multi-user.target, in 8.10 seconds)
(finished: run the VM test script, in 28.89 seconds)
test script finished in 29.09s
cleanup
kill QemuMachine (pid 47)
client # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/lfh101cfjj8p8npcari9hk0lbqi33yvh-python3-3.14.7/bin/python3.14)
kill QemuMachine (pid 48)
server # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/lfh101cfjj8p8npcari9hk0lbqi33yvh-python3-3.14.7/bin/python3.14)
(finished: cleanup, in 0.39 seconds)
additionally exposed symbols:
    client, server,
    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