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 machine: starting vm machine: QEMU running (pid 45) machine # Disk image does not exist, creating the virtualisation disk image... machine: must succeed: test -e /dev/tpm0 machine # Formatting '/build/vm-state-machine/tmp.ijIBYd3x0l', fmt=raw size=1073741824 machine: waiting for the VM to finish booting machine # mke2fs 1.47.4 (6-Mar-2025) machine # Discarding device blocks: 0/262144 done machine # Creating filesystem with 262144 4k blocks and 65536 inodes machine # Filesystem UUID: e23af6f1-d381-4028-8822-c9f20a04f4f9 machine # Superblock backups stored on blocks: machine # 32768, 98304, 163840, 229376 machine # machine # Allocating group tables: 0/8 done machine # Writing inode tables: 0/8 done machine # Creating journal (8192 blocks): done machine # Writing superblocks and filesystem accounting information: 0/8 done machine # machine # Virtualisation disk image created. machine # Formatting 'empty0.qcow2', fmt=qcow2 cluster_size=65536 extended_l2=off compression_type=zlib size=536870912 lazy_refcounts=off refcount_bits=16 machine # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40] machine # [ 0.000000] Linux version 6.18.48 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Fri Aug 28 06:22:54 UTC 2026 machine # [ 0.000000] KASLR enabled machine # [ 0.000000] random: crng init done machine # [ 0.000000] Machine model: linux,dummy-virt machine # [ 0.000000] efi: UEFI not found. machine # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT machine # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fded4c0-0x7fdf0c3f] machine # [ 0.000000] Zone ranges: machine # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] DMA32 empty machine # [ 0.000000] Normal empty machine # [ 0.000000] Device empty machine # [ 0.000000] Movable zone start for each node machine # [ 0.000000] Early memory node ranges machine # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] cma: Reserved 32 MiB at 0x000000007cc00000 machine # [ 0.000000] psci: probing for conduit method from DT. machine # [ 0.000000] psci: PSCIv1.3 detected in firmware. machine # [ 0.000000] psci: Using standard PSCI v0.2 function IDs machine # [ 0.000000] psci: Trusted OS migration not required machine # [ 0.000000] psci: SMC Calling Convention v1.1 machine # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003) machine # [ 0.000000] percpu: Embedded 76 pages/cpu s186648 r8192 d116456 u311296 machine # [ 0.000000] Detected PIPT I-cache on CPU0 machine # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm) machine # [ 0.000000] CPU features: detected: GICv3 CPU interface machine # [ 0.000000] CPU features: detected: Spectre-v4 machine # [ 0.000000] CPU features: detected: Spectre-BHB machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_38 machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_23 machine # [ 0.000000] alternatives: applying boot alternatives machine # [ 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/s47m858fzr8q96sns0vxi0v86kmzfli5-nixos-system-machine-test/init regInfo=/nix/store/2p9k067mkizh4yv3id3dvpac1g66kgn4-closure-info/registration console=ttyAMA0,115200n8 console=tty0 machine # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/2p9k067mkizh4yv3id3dvpac1g66kgn4-closure-info/registration", will be passed to user space. machine # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes machine # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear) machine # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear) machine # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB machine # [ 0.000000] software IO TLB: area num 1. machine # [ 0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB) machine # [ 0.000000] Fallback order for Node 0: 0 machine # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144 machine # [ 0.000000] Policy zone: DMA machine # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off machine # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1 machine # [ 0.000000] allocated 2097152 bytes of page_ext machine # [ 0.000000] ftrace: allocating 74886 entries in 294 pages machine # [ 0.000000] ftrace: allocated 294 pages with 4 groups machine # [ 0.000000] rcu: Hierarchical RCU implementation. machine # [ 0.000000] rcu: RCU event tracing is enabled. machine # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1. machine # [ 0.000000] Trampoline variant of Tasks RCU enabled. machine # [ 0.000000] Rude variant of Tasks RCU enabled. machine # [ 0.000000] Tracing variant of Tasks RCU enabled. machine # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. machine # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1 machine # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. machine # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. machine # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. machine # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 machine # [ 0.000000] GICv3: 256 SPIs implemented machine # [ 0.000000] GICv3: 0 Extended SPIs implemented machine # [ 0.000000] Root IRQ handler: gic_handle_irq machine # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI machine # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0 machine # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000 machine # [ 0.000000] ITS [mem 0x08080000-0x0809ffff] machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44ce0000 (indirect, esz 8, psz 64K, shr 1) machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44cf0000 (flat, esz 8, psz 64K, shr 1) machine # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000 machine # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000 machine # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention. machine # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns machine # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt). machine # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns machine # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns machine # [ 0.000031] arm-pv: using stolen time PV machine # [ 0.000452] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____) machine # [ 0.000616] Console: colour dummy device 80x25 machine # [ 0.000623] printk: legacy console [tty0] enabled machine # [ 0.000815] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000) machine # [ 0.000822] pid_max: default: 32768 minimum: 301 machine # [ 0.000917] LSM: initializing lsm=capability,landlock,yama,bpf,ima machine # [ 0.001056] landlock: Up and running. machine # [ 0.001059] Yama: becoming mindful. machine # [ 0.001549] LSM support for eBPF active machine # [ 0.001684] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear) machine # [ 0.001709] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear) machine # [ 0.002827] cacheinfo: Unable to detect cache hierarchy for CPU 0 machine # [ 0.003569] rcu: Hierarchical SRCU implementation. machine # [ 0.003573] rcu: Max phase no-delay instances is 1000. machine # [ 0.004759] fsl-mc MSI: its@8080000 domain created machine # [ 0.004854] EFI services will not be available. machine # [ 0.004919] smp: Bringing up secondary CPUs ... machine # [ 0.004927] smp: Brought up 1 node, 1 CPU machine # [ 0.004930] SMP: Total of 1 processors activated. machine # [ 0.004933] CPU: All CPU(s) started at EL1 machine # [ 0.004947] CPU features: detected: Branch Target Identification machine # [ 0.004952] CPU features: detected: ARMv8.4 Translation Table Level machine # [ 0.004955] CPU features: detected: Instruction cache invalidation not required for I/D coherence machine # [ 0.004959] CPU features: detected: Data cache clean to the PoU not required for I/D coherence machine # [ 0.004962] CPU features: detected: Common not Private translations machine # [ 0.004965] CPU features: detected: CRC32 instructions machine # [ 0.004968] CPU features: detected: Data cache clean to Point of Deep Persistence machine # [ 0.004972] CPU features: detected: Data cache clean to Point of Persistence machine # [ 0.004975] CPU features: detected: Data independent timing control (DIT) machine # [ 0.004978] CPU features: detected: E0PD machine # [ 0.004981] CPU features: detected: Enhanced Counter Virtualization machine # [ 0.004984] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF) machine # [ 0.004987] CPU features: detected: Enhanced Virtualization Traps machine # [ 0.004991] CPU features: detected: Fine Grained Traps machine # [ 0.004995] CPU features: detected: Generic authentication (architected QARMA5 algorithm) machine # [ 0.005000] CPU features: detected: RCpc load-acquire (LDAPR) machine # [ 0.005003] CPU features: detected: LSE atomic instructions machine # [ 0.005006] CPU features: detected: Privileged Access Never machine # [ 0.005008] CPU features: detected: PMUv3 machine # [ 0.005011] CPU features: detected: RAS Extension Support machine # [ 0.005014] CPU features: detected: RASv1p1 Extension Support machine # [ 0.005016] CPU features: detected: Random Number Generator machine # [ 0.005019] CPU features: detected: Speculation barrier (SB) machine # [ 0.005022] CPU features: detected: Stage-2 Force Write-Back machine # [ 0.005025] CPU features: detected: TLB range maintenance instructions machine # [ 0.005030] CPU features: detected: Speculative Store Bypassing Safe (SSBS) machine # [ 0.005069] alternatives: applying system-wide alternatives machine # [ 0.008142] CPU features: detected: BBM Level 2 without TLB conflict abort machine # [ 0.008372] Memory: 894876K/1048576K available (24448K kernel code, 7090K rwdata, 26344K rodata, 4736K init, 1107K bss, 112400K reserved, 32768K cma-reserved) machine # [ 0.008785] devtmpfs: initialized machine # [ 0.010531] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear) machine # [ 0.010555] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear). machine # [ 0.010801] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL machine # [ 0.010806] 0 pages in range for non-PLT usage machine # [ 0.010807] 508288 pages in range for PLT usage machine # [ 0.010932] pinctrl core: initialized pinctrl subsystem machine # [ 0.011749] DMI not present or invalid. machine # [ 0.015137] NET: Registered PF_NETLINK/PF_ROUTE protocol family machine # [ 0.017521] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations machine # [ 0.017677] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations machine # [ 0.017841] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations machine # [ 0.017863] audit: initializing netlink subsys (disabled) machine # [ 0.018428] thermal_sys: Registered thermal governor 'fair_share' machine # [ 0.018430] thermal_sys: Registered thermal governor 'bang_bang' machine # [ 0.018434] thermal_sys: Registered thermal governor 'step_wise' machine # [ 0.018436] thermal_sys: Registered thermal governor 'user_space' machine # [ 0.018442] thermal_sys: Registered thermal governor 'power_allocator' machine # [ 0.018473] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1 machine # [ 0.018481] cpuidle: using governor ladder machine # [ 0.018486] cpuidle: using governor menu machine # [ 0.018732] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers. machine # [ 0.018754] ASID allocator initialised with 65536 entries machine # [ 0.019911] Serial: AMBA PL011 UART driver machine # [ 0.025282] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1 machine # [ 0.025455] printk: console [ttyAMA0] enabled machine # [ 0.150171] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages machine # [ 0.150195] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page machine # [ 0.150200] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages machine # [ 0.150205] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page machine # [ 0.150209] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages machine # [ 0.150213] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page machine # [ 0.150218] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages machine # [ 0.150222] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page machine # [ 0.157975] fbcon: Taking over console machine # [ 0.157996] ACPI: Interpreter disabled. machine # [ 0.166584] iommu: Default domain type: Translated machine # [ 0.166599] iommu: DMA domain TLB invalidation policy: strict mode machine # [ 0.167042] SCSI subsystem initialized machine # [ 0.169147] usbcore: registered new interface driver usbfs machine # [ 0.169172] usbcore: registered new interface driver hub machine # [ 0.169195] usbcore: registered new device driver usb machine # [ 0.169522] pps_core: LinuxPPS API ver. 1 registered machine # [ 0.169528] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti machine # [ 0.169538] PTP clock support registered machine # [ 0.169577] EDAC MC: Ver: 3.0.0 machine # [ 0.174380] scmi_core: SCMI protocol bus registered machine # [ 0.175434] FPGA manager framework machine # [ 0.176442] vgaarb: loaded machine # [ 0.177092] clocksource: Switched to clocksource arch_sys_counter machine # [ 0.180243] VFS: Disk quotas dquot_6.6.0 machine # [ 0.180285] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) machine # [ 0.184172] netfs: FS-Cache loaded machine # [ 0.184333] pnp: PnP ACPI: disabled machine # [ 0.188361] NET: Registered PF_INET protocol family machine # [ 0.188530] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear) machine # [ 0.221503] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear) machine # [ 0.221563] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) machine # [ 0.221592] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear) machine # [ 0.221644] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear) machine # [ 0.221719] TCP: Hash tables configured (established 8192 bind 8192) machine # [ 0.221818] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear) machine # [ 0.221877] UDP hash table entries: 512 (order: 3, 32768 bytes, linear) machine # [ 0.221912] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear) machine # [ 0.222003] NET: Registered PF_UNIX/PF_LOCAL protocol family machine # [ 0.222031] NET: Registered PF_XDP protocol family machine # [ 0.222054] PCI: CLS 0 bytes, default 64 machine # [ 0.222327] Trying to unpack rootfs image as initramfs... machine # [ 0.239075] kvm [1]: HYP mode not available machine # [ 0.429694] Initialise system trusted keyrings machine # [ 0.430498] workingset: timestamp_bits=42 max_order=18 bucket_order=0 machine # [ 0.431908] squashfs: version 4.0 (2009/01/31) Phillip Lougher machine # [ 0.432732] 9p: Installing v9fs 9p2000 file system support machine # [ 0.461633] Key type asymmetric registered machine # [ 0.461667] Asymmetric key parser 'x509' registered machine # [ 0.461759] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242) machine # [ 0.464009] io scheduler mq-deadline registered machine # [ 0.464022] io scheduler kyber registered machine # [ 0.477526] pl061_gpio 9030000.pl061: PL061 GPIO chip registered machine # [ 0.478251] ledtrig-cpu: registered to indicate activity on CPUs machine # [ 0.478631] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges: machine # [ 0.478689] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000 machine # [ 0.478712] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000 machine # [ 0.478722] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000 machine # [ 0.478745] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits machine # [ 0.478769] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff] machine # [ 0.478845] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00 machine # [ 0.478854] pci_bus 0000:00: root bus resource [bus 00-ff] machine # [ 0.478860] pci_bus 0000:00: root bus resource [io 0x0000-0xffff] machine # [ 0.478866] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff] machine # [ 0.478871] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff] machine # [ 0.478945] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint machine # [ 0.479400] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint machine # [ 0.479592] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.479609] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.479640] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.479657] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref] machine # [ 0.480128] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint machine # [ 0.480313] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.480329] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.480359] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.480823] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint machine # [ 0.481012] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f] machine # [ 0.481029] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.481059] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.481550] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint machine # [ 0.481735] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.481751] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.481781] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.482249] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint machine # [ 0.482432] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.482448] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.482478] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.482993] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint machine # [ 0.483185] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f] machine # [ 0.483201] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.483232] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.483686] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint machine # [ 0.483875] pci 0000:00:07.0: BAR 0 [io 0x0000-0x007f] machine # [ 0.483891] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.483920] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.484371] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint machine # [ 0.484555] pci 0000:00:08.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.484574] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.484604] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.484620] pci 0000:00:08.0: ROM [mem 0x00000000-0x0003ffff pref] machine # [ 0.485079] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint machine # [ 0.533414] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.533471] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.534051] pci 0000:00:0a.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint machine # [ 0.534240] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.534270] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.534704] pci 0000:00:0b.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint machine # [ 0.534888] pci 0000:00:0b.0: BAR 0 [mem 0x00000000-0x00000fff] machine # [ 0.535142] pci 0000:00:0c.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint machine # [ 0.535446] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x003f] machine # [ 0.535464] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.535496] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.535962] pci 0000:00:0d.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint machine # [ 0.536145] pci 0000:00:0d.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.536161] pci 0000:00:0d.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.536190] pci 0000:00:0d.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.536801] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned machine # [ 0.536813] pci 0000:00:08.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned machine # [ 0.536819] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned machine # [ 0.536870] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned machine # [ 0.536917] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned machine # [ 0.536965] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned machine # [ 0.537013] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned machine # [ 0.537061] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned machine # [ 0.565229] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned machine # [ 0.565303] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned machine # [ 0.565356] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned machine # [ 0.565407] pci 0000:00:0a.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned machine # [ 0.565456] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned machine # [ 0.565616] pci 0000:00:0d.0: BAR 4 [mem 0x800002c000-0x800002ffff 64bit pref]: assigned machine # [ 0.565704] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned machine # [ 0.565729] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned machine # [ 0.565751] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned machine # [ 0.565778] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned machine # [ 0.565804] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned machine # [ 0.565827] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned machine # [ 0.565849] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned machine # [ 0.565874] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned machine # [ 0.565899] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned machine # [ 0.565923] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned machine # [ 0.565947] pci 0000:00:0b.0: BAR 0 [mem 0x1008a000-0x1008afff]: assigned machine # [ 0.565971] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned machine # [ 0.565996] pci 0000:00:0d.0: BAR 1 [mem 0x1008c000-0x1008cfff]: assigned machine # [ 0.566022] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned machine # [ 0.566047] pci 0000:00:07.0: BAR 0 [io 0x1080-0x10ff]: assigned machine # [ 0.566069] pci 0000:00:03.0: BAR 0 [io 0x1100-0x113f]: assigned machine # [ 0.566090] pci 0000:00:0c.0: BAR 0 [io 0x1140-0x117f]: assigned machine # [ 0.566113] pci 0000:00:01.0: BAR 0 [io 0x1180-0x119f]: assigned machine # [ 0.566135] pci 0000:00:02.0: BAR 0 [io 0x11a0-0x11bf]: assigned machine # [ 0.566156] pci 0000:00:04.0: BAR 0 [io 0x11c0-0x11df]: assigned machine # [ 0.566178] pci 0000:00:05.0: BAR 0 [io 0x11e0-0x11ff]: assigned machine # [ 0.566204] pci 0000:00:08.0: BAR 0 [io 0x1200-0x121f]: assigned machine # [ 0.566229] pci 0000:00:0d.0: BAR 0 [io 0x1220-0x123f]: assigned machine # [ 0.566265] pci_bus 0000:00: resource 4 [io 0x0000-0xffff] machine # [ 0.566275] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff] machine # [ 0.566280] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff] machine # [ 0.567637] pci 0000:00:0b.0: enabling device (0000 -> 0002) machine # [ 0.611561] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003) machine # [ 0.622879] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003) machine # [ 0.629278] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003) machine # [ 0.632006] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003) machine # [ 0.642784] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003) machine # [ 0.649319] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003) machine # [ 0.651713] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003) machine # [ 0.662858] virtio-pci 0000:00:08.0: enabling device (0000 -> 0003) machine # [ 0.669330] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002) machine # [ 0.671931] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002) machine # [ 0.682440] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003) machine # [ 0.685099] virtio-pci 0000:00:0d.0: enabling device (0000 -> 0003) machine # [ 0.706432] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled machine # [ 0.709291] msm_serial: driver initialized machine # [ 0.709466] SuperH (H)SCI(F) driver initialized machine # [ 0.709521] STM32 USART driver initialized machine # [ 0.743129] loop: module loaded machine # [ 0.743353] virtio_blk virtio5: 1/0/0 default/read/poll queues machine # [ 0.744248] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB) machine # [ 0.749321] virtio_blk virtio6: 1/0/0 default/read/poll queues machine # [ 0.750096] virtio_blk virtio6: [vdb] 1048576 512-byte logical blocks (537 MB/512 MiB) machine # [ 0.765911] megasas: 07.734.00.00-rc1 machine # [ 0.766791] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff] machine # [ 0.769091] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 machine # [ 0.769139] Intel/Sharp Extended Query Table at 0x0031 machine # [ 0.770944] Using buffer write method machine # [ 0.771033] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff] machine # [ 0.778104] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 machine # [ 0.778165] Intel/Sharp Extended Query Table at 0x0031 machine # [ 0.789786] Using buffer write method machine # [ 0.789836] Concatenating MTD devices: machine # [ 0.789840] (0): "0.flash" machine # [ 0.789844] (1): "0.flash" machine # [ 0.789848] into device "0.flash" machine # [ 1.049604] Freeing initrd memory: 25544K machine # [ 1.056038] tun: Universal TUN/TAP device driver, 1.6 machine # [ 1.060186] thunder_xcv, ver 1.0 machine # [ 1.060235] thunder_bgx, ver 1.0 machine # [ 1.060259] nicpf, ver 1.0 machine # [ 1.060818] e1000: Intel(R) PRO/1000 Network Driver machine # [ 1.060825] e1000: Copyright (c) 1999-2006 Intel Corporation. machine # [ 1.060849] e1000e: Intel(R) PRO/1000 Network Driver machine # [ 1.060859] e1000e: Copyright(c) 1999 - 2015 Intel Corporation. machine # [ 1.060887] igb: Intel(R) Gigabit Ethernet Network Driver machine # [ 1.060893] igb: Copyright (c) 2007-2014 Intel Corporation. machine # [ 1.060914] igbvf: Intel(R) Gigabit Virtual Function Network Driver machine # [ 1.060920] igbvf: Copyright (c) 2009 - 2012 Intel Corporation. machine # [ 1.061057] sky2: driver version 1.30 machine # [ 1.070330] usbcore: registered new interface driver usb-storage machine # [ 1.070389] usbcore: registered new interface driver usbserial_generic machine # [ 1.070402] usbserial: USB Serial support registered for generic machine # [ 1.071067] hv_vmbus: registering driver hyperv_keyboard machine # [ 1.072414] ehci-pci 0000:00:0b.0: EHCI Host Controller machine # [ 1.072442] ehci-pci 0000:00:0b.0: new USB bus registered, assigned bus number 1 machine # [ 1.072657] ehci-pci 0000:00:0b.0: irq 16, io mem 0x1008a000 machine # [ 1.078493] rtc-pl031 9010000.pl031: registered as rtc0 machine # [ 1.078525] rtc-pl031 9010000.pl031: setting system clock to 2026-09-01T03:10:30 UTC (1788232230) machine # [ 1.078952] i2c_dev: i2c /dev entries driver machine # [ 1.082076] ehci-pci 0000:00:0b.0: USB 2.0 started, EHCI 1.00 machine # [ 1.082393] hub 1-0:1.0: USB hub found machine # [ 1.082415] hub 1-0:1.0: 6 ports detected machine # [ 1.086727] sdhci: Secure Digital Host Controller Interface driver machine # [ 1.086737] sdhci: Copyright(c) Pierre Ossman machine # [ 1.087011] Synopsys Designware Multimedia Card Interface Driver machine # [ 1.087410] sdhci-pltfm: SDHCI platform and OF driver helper machine # [ 1.092017] hid: raw HID events driver (C) Jiri Kosina machine # [ 1.092264] usbcore: registered new interface driver usbhid machine # [ 1.092271] usbhid: USB HID core driver machine # [ 1.095336] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available machine # [ 1.096922] drop_monitor: Initializing network drop monitor service machine # [ 1.099177] NET: Registered PF_INET6 protocol family machine # [ 1.100494] Segment Routing with IPv6 machine # [ 1.100526] In-situ OAM (IOAM) with IPv6 machine # [ 1.100555] NET: Registered PF_PACKET protocol family machine # [ 1.102263] 9pnet: Installing 9P2000 support machine # [ 1.104679] Key type dns_resolver registered machine # [ 1.111739] registered taskstats version 1 machine # [ 1.111907] Loading compiled-in X.509 certificates machine # [ 1.120761] Demotion targets for Node 0: null machine # [ 1.120911] Key type .fscrypt registered machine # [ 1.120918] Key type fscrypt-provisioning registered machine # [ 1.121022] ima: No TPM chip found, activating TPM-bypass! machine # [ 1.121042] ima: Allocated hash algorithm: sha1 machine # [ 1.121065] ima: No architecture policies found machine # [ 1.125664] input: gpio-keys as /devices/platform/gpio-keys/input/input0 machine # [ 1.147976] clk: Disabling unused clocks machine # [ 1.148023] PM: genpd: Disabling unused power domains machine # [ 1.152619] Freeing unused kernel memory: 4736K machine # [ 1.152849] Run /init as init process machine # [ 1.172188] systemd[1]: Successfully made /usr/ read-only. machine # [ 1.329208] usb 1-1: new high-speed USB device number 2 using ehci-pci machine # [ 1.479146] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0b.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1 machine # [ 1.507382] systemd[1]: systemd 262-d0fcc5a 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) machine # [ 1.519931] systemd[1]: Detected virtualization qemu. machine # [ 1.522221] systemd[1]: Detected architecture arm64. machine # [ 1.524237] systemd[1]: Running in initrd. machine # [ 1.527045] systemd[1]: Initializing machine ID from random generator. machine # [ 1.530094] systemd[1]: Hostname set to . machine # [ 1.573550] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0b.0-1/input0 machine # [ 1.694191] systemd[1]: bpf-restrict-fs: LSM BPF program attached machine # [ 1.697182] usb 1-2: new high-speed USB device number 3 using ehci-pci machine # [ 1.756208] systemd[1]: Queued start job for default target Initrd Default Target. machine # [ 1.767225] systemd[1]: Created slice Slice /system/modprobe. machine # [ 1.768266] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. machine # [ 1.769353] systemd[1]: Expecting device /dev/disk/by-label/nixos... machine # [ 1.769395] systemd[1]: Reached target Path Units. machine # [ 1.769413] systemd[1]: Reached target Slice Units. machine # [ 1.769479] systemd[1]: Reached target Swaps. machine # [ 1.769504] systemd[1]: Reached target Timer Units. machine # [ 1.769667] systemd[1]: Listening on D-Bus System Message Bus Socket. machine # [ 1.769819] systemd[1]: Listening on Journal Socket (/dev/log). machine # [ 1.769938] systemd[1]: Listening on Journal Sockets. machine # [ 1.770022] systemd[1]: Listening on udev Kernel Socket. machine # [ 1.770040] systemd[1]: Reached target Socket Units. machine # [ 1.778899] systemd[1]: Starting Create List of Static Device Nodes... machine # [ 1.789369] systemd[1]: Starting Load Kernel Module 9pnet_virtio... machine # [ 1.790353] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs machine # [ 1.793417] systemd[1]: Mounting Kernel Configuration File System... machine # [ 1.805346] systemd[1]: Starting Journal Service... machine # [ 1.833715] systemd[1]: Starting Load Kernel Modules... machine # [ 1.833879] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 1.857588] systemd[1]: Starting Coldplug All udev Devices... machine # [ 1.862610] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0b.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2 machine # [ 1.864712] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0b.0-2/input0 machine # [ 1.872298] systemd[1]: Finished Create List of Static Device Nodes. machine # [ 1.875002] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. machine # [ 1.876201] systemd-journald[73]: Collecting audit messages is disabled. machine # [ 1.886579] systemd[1]: Finished Load Kernel Module 9pnet_virtio. machine # [ 1.887110] systemd[1]: Mounted Kernel Configuration File System. machine # [ 1.897845] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... machine # [ 1.939428] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. machine # [ 1.956157] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev machine # [ 1.973543] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0 machine # [ 1.973817] [drm] features: -virgl +edid -resource_blob -host_visible machine # [ 1.973829] [drm] features: -context_init machine # [ 1.974618] [drm] number of scanouts: 1 machine # [ 1.974670] [drm] number of cap sets: 0 machine # [ 1.989965] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. machine # [ 1.992914] virtio-pci 0000:00:09.0: [drm] Registered 1 planes with drm panic machine # [ 1.992943] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0 machine # [ 2.002613] systemd[1]: Starting Create Static Device Nodes in /dev... machine # [ 2.021587] Console: switching to colour frame buffer device 160x50 machine # [ 2.057904] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device machine # [ 2.065937] systemd[1]: Finished Load Kernel Modules. machine # [ 2.070362] systemd[1]: Starting Apply Kernel Variables... machine # [ 2.070140] systemd-modules-load[74]: Inserted module 'dm_mod' machine # [ 2.093596] systemd[1]: Started Journal Service. machine # [ 2.079400] systemd-modules-load[74]: Module 'virtio_balloon' is built in machine # [ 2.082987] systemd-modules-load[74]: Module 'virtio_console' is built in machine # [ 2.085331] systemd-modules-load[74]: Inserted module 'virtio_gpu' machine # [ 2.096645] systemd-modules-load[74]: Module 'virtio_rng' is built in machine # [ 2.099786] systemd[1]: Finished Create Static Device Nodes in /dev. machine # [ 2.112747] systemd[1]: Reached target Preparation for Local File Systems. machine # [ 2.114039] systemd[1]: Reached target Local File Systems. machine # [ 2.115033] systemd[1]: Starting Create System Files and Directories... machine # [ 2.127597] systemd[1]: Starting Rule-based Manager for Device Events and Files... machine # [ 2.132858] systemd[1]: Finished Apply Kernel Variables. machine # [ 2.173300] systemd[1]: Finished Create System Files and Directories. machine # [ 2.219386] systemd-udevd[82]: Using default interface naming scheme 'v261'. machine # [ 2.260196] systemd[1]: Started Rule-based Manager for Device Events and Files. machine # [ 2.340164] systemd[1]: Starting Virtual Console Setup... machine # [ 2.413941] systemd-vconsole-setup[104]: Configuration of first virtual console was skipped, ignoring remaining ones. machine # [ 2.419254] systemd[1]: Finished Virtual Console Setup. machine # [ 3.066617] systemd[1]: Finished Coldplug All udev Devices. machine # [ 3.073229] systemd[1]: Reached target System Initialization. machine # [ 3.074230] systemd[1]: Reached target Basic System. machine # [ 3.243347] (udev-worker)[96]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name. machine # [ 3.262747] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line. machine # [ 3.275883] (udev-worker)[96]: Network interface NamePolicy= disabled on kernel command line. machine # [ 3.327612] systemd[1]: Found device /dev/disk/by-label/nixos. machine # [ 3.330944] systemd[1]: Reached target Initrd Root Device. machine # [ 3.333632] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos... machine # [ 3.381312] systemd-fsck[113]: nixos: clean, 12/65536 files, 13019/262144 blocks machine # [ 3.390135] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos. machine # [ 3.396316] systemd[1]: Mounting /sysroot... machine # [ 3.463825] EXT4-fs (vda): mounted filesystem e23af6f1-d381-4028-8822-c9f20a04f4f9 r/w with ordered data mode. Quota mode: none. machine # [ 3.453011] systemd[1]: Mounted /sysroot. machine # [ 3.455238] systemd[1]: Reached target Initrd Root File System. machine # [ 3.462559] systemd[1]: Mounting /sysroot/nix/.ro-store... machine # [ 3.474603] systemd[1]: Mounting /sysroot/nix/.rw-store... machine # [ 3.490151] systemd[1]: Mounting /sysroot/run... machine # [ 3.506378] systemd[1]: Mounting /sysroot/tmp/shared... machine # [ 3.533695] systemd[1]: Mounting /sysroot/tmp/xchg... machine # [ 3.576184] systemd[1]: Starting Mountpoints Configured in the Real Root... machine # [ 3.579653] systemd[1]: Mounted /sysroot/nix/.rw-store. machine # [ 3.626084] systemd-sysroot-fstab-check[126]: /sysroot should be mounted in the initrd, will request daemon-reload. machine # [ 3.637071] systemd[1]: Starting rw-sysroot-nix-store.service... machine # [ 3.649741] systemd[1]: Mounted /sysroot/nix/.ro-store. machine # [ 3.653145] systemd[1]: Mounted /sysroot/run. machine # [ 3.674494] systemd[1]: Mounted /sysroot/tmp/shared. machine # [ 3.691854] systemd[1]: Mounted /sysroot/tmp/xchg. machine # [ 3.696167] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. machine # [ 3.699543] systemd[1]: Finished rw-sysroot-nix-store.service. machine # [ 3.705345] systemd[1]: Reload requested from client PID 126 ('systemd-sysroot') (unit initrd-parse-etc.service)... machine # [ 3.707007] systemd[1]: Reloading... machine # [ 3.937873] systemd[1]: Reloading finished in 235 ms. machine # [ 3.971510] systemd-sysroot-fstab-check[126]: Requesting initrd-fs.target/start/replace... machine # [ 3.977070] systemd-sysroot-fstab-check[126]: Requesting swap.target/start/replace... machine # [ 3.983962] systemd[1]: Starting rw-sysroot-nix-store.service... machine # [ 3.986902] systemd[1]: initrd-parse-etc.service: Deactivated successfully. machine # [ 3.996991] systemd[1]: Finished Mountpoints Configured in the Real Root. machine # [ 3.998330] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies. machine # [ 4.025738] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. machine # [ 4.027676] systemd[1]: Finished rw-sysroot-nix-store.service. machine # [ 4.033341] systemd[1]: Mounting /sysroot/nix/store... machine # [ 4.082801] systemd[1]: Mounted /sysroot/nix/store. machine # [ 4.085471] systemd[1]: Reached target Initrd File Systems. machine # [ 4.092155] systemd[1]: Starting Find NixOS closure... machine # [ 4.104167] systemd[1]: Starting Create Volatile Files and Directories in the Real Root... machine # [ 4.148955] systemd[1]: Finished Create Volatile Files and Directories in the Real Root. machine # [ 4.156175] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully. machine # [ 4.174833] systemd[1]: Finished Find NixOS closure. machine # [ 4.175732] systemd[1]: Reached target Initrd Default Target. machine # [ 4.181741] systemd[1]: Starting Cleaning Up and Shutting Down Daemons... machine # [ 4.218449] systemd[1]: Stopped target Initrd Default Target. machine # [ 4.220786] systemd[1]: Stopped target Basic System. machine # [ 4.224315] systemd[1]: Stopped target Initrd Root Device. machine # [ 4.226193] systemd[1]: Stopped target Path Units. machine # [ 4.228069] systemd[1]: systemd-ask-password-console.path: Deactivated successfully. machine # [ 4.232273] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch. machine # [ 4.236735] systemd[1]: Stopped target Slice Units. machine # [ 4.238026] systemd[1]: Stopped target Socket Units. machine # [ 4.240854] systemd[1]: Stopped target System Initialization. machine # [ 4.244173] systemd[1]: Stopped target Swaps. machine # [ 4.245930] systemd[1]: Stopped target Timer Units. machine # [ 4.249480] systemd[1]: dbus.socket: Deactivated successfully. machine # [ 4.251658] systemd[1]: Closed D-Bus System Message Bus Socket. machine # [ 4.254359] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully. machine # [ 4.261384] systemd[1]: Stopped Find NixOS closure. machine # [ 4.263020] systemd[1]: Starting Load Kernel Module 9pnet_virtio... machine # [ 4.265194] systemd[1]: Starting rw-sysroot-nix-store.service... machine # [ 4.267297] systemd[1]: systemd-sysctl.service: Deactivated successfully. machine # [ 4.272271] systemd[1]: Stopped Apply Kernel Variables. machine # [ 4.274035] systemd[1]: systemd-modules-load.service: Deactivated successfully. machine # [ 4.279142] systemd[1]: Stopped Load Kernel Modules. machine # [ 4.288304] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully. machine # [ 4.292302] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root. machine # [ 4.304554] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. machine # [ 4.311282] systemd[1]: Stopped Create System Files and Directories. machine # [ 4.314059] systemd[1]: Stopped target Local File Systems. machine # [ 4.320424] systemd[1]: Stopped target Preparation for Local File Systems. machine # [ 4.323288] systemd[1]: systemd-udev-trigger.service: Deactivated successfully. machine # [ 4.325641] systemd[1]: Stopped Coldplug All udev Devices. machine # [ 4.327693] systemd[1]: Stopping Rule-based Manager for Device Events and Files... machine # [ 4.332419] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 4.333556] systemd[1]: Stopped Virtual Console Setup. machine # [ 4.334263] systemd[1]: initrd-cleanup.service: Deactivated successfully. machine # [ 4.335207] systemd[1]: Finished Cleaning Up and Shutting Down Daemons. machine # [ 4.337271] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. machine # [ 4.338349] systemd[1]: Finished Load Kernel Module 9pnet_virtio. machine # [ 4.339214] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. machine # [ 4.340362] systemd[1]: Finished rw-sysroot-nix-store.service. machine # [ 4.349442] systemd[1]: systemd-udevd.service: Deactivated successfully. machine # [ 4.351498] systemd[1]: Stopped Rule-based Manager for Device Events and Files. machine # [ 4.356833] systemd[1]: Starting Cleanup udev Database... machine # [ 4.357750] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. machine # [ 4.358809] systemd[1]: Stopped Create Static Device Nodes in /dev. machine # [ 4.359685] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. machine # [ 4.362632] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully. machine # [ 4.363667] systemd[1]: kmod-static-nodes.service: Deactivated successfully. machine # [ 4.364834] systemd[1]: Stopped Create List of Static Device Nodes. machine # [ 4.395598] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. machine # [ 4.398042] systemd[1]: Finished Cleanup udev Database. machine # [ 4.400540] systemd[1]: Reached target Switch Root. machine # [ 4.403754] systemd[1]: Starting NixOS Activation... machine # [ 4.607287] initrd-nixos-activation-start[173]: booting system configuration /nix/store/s47m858fzr8q96sns0vxi0v86kmzfli5-nixos-system-machine-test machine # [ 4.681288] initrd-nixos-activation-start[173]: running activation script... machine # [ 5.150013] initrd-nixos-activation-start[196]: setting up /etc... machine # [ 5.454769] systemd[1]: initrd-nixos-activation.service: Deactivated successfully. machine # [ 5.458220] systemd[1]: Finished NixOS Activation. machine # [ 5.460229] systemd[1]: Starting Switch Root... machine # [ 5.488474] systemd[1]: Switching root. machine # [ 5.682314] systemd-journald[73]: Received SIGTERM from PID 1 (systemd). machine # [ 6.287767] systemd[1]: systemd 262-d0fcc5a 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) machine # [ 6.298290] systemd[1]: Detected virtualization qemu. machine # [ 6.301744] systemd[1]: Detected architecture arm64. machine # [ 6.305564] systemd[1]: Detected first boot. machine # [ 6.314521] systemd[1]: Initializing machine ID from random generator. machine # [ 6.502830] systemd[1]: bpf-restrict-fs: LSM BPF program attached machine # [ 6.678646] systemd[1]: Applying preset policy. machine # [ 7.207678] systemd[1]: Populated /etc with preset unit settings. machine # [ 7.743756] systemd[1]: initrd-switch-root.service: Deactivated successfully. machine # [ 7.745362] systemd[1]: Stopped initrd-switch-root.service. machine # [ 7.748712] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. machine # [ 7.752488] systemd[1]: Created slice Slice /system/getty. machine # [ 7.755588] systemd[1]: Created slice User and Session Slice. machine # [ 7.757852] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. machine # [ 7.760122] systemd[1]: Started Forward Password Requests to Wall Directory Watch. machine # [ 7.761234] systemd[1]: Expecting device /dev/hvc0... machine # [ 7.762902] systemd[1]: Expecting device /dev/ttyAMA0... machine # [ 7.764554] systemd[1]: Reached target Local Encrypted Volumes. machine # [ 7.766421] systemd[1]: Stopped target initrd-fs.target. machine # [ 7.768791] systemd[1]: Stopped target initrd-root-fs.target. machine # [ 7.769978] systemd[1]: Stopped target initrd-switch-root.target. machine # [ 7.772532] systemd[1]: Reached target Virtual Machines and Containers. machine # [ 7.775000] systemd[1]: Reached target Path Units. machine # [ 7.776886] systemd[1]: Reached target Remote File Systems. machine # [ 7.778925] systemd[1]: Reached target Slice Units. machine # [ 7.780814] systemd[1]: Reached target Swaps. machine # [ 7.785056] systemd[1]: Listening on Query the User Interactively for a Password. machine # [ 7.790395] systemd[1]: Listening on Process Core Dump Socket. machine # [ 7.794688] systemd[1]: Listening on Credential Encryption/Decryption. machine # [ 7.798889] systemd[1]: Listening on Factory Reset Management. machine # [ 7.800194] systemd[1]: Listening on Hostname Service Socket. machine # [ 7.806664] systemd[1]: Starting Journal Log Access Socket... machine # [ 7.808871] systemd[1]: Listening on Journal Audit Socket. machine # [ 7.813650] systemd[1]: Listening on Console Output Muting Service Socket. machine # [ 7.815346] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket. machine # [ 7.817309] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os machine # [ 7.819638] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki machine # [ 7.832247] systemd[1]: Listening on Disk Repartitioning Service Socket. machine # [ 7.833873] systemd[1]: Listening on udev Varlink Socket. machine # [ 7.839531] systemd[1]: Mounting Huge Pages File System... machine # [ 7.843975] systemd[1]: Mounting POSIX Message Queue File System... machine # [ 7.849998] systemd[1]: Mounting Kernel Debug File System... machine # [ 7.863205] systemd[1]: Mounting Kernel Trace File System... machine # [ 7.877694] systemd[1]: Starting Create List of Static Device Nodes... machine # [ 7.885353] systemd[1]: Starting Load Kernel Module 9pnet_virtio... machine # [ 7.887798] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs machine # [ 7.903623] systemd[1]: Mounting Kernel Configuration File System... machine # [ 7.905679] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm machine # [ 7.913927] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore machine # [ 7.932719] systemd[1]: Starting Load Kernel Module fuse... machine # [ 7.935802] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67 machine # [ 8.000939] systemd[1]: Starting Journal Service... machine # [ 8.066896] fuse: init (API version 7.45) machine # [ 8.067783] systemd[1]: Starting Load Kernel Modules... machine # [ 8.093355] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer... machine # [ 8.123282] systemd[1]: Starting Remount Root and Kernel File Systems... machine # [ 8.131026] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 8.147577] systemd-journald[269]: Collecting audit messages is enabled. machine # [ 8.151315] systemd[1]: Queued start job for default target Multi-User System. machine # [ 8.152934] systemd[1]: systemd-journald.service: Deactivated successfully. machine # [ 8.175100] systemd[1]: Starting Coldplug All udev Devices... machine # [ 8.183879] systemd[1]: Started Journal Service. machine # [ 8.183507] systemd[1]: Listening on Journal Log Access Socket. machine # [ 8.187249] systemd-modules-load[270]: Module 'atkbd' is built in machine # [ 8.193945] systemd-modules-load[270]: Module 'loop' is built in machine # [ 8.194915] systemd[1]: Mounted Huge Pages File System. machine # [ 8.195783] systemd[1]: Mounted POSIX Message Queue File System. machine # [ 8.207927] systemd[1]: Mounted Kernel Debug File System. machine # [ 8.212544] systemd[1]: Mounted Kernel Trace File System. machine # [ 8.213441] systemd[1]: Finished Create List of Static Device Nodes. machine # [ 8.214506] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. machine # [ 8.215583] systemd[1]: Finished Load Kernel Module 9pnet_virtio. machine # [ 8.225605] systemd[1]: Mounted Kernel Configuration File System. machine # [ 8.233592] systemd[1]: modprobe@fuse.service: Deactivated successfully. machine # [ 8.237627] systemd[1]: Finished Load Kernel Module fuse. machine # [ 8.239561] systemd[1]: Finished Load Kernel Modules.[ 8.261289] EXT4-fs (vda): re-mounted e23af6f1-d381-4028-8822-c9f20a04f4f9. machine # machine # [ 8.262751] systemd[1]: Mounting FUSE Control File System... machine # [ 8.271601] systemd[1]: Starting Firewall... machine # [ 8.277247] systemd[1]: Starting Apply Kernel Variables... machine # [ 8.293542] systemd-oomd[272]: No swap; memory pressure usage will be degraded machine # [ 8.327223] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... machine # [ 8.344960] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer. machine # [ 8.359805] systemd[1]: Finished Remount Root and Kernel File Systems. machine # [ 8.375842] systemd[1]: Listening on Disk Image Download Service Socket. machine # [ 8.399881] systemd[1]: Starting Flush Journal to Persistent Storage... machine # [ 8.401746] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore machine # [ 8.424825] systemd[1]: Starting Load/Save OS Random Seed... machine # [ 8.430108] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 8.481185] systemd[1]: Finished Apply Kernel Variables. machine # [ 8.517065] systemd[1]: Mounted FUSE Control File System. machine # [ 8.562099] systemd-journald[269]: Received client request to flush runtime journal. machine # [ 8.622270] systemd[1]: Finished Load/Save OS Random Seed. machine # [ 8.627188] systemd[1]: Reached target First Boot Complete. machine # [ 8.633765] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. machine # [ 8.639072] systemd[1]: Starting Create Static Device Nodes in /dev... machine # [ 8.645165] systemd[1]: Finished Flush Journal to Persistent Storage. machine # [ 8.734584] systemd[1]: Finished Create Static Device Nodes in /dev. machine # [ 8.738889] systemd[1]: Reached target Preparation for Local File Systems. machine # [ 8.750377] systemd[1]: Mounting /run/wrappers... machine # [ 8.768163] systemd[1]: Starting Rule-based Manager for Device Events and Files... machine # [ 8.841239] systemd[1]: Mounted /run/wrappers. machine # [ 8.843229] systemd[1]: Reached target Local File Systems. machine # [ 8.852533] systemd[1]: Listening on Boot Loader Control Service Socket. machine # [ 8.857317] systemd[1]: Starting register-nix-paths.service... machine # [ 8.860206] systemd[1]: Starting Create SUID/SGID Wrappers... machine # [ 8.862949] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met. machine # [ 8.876636] systemd[1]: Starting Save Transient machine-id to Disk... machine # [ 8.916187] systemd[1]: Starting Create System Files and Directories... machine # [ 9.048545] systemd[1]: etc-machine\x2did.mount: Deactivated successfully. machine # [ 9.067475] systemd[1]: Finished Save Transient machine-id to Disk. machine # [ 9.194537] systemd[1]: Finished Create System Files and Directories. machine # [ 9.209359] systemd[1]: Starting Rebuild Journal Catalog... machine # [ 9.225838] systemd[1]: Starting Record System Boot/Shutdown in UTMP... machine # [ 9.396198] systemd[1]: Finished Record System Boot/Shutdown in UTMP. machine # [ 9.494827] systemd[1]: Finished Rebuild Journal Catalog. machine # [ 9.509537] systemd[1]: Starting Update is Completed... machine # [ 9.578988] systemd-udevd[314]: Using default interface naming scheme 'v261'. machine # [ 9.627040] systemd[1]: Finished Update is Completed. machine # [ 9.855935] systemd[1]: Started Rule-based Manager for Device Events and Files. machine # [ 10.249024] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully. machine # [ 10.258161] systemd[1]: Finished Create SUID/SGID Wrappers. machine # [ 10.755281] systemd[1]: Finished register-nix-paths.service. machine # [ 10.827011] systemd[1]: Finished Coldplug All udev Devices. machine # [ 10.832540] systemd[1]: Reached target System Initialization. machine # [ 10.838052] systemd[1]: Started Discard unused filesystem blocks once a week. machine # [ 10.842542] systemd[1]: Started Daily Cleanup of Temporary Directories. machine # [ 10.850548] systemd[1]: Reached target Timer Units. machine # [ 10.851381] systemd[1]: Listening on D-Bus System Message Bus Socket. machine # [ 10.853540] systemd[1]: Listening on Nix Daemon Socket. machine # [ 10.857893] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket. machine # [ 10.868576] systemd[1]: Reached target Socket Units. machine # [ 10.869543] systemd[1]: Reached target Basic System. machine # [ 10.870718] systemd[1]: Starting Import lastlog data into lastlog2 database... machine # [ 10.880239] systemd[1]: Starting Name Service Cache Daemon (nsncd)... machine # [ 10.884659] systemd[1]: Starting Post-Boot Actions... machine # [ 10.915418] systemd[1]: Started Reset console on configuration changes. machine # [ 10.955048] systemd[1]: Starting resolvconf update... machine # [ 11.014322] systemd[1]: Starting D-Bus System Message Bus... machine # [ 11.022231] systemd[1]: Finished Post-Boot Actions. machine # [ 11.079430] nsncd[475]: Sep 01 03:10:40.517 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" machine # [ 11.093050] systemd[1]: Started Name Service Cache Daemon (nsncd). machine # [ 11.106619] systemd[1]: Finished Firewall. machine # [ 11.120234] systemd[1]: Reached target Host and Network Name Lookups. machine # [ 11.123520] systemd[1]: Reached target User and Group Name Lookups. machine # [ 11.140133] systemd[1]: Starting User Login Management... machine # [ 11.192181] systemd[1]: Finished Import lastlog data into lastlog2 database. machine # [ 11.297724] dbus-broker-launch[487]: Looking up NSS user entry for 'systemd-timesync'... machine # [ 11.306682] dbus-broker-launch[487]: NSS returned no entry for 'systemd-timesync' machine # [ 11.312152] dbus-broker-launch[487]: Invalid user-name in /nix/store/d2005fd0773b9jz7m31rbndmj9q5as51-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync" machine # [ 11.342231] systemd-logind[507]: New seat seat0. machine # [ 11.351451] systemd[1]: Started User Login Management. machine # [ 11.359954] systemd[1]: Starting linger-users.service... machine # [ 11.364808] systemd[1]: Started D-Bus System Message Bus. machine # [ 11.399719] systemd[1]: Stopped target Host and Network Name Lookups. machine # [ 11.405786] systemd[1]: Stopping Host and Network Name Lookups... machine # [ 11.412268] systemd[1]: Stopped target User and Group Name Lookups. machine # [ 11.419625] systemd[1]: Stopping User and Group Name Lookups... machine # [ 11.423258] systemd[1]: Stopping Name Service Cache Daemon (nsncd)... machine # [ 11.431240] dbus-broker-launch[487]: Ready machine # [ 11.436857] systemd[1]: nscd.service: Deactivated successfully. machine # [ 11.440580] systemd[1]: Stopped Name Service Cache Daemon (nsncd). machine # [ 11.464532] systemd[1]: Starting Name Service Cache Daemon (nsncd)... machine # [ 11.488250] systemd[1]: linger-users.service: Deactivated successfully. machine # [ 11.491280] systemd[1]: Finished linger-users.service. machine # [ 11.560622] systemd[1]: Started Name Service Cache Daemon (nsncd). machine # [ 11.564941] systemd[1]: Reached target Host and Network Name Lookups. machine # [ 11.569965] nsncd[559]: Sep 01 03:10:41.002 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" machine # [ 11.575170] systemd[1]: Reached target User and Group Name Lookups. machine # [ 11.587591] systemd[1]: Finished resolvconf update. machine # [ 11.590494] systemd[1]: Reached target Preparation for Network. machine # [ 11.599885] systemd[1]: Starting DHCP Client... machine # [ 11.607775] systemd[1]: Starting Extra networking commands.... machine # [ 11.865125] dhcpcd[587]: dhcpcd-10.3.2 starting machine # [ 11.888936] dhcpcd[618]: dev: loaded udev machine # [ 11.894851] dhcpcd[618]: no valid interfaces found machine # [ 11.898373] dhcpcd[618]: no valid interfaces found machine # [ 11.901508] dhcpcd[618]: libudev: received NULL device machine # [ 11.904216] dhcpcd[618]: libudev: received NULL device machine # [ 11.955319] systemd[1]: Finished Extra networking commands.. machine # [ 11.959476] systemd[1]: Reached target Network. machine # [ 11.964759] systemd[1]: Starting Permit User Sessions... machine # [ 12.021015] systemd[1]: Finished Permit User Sessions. machine # [ 12.029390] systemd[1]: Started Getty on tty1. machine # [ 12.031722] systemd[1]: Reached target Login Prompts. machine # [ 12.272592] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/virtio9/input/input3 machine # [ 12.592294] tpm_tis c000000.tpm_tis: 2.0 TPM (device-id 0x1, rev-id 1) machine # [ 12.597492] tpm tpm0: A TPM error (256) occurred attempting the self test machine # [ 12.597865] tpm tpm0: starting up the TPM manually machine # [ 12.752262] systemd[1]: Starting Virtual Console Setup... machine # [ 12.791480] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 12.796419] systemd[1]: Stopped Virtual Console Setup. machine # [ 12.806931] systemd[1]: Starting Virtual Console Setup... machine # [ 12.849989] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs machine # [ 13.119250] systemd[1]: Condition check resulted in /dev/hvc0 being skipped. machine # [ 13.172608] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped. machine # [ 13.182189] systemd[1]: Started backdoor.service. machine # [ 13.312568] 8021q: 802.1Q VLAN Support v1.8 machine # connecting to host... machine # [ 13.336707] (udev-worker)[654]: Network interface NamePolicy= disabled on kernel command line. machine # [ 13.346533] (udev-worker)[645]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name. machine # [ 13.354874] (udev-worker)[645]: Network interface NamePolicy= disabled on kernel command line. machine: Guest shell says: b'Spawning backdoor root shell...\n' machine: connected to guest root shell machine: (connecting took 13.96 seconds) machine: (finished: waiting for the VM to finish booting, in 13.96 seconds) machine: (finished: must succeed: test -e /dev/tpm0, in 14.04 seconds) machine: must succeed: test -e /dev/tpmrm0 machine # [ 13.501936] cfg80211: Loading compiled-in X.509 certificates for regulatory database machine # [ 13.501811] systemd-vconsole-setup[656]: Configuration of first virtual console was skipped, ignoring remaining ones. machine # [ 13.514519] systemd[1]: Finished Virtual Console Setup. machine: (finished: must succeed: test -e /dev/tpmrm0, in 0.07 seconds) machine: must succeed: systemd-cryptenroll --tpm2-device=list machine # [ 13.562575] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7' machine # [ 13.563206] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600' machine # [ 13.568674] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2 machine # [ 13.569079] cfg80211: failed to load regulatory.db machine: (finished: must succeed: systemd-cryptenroll --tpm2-device=list, in 0.10 seconds) machine: must succeed: echo -n lukspass | cryptsetup luksFormat -q /dev/vdb - machine # [ 13.755993] systemd[1]: Condition check resulted in Virtio network device being skipped. machine # [ 13.776081] systemd[1]: Starting Address configuration of eth1... machine # [ 13.921679] 8021q: adding VLAN 0 to HW filter on device eth0 machine # [ 13.908305] dhcpcd[618]: eth0: waiting for carrier machine # [ 13.913354] dhcpcd[618]: eth0: carrier acquired machine # [ 13.955441] dhcpcd[618]: DUID 00:01:00:01:32:28:fe:b3:52:54:00:12:34:56 machine # [ 13.960528] dhcpcd[618]: eth0: IAID 00:12:34:56 machine # [ 13.965798] dhcpcd[618]: eth0: adding address fe80::5054:ff:fe12:3456 machine # [ 13.993753] 8021q: adding VLAN 0 to HW filter on device eth1 machine # [ 14.031699] network-addresses-eth1-start[691]: adding address 192.168.1.1/24... done machine # [ 14.064178] network-addresses-eth1-start[691]: adding address 2001:db8:1::1/64... done machine # [ 14.113313] systemd[1]: Finished Address configuration of eth1. machine # [ 14.160154] systemd-logind[507]: Watching system buttons on /dev/input/event0 (gpio-keys) machine # [ 14.453256] mousedev: PS/2 mouse device common for all mice machine # [ 14.678968] systemd-logind[507]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard) machine # [ 14.952733] dhcpcd[618]: eth0: soliciting a DHCP lease machine # [ 14.962287] dhcpcd[618]: eth0: offered 10.0.2.15 from 10.0.2.2 machine # [ 14.969386] dhcpcd[618]: eth0: probing address 10.0.2.15/24 machine # [ 15.625196] dhcpcd[618]: eth0: soliciting an IPv6 router machine # [ 15.627269] dhcpcd[618]: eth0: Router Advertisement from fe80::2 machine # [ 15.628290] dhcpcd[618]: eth0: adding address fec0::5054:ff:fe12:3456/64 machine # [ 15.636307] dhcpcd[618]: eth0: adding route to fec0::/64 machine # [ 15.637126] dhcpcd[618]: eth0: adding default route via fe80::2 machine # [ 17.252603] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 17.252764] systemd[1]: Stopped Virtual Console Setup. machine # [ 17.252819] systemd[1]: Stopping Virtual Console Setup... machine # [ 17.266320] systemd[1]: Starting Virtual Console Setup... machine # [ 17.316924] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch. machine # [ 17.337206] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 17.345552] systemd[1]: Stopped Virtual Console Setup. machine # [ 17.372439] systemd[1]: Starting Virtual Console Setup... machine # [ 17.399893] systemd[1]: Reached target Trusted Platform Module. machine # [ 17.487348] systemd-logind[507]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard) machine # [ 17.913324] systemd-vconsole-setup[725]: Configuration of first virtual console was skipped, ignoring remaining ones. machine # [ 17.922941] systemd[1]: Finished Virtual Console Setup. machine # [ 19.589522] dhcpcd[618]: eth0: leased 10.0.2.15 for 86400 seconds machine # [ 19.592253] dhcpcd[618]: eth0: adding route to 10.0.2.0/24 machine # [ 19.593126] dhcpcd[618]: eth0: adding default route via 10.0.2.2 machine # [ 19.882806] systemd[1]: Started DHCP Client. machine # [ 19.890076] systemd[1]: Reached target Multi-User System. machine # [ 19.891004] systemd[1]: Startup finished in 1.140s (kernel) + 4.645s (initrd) + 14.103s (userspace) = 19.889s. machine: (finished: must succeed: echo -n lukspass | cryptsetup luksFormat -q /dev/vdb -, in 12.96 seconds) machine: must succeed: PASSWORD=lukspass systemd-cryptenroll --tpm2-device=auto --tpm2-pcrs=7 /dev/vdb machine # TPM2 device supports the sha256 PCR bank but none of the selected PCRs are initialized! Firmware apparently did not measure into any of them. Proceeding anyway, but the PCR policy is effectively unenforced! machine # New TPM2 token enrolled as key slot 1. machine: (finished: must succeed: PASSWORD=lukspass systemd-cryptenroll --tpm2-device=auto --tpm2-pcrs=7 /dev/vdb, in 4.01 seconds) machine: must succeed: echo 'luks /dev/vdb - tpm2-device=auto' >> /etc/crypttab machine: (finished: must succeed: echo 'luks /dev/vdb - tpm2-device=auto' >> /etc/crypttab, in 0.05 seconds) machine: waiting for the VM to power off additionally exposed symbols: machine, vlan1, start_all, test_script, machines, machines_qemu, machines_nspawn, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, BaseMachine, QemuMachine, NspawnMachine, t, debug, dump_machine_ssh machine # [ 30.665725] systemd-logind[507]: poweroff requested from client PID 800 ('poweroff') (unit backdoor.service)... machine # [ 30.671647] systemd-logind[507]: System is powering down. machine # [ 30.684614] systemd-logind[507]: The system will power off now! machine # [ 30.697676] systemd[1]: Removed slice Slice /system/modprobe. machine # [ 30.701177] systemd[1]: Stopped target Multi-User System. machine # [ 30.702133] systemd[1]: Stopped target Login Prompts. machine # [ 30.702862] systemd[1]: Stopped target Virtual Machines and Containers. machine # [ 30.703798] systemd[1]: Stopped target Host and Network Name Lookups. machine # [ 30.707361] systemd[1]: Stopped target Timer Units. machine # [ 30.708791] systemd[1]: fstrim.timer: Deactivated successfully. machine # [ 30.709963] systemd[1]: Stopped Discard unused filesystem blocks once a week. machine # [ 30.711167] systemd[1]: systemd-tmpfiles-clean.timer: Deactivated successfully. machine # [ 30.715394] systemd[1]: Stopped Daily Cleanup of Temporary Directories. machine # [ 30.721435] systemd[1]: Stopped target Trusted Platform Module. machine # [ 30.725252] dhcpcd[618]: received SIGTERM, stopping machine # [ 30.728641] systemd[1]: systemd-rfkill.socket: Deactivated successfully. machine # [ 30.731826] dhcpcd[618]: eth0: removing interface machine # [ 30.736733] systemd[1]: Closed Load/Save RF Kill Switch Status /dev/rfkill Watch. machine # [ 30.737910] dhcpcd[618]: eth0: deleting address fec0::5054:ff:fe12:3456/64 machine # [ 30.738892] systemd[1]: Mounting /run/initramfs... machine # [ 30.739617] dhcpcd[618]: eth0: deleting route to fec0::/64 machine # [ 30.745981] systemd[1]: Stopping backdoor.service... machine # [ 30.748593] dhcpcd[618]: eth0: deleting default route via fe80::2 machine # [ 30.752353] systemd[1]: Stopping DHCP Client... machine # [ 30.753944] dhcpcd[618]: script_status: /nix/store/8khzg7vlnmh8m4x1l2v6zabp22rlqj01-dhcpcd-10.3.2/libexec/dhcpcd-run-hooks: Terminated machine # [ 30.759124] systemd[1]: Stopping Getty on tty1... machine # [ 30.761243] dhcpcd[618]: eth0: deleting address fe80::5054:ff:fe12:3456 machine # [ 30.764308] systemd[1]: lastlog2-import.service: Deactivated successfully. machine # [ 30.767072] dhcpcd[618]: eth0: deleting route to 10.0.2.0/24 machine # [ 30.772925] systemd[1]: Stopped Import lastlog data into lastlog2 database. machine # [ 30.779101] dhcpcd[618]: eth0: deleting default route via 10.0.2.2 machine # [ 30.787464] systemd[1]: Stopping Address configuration of eth1... machine # [ 30.794024] systemd[1]: Stopping Post-Boot Actions... machine # [ 30.802282] systemd[1]: reload-systemd-vconsole-setup.service: Deactivated successfully. machine # [ 30.806057] dhcpcd[618]: dhcpcd exited machine # [ 30.809400] systemd[1]: Stopped Reset console on configuration changes. machine # [ 30.812310] systemd[1]: Stopping User Login Management... machine # [ 30.814675] systemd[1]: systemd-machine-id-commit.service: Deactivated successfully. machine # [ 30.820575] systemd[1]: Stopped Save Transient machine-id to Disk. machine # [ 30.821589] systemd[1]: Stopped target First Boot Complete. machine # [ 30.822418] systemd[1]: Stopping Userspace Out-Of-Memory (OOM) Killer... machine # [ 30.823359] systemd[1]: Stopping Load/Save OS Random Seed... machine # [ 30.828601] systemd[1]: systemd-oomd.service: Deactivated successfully. machine # [ 30.831129] systemd[1]: Stopped Userspace Out-Of-Memory (OOM) Killer. machine # [ 30.845851] systemd[1]: systemd-logind.service: Deactivated successfully. machine # [ 30.859645] systemd[1]: Stopped User Login Management. machine # [ 30.875397] network-addresses-eth1-pre-stop[811]: deleting address 192.168.1.1/24... done machine # [ 30.893985] systemd[1]: dhcpcd.service: Deactivated successfully. machine # [ 30.899887] network-addresses-eth1-pre-stop[811]: deleting address 2001:db8:1::1/64... done machine # [ 30.905470] systemd[1]: Stopped DHCP Client. machine # [ 30.909485] systemd[1]: dhcpcd.service: Consumed 255ms CPU time over 19.297s wall clock time, 5.5M memory peak, 8K written to disk, 96B incoming IP traffic, 56B outgoing IP traffic. machine # [ 30.929635] systemd[1]: getty@tty1.service: Deactivated successfully. machine # [ 30.935494] systemd[1]: Stopped Getty on tty1. machine # [ 30.946113] systemd[1]: backdoor.service: Deactivated successfully. machine # [ 30.947866] systemd[1]: Stopped backdoor.service. machine # [ 30.950289] systemd[1]: backdoor.service: Consumed 12.771s CPU time over 17.766s wall clock time, 359.9M memory peak, 939K read from disk, 32.5M written to disk. machine # [ 30.955431] systemd[1]: Mounted /run/initramfs. machine # [ 30.959161] systemd[1]: network-addresses-eth1.service: Deactivated successfully. machine # [ 30.960778] systemd[1]: Stopped Address configuration of eth1. machine # [ 30.963065] systemd[1]: post-boot.service: Deactivated successfully. machine # [ 30.965383] systemd[1]: Stopped Post-Boot Actions. machine # [ 30.970265] systemd[1]: Removed slice Slice /system/getty. machine # [ 30.976617] systemd[1]: Starting Generate shutdown ramfs... machine # [ 30.982134] systemd[1]: Stopping Permit User Sessions... machine # [ 31.041658] systemd[1]: systemd-user-sessions.service: Deactivated successfully. machine # [ 31.048279] systemd[1]: Stopped Permit User Sessions. machine # [ 31.051405] systemd[1]: Stopped target Network. machine # [ 31.052547] systemd[1]: Stopped target User and Group Name Lookups. machine # [ 31.053518] systemd[1]: Stopped target Remote File Systems. machine # [ 31.054325] systemd[1]: network-local-commands.service: Deactivated successfully. machine # [ 31.055367] systemd[1]: Stopped Extra networking commands.. machine # [ 31.060860] systemd[1]: Stopped target Preparation for Network. machine # [ 31.065240] systemd[1]: Stopping Firewall... machine # [ 31.068633] systemd[1]: Stopping Name Service Cache Daemon (nsncd)... machine # [ 31.073523] systemd[1]: resolvconf.service: Deactivated successfully. machine # [ 31.082057] systemd[1]: Stopped resolvconf update. machine # [ 31.085368] systemd[1]: nscd.service: Deactivated successfully. machine # [ 31.087918] systemd[1]: Stopped Name Service Cache Daemon (nsncd). machine # [ 31.101141] systemd[1]: Stopped target Basic System. machine # [ 31.103400] systemd[1]: Stopped target Path Units. machine # [ 31.108458] systemd[1]: Stopped target Slice Units. machine # [ 31.113415] systemd[1]: Removed slice User and Session Slice. machine # [ 31.120520] make-initrd-ng[833]: /etc/initrd-release -> /nix/store/vq8whsd6zaycfzm97b62z2qxfql1wiz4-etc-os-release machine # [ 31.125059] make-initrd-ng[833]: /etc/os-release -> /nix/store/vq8whsd6zaycfzm97b62z2qxfql1wiz4-etc-os-release machine # [ 31.129677] make-initrd-ng[833]: /shutdown -> /nix/store/aap1fb66p72ib35mngb3ccjh9halipzf-systemd-262-d0fcc5a/lib/systemd/systemd-shutdown machine # [ 31.138940] systemd[1]: Stopped target Socket Units. machine # [ 31.142374] systemd[1]: nix-daemon.socket: Deactivated successfully. machine # [ 31.147206] systemd[1]: Closed Nix Daemon Socket. machine # [ 31.149666] systemd[1]: systemd-hostnamed.socket: Deactivated successfully. machine # [ 31.152421] systemd[1]: Closed Hostname Service Socket. machine # [ 31.156445] systemd[1]: systemd-importd.socket: Deactivated successfully. machine # [ 31.160791] systemd[1]: Closed Disk Image Download Service Socket. machine # [ 31.165446] systemd[1]: systemd-machined.socket: Deactivated successfully. machine # [ 31.168826] systemd[1]: Closed Virtual Machine and Container Registration Service Socket. machine # [ 31.173333] systemd[1]: systemd-mute-console.socket: Deactivated successfully. machine # [ 31.177979] systemd[1]: Closed Console Output Muting Service Socket. machine # [ 31.179891] systemd[1]: systemd-oomd.socket: Deactivated successfully. machine # [ 31.183117] systemd[1]: Closed Userspace Out-Of-Memory (OOM) Killer Socket. machine # [ 31.187234] systemd[1]: systemd-repart.socket: Deactivated successfully. machine # [ 31.188979] systemd[1]: Closed Disk Repartitioning Service Socket. machine # [ 31.193171] dbus-broker[547]: Dispatched 1190 messages @ 4(±7)μs / message. machine # [ 31.196858] systemd[1]: Stopping D-Bus System Message Bus... machine # [ 31.202191] systemd[1]: dbus-broker.service: Deactivated successfully. machine # [ 31.204720] systemd[1]: Stopped D-Bus System Message Bus. machine # [ 31.206288] systemd[1]: dbus.socket: Deactivated successfully. machine # [ 31.207667] systemd[1]: Closed D-Bus System Message Bus Socket. machine # [ 31.209846] systemd[1]: Stopped target System Initialization. machine # [ 31.211387] systemd[1]: Stopped target Local Encrypted Volumes. machine # [ 31.214790] systemd[1]: systemd-ask-password-console.path: Deactivated successfully. machine # [ 31.217858] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch. machine # [ 31.220572] systemd[1]: systemd-ask-password-wall.path: Deactivated successfully. machine # [ 31.223391] systemd[1]: Stopped Forward Password Requests to Wall Directory Watch. machine # [ 31.228815] systemd[1]: register-nix-paths.service: Deactivated successfully. machine # [ 31.231140] systemd[1]: Stopped register-nix-paths.service. machine # [ 31.235522] systemd[1]: systemd-sysctl.service: Deactivated successfully. machine # [ 31.238666] systemd[1]: Stopped Apply Kernel Variables. machine # [ 31.244202] systemd[1]: systemd-coredump.socket: Deactivated successfully. machine # [ 31.246126] systemd[1]: Closed Process Core Dump Socket. machine # [ 31.249334] systemd[1]: systemd-update-done.service: Deactivated successfully. machine # [ 31.251976] systemd[1]: Stopped Update is Completed. machine # [ 31.257844] systemd[1]: systemd-journal-catalog-update.service: Deactivated successfully. machine # [ 31.261459] systemd[1]: Stopped Rebuild Journal Catalog. machine # [ 31.262626] systemd[1]: Stopping Record System Boot/Shutdown in UTMP... machine # [ 31.280442] systemd[1]: systemd-update-utmp.service: Deactivated successfully. machine # [ 31.286902] systemd[1]: Stopped Record System Boot/Shutdown in UTMP. machine # [ 31.290598] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. machine # [ 31.293542] systemd[1]: Stopped Create System Files and Directories. machine # [ 31.298131] systemd[1]: Stopped target Local File Systems. machine # [ 31.301234] systemd[1]: Unmounting /run/keys... machine # [ 31.304937] systemd[1]: Unmounting /run/wrappers... machine # [ 31.348244] systemd[1]: firewall.service: Deactivated successfully. machine # [ 31.352190] systemd[1]: Stopped Firewall. machine # [ 31.358489] systemd[1]: systemd-random-seed.service: Deactivated successfully. machine # [ 31.361974] systemd[1]: Stopped Load/Save OS Random Seed. machine # [ 31.368188] systemd[1]: systemd-modules-load.service: Deactivated successfully. machine # [ 31.371160] systemd[1]: Stopped Load Kernel Modules. machine # [ 31.395409] systemd[1]: run-keys.mount: Deactivated successfully. machine # [ 31.399542] systemd[1]: Unmounted /run/keys. machine # [ 31.400414] systemd[1]: run-wrappers.mount: Deactivated successfully. machine # [ 31.402983] systemd[1]: Unmounted /run/wrappers. machine # [ 31.411266] systemd[1]: Stopped target Preparation for Local File Systems. machine # [ 31.412654] systemd[1]: Stopped target Swaps. machine # [ 31.413374] systemd[1]: Reached target Unmount All Filesystems. machine # [ 31.414218] systemd[1]: systemd-remount-fs.service: Deactivated successfully. machine # [ 31.415211] systemd[1]: Stopped Remount Root and Kernel File Systems. machine # [ 31.416563] systemd[1]: systemd-fsck-root.service: Deactivated successfully. machine # [ 31.417973] systemd[1]: Stopped File System Check on Root Device. machine # [ 31.418917] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. machine # [ 31.420137] systemd[1]: Stopped Create Static Device Nodes in /dev. machine # [ 31.421109] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. machine # [ 31.422598] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully. machine # [ 31.493087] systemd[1]: generate-shutdown-ramfs.service: Deactivated successfully. machine # [ 31.496290] systemd[1]: Finished Generate shutdown ramfs. machine # [ 31.500857] systemd[1]: Reached target System Shutdown. machine # [ 31.501929] systemd[1]: Reached target Late Shutdown Services. machine # [ 31.503448] systemd[1]: systemd-poweroff.service: Deactivated successfully. machine # [ 31.506887] systemd[1]: Finished System Power Off. machine # [ 31.509849] systemd[1]: Reached target System Power Off. machine # [ 31.512311] systemd[1]: Shutting down. machine # [ 31.710813] systemd-shutdown[1]: Syncing filesystems and block devices. machine # [ 33.217663] systemd-shutdown[1]: Sending SIGTERM to remaining processes... machine # [ 33.239652] systemd-journald[269]: Received SIGTERM from PID 1 (systemd-shutdow). machine # [ 37.849053] systemd-shutdown[1]: Sending SIGKILL to remaining processes... machine # [ 37.862800] systemd-shutdown[1]: Unmounting file systems. machine # [ 37.874258] (sd-umount)[865]: Unmounting '/run/credentials/systemd-journald.service'. machine # [ 37.880194] (sd-remount)[866]: Remounting '/nix/store' read-only with options 'lowerdir=/sysroot/nix/.ro-store,upperdir=/sysroot/nix/.rw-store/upper,workdir=/sysroot/nix/.rw-store/work,uuid=on'. machine # [ 37.912614] (sd-remount)[867]: Remounting '/nix/store' read-only with options 'lowerdir=/sysroot/nix/.ro-store,upperdir=/sysroot/nix/.rw-store/upper,workdir=/sysroot/nix/.rw-store/work,uuid=on'. machine # [ 37.922862] (sd-remount)[868]: Remounting '/tmp/xchg' read-only with options 'access=client,msize=16384,trans=virtio'. machine # [ 37.929367] (sd-umount)[869]: Unmounting '/tmp/xchg'. machine # [ 37.947762] (sd-remount)[870]: Remounting '/tmp/shared' read-only with options 'access=client,msize=16384,trans=virtio'. machine # [ 37.955893] (sd-umount)[871]: Unmounting '/tmp/shared'. machine # [ 37.962194] (sd-remount)[872]: Remounting '/nix/.ro-store' read-only with options 'cache=0xf,access=client,msize=16384,trans=virtio'. machine # [ 38.060892] (sd-umount)[873]: Unmounting '/nix/.ro-store'. machine # [ 38.064003] (sd-umount)[874]: Unmounting '/nix/.rw-store'. machine # [ 38.066717] (sd-remount)[875]: Remounting '/' read-only with options ''. machine # [ 38.609592] EXT4-fs (vda): re-mounted e23af6f1-d381-4028-8822-c9f20a04f4f9 ro. machine # [ 38.615644] systemd-shutdown[1]: All filesystems unmounted. machine # [ 38.618223] systemd-shutdown[1]: Deactivating swaps. machine # [ 38.623016] systemd-shutdown[1]: All swaps deactivated. machine # [ 38.625283] systemd-shutdown[1]: Detaching loop devices. machine # [ 38.647668] systemd-shutdown[1]: All loop devices detached. machine # [ 38.650183] systemd-shutdown[1]: Stopping MD devices. machine # [ 38.653913] systemd-shutdown[1]: All MD devices stopped. machine # [ 38.656697] systemd-shutdown[1]: Detaching DM devices. machine # [ 38.660312] systemd-shutdown[1]: All DM devices detached. machine # [ 38.663345] systemd-shutdown[1]: All filesystems, swaps, loop devices, MD devices and DM devices detached. machine # [ 38.670419] systemd-shutdown[1]: Failed to chase and open directory '/etc/systemd/system-shutdown', ignoring: Input/output error machine # [ 39.014295] systemd-shutdown[1]: Successfully changed into root pivot. machine # [ 39.017310] systemd-shutdown[1]: Entering exitrd... machine # [ 39.042751] shutdown[1]: Syncing filesystems and block devices. machine # [ 39.049292] shutdown[1]: Sending SIGTERM to remaining processes... machine # [ 39.062037] shutdown[1]: Sending SIGKILL to remaining processes... machine # [ 39.074514] shutdown[1]: Unmounting file systems. machine # [ 39.082541] (sd-umoun[877]: Unmounting '/run/credentials'. machine # [ 39.089029] (sd-umoun[878]: Unmounting '/oldroot/sys/fs/fuse/connections'. machine # [ 39.096027] (sd-umoun[879]: Unmounting '/oldroot/sys/kernel/config'. machine # [ 39.102877] (sd-umoun[880]: Unmounting '/oldroot/sys/kernel/tracing'. machine # [ 39.109425] (sd-umoun[881]: Unmounting '/oldroot/dev/hugepages'. machine # [ 39.115246] (sd-umoun[882]: Unmounting '/oldroot/sys/kernel/debug'. machine # [ 39.121725] (sd-umoun[883]: Unmounting '/oldroot/dev/mqueue'. machine # [ 39.125949] (sd-umoun[884]: Unmounting '/oldroot/sys/fs/bpf'. machine # [ 39.129773] (sd-umoun[885]: Unmounting '/oldroot/sys/fs/pstore'. machine # [ 39.133859] (sd-umoun[886]: Unmounting '/oldroot/sys/fs/cgroup'. machine # [ 39.138622] (sd-umoun[887]: Unmounting '/oldroot/sys/kernel/security'. machine # [ 39.143532] (sd-umoun[888]: Unmounting '/oldroot/nix/store'. machine # [ 39.146948] (sd-umoun[889]: Unmounting '/oldroot/sys'. machine # [ 39.150417] (sd-umoun[890]: Unmounting '/oldroot/proc'. machine # [ 39.155009] (sd-umoun[891]: Unmounting '/oldroot/dev/shm'. machine # [ 39.158905] (sd-umoun[892]: Unmounting '/oldroot/dev/pts'. machine # [ 39.163728] (sd-umoun[893]: Unmounting '/oldroot/dev'. machine # [ 39.167651] (sd-umoun[894]: Unmounting '/oldroot/nix/store'. machine # [ 39.212052] (sd-umoun[895]: Unmounting '/oldroot/run'. machine # [ 39.216637] (sd-umoun[896]: Unmounting '/oldroot'. machine # [ 39.222774] EXT4-fs (vda): unmounting filesystem e23af6f1-d381-4028-8822-c9f20a04f4f9. machine # [ 39.227496] shutdown[1]: All filesystems unmounted. machine # [ 39.230826] shutdown[1]: Deactivating swaps. machine # [ 39.233904] shutdown[1]: All swaps deactivated. machine # [ 39.236469] shutdown[1]: Detaching loop devices. machine # [ 39.242982] shutdown[1]: All loop devices detached. machine # [ 39.245773] shutdown[1]: Stopping MD devices. machine # [ 39.248599] shutdown[1]: All MD devices stopped. machine # [ 39.251268] shutdown[1]: Detaching DM devices. machine # [ 39.254235] shutdown[1]: All DM devices detached. machine # [ 39.256943] shutdown[1]: All filesystems, swaps, loop devices, MD devices and DM devices detached. machine # [ 39.262215] shutdown[1]: Syncing filesystems and block devices. machine # [ 39.265563] shutdown[1]: Powering off. machine # [ 39.301814] Console: switching to colour dummy device 80x25 machine # [ 39.315328] Flash device refused suspend due to active operation (state 20) machine # [ 39.315400] Flash device refused suspend due to active operation (state 20) machine # [ 39.319872] reboot: Power down machine: (finished: waiting for the VM to power off, in 8.96 seconds) machine: starting vm machine: QEMU running (pid 95) machine: waiting for unit systemd-cryptsetup@luks.service machine: waiting for the VM to finish booting machine # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40] machine # [ 0.000000] Linux version 6.18.48 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Fri Aug 28 06:22:54 UTC 2026 machine # [ 0.000000] KASLR enabled machine # [ 0.000000] random: crng init done machine # [ 0.000000] Machine model: linux,dummy-virt machine # [ 0.000000] efi: UEFI not found. machine # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT machine # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fded4c0-0x7fdf0c3f] machine # [ 0.000000] Zone ranges: machine # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] DMA32 empty machine # [ 0.000000] Normal empty machine # [ 0.000000] Device empty machine # [ 0.000000] Movable zone start for each node machine # [ 0.000000] Early memory node ranges machine # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff] machine # [ 0.000000] cma: Reserved 32 MiB at 0x000000007cc00000 machine # [ 0.000000] psci: probing for conduit method from DT. machine # [ 0.000000] psci: PSCIv1.3 detected in firmware. machine # [ 0.000000] psci: Using standard PSCI v0.2 function IDs machine # [ 0.000000] psci: Trusted OS migration not required machine # [ 0.000000] psci: SMC Calling Convention v1.1 machine # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003) machine # [ 0.000000] percpu: Embedded 76 pages/cpu s186648 r8192 d116456 u311296 machine # [ 0.000000] Detected PIPT I-cache on CPU0 machine # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm) machine # [ 0.000000] CPU features: detected: GICv3 CPU interface machine # [ 0.000000] CPU features: detected: Spectre-v4 machine # [ 0.000000] CPU features: detected: Spectre-BHB machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_38 machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_23 machine # [ 0.000000] alternatives: applying boot alternatives machine # [ 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/s47m858fzr8q96sns0vxi0v86kmzfli5-nixos-system-machine-test/init regInfo=/nix/store/2p9k067mkizh4yv3id3dvpac1g66kgn4-closure-info/registration console=ttyAMA0,115200n8 console=tty0 machine # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/2p9k067mkizh4yv3id3dvpac1g66kgn4-closure-info/registration", will be passed to user space. machine # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes machine # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear) machine # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear) machine # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB machine # [ 0.000000] software IO TLB: area num 1. machine # [ 0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB) machine # [ 0.000000] Fallback order for Node 0: 0 machine # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144 machine # [ 0.000000] Policy zone: DMA machine # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off machine # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1 machine # [ 0.000000] allocated 2097152 bytes of page_ext machine # [ 0.000000] ftrace: allocating 74886 entries in 294 pages machine # [ 0.000000] ftrace: allocated 294 pages with 4 groups machine # [ 0.000000] rcu: Hierarchical RCU implementation. machine # [ 0.000000] rcu: RCU event tracing is enabled. machine # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1. machine # [ 0.000000] Trampoline variant of Tasks RCU enabled. machine # [ 0.000000] Rude variant of Tasks RCU enabled. machine # [ 0.000000] Tracing variant of Tasks RCU enabled. machine # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. machine # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1 machine # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. machine # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. machine # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. machine # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 machine # [ 0.000000] GICv3: 256 SPIs implemented machine # [ 0.000000] GICv3: 0 Extended SPIs implemented machine # [ 0.000000] Root IRQ handler: gic_handle_irq machine # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI machine # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0 machine # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000 machine # [ 0.000000] ITS [mem 0x08080000-0x0809ffff] machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1) machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1) machine # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000 machine # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000 machine # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention. machine # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns machine # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt). machine # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns machine # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns machine # [ 0.000032] arm-pv: using stolen time PV machine # [ 0.000421] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____) machine # [ 0.000553] Console: colour dummy device 80x25 machine # [ 0.000562] printk: legacy console [tty0] enabled machine # [ 0.000782] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000) machine # [ 0.000789] pid_max: default: 32768 minimum: 301 machine # [ 0.000872] LSM: initializing lsm=capability,landlock,yama,bpf,ima machine # [ 0.001047] landlock: Up and running. machine # [ 0.001050] Yama: becoming mindful. machine # [ 0.001522] LSM support for eBPF active machine # [ 0.001628] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear) machine # [ 0.001649] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear) machine # [ 0.002810] cacheinfo: Unable to detect cache hierarchy for CPU 0 machine # [ 0.003895] rcu: Hierarchical SRCU implementation. machine # [ 0.003899] rcu: Max phase no-delay instances is 1000. machine # [ 0.005115] fsl-mc MSI: its@8080000 domain created machine # [ 0.005210] EFI services will not be available. machine # [ 0.005299] smp: Bringing up secondary CPUs ... machine # [ 0.005308] smp: Brought up 1 node, 1 CPU machine # [ 0.005311] SMP: Total of 1 processors activated. machine # [ 0.005314] CPU: All CPU(s) started at EL1 machine # [ 0.005327] CPU features: detected: Branch Target Identification machine # [ 0.005333] CPU features: detected: ARMv8.4 Translation Table Level machine # [ 0.005336] CPU features: detected: Instruction cache invalidation not required for I/D coherence machine # [ 0.005340] CPU features: detected: Data cache clean to the PoU not required for I/D coherence machine # [ 0.005343] CPU features: detected: Common not Private translations machine # [ 0.005346] CPU features: detected: CRC32 instructions machine # [ 0.005349] CPU features: detected: Data cache clean to Point of Deep Persistence machine # [ 0.005352] CPU features: detected: Data cache clean to Point of Persistence machine # [ 0.005356] CPU features: detected: Data independent timing control (DIT) machine # [ 0.005359] CPU features: detected: E0PD machine # [ 0.005362] CPU features: detected: Enhanced Counter Virtualization machine # [ 0.005365] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF) machine # [ 0.005368] CPU features: detected: Enhanced Virtualization Traps machine # [ 0.005371] CPU features: detected: Fine Grained Traps machine # [ 0.005375] CPU features: detected: Generic authentication (architected QARMA5 algorithm) machine # [ 0.005379] CPU features: detected: RCpc load-acquire (LDAPR) machine # [ 0.005383] CPU features: detected: LSE atomic instructions machine # [ 0.005386] CPU features: detected: Privileged Access Never machine # [ 0.005388] CPU features: detected: PMUv3 machine # [ 0.005391] CPU features: detected: RAS Extension Support machine # [ 0.005394] CPU features: detected: RASv1p1 Extension Support machine # [ 0.005396] CPU features: detected: Random Number Generator machine # [ 0.005399] CPU features: detected: Speculation barrier (SB) machine # [ 0.005402] CPU features: detected: Stage-2 Force Write-Back machine # [ 0.005405] CPU features: detected: TLB range maintenance instructions machine # [ 0.005410] CPU features: detected: Speculative Store Bypassing Safe (SSBS) machine # [ 0.005448] alternatives: applying system-wide alternatives machine # [ 0.008451] CPU features: detected: BBM Level 2 without TLB conflict abort machine # [ 0.008622] Memory: 894912K/1048576K available (24448K kernel code, 7090K rwdata, 26344K rodata, 4736K init, 1107K bss, 112400K reserved, 32768K cma-reserved) machine # [ 0.009012] devtmpfs: initialized machine # [ 0.010795] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear) machine # [ 0.010818] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear). machine # [ 0.011017] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL machine # [ 0.011022] 0 pages in range for non-PLT usage machine # [ 0.011023] 508288 pages in range for PLT usage machine # [ 0.011135] pinctrl core: initialized pinctrl subsystem machine # [ 0.011892] DMI not present or invalid. machine # [ 0.015062] NET: Registered PF_NETLINK/PF_ROUTE protocol family machine # [ 0.017427] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations machine # [ 0.017572] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations machine # [ 0.017733] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations machine # [ 0.017756] audit: initializing netlink subsys (disabled) machine # [ 0.018356] thermal_sys: Registered thermal governor 'fair_share' machine # [ 0.018358] thermal_sys: Registered thermal governor 'bang_bang' machine # [ 0.018361] thermal_sys: Registered thermal governor 'step_wise' machine # [ 0.018364] thermal_sys: Registered thermal governor 'user_space' machine # [ 0.018369] thermal_sys: Registered thermal governor 'power_allocator' machine # [ 0.018394] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1 machine # [ 0.018403] cpuidle: using governor ladder machine # [ 0.018408] cpuidle: using governor menu machine # [ 0.018631] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers. machine # [ 0.018647] ASID allocator initialised with 65536 entries machine # [ 0.019882] Serial: AMBA PL011 UART driver machine # [ 0.025399] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1 machine # [ 0.025536] printk: console [ttyAMA0] enabled machine # [ 0.147339] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages machine # [ 0.147363] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page machine # [ 0.147368] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages machine # [ 0.147372] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page machine # [ 0.147376] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages machine # [ 0.147381] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page machine # [ 0.147385] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages machine # [ 0.147389] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page machine # [ 0.154953] fbcon: Taking over console machine # [ 0.154974] ACPI: Interpreter disabled. machine # [ 0.156924] iommu: Default domain type: Translated machine # [ 0.156936] iommu: DMA domain TLB invalidation policy: strict mode machine # [ 0.163086] SCSI subsystem initialized machine # [ 0.163795] usbcore: registered new interface driver usbfs machine # [ 0.163820] usbcore: registered new interface driver hub machine # [ 0.163843] usbcore: registered new device driver usb machine # [ 0.164136] pps_core: LinuxPPS API ver. 1 registered machine # [ 0.164143] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti machine # [ 0.164152] PTP clock support registered machine # [ 0.164195] EDAC MC: Ver: 3.0.0 machine # [ 0.168722] scmi_core: SCMI protocol bus registered machine # [ 0.169748] FPGA manager framework machine # [ 0.170811] vgaarb: loaded machine # [ 0.171494] clocksource: Switched to clocksource arch_sys_counter machine # [ 0.177806] VFS: Disk quotas dquot_6.6.0 machine # [ 0.177865] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) machine # [ 0.179577] netfs: FS-Cache loaded machine # [ 0.179736] pnp: PnP ACPI: disabled machine # [ 0.184069] NET: Registered PF_INET protocol family machine # [ 0.184243] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear) machine # [ 0.215447] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear) machine # [ 0.216768] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) machine # [ 0.216803] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear) machine # [ 0.216856] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear) machine # [ 0.216932] TCP: Hash tables configured (established 8192 bind 8192) machine # [ 0.217027] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear) machine # [ 0.217066] UDP hash table entries: 512 (order: 3, 32768 bytes, linear) machine # [ 0.217092] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear) machine # [ 0.217202] NET: Registered PF_UNIX/PF_LOCAL protocol family machine # [ 0.217225] NET: Registered PF_XDP protocol family machine # [ 0.217251] PCI: CLS 0 bytes, default 64 machine # [ 0.217519] Trying to unpack rootfs image as initramfs... machine # [ 0.239580] kvm [1]: HYP mode not available machine # [ 0.416159] Initialise system trusted keyrings machine # [ 0.416991] workingset: timestamp_bits=42 max_order=18 bucket_order=0 machine # [ 0.418302] squashfs: version 4.0 (2009/01/31) Phillip Lougher machine # [ 0.419125] 9p: Installing v9fs 9p2000 file system support machine # [ 0.448078] Key type asymmetric registered machine # [ 0.448112] Asymmetric key parser 'x509' registered machine # [ 0.448206] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242) machine # [ 0.450358] io scheduler mq-deadline registered machine # [ 0.450370] io scheduler kyber registered machine # [ 0.463864] pl061_gpio 9030000.pl061: PL061 GPIO chip registered machine # [ 0.464631] ledtrig-cpu: registered to indicate activity on CPUs machine # [ 0.465052] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges: machine # [ 0.465074] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000 machine # [ 0.465088] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000 machine # [ 0.465098] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000 machine # [ 0.465126] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits machine # [ 0.465154] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff] machine # [ 0.465238] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00 machine # [ 0.465248] pci_bus 0000:00: root bus resource [bus 00-ff] machine # [ 0.465254] pci_bus 0000:00: root bus resource [io 0x0000-0xffff] machine # [ 0.465260] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff] machine # [ 0.465265] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff] machine # [ 0.465360] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint machine # [ 0.465826] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint machine # [ 0.466014] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.466031] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.466061] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.466078] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref] machine # [ 0.466551] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint machine # [ 0.466744] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.466761] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.466791] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.467260] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint machine # [ 0.467442] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f] machine # [ 0.467460] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.467491] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.468001] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint machine # [ 0.468186] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.468203] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.468234] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.468697] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint machine # [ 0.468880] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.468897] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.468941] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.469398] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint machine # [ 0.469583] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f] machine # [ 0.469600] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.469631] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.470091] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint machine # [ 0.470274] pci 0000:00:07.0: BAR 0 [io 0x0000-0x007f] machine # [ 0.470291] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.470321] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.470789] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint machine # [ 0.470973] pci 0000:00:08.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.470990] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.471020] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.471037] pci 0000:00:08.0: ROM [mem 0x00000000-0x0003ffff pref] machine # [ 0.519586] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint machine # [ 0.519883] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.519920] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.520494] pci 0000:00:0a.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint machine # [ 0.520685] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.520716] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.521131] pci 0000:00:0b.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint machine # [ 0.521320] pci 0000:00:0b.0: BAR 0 [mem 0x00000000-0x00000fff] machine # [ 0.521579] pci 0000:00:0c.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint machine # [ 0.521876] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x003f] machine # [ 0.521895] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.521926] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.522407] pci 0000:00:0d.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint machine # [ 0.522627] pci 0000:00:0d.0: BAR 0 [io 0x0000-0x001f] machine # [ 0.522645] pci 0000:00:0d.0: BAR 1 [mem 0x00000000-0x00000fff] machine # [ 0.522675] pci 0000:00:0d.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] machine # [ 0.523292] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned machine # [ 0.523304] pci 0000:00:08.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned machine # [ 0.523309] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned machine # [ 0.523362] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned machine # [ 0.523411] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned machine # [ 0.523460] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned machine # [ 0.523534] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned machine # [ 0.523584] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned machine # [ 0.523634] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned machine # [ 0.523682] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned machine # [ 0.523735] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned machine # [ 0.523783] pci 0000:00:0a.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned machine # [ 0.523832] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned machine # [ 0.523917] pci 0000:00:0d.0: BAR 4 [mem 0x800002c000-0x800002ffff 64bit pref]: assigned machine # [ 0.523968] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned machine # [ 0.523990] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned machine # [ 0.524013] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned machine # [ 0.524035] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned machine # [ 0.524058] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned machine # [ 0.524081] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned machine # [ 0.524104] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned machine # [ 0.524127] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned machine # [ 0.524149] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned machine # [ 0.524173] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned machine # [ 0.524210] pci 0000:00:0b.0: BAR 0 [mem 0x1008a000-0x1008afff]: assigned machine # [ 0.524233] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned machine # [ 0.524256] pci 0000:00:0d.0: BAR 1 [mem 0x1008c000-0x1008cfff]: assigned machine # [ 0.524278] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned machine # [ 0.524301] pci 0000:00:07.0: BAR 0 [io 0x1080-0x10ff]: assigned machine # [ 0.524323] pci 0000:00:03.0: BAR 0 [io 0x1100-0x113f]: assigned machine # [ 0.524344] pci 0000:00:0c.0: BAR 0 [io 0x1140-0x117f]: assigned machine # [ 0.524367] pci 0000:00:01.0: BAR 0 [io 0x1180-0x119f]: assigned machine # [ 0.524389] pci 0000:00:02.0: BAR 0 [io 0x11a0-0x11bf]: assigned machine # [ 0.524412] pci 0000:00:04.0: BAR 0 [io 0x11c0-0x11df]: assigned machine # [ 0.524434] pci 0000:00:05.0: BAR 0 [io 0x11e0-0x11ff]: assigned machine # [ 0.524456] pci 0000:00:08.0: BAR 0 [io 0x1200-0x121f]: assigned machine # [ 0.524479] pci 0000:00:0d.0: BAR 0 [io 0x1220-0x123f]: assigned machine # [ 0.524510] pci_bus 0000:00: resource 4 [io 0x0000-0xffff] machine # [ 0.524520] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff] machine # [ 0.524525] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff] machine # [ 0.525845] pci 0000:00:0b.0: enabling device (0000 -> 0002) machine # [ 0.598768] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003) machine # [ 0.609016] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003) machine # [ 0.620195] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003) machine # [ 0.622398] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003) machine # [ 0.624544] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003) machine # [ 0.627065] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003) machine # [ 0.637060] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003) machine # [ 0.639332] virtio-pci 0000:00:08.0: enabling device (0000 -> 0003) machine # [ 0.651128] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002) machine # [ 0.661335] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002) machine # [ 0.672140] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003) machine # [ 0.674720] virtio-pci 0000:00:0d.0: enabling device (0000 -> 0003) machine # [ 0.688785] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled machine # [ 0.691553] msm_serial: driver initialized machine # [ 0.691728] SuperH (H)SCI(F) driver initialized machine # [ 0.691781] STM32 USART driver initialized machine # [ 0.725193] loop: module loaded machine # [ 0.725401] virtio_blk virtio5: 1/0/0 default/read/poll queues machine # [ 0.726220] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB) machine # [ 0.731730] virtio_blk virtio6: 1/0/0 default/read/poll queues machine # [ 0.732468] virtio_blk virtio6: [vdb] 1048576 512-byte logical blocks (537 MB/512 MiB) machine # [ 0.740276] megasas: 07.734.00.00-rc1 machine # [ 0.741007] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff] machine # [ 0.743173] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 machine # [ 0.743202] Intel/Sharp Extended Query Table at 0x0031 machine # [ 0.756704] Using buffer write method machine # [ 0.756805] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff] machine # [ 0.758913] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 machine # [ 0.758944] Intel/Sharp Extended Query Table at 0x0031 machine # [ 0.763822] Using buffer write method machine # [ 0.763850] Concatenating MTD devices: machine # [ 0.763854] (0): "0.flash" machine # [ 0.763859] (1): "0.flash" machine # [ 0.763862] into device "0.flash" machine # [ 1.005042] Freeing initrd memory: 25544K machine # [ 1.011449] tun: Universal TUN/TAP device driver, 1.6 machine # [ 1.015631] thunder_xcv, ver 1.0 machine # [ 1.015677] thunder_bgx, ver 1.0 machine # [ 1.015701] nicpf, ver 1.0 machine # [ 1.016282] e1000: Intel(R) PRO/1000 Network Driver machine # [ 1.016289] e1000: Copyright (c) 1999-2006 Intel Corporation. machine # [ 1.016315] e1000e: Intel(R) PRO/1000 Network Driver machine # [ 1.016323] e1000e: Copyright(c) 1999 - 2015 Intel Corporation. machine # [ 1.016353] igb: Intel(R) Gigabit Ethernet Network Driver machine # [ 1.016359] igb: Copyright (c) 2007-2014 Intel Corporation. machine # [ 1.016382] igbvf: Intel(R) Gigabit Virtual Function Network Driver machine # [ 1.016388] igbvf: Copyright (c) 2009 - 2012 Intel Corporation. machine # [ 1.016524] sky2: driver version 1.30 machine # [ 1.018172] usbcore: registered new interface driver usb-storage machine # [ 1.018223] usbcore: registered new interface driver usbserial_generic machine # [ 1.018236] usbserial: USB Serial support registered for generic machine # [ 1.018941] hv_vmbus: registering driver hyperv_keyboard machine # [ 1.020337] ehci-pci 0000:00:0b.0: EHCI Host Controller machine # [ 1.020370] ehci-pci 0000:00:0b.0: new USB bus registered, assigned bus number 1 machine # [ 1.020647] ehci-pci 0000:00:0b.0: irq 16, io mem 0x1008a000 machine # [ 1.032193] ehci-pci 0000:00:0b.0: USB 2.0 started, EHCI 1.00 machine # [ 1.032567] hub 1-0:1.0: USB hub found machine # [ 1.032627] hub 1-0:1.0: 6 ports detected machine # [ 1.034924] rtc-pl031 9010000.pl031: registered as rtc0 machine # [ 1.034955] rtc-pl031 9010000.pl031: setting system clock to 2026-09-01T03:11:12 UTC (1788232272) machine # [ 1.035364] i2c_dev: i2c /dev entries driver machine # [ 1.040191] sdhci: Secure Digital Host Controller Interface driver machine # [ 1.040202] sdhci: Copyright(c) Pierre Ossman machine # [ 1.040475] Synopsys Designware Multimedia Card Interface Driver machine # [ 1.040842] sdhci-pltfm: SDHCI platform and OF driver helper machine # [ 1.042617] hid: raw HID events driver (C) Jiri Kosina machine # [ 1.042852] usbcore: registered new interface driver usbhid machine # [ 1.042859] usbhid: USB HID core driver machine # [ 1.048296] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available machine # [ 1.049927] drop_monitor: Initializing network drop monitor service machine # [ 1.050121] NET: Registered PF_INET6 protocol family machine # [ 1.053045] Segment Routing with IPv6 machine # [ 1.053066] In-situ OAM (IOAM) with IPv6 machine # [ 1.053097] NET: Registered PF_PACKET protocol family machine # [ 1.054676] 9pnet: Installing 9P2000 support machine # [ 1.057628] Key type dns_resolver registered machine # [ 1.064378] registered taskstats version 1 machine # [ 1.064553] Loading compiled-in X.509 certificates machine # [ 1.073521] Demotion targets for Node 0: null machine # [ 1.073648] Key type .fscrypt registered machine # [ 1.073655] Key type fscrypt-provisioning registered machine # [ 1.073757] ima: No TPM chip found, activating TPM-bypass! machine # [ 1.073777] ima: Allocated hash algorithm: sha1 machine # [ 1.073802] ima: No architecture policies found machine # [ 1.077806] input: gpio-keys as /devices/platform/gpio-keys/input/input0 machine # [ 1.097063] clk: Disabling unused clocks machine # [ 1.097095] PM: genpd: Disabling unused power domains machine # [ 1.101485] Freeing unused kernel memory: 4736K machine # [ 1.101677] Run /init as init process machine # [ 1.118146] systemd[1]: Successfully made /usr/ read-only. machine # [ 1.279620] usb 1-1: new high-speed USB device number 2 using ehci-pci machine # [ 1.432124] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0b.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1 machine # [ 1.453357] systemd[1]: systemd 262-d0fcc5a 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) machine # [ 1.464542] systemd[1]: Detected virtualization qemu. machine # [ 1.466353] systemd[1]: Detected architecture arm64. machine # [ 1.468193] systemd[1]: Running in initrd. machine # [ 1.470702] systemd[1]: Initializing machine ID from random generator. machine # [ 1.473344] systemd[1]: Hostname set to . machine # [ 1.515802] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0b.0-1/input0 machine # [ 1.633103] systemd[1]: bpf-restrict-fs: LSM BPF program attached machine # [ 1.639606] usb 1-2: new high-speed USB device number 3 using ehci-pci machine # [ 1.697452] systemd[1]: Queued start job for default target Initrd Default Target. machine # [ 1.705724] systemd[1]: Created slice Slice /system/modprobe. machine # [ 1.706874] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. machine # [ 1.707913] systemd[1]: Expecting device /dev/disk/by-label/nixos... machine # [ 1.708683] systemd[1]: Reached target Path Units. machine # [ 1.709265] systemd[1]: Reached target Slice Units. machine # [ 1.709935] systemd[1]: Reached target Swaps. machine # [ 1.710471] systemd[1]: Reached target Timer Units. machine # [ 1.711386] systemd[1]: Listening on D-Bus System Message Bus Socket. machine # [ 1.712469] systemd[1]: Listening on Journal Socket (/dev/log). machine # [ 1.713339] systemd[1]: Listening on Journal Sockets. machine # [ 1.714028] systemd[1]: Listening on udev Kernel Socket. machine # [ 1.714685] systemd[1]: Reached target Socket Units. machine # [ 1.716862] systemd[1]: Starting Create List of Static Device Nodes... machine # [ 1.726816] systemd[1]: Starting Load Kernel Module 9pnet_virtio... machine # [ 1.727921] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs machine # [ 1.737138] systemd[1]: Mounting Kernel Configuration File System... machine # [ 1.758611] systemd[1]: Starting Journal Service... machine # [ 1.768003] systemd[1]: Starting Load Kernel Modules... machine # [ 1.768887] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 1.796704] systemd[1]: Starting Coldplug All udev Devices... machine # [ 1.798272] systemd-journald[73]: Collecting audit messages is disabled. machine # [ 1.804442] systemd[1]: Finished Create List of Static Device Nodes. machine # [ 1.805759] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. machine # [ 1.810827] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0b.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2 machine # [ 1.815939] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0b.0-2/input0 machine # [ 1.820098] systemd[1]: Finished Load Kernel Module 9pnet_virtio. machine # [ 1.821813] systemd[1]: Mounted Kernel Configuration File System. machine # [ 1.840153] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... machine # [ 1.873256] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. machine # [ 1.899564] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev machine # [ 1.904780] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0 machine # [ 1.905030] [drm] features: -virgl +edid -resource_blob -host_visible machine # [ 1.905043] [drm] features: -context_init machine # [ 1.905802] [drm] number of scanouts: 1 machine # [ 1.905825] [drm] number of cap sets: 0 machine # [ 1.920424] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. machine # [ 1.923378] systemd[1]: Starting Create Static Device Nodes in /dev... machine # [ 1.932048] virtio-pci 0000:00:09.0: [drm] Registered 1 planes with drm panic machine # [ 1.932081] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0 machine # [ 1.955850] Console: switching to colour frame buffer device 160x50 machine # [ 1.988310] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device machine # [ 1.992777] systemd[1]: Finished Create Static Device Nodes in /dev. machine # [ 1.993078] systemd[1]: Reached target Preparation for Local File Systems. machine # [ 1.993122] systemd[1]: Reached target Local File Systems. machine # [ 1.999443] systemd[1]: Starting Rule-based Manager for Device Events and Files... machine # [ 2.006424] systemd-modules-load[74]: Inserted module 'dm_mod' machine # [ 2.023340] systemd[1]: Started Journal Service. machine # [ 2.013915] systemd-modules-load[74]: Module 'virtio_balloon' is built in machine # [ 2.016553] systemd-modules-load[74]: Module 'virtio_console' is built in machine # [ 2.024419] systemd-modules-load[74]: Inserted module 'virtio_gpu' machine # [ 2.025549] systemd-modules-load[74]: Module 'virtio_rng' is built in machine # [ 2.028436] systemd[1]: Finished Load Kernel Modules. machine # [ 2.030080] systemd[1]: Starting Apply Kernel Variables... machine # [ 2.033564] systemd[1]: Starting Create System Files and Directories... machine # [ 2.100502] systemd[1]: Finished Apply Kernel Variables. machine # [ 2.122825] systemd-udevd[79]: Using default interface naming scheme 'v261'. machine # [ 2.128978] systemd[1]: Finished Create System Files and Directories. machine # [ 2.161807] systemd[1]: Started Rule-based Manager for Device Events and Files. machine # [ 2.244130] systemd[1]: Starting Virtual Console Setup... machine # [ 2.332674] systemd-vconsole-setup[102]: Configuration of first virtual console was skipped, ignoring remaining ones. machine # [ 2.340422] systemd[1]: Finished Virtual Console Setup. machine # [ 3.018249] systemd[1]: Finished Coldplug All udev Devices. machine # [ 3.020836] systemd[1]: Reached target System Initialization. machine # [ 3.024194] systemd[1]: Reached target Basic System. machine # [ 3.201905] (udev-worker)[101]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name. machine # [ 3.215780] (udev-worker)[91]: Network interface NamePolicy= disabled on kernel command line. machine # [ 3.219084] (udev-worker)[101]: Network interface NamePolicy= disabled on kernel command line. machine # [ 3.280169] systemd[1]: Found device /dev/disk/by-label/nixos. machine # [ 3.283771] systemd[1]: Reached target Initrd Root Device. machine # [ 3.286018] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos... machine # [ 3.344375] systemd-fsck[111]: nixos: clean, 249/65536 files, 17377/262144 blocks machine # [ 3.359114] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos. machine # [ 3.365015] systemd[1]: Mounting /sysroot... machine # [ 3.935081] EXT4-fs (vda): mounted filesystem e23af6f1-d381-4028-8822-c9f20a04f4f9 r/w with ordered data mode. Quota mode: none. machine # [ 3.929063] systemd[1]: Mounted /sysroot. machine # [ 3.931483] systemd[1]: Reached target Initrd Root File System. machine # [ 3.939924] systemd[1]: Mounting /sysroot/nix/.ro-store... machine # [ 3.949792] systemd[1]: Mounting /sysroot/nix/.rw-store... machine # [ 3.970549] systemd[1]: Mounting /sysroot/run... machine # [ 3.997774] systemd[1]: Mounting /sysroot/tmp/shared... machine # [ 4.045071] systemd[1]: Mounting /sysroot/tmp/xchg... machine # [ 4.049811] systemd[1]: Starting Mountpoints Configured in the Real Root... machine # [ 4.098639] systemd[1]: Mounted /sysroot/nix/.ro-store. machine # [ 4.101027] systemd[1]: Mounted /sysroot/nix/.rw-store. machine # [ 4.102136] systemd[1]: Mounted /sysroot/run. machine # [ 4.136488] systemd[1]: Starting rw-sysroot-nix-store.service... machine # [ 4.145270] systemd-sysroot-fstab-check[124]: /sysroot should be mounted in the initrd, will request daemon-reload. machine # [ 4.163567] systemd[1]: Mounted /sysroot/tmp/shared. machine # [ 4.173388] systemd[1]: Mounted /sysroot/tmp/xchg. machine # [ 4.175742] systemd[1]: Reload requested from client PID 124 ('systemd-sysroot') (unit initrd-parse-etc.service)... machine # [ 4.183678] systemd[1]: Reloading... machine # [ 4.427877] systemd[1]: Reloading finished in 256 ms. machine # [ 4.468286] systemd-sysroot-fstab-check[124]: Requesting initrd-fs.target/start/replace... machine # [ 4.473697] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. machine # [ 4.476390] systemd[1]: Finished rw-sysroot-nix-store.service. machine # [ 4.486346] systemd-sysroot-fstab-check[124]: Requesting swap.target/start/replace... machine # [ 4.493645] systemd[1]: Starting rw-sysroot-nix-store.service... machine # [ 4.496883] systemd[1]: initrd-parse-etc.service: Deactivated successfully. machine # [ 4.501794] systemd[1]: Finished Mountpoints Configured in the Real Root. machine # [ 4.503968] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies. machine # [ 4.539682] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. machine # [ 4.541625] systemd[1]: Finished rw-sysroot-nix-store.service. machine # [ 4.791459] (udev-worker)[101]: mtd0ro: Failed to find and pin callout binary "/nix/store/aap1fb66p72ib35mngb3ccjh9halipzf-systemd-262-d0fcc5a/lib/udev/mtd_probe": No such file or directory machine # [ 4.812994] tpm_tis c000000.tpm_tis: 2.0 TPM (device-id 0x1, rev-id 1) machine # [ 4.799861] (udev-worker)[101]: mtd0ro: /nix/store/aap1fb66p72ib35mngb3ccjh9halipzf-systemd-262-d0fcc5a/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 machine # [ 4.827574] tpm tpm0: A TPM error (256) occurred attempting the self test machine # [ 4.827633] tpm tpm0: starting up the TPM manually machine # [ 4.833418] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 4.834959] systemd[1]: Stopped Virtual Console Setup. machine # [ 4.837164] systemd[1]: Stopping Virtual Console Setup... machine # [ 4.840669] systemd[1]: Starting Virtual Console Setup... machine # [ 4.865812] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 4.868234] systemd[1]: Stopped Virtual Console Setup. machine # [ 4.870396] systemd[1]: Starting Virtual Console Setup... machine # [ 4.910205] systemd-vconsole-setup[157]: Configuration of first virtual console was skipped, ignoring remaining ones. machine # [ 4.916441] systemd[1]: Finished Virtual Console Setup. machine # [ 4.928767] systemd[1]: Mounting /sysroot/nix/store... machine # [ 4.952928] systemd[1]: Condition check resulted in /dev/tpmrm0 being skipped. machine # [ 4.956270] systemd[1]: Reached target Trusted Platform Module. machine # [ 4.970511] systemd[1]: Mounted /sysroot/nix/store. machine # [ 4.971868] systemd[1]: Reached target Initrd File Systems. machine # [ 4.974617] systemd[1]: Starting Find NixOS closure... machine # [ 4.981408] systemd[1]: Starting Create Volatile Files and Directories in the Real Root... machine # [ 5.022293] systemd[1]: Finished Create Volatile Files and Directories in the Real Root. machine # [ 5.023747] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully. machine # [ 5.037241] systemd[1]: Finished Find NixOS closure. machine # [ 5.040345] systemd[1]: Reached target Initrd Default Target. machine # [ 5.042799] systemd[1]: Starting Cleaning Up and Shutting Down Daemons... machine # [ 5.074110] systemd[1]: Stopped target Initrd Default Target. machine # [ 5.075834] systemd[1]: Stopped target Basic System. machine # [ 5.080666] systemd[1]: Stopped target Initrd Root Device. machine # [ 5.081546] systemd[1]: Stopped target Path Units. machine # [ 5.082259] systemd[1]: systemd-ask-password-console.path: Deactivated successfully. machine # [ 5.083365] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch. machine # [ 5.086036] systemd[1]: Stopped target Slice Units. machine # [ 5.087607] systemd[1]: Stopped target Socket Units. machine # [ 5.090175] systemd[1]: Stopped target System Initialization. machine # [ 5.092201] systemd[1]: Stopped target Swaps. machine # [ 5.096294] systemd[1]: Stopped target Timer Units. machine # [ 5.097222] systemd[1]: Stopped target Trusted Platform Module. machine # [ 5.098086] systemd[1]: dbus.socket: Deactivated successfully. machine # [ 5.098928] systemd[1]: Closed D-Bus System Message Bus Socket. machine # [ 5.100674] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully. machine # [ 5.104257] systemd[1]: Stopped Find NixOS closure. machine # [ 5.105147] systemd[1]: Starting Load Kernel Module 9pnet_virtio... machine # [ 5.107259] systemd[1]: Starting rw-sysroot-nix-store.service... machine # [ 5.110851] systemd[1]: systemd-sysctl.service: Deactivated successfully. machine # [ 5.117136] systemd[1]: Stopped Apply Kernel Variables. machine # [ 5.119138] systemd[1]: systemd-modules-load.service: Deactivated successfully. machine # [ 5.121447] systemd[1]: Stopped Load Kernel Modules. machine # [ 5.122263] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully. machine # [ 5.123411] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root. machine # [ 5.134240] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. machine # [ 5.135406] systemd[1]: Stopped Create System Files and Directories. machine # [ 5.150699] systemd[1]: Stopped target Local File Systems. machine # [ 5.151881] systemd[1]: Stopped target Preparation for Local File Systems. machine # [ 5.159131] systemd[1]: systemd-udev-trigger.service: Deactivated successfully. machine # [ 5.165862] systemd[1]: Stopped Coldplug All udev Devices. machine # [ 5.166781] systemd[1]: Stopping Rule-based Manager for Device Events and Files... machine # [ 5.167863] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. machine # [ 5.174463] systemd[1]: Stopped Virtual Console Setup. machine # [ 5.176205] systemd[1]: initrd-cleanup.service: Deactivated successfully. machine # [ 5.177928] systemd[1]: Finished Cleaning Up and Shutting Down Daemons. machine # [ 5.180539] systemd[1]: systemd-udevd.service: Deactivated successfully. machine # [ 5.183501] systemd[1]: Stopped Rule-based Manager for Device Events and Files. machine # [ 5.185324] systemd[1]: systemd-udevd.service: Consumed 1.679s CPU time over 3.186s wall clock time, 22.4M memory peak. machine # [ 5.192277] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. machine # [ 5.193470] systemd[1]: Finished Load Kernel Module 9pnet_virtio. machine # [ 5.194349] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. machine # [ 5.195388] systemd[1]: Finished rw-sysroot-nix-store.service. machine # [ 5.197075] systemd[1]: Starting Cleanup udev Database... machine # [ 5.197963] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. machine # [ 5.199085] systemd[1]: Stopped Create Static Device Nodes in /dev. machine # [ 5.199978] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. machine # [ 5.201156] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully. machine # [ 5.202163] systemd[1]: kmod-static-nodes.service: Deactivated successfully. machine # [ 5.203216] systemd[1]: Stopped Create List of Static Device Nodes. machine # [ 5.248665] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. machine # [ 5.252650] systemd[1]: Finished Cleanup udev Database. machine # [ 5.253574] systemd[1]: Reached target Switch Root. machine # [ 5.255921] systemd[1]: Starting NixOS Activation... machine # [ 5.457351] initrd-nixos-activation-start[183]: booting system configuration /nix/store/s47m858fzr8q96sns0vxi0v86kmzfli5-nixos-system-machine-test machine # [ 5.541860] initrd-nixos-activation-start[183]: running activation script... machine # [ 6.042499] initrd-nixos-activation-start[206]: setting up /etc... machine # [ 6.413627] systemd[1]: initrd-nixos-activation.service: Deactivated successfully. machine # [ 6.416222] systemd[1]: Finished NixOS Activation. machine # [ 6.418268] systemd[1]: Starting Switch Root... machine # [ 6.447157] systemd[1]: Switching root. machine # [ 6.637099] systemd-journald[73]: Received SIGTERM from PID 1 (systemd). machine # [ 7.254901] systemd[1]: systemd 262-d0fcc5a 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) machine # [ 7.268435] systemd[1]: Detected virtualization qemu. machine # [ 7.271631] systemd[1]: Detected architecture arm64. machine # [ 7.461974] systemd[1]: bpf-restrict-fs: LSM BPF program attached machine # [ 10.151800] systemd[1]: initrd-switch-root.service: Deactivated successfully. machine # [ 10.155373] systemd[1]: Stopped initrd-switch-root.service. machine # [ 10.162575] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. machine # [ 10.171925] systemd[1]: Created slice Slice /system/getty. machine # [ 10.178016] systemd[1]: Created slice Slice /system/systemd-cryptsetup. machine # [ 10.184773] systemd[1]: Created slice User and Session Slice. machine # [ 10.188783] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. machine # [ 10.193037] systemd[1]: Started Forward Password Requests to Wall Directory Watch. machine # [ 10.198951] systemd[1]: Expecting device /dev/hvc0... machine # [ 10.201801] systemd[1]: Expecting device /dev/ttyAMA0... machine # [ 10.204116] systemd[1]: Expecting device /dev/vdb... machine # [ 10.207388] systemd[1]: Stopped target initrd-fs.target. machine # [ 10.211074] systemd[1]: Stopped target initrd-root-fs.target. machine # [ 10.214834] systemd[1]: Stopped target initrd-switch-root.target. machine # [ 10.218568] systemd[1]: Reached target Virtual Machines and Containers. machine # [ 10.222456] systemd[1]: Reached target Path Units. machine # [ 10.225826] systemd[1]: Reached target Remote File Systems. machine # [ 10.229473] systemd[1]: Reached target Slice Units. machine # [ 10.233015] systemd[1]: Reached target Swaps. machine # [ 10.240303] systemd[1]: Listening on Query the User Interactively for a Password. machine # [ 10.248879] systemd[1]: Listening on Process Core Dump Socket. machine # [ 10.256017] systemd[1]: Listening on Credential Encryption/Decryption. machine # [ 10.262680] systemd[1]: Listening on Factory Reset Management. machine # [ 10.266511] systemd[1]: Listening on Hostname Service Socket. machine # [ 10.276888] systemd[1]: Starting Journal Log Access Socket... machine # [ 10.281217] systemd[1]: Listening on Journal Audit Socket. machine # [ 10.289889] systemd[1]: Listening on Console Output Muting Service Socket. machine # [ 10.294137] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket. machine # [ 10.298013] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os machine # [ 10.302357] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki machine # [ 10.317847] systemd[1]: Listening on Disk Repartitioning Service Socket. machine # [ 10.321724] systemd[1]: Listening on udev Varlink Socket. machine # [ 10.329558] systemd[1]: Mounting Huge Pages File System... machine # [ 10.338941] systemd[1]: Mounting POSIX Message Queue File System... machine # [ 10.352086] systemd[1]: Mounting Kernel Debug File System... machine # [ 10.368562] systemd[1]: Mounting Kernel Trace File System... machine # [ 10.388317] systemd[1]: Starting Create List of Static Device Nodes... machine # [ 10.401798] systemd[1]: Starting Load Kernel Module 9pnet_virtio... machine # [ 10.407748] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs machine # [ 10.428356] systemd[1]: Mounting Kernel Configuration File System... machine # [ 10.431131] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm machine # [ 10.439626] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore machine # [ 10.464020] systemd[1]: Starting Load Kernel Module fuse... machine # [ 10.466632] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67 machine # [ 10.532041] systemd[1]: Starting Journal Service... machine # [ 10.566413] systemd[1]: Starting Load Kernel Modules... machine # [ 10.604341] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer... machine # [ 10.642158] fuse: init (API version 7.45) machine # [ 10.650804] systemd[1]: Starting Remount Root and Kernel File Systems... machine # [ 10.656342] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 10.676676] systemd-journald[278]: Collecting audit messages is enabled. machine # [ 10.679211] systemd[1]: Queued start job for default target Multi-User System. machine # [ 10.683619] systemd[1]: systemd-journald.service: Deactivated successfully.[ 10.700989] systemd[1]: Starting Coldplug All udev Devices... machine # machine # [ 10.729396] systemd[1]: Started Journal Service. machine # [ 10.721442] systemd-modules-load[279]: Module 'atkbd' is built in machine # [ 10.725793] systemd-modules-load[279]: Module 'loop' is built in machine # [ 10.733217] systemd[1]: Listening on Journal Log Access Socket. machine # [ 10.734553] systemd[1]: Mounted Huge Pages File System. machine # [ 10.742062] systemd[1]: Mounted POSIX Message Queue File System. machine # [ 10.742980] systemd[1]: Mounted Kernel Debug File System. machine # [ 10.743742] systemd[1]: Mounted Kernel Trace File System. machine # [ 10.752552] systemd[1]: Finished Create List of Static Device Nodes. machine # [ 10.758665] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. machine # [ 10.765636] systemd[1]: Finished Load Kernel Module 9pnet_virtio. machine # [ 10.766525] systemd[1]: Mounted Kernel Configuration File System. machine # [ 10.767400] systemd[1]: modprobe@fuse.service: Deactivated successfully. machine # [ 10.785615] EXT4-fs (vda): re-mounted e23af6f1-d381-4028-8822-c9f20a04f4f9. machine # [ 10.778351] systemd[1]: Finished Load Kernel Module fuse. machine # [ 10.784335] systemd[1]: Finished Load Kernel Modules. machine # [ 10.785210] systemd[1]: Finished Remount Root and Kernel File Systems. machine # [ 10.799267] systemd[1]: Listening on Disk Image Download Service Socket. machine # [ 10.802829] systemd[1]: Mounting FUSE Control File System... machine # [ 10.818341] systemd[1]: Starting Firewall... machine # [ 10.837233] systemd-oomd[281]: No swap; memory pressure usage will be degraded machine # [ 10.843120] systemd[1]: Starting Flush Journal to Persistent Storage... machine # [ 10.849721] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore machine # [ 10.870377] systemd[1]: Starting Load/Save OS Random Seed... machine # [ 10.907009] systemd[1]: Starting Apply Kernel Variables... machine # [ 10.924231] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... machine # [ 10.931286] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 10.960327] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer. machine # [ 10.980300] systemd-journald[278]: Received client request to flush runtime journal. machine # [ 12.512392] systemd[1]: Mounted FUSE Control File System. machine # [ 12.515166] systemd[1]: Finished Apply Kernel Variables. machine # [ 12.520664] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. machine # [ 12.525217] systemd[1]: Starting Create Static Device Nodes in /dev... machine # [ 12.529634] systemd[1]: Finished Create Static Device Nodes in /dev. machine # [ 12.534654] systemd[1]: Reached target Preparation for Local File Systems. machine # [ 12.545513] systemd[1]: Mounting /run/wrappers... machine # [ 12.546387] systemd[1]: Starting Rule-based Manager for Device Events and Files... machine # [ 12.547505] systemd[1]: Mounted /run/wrappers. machine # [ 12.557689] systemd[1]: Reached target Local File Systems. machine # [ 12.565741] systemd[1]: Listening on Boot Loader Control Service Socket. machine # [ 12.569270] systemd[1]: Starting register-nix-paths.service... machine # [ 12.573681] systemd[1]: Starting Create SUID/SGID Wrappers... machine # [ 12.581679] systemd-udevd[320]: Using default interface naming scheme 'v261'. machine # [ 12.582753] systemd[1]: Started Rule-based Manager for Device Events and Files. machine # [ 12.583826] systemd[1]: Finished Load/Save OS Random Seed. machine # [ 12.593101] systemd[1]: First Boot Complete skipped, unmet condition check ConditionFirstBoot=yes machine # [ 12.600564] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met. machine # [ 12.609723] systemd[1]: Save Transient machine-id to Disk skipped, unmet condition check ConditionPathIsMountPoint=/etc/machine-id machine # [ 12.619761] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully. machine # [ 12.625993] systemd[1]: Finished Create SUID/SGID Wrappers. machine # [ 12.628634] systemd[1]: Finished Flush Journal to Persistent Storage. machine # [ 12.636810] systemd[1]: Starting Create System Files and Directories... machine # [ 13.102443] systemd[1]: Finished Create System Files and Directories. machine # [ 13.109664] systemd[1]: Rebuild Journal Catalog skipped, unmet condition check ConditionNeedsUpdate=/var machine # [ 13.113540] systemd[1]: Update is Completed skipped, no trigger condition checks were met. machine # [ 13.127711] systemd[1]: Starting Record System Boot/Shutdown in UTMP... machine # [ 13.221546] systemd[1]: Finished Coldplug All udev Devices. machine # [ 13.239087] systemd[1]: Finished Record System Boot/Shutdown in UTMP. machine # [ 13.299243] systemd[1]: Finished Firewall. machine # [ 13.308412] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs machine # [ 13.441328] systemd[1]: Condition check resulted in /dev/hvc0 being skipped. machine # [ 13.467058] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped. machine # [ 13.689082] systemd[1]: Condition check resulted in /dev/tpmrm0 being skipped. machine # [ 13.690312] systemd[1]: Expecting device /dev/tpm0... machine # [ 13.701893] systemd[1]: Finished register-nix-paths.service. machine # [ 13.738095] systemd[1]: Condition check resulted in /dev/vdb being skipped. machine # [ 13.747880] systemd[1]: Starting Cryptography Setup for luks... machine # [ 13.758398] (udev-worker)[358]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name. machine # [ 13.764540] (udev-worker)[358]: Network interface NamePolicy= disabled on kernel command line. machine # [ 13.767989] (udev-worker)[359]: Network interface NamePolicy= disabled on kernel command line. machine # [ 14.036229] systemd[1]: Condition check resulted in Virtio network device being skipped. machine # [ 14.037563] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore machine # [ 14.048131] systemd[1]: Starting Create SUID/SGID Wrappers... machine # [ 14.052347] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met. machine # [ 14.064715] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67 machine # [ 14.067589] systemd[1]: Rebuild Journal Catalog skipped, unmet condition check ConditionNeedsUpdate=/var machine # [ 14.073209] systemd[1]: Save Transient machine-id to Disk skipped, unmet condition check ConditionPathIsMountPoint=/etc/machine-id machine # [ 14.078661] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore machine # [ 14.085399] systemd[1]: Update is Completed skipped, no trigger condition checks were met. machine # [ 14.113150] mousedev: PS/2 mouse device common for all mice machine # [ 14.696244] Key type trusted registered machine # [ 14.706016] Key type encrypted registered machine # [ 14.952726] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully. machine # [ 14.956277] systemd[1]: Finished Create SUID/SGID Wrappers. machine # [ 15.550269] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/virtio9/input/input3 machine # [ 15.722009] systemd[1]: Condition check resulted in /dev/tpm0 being skipped. machine # [ 15.724283] systemd[1]: Reached target Trusted Platform Module. machine # [ 15.725379] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 15.728129] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os machine # [ 15.921844] systemd[1]: Starting Virtual Console Setup... machine # [ 15.968444] systemd[1]: Finished Cryptography Setup for luks. machine # [ 15.970306] systemd[1]: Reached target Local Encrypted Volumes. machine # [ 16.412251] systemd-vconsole-setup[574]: Configuration of first virtual console was skipped, ignoring remaining ones. machine # [ 16.416700] systemd[1]: Finished Virtual Console Setup. machine # [ 16.419355] systemd[1]: Reached target System Initialization. machine # [ 16.421425] systemd[1]: Started Discard unused filesystem blocks once a week. machine # [ 16.424361] systemd[1]: Started Daily Cleanup of Temporary Directories. machine # [ 16.426269] systemd[1]: Reached target Timer Units. machine # [ 16.427288] systemd[1]: Listening on D-Bus System Message Bus Socket. machine # [ 16.430109] systemd[1]: Listening on Nix Daemon Socket. machine # [ 16.431266] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket. machine # [ 16.433838] systemd[1]: Reached target Socket Units. machine # [ 16.435317] systemd[1]: Reached target Basic System. machine # [ 16.438564] systemd[1]: Started backdoor.service. machine # [ 16.439435] systemd[1]: Import lastlog data into lastlog2 database skipped, unmet condition check ConditionPathExists=!/var/lib/lastlog/lastlog2.db machine # [ 16.446010] systemd[1]: Starting Name Service Cache Daemon (nsncd)... machine # [ 16.449688] systemd[1]: Starting Post-Boot Actions... machine # [ 16.464067] systemd[1]: Started Reset console on configuration changes. machine # [ 16.481091] systemd[1]: Starting resolvconf update... machine # [ 16.532354] systemd[1]: Starting D-Bus System Message Bus... machine # [ 16.549961] systemd[1]: Finished Post-Boot Actions. machine # connecting to host... machine # [ 16.604436] nsncd[580]: Sep 01 03:11:28.083 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" machine # [ 16.615631] systemd[1]: Started Name Service Cache Daemon (nsncd). machine # [ 16.618704] systemd[1]: Reached target Host and Network Name Lookups. machine # [ 16.621231] systemd[1]: Reached target User and Group Name Lookups. machine # [ 16.623504] systemd[1]: Starting User Login Management... machine: Guest shell says: b'Spawning backdoor root shell...\n' machine: connected to guest root shell machine: (connecting took 17.02 seconds) machine: (finished: waiting for the VM to finish booting, in 17.02 seconds) machine # [ 16.749729] dbus-broker-launch[585]: Looking up NSS user entry for 'systemd-timesync'... machine # [ 16.792608] systemd-logind[603]: New seat seat0. machine # [ 16.799863] dbus-broker-launch[585]: NSS returned no entry for 'systemd-timesync' machine: (finished: waiting for unit systemd-cryptsetup@luks.service, in 17.15 seconds) machine: must succeed: systemd-cryptenroll --wipe-slot=tpm2 /dev/vdb machine # [ 16.807519] dbus-broker-launch[585]: Invalid user-name in /nix/store/d2005fd0773b9jz7m31rbndmj9q5as51-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync" machine # [ 16.821291] systemd-logind[603]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard) machine # [ 16.831413] systemd-logind[603]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard) machine # [ 16.840370] systemd-logind[603]: Watching system buttons on /dev/input/event0 (gpio-keys) machine # [ 16.848364] systemd[1]: Started User Login Management. machine # [ 16.849218] systemd[1]: Starting linger-users.service... machine # [ 16.863718] systemd[1]: Started D-Bus System Message Bus. machine # [ 16.886409] systemd[1]: Stopped target Host and Network Name Lookups. machine # [ 16.887473] systemd[1]: Stopping Host and Network Name Lookups... machine # [ 16.897534] systemd[1]: Stopped target User and Group Name Lookups. machine # [ 16.898635] systemd[1]: Stopping User and Group Name Lookups... machine # [ 16.899502] systemd[1]: Stopping Name Service Cache Daemon (nsncd)... machine # [ 16.916916] systemd[1]: nscd.service: Deactivated successfully. machine # [ 16.917849] systemd[1]: Stopped Name Service Cache Daemon (nsncd). machine # [ 16.949996] dbus-broker-launch[585]: Ready machine # [ 16.970758] systemd[1]: Starting Name Service Cache Daemon (nsncd)... machine # [ 16.971847] systemd[1]: linger-users.service: Deactivated successfully. machine # [ 16.979059] systemd[1]: Finished linger-users.service. machine # Wiped slot 1. machine # [ 17.055806] systemd[1]: Started Name Service Cache Daemon (nsncd). machine # [ 17.063655] systemd[1]: Reached target Host and Network Name Lookups. machine # [ 17.066381] nsncd[660]: Sep 01 03:11:28.537 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" machine # [ 17.071358] systemd[1]: Reached target User and Group Name Lookups. machine: (finished: must succeed: systemd-cryptenroll --wipe-slot=tpm2 /dev/vdb, in 0.27 seconds) (finished: run the VM test script, in 59.83 seconds) machine # [ 17.110285] systemd[1]: Finished resolvconf update. machine # [ 17.113444] systemd[1]: Reached target Preparation for Network. machine # [ 17.121653] systemd[1]: Starting DHCP Client... machine # [ 17.127641] systemd[1]: Starting Address configuration of eth1... machine # [ 17.143402] systemd[1]: Starting Extra networking commands.... test script finished in 59.96s cleanup kill QemuMachine (pid 95) machine # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/lfh101cfjj8p8npcari9hk0lbqi33yvh-python3-3.14.7/bin/python3.14) (finished: cleanup, in 0.11 seconds)