vm-test-run-sops-user-passwords-userborn-key-mount
checks.aarch64-linux.user-passwords-userborn-key-mount
· build #118
· raw
1tribuchet: building on eliza2Machine state will be reset. To keep it, pass --keep-machine-state3start all VLans4(finished: start all VLans, in 0.00 seconds)5Test will time out and terminate in 3600.0 seconds6run the VM test script7start all VMs8machine: starting vm9machine # Disk image does not exist, creating the virtualisation disk image...10machine: QEMU running (pid 46)11machine # Formatting '/build/vm-state-machine/tmp.Ik5cr9xbz9', fmt=raw size=107374182412machine # mke2fs 1.47.4 (6-Mar-2025)13machine # Discarding device blocks: 0/262144 done14machine # Creating filesystem with 262144 4k blocks and 65536 inodes15machine # Filesystem UUID: a385634c-12c1-4af9-9d37-619e8ce47fc216machine # Superblock backups stored on blocks:17(finished: start all VMs, in 0.32 seconds)18machine # 32768, 98304, 163840, 22937619machine: waiting for unit multi-user.target20machine # 21machine: waiting for the VM to finish booting22machine # Allocating group tables: 0/8 done23machine # Writing inode tables: 0/8 done24machine # Creating journal (8192 blocks): done25machine # Writing superblocks and filesystem accounting information: 0/8 done26machine # 27machine # Virtualisation disk image created.28machine # Starting virtiofs daemons...29machine # [2026-11-02T22:06:44Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)30machine # [2026-11-02T22:06:44Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether31machine # [2026-11-02T22:06:44Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)32machine # [2026-11-02T22:06:44Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether33machine # [2026-11-02T22:06:44Z INFO virtiofsd] Waiting for vhost-user socket connection...34machine # [2026-11-02T22:06:44Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)35machine # [2026-11-02T22:06:44Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether36machine # [2026-11-02T22:06:44Z INFO virtiofsd] Waiting for vhost-user socket connection...37machine # [2026-11-02T22:06:44Z INFO virtiofsd] Waiting for vhost-user socket connection...38machine # [2026-11-02T22:06:44Z INFO virtiofsd] Client connected, servicing requests39machine # [2026-11-02T22:06:44Z INFO virtiofsd] Client connected, servicing requests40machine # [2026-11-02T22:06:44Z INFO virtiofsd] Client connected, servicing requests41machine # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]42machine # [ 0.000000] Linux version 6.18.56 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT @179172517243machine # [ 0.000000] KASLR enabled44machine # [ 0.000000] random: crng init done45machine # [ 0.000000] Machine model: linux,dummy-virt46machine # [ 0.000000] efi: UEFI not found.47machine # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT48machine # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]49machine # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fded700-0x7fdf0e7f]50machine # [ 0.000000] Zone ranges:51machine # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]52machine # [ 0.000000] DMA32 empty53machine # [ 0.000000] Normal empty54machine # [ 0.000000] Device empty55machine # [ 0.000000] Movable zone start for each node56machine # [ 0.000000] Early memory node ranges57machine # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]58machine # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]59machine # [ 0.000000] cma: Reserved 32 MiB at 0x000000007cc0000060machine # [ 0.000000] psci: probing for conduit method from DT.61machine # [ 0.000000] psci: PSCIv1.3 detected in firmware.62machine # [ 0.000000] psci: Using standard PSCI v0.2 function IDs63machine # [ 0.000000] psci: Trusted OS migration not required64machine # [ 0.000000] psci: SMC Calling Convention v1.165machine # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)66machine # [ 0.000000] percpu: Embedded 76 pages/cpu s186904 r8192 d116200 u31129667machine # [ 0.000000] Detected PIPT I-cache on CPU068machine # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)69machine # [ 0.000000] CPU features: detected: GICv3 CPU interface70machine # [ 0.000000] CPU features: detected: Spectre-v471machine # [ 0.000000] CPU features: detected: Spectre-BHB72machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_3873machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_2374machine # [ 0.000000] alternatives: applying boot alternatives75machine # [ 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/p41vvs3llgr64zp4qm88gxlyhw3lmk24-nixos-system-machine-test/init regInfo=/nix/.ro-store/1rdfdsq95qhpz6y8py9ggfx0c17avcl3-closure-info/registration console=ttyAMA0,115200n8 console=tty076machine # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/1rdfdsq95qhpz6y8py9ggfx0c17avcl3-closure-info/registration", will be passed to user space.77machine # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes78machine # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)79machine # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)80machine # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB81machine # [ 0.000000] software IO TLB: area num 1.82machine # [ 0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB)83machine # [ 0.000000] Fallback order for Node 0: 084machine # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 26214485machine # [ 0.000000] Policy zone: DMA86machine # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off87machine # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=188machine # [ 0.000000] allocated 2097152 bytes of page_ext89machine # [ 0.000000] ftrace: allocating 75049 entries in 294 pages90machine # [ 0.000000] ftrace: allocated 294 pages with 4 groups91machine # [ 0.000000] rcu: Hierarchical RCU implementation.92machine # [ 0.000000] rcu: RCU event tracing is enabled.93machine # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=1.94machine # [ 0.000000] Trampoline variant of Tasks RCU enabled.95machine # [ 0.000000] Rude variant of Tasks RCU enabled.96machine # [ 0.000000] Tracing variant of Tasks RCU enabled.97machine # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.98machine # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=199machine # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.100machine # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.101machine # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.102machine # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0103machine # [ 0.000000] GICv3: 256 SPIs implemented104machine # [ 0.000000] GICv3: 0 Extended SPIs implemented105machine # [ 0.000000] Root IRQ handler: gic_handle_irq106machine # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI107machine # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0108machine # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000109machine # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]110machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44ce0000 (indirect, esz 8, psz 64K, shr 1)111machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44cf0000 (flat, esz 8, psz 64K, shr 1)112machine # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000113machine # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000114machine # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.115machine # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns116machine # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).117machine # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns118machine # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns119machine # [ 0.000037] arm-pv: using stolen time PV120machine # [ 0.000539] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)121machine # [ 0.000756] Console: colour dummy device 80x25122machine # [ 0.000765] printk: legacy console [tty0] enabled123machine # [ 0.000963] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)124machine # [ 0.000970] pid_max: default: 32768 minimum: 301125machine # [ 0.001046] LSM: initializing lsm=capability,landlock,yama,bpf,ima126machine # [ 0.001200] landlock: Up and running.127machine # [ 0.001203] Yama: becoming mindful.128machine # [ 0.001736] LSM support for eBPF active129machine # [ 0.001907] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)130machine # [ 0.001929] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)131machine # [ 0.003985] rcu: Hierarchical SRCU implementation.132machine # [ 0.003991] rcu: Max phase no-delay instances is 1000.133machine # [ 0.005306] fsl-mc MSI: its@8080000 domain created134machine # [ 0.005429] EFI services will not be available.135machine # [ 0.005503] smp: Bringing up secondary CPUs ...136machine # [ 0.005513] smp: Brought up 1 node, 1 CPU137machine # [ 0.005516] SMP: Total of 1 processors activated.138machine # [ 0.005519] CPU: All CPU(s) started at EL1139machine # [ 0.005529] CPU features: detected: Branch Target Identification140machine # [ 0.005533] CPU features: detected: ARMv8.4 Translation Table Level141machine # [ 0.005537] CPU features: detected: Instruction cache invalidation not required for I/D coherence142machine # [ 0.005540] CPU features: detected: Data cache clean to the PoU not required for I/D coherence143machine # [ 0.005548] CPU features: detected: Common not Private translations144machine # [ 0.005551] CPU features: detected: CRC32 instructions145machine # [ 0.005554] CPU features: detected: Data cache clean to Point of Deep Persistence146machine # [ 0.005557] CPU features: detected: Data cache clean to Point of Persistence147machine # [ 0.005560] CPU features: detected: Data independent timing control (DIT)148machine # [ 0.005563] CPU features: detected: E0PD149machine # [ 0.005565] CPU features: detected: Enhanced Counter Virtualization150machine # [ 0.005568] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)151machine # [ 0.005571] CPU features: detected: Enhanced Virtualization Traps152machine # [ 0.005574] CPU features: detected: Fine Grained Traps153machine # [ 0.005577] CPU features: detected: Generic authentication (architected QARMA5 algorithm)154machine # [ 0.005582] CPU features: detected: RCpc load-acquire (LDAPR)155machine # [ 0.005586] CPU features: detected: LSE atomic instructions156machine # [ 0.005589] CPU features: detected: Privileged Access Never157machine # [ 0.005591] CPU features: detected: PMUv3158machine # [ 0.005594] CPU features: detected: RAS Extension Support159machine # [ 0.005597] CPU features: detected: RASv1p1 Extension Support160machine # [ 0.005600] CPU features: detected: Random Number Generator161machine # [ 0.005604] CPU features: detected: Speculation barrier (SB)162machine # [ 0.005607] CPU features: detected: Stage-2 Force Write-Back163machine # [ 0.005610] CPU features: detected: TLB range maintenance instructions164machine # [ 0.005615] CPU features: detected: Speculative Store Bypassing Safe (SSBS)165machine # [ 0.005655] alternatives: applying system-wide alternatives166machine # [ 0.008746] CPU features: detected: BBM Level 2 without TLB conflict abort167machine # [ 0.008930] Memory: 893104K/1048576K available (24512K kernel code, 7102K rwdata, 26572K rodata, 4736K init, 1184K bss, 114152K reserved, 32768K cma-reserved)168machine # [ 0.009280] devtmpfs: initialized169machine # [ 0.011077] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)170machine # [ 0.011108] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).171machine # [ 0.011306] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL172machine # [ 0.011311] 0 pages in range for non-PLT usage173machine # [ 0.011312] 508192 pages in range for PLT usage174machine # [ 0.011433] pinctrl core: initialized pinctrl subsystem175machine # [ 0.012393] DMI not present or invalid.176machine # [ 0.015989] NET: Registered PF_NETLINK/PF_ROUTE protocol family177machine # [ 0.018542] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations178machine # [ 0.018705] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations179machine # [ 0.018866] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations180machine # [ 0.018893] audit: initializing netlink subsys (disabled)181machine # [ 0.019515] thermal_sys: Registered thermal governor 'fair_share'182machine # [ 0.019517] thermal_sys: Registered thermal governor 'bang_bang'183machine # [ 0.019521] thermal_sys: Registered thermal governor 'step_wise'184machine # [ 0.019524] thermal_sys: Registered thermal governor 'user_space'185machine # [ 0.019526] thermal_sys: Registered thermal governor 'power_allocator'186machine # [ 0.019562] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1187machine # [ 0.019571] cpuidle: using governor ladder188machine # [ 0.019578] cpuidle: using governor menu189machine # [ 0.019898] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.190machine # [ 0.019919] ASID allocator initialised with 65536 entries191machine # [ 0.021295] Serial: AMBA PL011 UART driver192machine # [ 0.027113] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1193machine # [ 0.027294] printk: console [ttyAMA0] enabled194machine # [ 0.158292] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages195machine # [ 0.158304] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page196machine # [ 0.158307] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages197machine # [ 0.158310] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page198machine # [ 0.158313] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages199machine # [ 0.158316] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page200machine # [ 0.158318] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages201machine # [ 0.158321] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page202machine # [ 0.159551] fbcon: Taking over console203machine # [ 0.159561] ACPI: Interpreter disabled.204machine # [ 0.170050] iommu: Default domain type: Translated205machine # [ 0.170057] iommu: DMA domain TLB invalidation policy: strict mode206machine # [ 0.170464] SCSI subsystem initialized207machine # [ 0.172673] usbcore: registered new interface driver usbfs208machine # [ 0.172704] usbcore: registered new interface driver hub209machine # [ 0.172719] usbcore: registered new device driver usb210machine # [ 0.173041] pps_core: LinuxPPS API ver. 1 registered211machine # [ 0.173045] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>212machine # [ 0.173053] PTP clock support registered213machine # [ 0.173095] EDAC MC: Ver: 3.0.0214machine # [ 0.179766] scmi_core: SCMI protocol bus registered215machine # [ 0.180155] FPGA manager framework216machine # [ 0.180709] vgaarb: loaded217machine # [ 0.180993] clocksource: Switched to clocksource arch_sys_counter218machine # [ 0.191444] VFS: Disk quotas dquot_6.6.0219machine # [ 0.191478] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)220machine # [ 0.194677] netfs: FS-Cache loaded221machine # [ 0.194818] pnp: PnP ACPI: disabled222machine # [ 0.199927] NET: Registered PF_INET protocol family223machine # [ 0.200095] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)224machine # [ 0.232050] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)225machine # [ 0.232100] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)226machine # [ 0.232126] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)227machine # [ 0.232179] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)228machine # [ 0.232252] TCP: Hash tables configured (established 8192 bind 8192)229machine # [ 0.232371] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)230machine # [ 0.232439] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)231machine # [ 0.232486] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)232machine # [ 0.232575] NET: Registered PF_UNIX/PF_LOCAL protocol family233machine # [ 0.232594] NET: Registered PF_XDP protocol family234machine # [ 0.232613] PCI: CLS 0 bytes, default 64235machine # [ 0.232988] Trying to unpack rootfs image as initramfs...236machine # [ 0.249037] kvm [1]: HYP mode not available237machine # [ 0.373666] Initialise system trusted keyrings238machine # [ 0.373829] workingset: timestamp_bits=42 max_order=18 bucket_order=0239machine # [ 0.374242] squashfs: version 4.0 (2009/01/31) Phillip Lougher240machine # [ 0.374310] 9p: Installing v9fs 9p2000 file system support241machine # [ 0.402456] Key type asymmetric registered242machine # [ 0.402476] Asymmetric key parser 'x509' registered243machine # [ 0.402558] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)244machine # [ 0.402735] io scheduler mq-deadline registered245machine # [ 0.402740] io scheduler kyber registered246machine # [ 0.415559] pl061_gpio 9030000.pl061: PL061 GPIO chip registered247machine # [ 0.417845] ledtrig-cpu: registered to indicate activity on CPUs248machine # [ 0.418295] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:249machine # [ 0.418312] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000250machine # [ 0.418321] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000251machine # [ 0.418327] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000252machine # [ 0.418353] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits253machine # [ 0.418378] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]254machine # [ 0.418484] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00255machine # [ 0.418492] pci_bus 0000:00: root bus resource [bus 00-ff]256machine # [ 0.418496] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]257machine # [ 0.418499] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]258machine # [ 0.418503] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]259machine # [ 0.418595] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint260machine # [ 0.419053] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint261machine # [ 0.419248] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]262machine # [ 0.419261] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]263machine # [ 0.419289] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]264machine # [ 0.419301] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]265machine # [ 0.419890] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint266machine # [ 0.420081] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]267machine # [ 0.420093] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]268machine # [ 0.420120] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]269machine # [ 0.420621] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint270machine # [ 0.420820] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]271machine # [ 0.420834] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]272machine # [ 0.420863] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]273machine # [ 0.453530] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint274machine # [ 0.453740] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]275machine # [ 0.453754] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]276machine # [ 0.453782] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]277machine # [ 0.453794] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]278machine # [ 0.454310] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint279machine # [ 0.454504] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]280machine # [ 0.454531] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]281machine # [ 0.455017] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint282machine # [ 0.455214] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]283machine # [ 0.455241] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]284machine # [ 0.455676] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint285machine # [ 0.455870] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]286machine # [ 0.456168] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint287machine # [ 0.456362] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]288machine # [ 0.456389] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]289machine # [ 0.456874] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint290machine # [ 0.472816] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]291machine # [ 0.472844] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]292machine # [ 0.475031] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint293machine # [ 0.475229] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]294machine # [ 0.475256] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]295machine # [ 0.475811] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint296machine # [ 0.476101] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]297machine # [ 0.476114] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]298machine # [ 0.476141] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]299machine # [ 0.476637] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint300machine # [ 0.476830] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]301machine # [ 0.476843] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]302machine # [ 0.476869] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]303machine # [ 0.493669] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned304machine # [ 0.493681] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned305machine # [ 0.493685] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned306machine # [ 0.493736] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned307machine # [ 0.493782] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned308machine # [ 0.493828] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned309machine # [ 0.493876] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned310machine # [ 0.493921] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned311machine # [ 0.493968] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned312machine # [ 0.494015] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned313machine # [ 0.494063] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned314machine # [ 0.494109] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned315machine # [ 0.494211] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned316machine # [ 0.494257] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned317machine # [ 0.494275] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned318machine # [ 0.494293] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned319machine # [ 0.494310] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned320machine # [ 0.494328] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned321machine # [ 0.494346] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned322machine # [ 0.494365] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned323machine # [ 0.494385] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned324machine # [ 0.494403] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned325machine # [ 0.494421] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned326machine # [ 0.494439] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned327machine # [ 0.494459] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned328machine # [ 0.494476] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned329machine # [ 0.494494] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned330machine # [ 0.494512] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned331machine # [ 0.494530] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned332machine # [ 0.494547] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned333machine # [ 0.494566] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned334machine # [ 0.494591] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]335machine # [ 0.494597] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]336machine # [ 0.494600] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]337machine # [ 0.495495] pci 0000:00:07.0: enabling device (0000 -> 0002)338machine # [ 0.549926] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)339machine # [ 0.552019] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)340machine # [ 0.570087] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)341machine # [ 0.572175] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)342machine # [ 0.576226] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)343machine # [ 0.579131] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)344machine # [ 0.589571] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)345machine # [ 0.591636] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)346machine # [ 0.601640] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)347machine # [ 0.603556] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)348machine # [ 0.608082] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)349machine # [ 0.621447] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled350machine # [ 0.623346] msm_serial: driver initialized351machine # [ 0.623502] SuperH (H)SCI(F) driver initialized352machine # [ 0.623565] STM32 USART driver initialized353machine # [ 0.660064] loop: module loaded354machine # [ 0.660263] virtio_blk virtio2: 1/0/0 default/read/poll queues355machine # [ 0.662340] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)356machine # [ 0.669657] megasas: 07.734.00.00-rc1357machine # [ 0.670429] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]358machine # [ 0.672446] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000359machine # [ 0.672463] Intel/Sharp Extended Query Table at 0x0031360machine # [ 0.686070] Using buffer write method361machine # [ 0.686128] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]362machine # [ 0.688036] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000363machine # [ 0.688052] Intel/Sharp Extended Query Table at 0x0031364machine # [ 0.693464] Using buffer write method365machine # [ 0.693480] Concatenating MTD devices:366machine # [ 0.693482] (0): "0.flash"367machine # [ 0.693485] (1): "0.flash"368machine # [ 0.693486] into device "0.flash"369machine # [ 0.965456] Freeing initrd memory: 26908K370machine # [ 0.972175] tun: Universal TUN/TAP device driver, 1.6371machine # [ 0.976130] thunder_xcv, ver 1.0372machine # [ 0.976179] thunder_bgx, ver 1.0373machine # [ 0.976199] nicpf, ver 1.0374machine # [ 0.976816] e1000: Intel(R) PRO/1000 Network Driver375machine # [ 0.976821] e1000: Copyright (c) 1999-2006 Intel Corporation.376machine # [ 0.976848] e1000e: Intel(R) PRO/1000 Network Driver377machine # [ 0.976855] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.378machine # [ 0.976881] igb: Intel(R) Gigabit Ethernet Network Driver379machine # [ 0.976884] igb: Copyright (c) 2007-2014 Intel Corporation.380machine # [ 0.976906] igbvf: Intel(R) Gigabit Virtual Function Network Driver381machine # [ 0.976910] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.382machine # [ 0.984282] sky2: driver version 1.30383machine # [ 0.986587] usbcore: registered new interface driver usb-storage384machine # [ 0.986681] usbcore: registered new interface driver usbserial_generic385machine # [ 0.986694] usbserial: USB Serial support registered for generic386machine # [ 0.987365] hv_vmbus: registering driver hyperv_keyboard387machine # [ 0.988759] ehci-pci 0000:00:07.0: EHCI Host Controller388machine # [ 0.988779] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 1389machine # [ 0.988987] ehci-pci 0000:00:07.0: irq 16, io mem 0x10086000390machine # [ 0.994914] rtc-pl031 9010000.pl031: registered as rtc0391machine # [ 0.994943] rtc-pl031 9010000.pl031: setting system clock to 2026-11-02T22:06:46 UTC (1793657206)392machine # [ 0.995308] i2c_dev: i2c /dev entries driver393machine # [ 1.001362] sdhci: Secure Digital Host Controller Interface driver394machine # [ 1.001369] sdhci: Copyright(c) Pierre Ossman395machine # [ 1.001680] Synopsys Designware Multimedia Card Interface Driver396machine # [ 1.002091] sdhci-pltfm: SDHCI platform and OF driver helper397machine # [ 1.003904] hid: raw HID events driver (C) Jiri Kosina398machine # [ 1.004172] usbcore: registered new interface driver usbhid399machine # [ 1.004176] usbhid: USB HID core driver400machine # [ 1.005048] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.00401machine # [ 1.005423] hub 1-0:1.0: USB hub found402machine # [ 1.005442] hub 1-0:1.0: 6 ports detected403machine # [ 1.013038] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available404machine # [ 1.014738] drop_monitor: Initializing network drop monitor service405machine # [ 1.014895] NET: Registered PF_INET6 protocol family406machine # [ 1.015454] Segment Routing with IPv6407machine # [ 1.015471] In-situ OAM (IOAM) with IPv6408machine # [ 1.015510] NET: Registered PF_PACKET protocol family409machine # [ 1.015564] 9pnet: Installing 9P2000 support410machine # [ 1.015620] Key type dns_resolver registered411machine # [ 1.027375] registered taskstats version 1412machine # [ 1.027560] Loading compiled-in X.509 certificates413machine # [ 1.036622] Demotion targets for Node 0: null414machine # [ 1.036740] Key type .fscrypt registered415machine # [ 1.036744] Key type fscrypt-provisioning registered416machine # [ 1.036837] ima: No TPM chip found, activating TPM-bypass!417machine # [ 1.036854] ima: Allocated hash algorithm: sha1418machine # [ 1.036874] ima: No architecture policies found419machine # [ 1.041186] input: gpio-keys as /devices/platform/gpio-keys/input/input0420machine # [ 1.059245] clk: Disabling unused clocks421machine # [ 1.059260] PM: genpd: Disabling unused power domains422machine # [ 1.063475] Freeing unused kernel memory: 4736K423machine # [ 1.063673] Run /init as init process424machine # [ 1.079285] systemd[1]: Successfully made /usr/ read-only.425machine # [ 1.253115] usb 1-1: new high-speed USB device number 2 using ehci-pci426machine # [ 1.402803] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1427machine # [ 1.413314] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)428machine # [ 1.413340] systemd[1]: Detected virtualization qemu.429machine # [ 1.413385] systemd[1]: Detected architecture arm64.430machine # [ 1.413395] systemd[1]: Running in initrd.431machine # [ 1.413949] systemd[1]: Initializing machine ID from random generator.432machine # [ 1.414101] systemd[1]: Hostname set to <machine>.433machine # [ 1.489201] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input0434machine # [ 1.546485] systemd[1]: bpf-restrict-fs: LSM BPF program attached435machine # [ 1.603245] systemd[1]: Queued start job for default target Initrd Default Target.436machine # [ 1.610957] systemd[1]: Created slice Slice /system/modprobe.437machine # [ 1.611130] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.438machine # [ 1.611156] systemd[1]: Expecting device /dev/disk/by-label/nixos...439machine # [ 1.611178] systemd[1]: Reached target Path Units.440machine # [ 1.611191] systemd[1]: Reached target Slice Units.441machine # [ 1.611205] systemd[1]: Reached target Swaps.442machine # [ 1.611218] systemd[1]: Reached target Timer Units.443machine # [ 1.611344] systemd[1]: Listening on D-Bus System Message Bus Socket.444machine # [ 1.611490] systemd[1]: Listening on Journal Socket (/dev/log).445machine # [ 1.611734] systemd[1]: Listening on Journal Sockets.446machine # [ 1.611839] systemd[1]: Listening on udev Control Socket.447machine # [ 1.611905] systemd[1]: Listening on udev Kernel Socket.448machine # [ 1.611920] systemd[1]: Reached target Socket Units.449machine # [ 1.612898] usb 1-2: new high-speed USB device number 3 using ehci-pci450machine # [ 1.624561] systemd[1]: Starting Create List of Static Device Nodes...451machine # [ 1.624623] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs452machine # [ 1.630105] systemd[1]: Mounting Kernel Configuration File System...453machine # [ 1.643357] systemd[1]: Starting Journal Service...454machine # [ 1.651006] systemd[1]: Starting Load Kernel Modules...455machine # [ 1.651109] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os456machine # [ 1.663381] systemd[1]: Starting Coldplug All udev Devices...457machine # [ 1.685821] systemd[1]: Finished Create List of Static Device Nodes.458machine # [ 1.709772] systemd-journald[71]: Collecting audit messages is disabled.459machine # [ 1.713188] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...460machine # [ 1.737084] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.461machine # [ 1.745650] systemd[1]: Mounted Kernel Configuration File System.462machine # [ 1.753082] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev463machine # [ 1.777840] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.464machine # [ 1.779552] systemd[1]: Starting Create Static Device Nodes in /dev...465machine # [ 1.783182] [drm] pci: virtio-gpu-pci detected at 0000:00:05.0466machine # [ 1.783442] [drm] features: -virgl +edid -resource_blob -host_visible467machine # [ 1.783445] [drm] features: -context_init468machine # [ 1.784403] [drm] number of scanouts: 1469machine # [ 1.784415] [drm] number of cap sets: 0470machine # [ 1.792875] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2471machine # [ 1.793044] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input0472machine # [ 1.801288] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic473machine # [ 1.801296] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 0474machine # [ 1.829378] Console: switching to colour frame buffer device 160x50475machine # [ 1.847979] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device476machine # [ 1.850682] systemd[1]: Finished Create Static Device Nodes in /dev.477machine # [ 1.851866] systemd[1]: Reached target Preparation for Local File Systems.478machine # [ 1.851994] systemd[1]: Reached target Local File Systems.479machine # [ 1.865570] systemd[1]: Starting Rule-based Manager for Device Events and Files...480machine # [ 1.867222] systemd[1]: Finished Load Kernel Modules.481machine # [ 1.881904] systemd[1]: Starting Apply Kernel Variables...482machine # [ 1.869326] systemd-modules-load[72]: Inserted module 'dm_mod'483machine # [ 1.870440] systemd-modules-load[72]: Module 'virtio_balloon' is built in484machine # [ 1.892577] systemd[1]: Started Journal Service.485machine # [ 1.873961] systemd-modules-load[72]: Module 'virtio_console' is built in486machine # [ 1.880313] systemd-modules-load[72]: Inserted module 'virtio_gpu'487machine # [ 1.884337] systemd-modules-load[72]: Module 'virtio_rng' is built in488machine # [ 1.893089] systemd[1]: Starting Create System Files and Directories...489machine # [ 1.937074] systemd[1]: Finished Apply Kernel Variables.490machine # [ 1.955357] systemd[1]: Finished Create System Files and Directories.491machine # [ 1.965874] systemd-udevd[78]: Using default interface naming scheme 'v261'.492machine # [ 1.994532] systemd[1]: Started Rule-based Manager for Device Events and Files.493machine # [ 2.087834] systemd[1]: Starting Virtual Console Setup...494machine # [ 2.152531] systemd-vconsole-setup[101]: Configuration of first virtual console was skipped, ignoring remaining ones.495machine # [ 2.156176] systemd[1]: Finished Virtual Console Setup.496machine # [ 2.753054] systemd[1]: Finished Coldplug All udev Devices.497machine # [ 2.756152] systemd[1]: Reached target System Initialization.498machine # [ 2.757091] systemd[1]: Reached target Basic System.499machine # [ 2.929303] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.500machine # [ 2.936503] (udev-worker)[89]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.501machine # [ 2.940626] (udev-worker)[89]: Network interface NamePolicy= disabled on kernel command line.502machine # [ 2.994944] systemd[1]: Found device /dev/disk/by-label/nixos.503machine # [ 2.996784] systemd[1]: Reached target Initrd Root Device.504machine # [ 3.000195] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...505machine # [ 3.050530] systemd-fsck[109]: nixos: clean, 12/65536 files, 13019/262144 blocks506machine # [ 3.057764] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.507machine # [ 3.067741] systemd[1]: Mounting /sysroot...508machine # [ 3.131748] EXT4-fs (vda): mounted filesystem a385634c-12c1-4af9-9d37-619e8ce47fc2 r/w with ordered data mode. Quota mode: none.509machine # [ 3.119405] systemd[1]: Mounted /sysroot.510machine # [ 3.122422] systemd[1]: Reached target Initrd Root File System.511machine # [ 3.128744] systemd[1]: Starting Mountpoints Configured in the Real Root...512machine # [ 3.156594] systemd-sysroot-fstab-check[117]: /sysroot should be mounted in the initrd, will request daemon-reload.513machine # [ 3.160808] systemd[1]: Reload requested from client PID 117 ('systemd-sysroot') (unit initrd-parse-etc.service)...514machine # [ 3.166743] systemd[1]: Reloading...515machine # [ 3.392058] systemd[1]: Reloading finished in 224 ms.516machine # [ 3.421880] systemd-sysroot-fstab-check[117]: Requesting initrd-fs.target/start/replace...517machine # [ 3.431083] systemd-sysroot-fstab-check[117]: Requesting swap.target/start/replace...518machine # [ 3.437458] systemd[1]: initrd-parse-etc.service: Deactivated successfully.519machine # [ 3.438826] systemd[1]: Finished Mountpoints Configured in the Real Root.520machine # [ 3.441221] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.521machine # [ 3.646821] systemd[1]: Mounting /sysroot/nix/.ro-store...522machine # [ 3.660126] systemd[1]: Mounting /sysroot/nix/.rw-store...523machine # [ 3.675680] systemd[1]: Mounting /sysroot/run...524machine # [ 3.688260] systemd[1]: Mounting /sysroot/tmp/shared...525machine # [ 3.719295] systemd[1]: Mounting /sysroot/tmp/xchg...526machine # [ 3.771906] systemd[1]: Mounted /sysroot/nix/.rw-store.527machine # [ 3.812162] fuse: init (API version 7.45)528machine # [ 3.802217] systemd[1]: Mounted /sysroot/run.529machine # [ 3.829215] virtiofs virtio6: discovered new tag: nix-store530machine # [ 3.830027] virtiofs virtio6: virtio_fs_setup_dax: No cache capability531machine # [ 3.816821] systemd[1]: Starting rw-sysroot-nix-store.service...532machine # [ 3.846829] virtiofs virtio7: discovered new tag: shared533machine # [ 3.847658] virtiofs virtio7: virtio_fs_setup_dax: No cache capability534machine # [ 3.856699] virtiofs virtio8: discovered new tag: xchg535machine # [ 3.862225] virtiofs virtio8: virtio_fs_setup_dax: No cache capability536machine # [ 3.855326] systemd[1]: Mounted /sysroot/tmp/xchg.537machine # [ 3.861257] systemd[1]: Mounted /sysroot/nix/.ro-store.538machine # [ 3.869967] systemd[1]: Mounted /sysroot/tmp/shared.539machine # [ 3.872313] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.540machine # [ 3.875811] systemd[1]: Finished rw-sysroot-nix-store.service.541machine # [ 4.385812] (udev-worker)[99]: mtd0ro: Failed to find and pin callout binary "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/udev/mtd_probe": No such file or directory542machine # [ 4.392283] (udev-worker)[99]: mtd0ro: /etc/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 directory543machine # [ 4.429780] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.544machine # [ 4.436760] systemd[1]: Stopped Virtual Console Setup.545machine # [ 4.437660] systemd[1]: Stopping Virtual Console Setup...546machine # [ 4.439102] systemd[1]: Starting Virtual Console Setup...547machine # [ 4.458750] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.548machine # [ 4.461386] systemd[1]: Stopped Virtual Console Setup.549machine # [ 4.467676] systemd[1]: Starting Virtual Console Setup...550machine # [ 4.494156] systemd-vconsole-setup[155]: Configuration of first virtual console was skipped, ignoring remaining ones.551machine # [ 4.497076] systemd[1]: Finished Virtual Console Setup.552machine # [ 4.647328] systemd[1]: Mounting /sysroot/nix/store...553machine # [ 4.691610] systemd[1]: Mounted /sysroot/nix/store.554machine # [ 4.697896] systemd[1]: Mounting /sysroot/var/lib/sops-nix...555machine # [ 4.706015] systemd[1]: Starting Find NixOS closure...556machine # [ 4.746058] systemd[1]: Mounted /sysroot/var/lib/sops-nix.557machine # [ 4.751043] systemd[1]: Reached target Initrd File Systems.558machine # [ 4.756683] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...559machine # [ 4.779137] systemd[1]: Finished Find NixOS closure.560machine # [ 4.788613] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.561machine # [ 4.792311] systemd[1]: Reached target Initrd Default Target.562machine # [ 4.794484] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...563machine # [ 4.823185] systemd[1]: Stopped target Initrd Default Target.564machine # [ 4.824994] systemd[1]: Stopped target Basic System.565machine # [ 4.828540] systemd[1]: Stopped target Initrd Root Device.566machine # [ 4.829595] systemd[1]: Stopped target Path Units.567machine # [ 4.830786] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.568machine # [ 4.833585] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.569machine # [ 4.836220] systemd[1]: Stopped target Slice Units.570machine # [ 4.838159] systemd[1]: Stopped target Socket Units.571machine # [ 4.840326] systemd[1]: Stopped target System Initialization.572machine # [ 4.843563] systemd[1]: Stopped target Swaps.573machine # [ 4.848628] systemd[1]: Stopped target Timer Units.574machine # [ 4.849444] systemd[1]: dbus.socket: Deactivated successfully.575machine # [ 4.850337] systemd[1]: Closed D-Bus System Message Bus Socket.576machine # [ 4.851253] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.577machine # [ 4.867298] systemd[1]: Stopped Find NixOS closure.578machine # [ 4.868413] systemd[1]: Starting rw-sysroot-nix-store.service...579machine # [ 4.875519] systemd[1]: systemd-sysctl.service: Deactivated successfully.580machine # [ 4.877324] systemd[1]: Stopped Apply Kernel Variables.581machine # [ 4.878637] systemd[1]: systemd-modules-load.service: Deactivated successfully.582machine # [ 4.882754] systemd[1]: Stopped Load Kernel Modules.583machine # [ 4.884269] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.584machine # [ 4.887888] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.585machine # [ 4.889527] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.586machine # [ 4.892396] systemd[1]: Stopped Create System Files and Directories.587machine # [ 4.896350] systemd[1]: Stopped target Local File Systems.588machine # [ 4.897222] systemd[1]: Stopped target Preparation for Local File Systems.589machine # [ 4.898220] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.590machine # [ 4.899279] systemd[1]: Stopped Coldplug All udev Devices.591machine # [ 4.900873] systemd[1]: Stopping Rule-based Manager for Device Events and Files...592machine # [ 4.901973] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.593machine # [ 4.903108] systemd[1]: Stopped Virtual Console Setup.594machine # [ 4.903865] systemd[1]: initrd-cleanup.service: Deactivated successfully.595machine # [ 4.904956] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.596machine # [ 4.905911] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.597machine # [ 4.906965] systemd[1]: Finished rw-sysroot-nix-store.service.598machine # [ 4.907805] systemd[1]: systemd-udevd.service: Deactivated successfully.599machine # [ 4.912273] systemd[1]: Stopped Rule-based Manager for Device Events and Files.600machine # [ 4.913379] systemd[1]: systemd-udevd.service: Consumed 1.505s CPU time over 3.041s wall clock time, 22.5M memory peak.601machine # [ 4.920156] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.602machine # [ 4.921291] systemd[1]: Closed udev Control Socket.603machine # [ 4.922044] systemd[1]: Starting Cleanup udev Database...604machine # [ 4.922860] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.605machine # [ 4.928120] systemd[1]: Stopped Create Static Device Nodes in /dev.606machine # [ 4.929088] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.607machine # [ 4.930255] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.608machine # [ 4.931298] systemd[1]: kmod-static-nodes.service: Deactivated successfully.609machine # [ 4.936440] systemd[1]: Stopped Create List of Static Device Nodes.610machine # [ 4.964429] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.611machine # [ 4.965657] systemd[1]: Finished Cleanup udev Database.612machine # [ 4.968582] systemd[1]: Reached target Switch Root.613machine # [ 4.969393] systemd[1]: Starting NixOS Activation...614machine # [ 5.046450] initrd-nixos-activation-start[180]: booting system configuration /nix/store/p41vvs3llgr64zp4qm88gxlyhw3lmk24-nixos-system-machine-test615machine # [ 5.078922] initrd-nixos-activation-start[180]: running activation script...616machine # [ 5.147500] initrd-nixos-activation-start[203]: setting up /etc...617machine # [ 5.304467] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.618machine # [ 5.307433] systemd[1]: Finished NixOS Activation.619machine # [ 5.308703] systemd[1]: Starting Switch Root...620machine # [ 5.332121] systemd[1]: Switching root.621machine # [ 5.522395] systemd-journald[71]: Received SIGTERM from PID 1 (systemd).622machine # [ 6.012981] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)623machine # [ 6.013066] systemd[1]: Detected virtualization qemu.624machine # [ 6.013120] systemd[1]: Detected architecture arm64.625machine # [ 6.013227] systemd[1]: Detected first boot.626machine # [ 6.024617] systemd[1]: Initializing machine ID from random generator.627machine # [ 6.152503] systemd[1]: bpf-restrict-fs: LSM BPF program attached628machine # [ 6.266515] systemd[1]: Applying preset policy.629machine # [ 6.455250] systemd[1]: Populated /etc with preset unit settings.630machine # [ 6.671484] systemd[1]: initrd-switch-root.service: Deactivated successfully.631machine # [ 6.672291] systemd[1]: Stopped initrd-switch-root.service.632machine # [ 6.677726] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.633machine # [ 6.679340] systemd[1]: Created slice Slice /system/getty.634machine # [ 6.680598] systemd[1]: Created slice User and Session Slice.635machine # [ 6.684425] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.636machine # [ 6.684910] systemd[1]: Started Forward Password Requests to Wall Directory Watch.637machine # [ 6.688005] systemd[1]: Expecting device /dev/hvc0...638machine # [ 6.688384] systemd[1]: Expecting device /dev/ttyAMA0...639machine # [ 6.688989] systemd[1]: Reached target Local Encrypted Volumes.640machine # [ 6.692269] systemd[1]: Stopped target initrd-fs.target.641machine # [ 6.692645] systemd[1]: Stopped target initrd-root-fs.target.642machine # [ 6.695219] systemd[1]: Stopped target initrd-switch-root.target.643machine # [ 6.695620] systemd[1]: Reached target Virtual Machines and Containers.644machine # [ 6.696206] systemd[1]: Reached target Path Units.645machine # [ 6.696766] systemd[1]: Reached target Remote File Systems.646machine # [ 6.700848] systemd[1]: Reached target Slice Units.647machine # [ 6.702511] systemd[1]: Reached target Swaps.648machine # [ 6.704366] systemd[1]: Listening on Query the User Interactively for a Password.649machine # [ 6.708371] systemd[1]: Listening on Process Core Dump Socket.650machine # [ 6.710888] systemd[1]: Listening on Credential Encryption/Decryption.651machine # [ 6.712526] systemd[1]: Listening on Factory Reset Management.652machine # [ 6.715076] systemd[1]: Listening on Hostname Service Socket.653machine # [ 6.715833] systemd[1]: Listening on Journal Audit Socket.654machine # [ 6.718932] systemd[1]: Listening on Console Output Muting Service Socket.655machine # [ 6.719513] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.656machine # [ 6.720030] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os657machine # [ 6.720597] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki658machine # [ 6.729019] systemd[1]: Listening on Disk Repartitioning Service Socket.659machine # [ 6.729541] systemd[1]: Listening on udev Control Socket.660machine # [ 6.730233] systemd[1]: Listening on udev Varlink Socket.661machine # [ 6.735464] systemd[1]: Mounting Huge Pages File System...662machine # [ 6.739819] systemd[1]: Mounting POSIX Message Queue File System...663machine # [ 6.749703] systemd[1]: Mounting Kernel Debug File System...664machine # [ 6.757642] systemd[1]: Mounting Kernel Trace File System...665machine # [ 6.771173] systemd[1]: Starting Create List of Static Device Nodes...666machine # [ 6.774012] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs667machine # [ 6.790904] systemd[1]: Mounting Kernel Configuration File System...668machine # [ 6.791388] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm669machine # [ 6.801608] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore670machine # [ 6.802086] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse671machine # [ 6.821925] systemd[1]: Mounting FUSE Control File System...672machine # [ 6.839331] systemd[1]: Starting sops-install-secrets-for-users.service...673machine # [ 6.839718] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67674machine # [ 6.873919] systemd[1]: Starting Journal Service...675machine # [ 6.897657] systemd[1]: Starting Load Kernel Modules...676machine # [ 6.909428] systemd[1]: Starting Remount Root and Kernel File Systems...677machine # [ 6.910043] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os678machine # [ 6.947609] systemd[1]: Starting Coldplug All udev Devices...679machine # [ 6.958581] systemd[1]: Mounted Huge Pages File System.680machine # [ 6.959092] systemd[1]: Mounted POSIX Message Queue File System.681machine # [ 6.959473] systemd[1]: Mounted Kernel Debug File System.682machine # [ 6.959870] systemd[1]: Mounted Kernel Trace File System.683machine # [ 6.969995] systemd[1]: Finished Create List of Static Device Nodes.684machine # [ 7.008124] systemd-journald[268]: Collecting audit messages is enabled.685machine # [ 7.010506] EXT4-fs (vda): re-mounted a385634c-12c1-4af9-9d37-619e8ce47fc2.686machine # [ 7.018467] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...687machine # [ 7.014918] systemd[1]: Queued start job for default target Multi-User System.688machine # [ 7.018274] systemd[1]: systemd-journald.service: Deactivated successfully.689machine # [ 7.037621] systemd[1]: Started Journal Service.690machine # [ 7.024640] systemd[1]: Mounted Kernel Configuration File System.691machine # [ 7.025990] systemd-modules-load[269]: Module 'atkbd' is built in692machine # [ 7.032363] systemd-modules-load[269]: Module 'loop' is built in693machine # [ 7.033378] systemd[1]: Finished Remount Root and Kernel File Systems.694machine # [ 7.044948] systemd[1]: Finished Load Kernel Modules.695machine # [ 7.050377] systemd[1]: Mounted FUSE Control File System.696machine # [ 7.072128] systemd[1]: Listening on Disk Image Download Service Socket.697machine # [ 7.084506] systemd[1]: Starting Firewall...698machine # [ 7.093829] systemd[1]: Starting Flush Journal to Persistent Storage...699machine # [ 7.096406] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore700machine # [ 7.108361] systemd[1]: Starting Load/Save OS Random Seed...701machine # [ 7.125355] systemd[1]: Starting Apply Kernel Variables...702machine # [ 7.129374] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os703machine # [ 7.140402] systemd[1]: Import legacy update-users-groups.pl state for userborn skipped, unmet condition check ConditionPathExists=/var/lib/nixos/uid-map704machine # [ 7.250702] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.705machine # [ 7.278980] systemd-journald[268]: Received client request to flush runtime journal.706machine # [ 7.343391] systemd[1]: Finished Load/Save OS Random Seed.707machine # [ 7.346752] systemd[1]: Reached target First Boot Complete.708machine # [ 7.350960] systemd[1]: Finished Apply Kernel Variables.709machine # [ 7.355791] systemd[1]: Finished Flush Journal to Persistent Storage.710machine # [ 7.375644] systemd[1]: Finished sops-install-secrets-for-users.service.711machine # [ 7.381138] systemd[1]: Starting Manage Users and Groups...712machine # [ 7.461842] umount[303]: umount: /etc/group: no mount point specified.713machine # [ 7.523432] umount[309]: umount: /etc/passwd: no mount point specified.714machine # [ 7.597577] umount[316]: umount: /etc/shadow: no mount point specified.715machine # [ 7.653616] umount[322]: umount: /etc/subuid: no mount point specified.716machine # [ 7.726094] umount[329]: umount: /etc/subgid: no mount point specified.717machine # [ 7.789658] userborn[335]: Created group adm with GID 55.718machine # [ 7.790664] userborn[335]: Created group audio with GID 17.719machine # [ 7.791586] userborn[335]: Created group cdrom with GID 24.720machine # [ 7.798080] userborn[335]: Created group clock with GID 327.721machine # [ 7.799110] userborn[335]: Created group dhcpcd with GID 999.722machine # [ 7.804261] userborn[335]: Created group dialout with GID 27.723machine # [ 7.805284] userborn[335]: Created group disk with GID 6.724machine # [ 7.808137] userborn[335]: Created group floppy with GID 18.725machine # [ 7.808971] userborn[335]: Created group input with GID 174.726machine # [ 7.809778] userborn[335]: Created group keys with GID 96.727machine # [ 7.810566] userborn[335]: Created group kmem with GID 2.728machine # [ 7.811354] userborn[335]: Created group kvm with GID 302.729machine # [ 7.820267] userborn[335]: Created group lp with GID 20.730machine # [ 7.821319] userborn[335]: Created group messagebus with GID 4.731machine # [ 7.822201] userborn[335]: Created group nixbld with GID 30000.732machine # [ 7.823134] userborn[335]: Created group nogroup with GID 65534.733machine # [ 7.823966] userborn[335]: Created group nscd with GID 998.734machine # [ 7.832172] userborn[335]: Created group render with GID 303.735machine # [ 7.833022] userborn[335]: Created group resolvconf with GID 997.736machine # [ 7.833877] userborn[335]: Created group root with GID 0.737machine # [ 7.834666] userborn[335]: Created group sgx with GID 304.738machine # [ 7.835480] userborn[335]: Created group shadow with GID 318.739machine # [ 7.844318] userborn[335]: Created group systemd-coredump with GID 996.740machine # [ 7.845278] userborn[335]: Created group systemd-journal with GID 62.741machine # [ 7.846226] userborn[335]: Created group systemd-network with GID 152.742machine # [ 7.847251] userborn[335]: Created group systemd-oom with GID 995.743machine # [ 7.853407] userborn[335]: Created group systemd-resolve with GID 153.744machine # [ 7.854355] userborn[335]: Created group tape with GID 25.745machine # [ 7.855220] userborn[335]: Created group tty with GID 3.746machine # [ 7.855965] userborn[335]: Created group users with GID 100.747machine # [ 7.868184] userborn[335]: Created group utmp with GID 29.748machine # [ 7.869002] userborn[335]: Created group uucp with GID 19.749machine # [ 7.869791] userborn[335]: Created group video with GID 26.750machine # [ 7.870664] userborn[335]: Created group wheel with GID 1.751machine # [ 7.871434] userborn[335]: Created user dhcpcd with UID 999.752machine # [ 7.884306] userborn[335]: Created user example-user with UID 1000.753machine # [ 7.885226] userborn[335]: Created user messagebus with UID 4.754machine # [ 7.886049] userborn[335]: Created user nixbld1 with UID 30001.755machine # [ 7.886967] userborn[335]: Created user nixbld10 with UID 30010.756machine # [ 7.887809] userborn[335]: Created user nixbld11 with UID 30011.757machine # [ 7.896171] userborn[335]: Created user nixbld12 with UID 30012.758machine # [ 7.897052] userborn[335]: Created user nixbld13 with UID 30013.759machine # [ 7.897905] userborn[335]: Created user nixbld14 with UID 30014.760machine # [ 7.898783] userborn[335]: Created user nixbld15 with UID 30015.761machine # [ 7.899628] userborn[335]: Created user nixbld16 with UID 30016.762machine # [ 7.904729] userborn[335]: Created user nixbld17 with UID 30017.763machine # [ 7.905595] userborn[335]: Created user nixbld18 with UID 30018.764machine # [ 7.906434] userborn[335]: Created user nixbld19 with UID 30019.765machine # [ 7.907288] userborn[335]: Created user nixbld2 with UID 30002.766machine # [ 7.915901] userborn[335]: Created user nixbld20 with UID 30020.767machine # [ 7.919405] userborn[335]: Created user nixbld21 with UID 30021.768machine # [ 7.924184] userborn[335]: Created user nixbld22 with UID 30022.769machine # [ 7.925108] userborn[335]: Created user nixbld23 with UID 30023.770machine # [ 7.925970] userborn[335]: Created user nixbld24 with UID 30024.771machine # [ 7.926938] userborn[335]: Created user nixbld25 with UID 30025.772machine # [ 7.927792] userborn[335]: Created user nixbld26 with UID 30026.773machine # [ 7.936304] userborn[335]: Created user nixbld27 with UID 30027.774machine # [ 7.937193] userborn[335]: Created user nixbld28 with UID 30028.775machine # [ 7.938035] userborn[335]: Created user nixbld29 with UID 30029.776machine # [ 7.938917] userborn[335]: Created user nixbld3 with UID 30003.777machine # [ 7.939756] userborn[335]: Created user nixbld30 with UID 30030.778machine # [ 7.948660] userborn[335]: Created user nixbld31 with UID 30031.779machine # [ 7.949558] userborn[335]: Created user nixbld32 with UID 30032.780machine # [ 7.950403] userborn[335]: Created user nixbld4 with UID 30004.781machine # [ 7.951321] userborn[335]: Created user nixbld5 with UID 30005.782machine # [ 7.959075] userborn[335]: Created user nixbld6 with UID 30006.783machine # [ 7.959950] userborn[335]: Created user nixbld7 with UID 30007.784machine # [ 7.964392] userborn[335]: Created user nixbld8 with UID 30008.785machine # [ 7.965255] userborn[335]: Created user nixbld9 with UID 30009.786machine # [ 7.966122] userborn[335]: Created user nobody with UID 65534.787machine # [ 7.967051] userborn[335]: Created user nscd with UID 998.788machine # [ 7.967835] userborn[335]: Created user root with UID 0.789machine # [ 7.979646] userborn[335]: Created user systemd-coredump with UID 151.790machine # [ 7.984273] userborn[335]: Created user systemd-network with UID 152.791machine # [ 7.985189] userborn[335]: Created user systemd-oom with UID 997.792machine # [ 7.986044] userborn[335]: Created user systemd-resolve with UID 153.793machine # [ 7.987078] userborn[335]: Allocated subordinate id range 100000 (count 65536) for user example-user.794machine # [ 8.205525] systemd[1]: Finished Manage Users and Groups.795machine # [ 8.214464] systemd[1]: Starting Journal Log Access Socket...796machine # [ 8.225848] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...797machine # [ 8.234538] systemd[1]: Starting Create Static Device Nodes in /dev...798machine # [ 8.240317] systemd[1]: Listening on Journal Log Access Socket.799machine # [ 8.369434] systemd-oomd[373]: No swap; memory pressure usage will be degraded800machine # [ 8.376958] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.801machine # [ 8.392485] systemd[1]: Finished Create Static Device Nodes in /dev.802machine # [ 8.398019] systemd[1]: Reached target Preparation for Local File Systems.803machine # [ 8.400942] systemd[1]: Starting Rule-based Manager for Device Events and Files...804machine # [ 8.513949] systemd-udevd[385]: Using default interface naming scheme 'v261'.805machine # [ 8.559686] systemd[1]: Finished Coldplug All udev Devices.806machine # [ 8.604778] systemd[1]: Started Rule-based Manager for Device Events and Files.807machine # [ 8.662195] systemd[1]: Mounting /run/wrappers...808machine # [ 8.728635] systemd[1]: Mounted /run/wrappers.809machine # [ 8.729474] systemd[1]: Reached target Local File Systems.810machine # [ 8.735143] systemd[1]: Listening on Boot Loader Control Service Socket.811machine # [ 8.743315] systemd[1]: Starting register-nix-paths.service...812machine # [ 8.746762] systemd[1]: Starting Create SUID/SGID Wrappers...813machine # [ 8.747703] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.814machine # [ 8.754171] systemd[1]: Starting Save Transient machine-id to Disk...815machine # [ 8.764344] systemd[1]: Starting Create System Files and Directories...816machine # [ 8.901347] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.817machine # [ 8.917266] systemd[1]: Finished Save Transient machine-id to Disk.818machine # [ 8.995104] systemd[1]: Finished Create System Files and Directories.819machine # [ 9.003610] systemd[1]: Starting Rebuild Journal Catalog...820machine # [ 9.015150] systemd[1]: Starting Record System Boot/Shutdown in UTMP...821machine # [ 9.156151] systemd[1]: Finished Record System Boot/Shutdown in UTMP.822machine # [ 9.198654] systemd[1]: Finished Rebuild Journal Catalog.823machine # [ 9.213063] systemd[1]: Starting Update is Completed...824machine # [ 9.311867] systemd[1]: Finished Update is Completed.825machine # [ 9.316870] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs826machine # [ 9.378831] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse827machine # [ 9.471547] systemd[1]: Finished Firewall.828machine # [ 9.646990] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.829machine # [ 9.652311] systemd[1]: Finished Create SUID/SGID Wrappers.830machine # [ 9.653199] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.831machine # [ 9.693849] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.832machine # [ 9.717035] systemd[1]: Finished register-nix-paths.service.833machine # [ 9.721002] systemd[1]: Reached target System Initialization.834machine # [ 9.721972] systemd[1]: Started Discard unused filesystem blocks once a week.835machine # [ 9.723031] systemd[1]: Started Daily Cleanup of Temporary Directories.836machine # [ 9.731442] systemd[1]: Reached target Timer Units.837machine # [ 9.733984] systemd[1]: Listening on D-Bus System Message Bus Socket.838machine # [ 9.738931] systemd[1]: Listening on Nix Daemon Socket.839machine # [ 9.740168] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.840machine # [ 9.744299] systemd[1]: Reached target Socket Units.841machine # [ 9.749040] systemd[1]: Reached target Basic System.842machine # [ 9.750815] systemd[1]: Started backdoor.service.843machine # [ 9.756616] systemd[1]: Starting Import lastlog data into lastlog2 database...844machine # [ 9.759104] systemd[1]: Starting Name Service Cache Daemon (nsncd)...845machine # [ 9.784417] systemd[1]: Starting Post-Boot Actions...846machine # [ 9.788672] systemd[1]: Started Reset console on configuration changes.847machine # [ 9.844138] systemd[1]: Starting resolvconf update...848machine # [ 9.874097] systemd[1]: Starting D-Bus System Message Bus...849machine # connecting to host...850machine # [ 9.925355] nsncd[514]: Nov 02 22:06:55.439 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"851machine # [ 9.941724] systemd[1]: Finished Post-Boot Actions.852machine # [ 9.942837] systemd[1]: Started Name Service Cache Daemon (nsncd).853machine # [ 9.952705] systemd[1]: Reached target Host and Network Name Lookups.854machine # [ 9.960293] systemd[1]: Reached target User and Group Name Lookups.855machine: Guest shell says: b'Spawning backdoor root shell...\n'856machine: connected to guest root shell857machine: (connecting took 10.64 seconds)858machine: (finished: waiting for the VM to finish booting, in 10.64 seconds)859machine # [ 10.003431] systemd[1]: Starting User Login Management...860machine # [ 10.032812] (udev-worker)[444]: Network interface NamePolicy= disabled on kernel command line.861machine # [ 10.058931] (udev-worker)[447]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.862machine # [ 10.071262] (udev-worker)[447]: Network interface NamePolicy= disabled on kernel command line.863machine # [ 10.084576] systemd[1]: Finished Import lastlog data into lastlog2 database.864machine # [ 10.201300] dbus-broker-launch[519]: Looking up NSS user entry for 'systemd-timesync'...865machine # [ 10.263617] systemd-logind[537]: New seat seat0.866machine # [ 10.293189] systemd[1]: Started User Login Management.867machine # [ 10.298771] dbus-broker-launch[519]: NSS returned no entry for 'systemd-timesync'868machine # [ 10.299954] dbus-broker-launch[519]: Invalid user-name in /nix/store/ind8c6j91pfsiipb81amn45yml2vsyyc-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"869machine # [ 10.315948] systemd[1]: Starting linger-users.service...870machine # [ 10.348075] systemd[1]: Stopped target Host and Network Name Lookups.871machine # [ 10.349168] systemd[1]: Stopping Host and Network Name Lookups...872machine # [ 10.350041] systemd[1]: Stopped target User and Group Name Lookups.873machine # [ 10.351000] systemd[1]: Stopping User and Group Name Lookups...874machine # [ 10.372272] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...875machine # [ 10.378536] systemd[1]: Started D-Bus System Message Bus.876machine # [ 10.379445] systemd[1]: nscd.service: Deactivated successfully.877machine # [ 10.390072] systemd[1]: Stopped Name Service Cache Daemon (nsncd).878machine # [ 10.423347] dbus-broker-launch[519]: Ready879machine # [ 10.427449] systemd[1]: Starting Name Service Cache Daemon (nsncd)...880machine # [ 10.431705] systemd[1]: linger-users.service: Deactivated successfully.881machine # [ 10.435895] systemd[1]: Finished linger-users.service.882machine # [ 10.507952] systemd[1]: Started Name Service Cache Daemon (nsncd).883machine # [ 10.513535] systemd[1]: Reached target Host and Network Name Lookups.884machine # [ 10.514879] nsncd[600]: Nov 02 22:06:56.037 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"885machine # [ 10.524400] systemd[1]: Reached target User and Group Name Lookups.886machine # [ 10.542933] systemd-logind[537]: Watching system buttons on /dev/input/event0 (gpio-keys)887machine # [ 10.551074] systemd[1]: Finished resolvconf update.888machine # [ 10.556171] systemd[1]: Reached target Preparation for Network.889machine # [ 10.562544] systemd[1]: Starting DHCP Client...890machine # [ 10.566281] systemd[1]: Starting Extra networking commands....891machine # [ 10.592779] systemd[1]: Condition check resulted in Virtio network device being skipped.892machine # [ 10.605512] systemd[1]: Starting Address configuration of eth1...893machine # [ 10.763286] network-addresses-eth1-start[628]: adding address 192.168.1.1/24... done894machine # [ 10.813581] network-addresses-eth1-start[628]: adding address 2001:db8:1::1/64... done895machine # [ 10.859878] systemd[1]: Finished Address configuration of eth1.896machine # [ 10.885069] dhcpcd[634]: dhcpcd-10.3.2 starting897machine # [ 10.908569] mousedev: PS/2 mouse device common for all mice898machine # [ 10.898418] dhcpcd[684]: dev: loaded udev899machine # [ 10.958041] 8021q: 802.1Q VLAN Support v1.8900machine # [ 10.958419] 8021q: adding VLAN 0 to HW filter on device eth1901machine # [ 10.944239] systemd[1]: Finished Extra networking commands..902machine # [ 10.950253] systemd[1]: Reached target Network.903machine # [ 10.954094] systemd[1]: Starting Permit User Sessions...904machine # [ 11.094930] cfg80211: Loading compiled-in X.509 certificates for regulatory database905machine # [ 11.084131] systemd[1]: Finished Permit User Sessions.906machine # [ 11.091062] systemd[1]: Started Getty on tty1.907machine # [ 11.094870] systemd[1]: Reached target Login Prompts.908machine # [ 11.118337] systemd-logind[537]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)909machine # [ 11.165380] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'910machine # [ 11.165892] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'911machine # [ 11.166871] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2912machine # [ 11.167189] cfg80211: failed to load regulatory.db913machine # [ 11.222402] dhcpcd[684]: eth0: waiting for carrier914machine # [ 11.242015] 8021q: adding VLAN 0 to HW filter on device eth0915machine # [ 11.226826] dhcpcd[684]: eth0: carrier acquired916machine # [ 11.237928] dhcpcd[684]: DUID 00:01:00:01:32:7b:c6:00:52:54:00:12:34:56917machine # [ 11.239063] dhcpcd[684]: eth0: IAID 00:12:34:56918machine # [ 11.239723] dhcpcd[684]: eth0: adding address fe80::5054:ff:fe12:3456919machine # [ 11.720836] dhcpcd[684]: eth0: soliciting a DHCP lease920machine # [ 11.728603] dhcpcd[684]: eth0: offered 10.0.2.15 from 10.0.2.2921machine # [ 11.736268] dhcpcd[684]: eth0: probing address 10.0.2.15/24922machine # [ 11.924081] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input3923machine # [ 12.237978] systemd[1]: Starting Virtual Console Setup...924machine # [ 12.259927] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.925machine # [ 12.269233] systemd[1]: Stopped Virtual Console Setup.926machine # [ 12.270065] systemd[1]: Starting Virtual Console Setup...927machine # [ 12.294309] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.928machine # [ 12.351114] systemd-logind[537]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)929machine # [ 12.420591] systemd-vconsole-setup[734]: Configuration of first virtual console was skipped, ignoring remaining ones.930machine # [ 12.424067] systemd[1]: Finished Virtual Console Setup.931machine # [ 13.224879] dhcpcd[684]: eth0: soliciting an IPv6 router932machine # [ 13.226851] dhcpcd[684]: eth0: Router Advertisement from fe80::2933machine # [ 13.228362] dhcpcd[684]: eth0: adding address fec0::5054:ff:fe12:3456/64934machine # [ 13.229877] dhcpcd[684]: eth0: adding route to fec0::/64935machine # [ 13.231065] dhcpcd[684]: eth0: adding default route via fe80::2936machine # [ 16.793292] dhcpcd[684]: eth0: leased 10.0.2.15 for 86400 seconds937machine # [ 16.793476] dhcpcd[684]: eth0: adding route to 10.0.2.0/24938machine # [ 16.793548] dhcpcd[684]: eth0: adding default route via 10.0.2.2939machine # [ 16.945793] systemd[1]: Started DHCP Client.940machine # [ 16.948862] systemd[1]: Reached target Multi-User System.941machine # [ 16.950162] systemd[1]: Startup finished in 1.047s (kernel) + 4.534s (initrd) + 11.368s (userspace) = 16.949s.942machine: (finished: waiting for unit multi-user.target, in 18.62 seconds)943machine: must succeed: getent shadow example-user | grep -q :test_value:944machine: (finished: must succeed: getent shadow example-user | grep -q :test_value:, in 0.03 seconds)945machine: must succeed: systemctl show -p After --value sops-install-secrets-for-users.service946machine: (finished: must succeed: systemctl show -p After --value sops-install-secrets-for-users.service, in 0.03 seconds)947machine: waiting for the VM to power off948additionally exposed symbols:949 machine,950 vlan1,951 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_ssh952machine # [ 18.040457] systemd-logind[537]: poweroff requested from client PID 855 ('poweroff') (unit backdoor.service)...953machine # [ 18.044449] systemd-logind[537]: System is powering down.954machine # [ 18.053914] systemd-logind[537]: The system will power off now!955machine # [ 18.068868] systemd[1]: Removed slice Slice /system/modprobe.956machine # [ 18.072865] systemd[1]: Stopped target Multi-User System.957machine # [ 18.075640] systemd[1]: Stopped target Login Prompts.958machine # [ 18.076838] systemd[1]: Stopped target Virtual Machines and Containers.959machine # [ 18.077861] systemd[1]: Stopped target Host and Network Name Lookups.960machine # [ 18.078904] systemd[1]: Stopped target Timer Units.961machine # [ 18.079640] systemd[1]: fstrim.timer: Deactivated successfully.962machine # [ 18.088637] systemd[1]: Stopped Discard unused filesystem blocks once a week.963machine # [ 18.089991] dhcpcd[684]: received SIGTERM, stopping964machine # [ 18.090795] systemd[1]: systemd-tmpfiles-clean.timer: Deactivated successfully.965machine # [ 18.091839] dhcpcd[684]: eth0: removing interface966machine # [ 18.100609] systemd[1]: Stopped Daily Cleanup of Temporary Directories.967machine # [ 18.101611] dhcpcd[684]: eth0: deleting address fec0::5054:ff:fe12:3456/64968machine # [ 18.102679] systemd[1]: systemd-rfkill.socket: Deactivated successfully.969machine # [ 18.103647] dhcpcd[684]: eth0: deleting route to fec0::/64970machine # [ 18.115349] systemd[1]: Closed Load/Save RF Kill Switch Status /dev/rfkill Watch.971machine # [ 18.121034] dhcpcd[684]: eth0: deleting default route via fe80::2972machine # [ 18.121979] systemd[1]: Mounting /run/initramfs...973machine # [ 18.122759] systemd[1]: Stopping backdoor.service...974machine # [ 18.123523] systemd[1]: Stopping DHCP Client...975machine # [ 18.127979] systemd[1]: Stopping Getty on tty1...976machine # [ 18.129566] systemd[1]: lastlog2-import.service: Deactivated successfully.977machine # [ 18.130640] systemd[1]: Stopped Import lastlog data into lastlog2 database.978machine # [ 18.131703] systemd[1]: Stopping Address configuration of eth1...979machine # [ 18.136598] systemd[1]: Stopping Post-Boot Actions...980machine # [ 18.137415] systemd[1]: reload-systemd-vconsole-setup.service: Deactivated successfully.981machine # [ 18.138583] systemd[1]: Stopped Reset console on configuration changes.982machine # [ 18.139557] systemd[1]: Stopping User Login Management...983machine # [ 18.158879] systemd[1]: systemd-machine-id-commit.service: Deactivated successfully.984machine # [ 18.164218] systemd[1]: Stopped Save Transient machine-id to Disk.985machine # [ 18.170068] systemd[1]: Stopped target First Boot Complete.986machine # [ 18.171119] systemd[1]: Stopping Userspace Out-Of-Memory (OOM) Killer...987machine # [ 18.179562] systemd[1]: Stopping Load/Save OS Random Seed...988machine # [ 18.186628] systemd[1]: systemd-oomd.service: Deactivated successfully.989machine # [ 18.192487] systemd[1]: Stopped Userspace Out-Of-Memory (OOM) Killer.990machine # [ 18.196973] systemd[1]: backdoor.service: Deactivated successfully.991machine # [ 18.197972] systemd[1]: Stopped backdoor.service.992machine # [ 18.198782] systemd[1]: systemd-logind.service: Deactivated successfully.993machine # [ 18.199741] systemd[1]: Stopped User Login Management.994machine # [ 18.207972] systemd[1]: getty@tty1.service: Deactivated successfully.995machine # [ 18.211210] dhcpcd[684]: eth0: deleting address fe80::5054:ff:fe12:3456996machine # [ 18.217552] network-addresses-eth1-pre-stop[861]: deleting address 192.168.1.1/24... done997machine # [ 18.218810] systemd[1]: Stopped Getty on tty1.998machine # [ 18.219544] dhcpcd[684]: eth0: deleting route to 10.0.2.0/24999machine # [ 18.234610] systemd[1]: post-boot.service: Deactivated successfully.1000machine # [ 18.235586] dhcpcd[684]: eth0: deleting default route via 10.0.2.21001machine # [ 18.246019] network-addresses-eth1-pre-stop[861]: deleting address 2001:db8:1::1/64... done1002machine # [ 18.247300] systemd[1]: Stopped Post-Boot Actions.1003machine # [ 18.256940] dhcpcd[684]: dhcpcd exited1004machine # [ 18.258635] systemd[1]: network-addresses-eth1.service: Deactivated successfully.1005machine # [ 18.261989] systemd[1]: Stopped Address configuration of eth1.1006machine # [ 18.266118] systemd[1]: dhcpcd.service: Deactivated successfully.1007machine # [ 18.268857] systemd[1]: Stopped DHCP Client.1008machine # [ 18.270206] systemd[1]: dhcpcd.service: Consumed 247ms CPU time over 7.706s wall clock time, 6.1M memory peak, 8K written to disk, 96B incoming IP traffic, 56B outgoing IP traffic.1009machine # [ 18.277081] systemd[1]: systemd-random-seed.service: Deactivated successfully.1010machine # [ 18.279364] systemd[1]: Stopped Load/Save OS Random Seed.1011machine # [ 18.284874] systemd[1]: Mounted /run/initramfs.1012machine # [ 18.289588] systemd[1]: Removed slice Slice /system/getty.1013machine # [ 18.293213] systemd[1]: Starting Generate shutdown ramfs...1014machine # [ 18.297370] systemd[1]: Stopping Permit User Sessions...1015machine # [ 18.344991] systemd[1]: systemd-user-sessions.service: Deactivated successfully.1016machine # [ 18.348497] systemd[1]: Stopped Permit User Sessions.1017machine # [ 18.349796] systemd[1]: Stopped target Network.1018machine # [ 18.356424] systemd[1]: Stopped target User and Group Name Lookups.1019machine # [ 18.357441] systemd[1]: Stopped target Remote File Systems.1020machine # [ 18.358292] systemd[1]: network-local-commands.service: Deactivated successfully.1021machine # [ 18.359415] systemd[1]: Stopped Extra networking commands..1022machine # [ 18.369219] systemd[1]: Stopped target Preparation for Network.1023machine # [ 18.370142] systemd[1]: Stopping Firewall...1024machine # [ 18.370827] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...1025machine # [ 18.371778] systemd[1]: resolvconf.service: Deactivated successfully.1026machine # [ 18.383334] systemd[1]: Stopped resolvconf update.1027machine # [ 18.384341] systemd[1]: nscd.service: Deactivated successfully.1028machine # [ 18.385200] systemd[1]: Stopped Name Service Cache Daemon (nsncd).1029machine # [ 18.386075] systemd[1]: Stopped target Basic System.1030machine # [ 18.386852] systemd[1]: Stopped target Path Units.1031machine # [ 18.387561] systemd[1]: Stopped target Slice Units.1032machine # [ 18.394038] systemd[1]: Removed slice User and Session Slice.1033machine # [ 18.394956] systemd[1]: Stopped target Socket Units.1034machine # [ 18.395703] systemd[1]: nix-daemon.socket: Deactivated successfully.1035machine # [ 18.403788] systemd[1]: Closed Nix Daemon Socket.1036machine # [ 18.408201] systemd[1]: systemd-hostnamed.socket: Deactivated successfully.1037machine # [ 18.409372] systemd[1]: Closed Hostname Service Socket.1038machine # [ 18.410155] systemd[1]: systemd-importd.socket: Deactivated successfully.1039machine # [ 18.411139] systemd[1]: Closed Disk Image Download Service Socket.1040machine # [ 18.417473] systemd[1]: systemd-machined.socket: Deactivated successfully.1041machine # [ 18.424686] make-initrd-ng[890]: /etc/initrd-release -> /nix/store/pqw34vf15pgjdbln6agl61gmmp9xfjik-etc-os-release1042machine # [ 18.426146] make-initrd-ng[890]: /etc/os-release -> /nix/store/pqw34vf15pgjdbln6agl61gmmp9xfjik-etc-os-release1043machine # [ 18.427508] make-initrd-ng[890]: /shutdown -> /nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/systemd/systemd-shutdown1044machine # [ 18.436888] systemd[1]: Closed Virtual Machine and Container Registration Service Socket.1045machine # [ 18.438090] systemd[1]: systemd-mute-console.socket: Deactivated successfully.1046machine # [ 18.439197] systemd[1]: Closed Console Output Muting Service Socket.1047machine # [ 18.441293] systemd[1]: systemd-oomd.socket: Deactivated successfully.1048machine # [ 18.442272] systemd[1]: Closed Userspace Out-Of-Memory (OOM) Killer Socket.1049machine # [ 18.443295] systemd[1]: systemd-repart.socket: Deactivated successfully.1050machine # [ 18.444528] systemd[1]: Closed Disk Repartitioning Service Socket.1051machine # [ 18.445554] dbus-broker[594]: Dispatched 840 messages @ 3(±4)μs / message.1052machine # [ 18.446673] systemd[1]: Stopping D-Bus System Message Bus...1053machine # [ 18.447521] systemd[1]: dbus-broker.service: Deactivated successfully.1054machine # [ 18.449269] systemd[1]: Stopped D-Bus System Message Bus.1055machine # [ 18.463593] systemd[1]: dbus.socket: Deactivated successfully.1056machine # [ 18.467878] systemd[1]: Closed D-Bus System Message Bus Socket.1057machine # [ 18.471068] systemd[1]: Stopped target System Initialization.1058machine # [ 18.471942] systemd[1]: Stopped target Local Encrypted Volumes.1059machine # [ 18.477704] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1060machine # [ 18.478898] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1061machine # [ 18.487595] systemd[1]: systemd-ask-password-wall.path: Deactivated successfully.1062machine # [ 18.493358] systemd[1]: Stopped Forward Password Requests to Wall Directory Watch.1063machine # [ 18.497368] systemd[1]: register-nix-paths.service: Deactivated successfully.1064machine # [ 18.498424] systemd[1]: Stopped register-nix-paths.service.1065machine # [ 18.499260] systemd[1]: systemd-sysctl.service: Deactivated successfully.1066machine # [ 18.505673] systemd[1]: Stopped Apply Kernel Variables.1067machine # [ 18.506492] systemd[1]: systemd-coredump.socket: Deactivated successfully.1068machine # [ 18.507473] systemd[1]: Closed Process Core Dump Socket.1069machine # [ 18.515139] systemd[1]: systemd-update-done.service: Deactivated successfully.1070machine # [ 18.520824] systemd[1]: Stopped Update is Completed.1071machine # [ 18.521596] systemd[1]: systemd-journal-catalog-update.service: Deactivated successfully.1072machine # [ 18.522759] systemd[1]: Stopped Rebuild Journal Catalog.1073machine # [ 18.523577] systemd[1]: Stopping Record System Boot/Shutdown in UTMP...1074machine # [ 18.536981] systemd[1]: systemd-update-utmp.service: Deactivated successfully.1075machine # [ 18.538037] systemd[1]: Stopped Record System Boot/Shutdown in UTMP.1076machine # [ 18.538969] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1077machine # [ 18.543917] systemd[1]: Stopped Create System Files and Directories.1078machine # [ 18.554676] systemd[1]: Stopped target Local File Systems.1079machine # [ 18.555527] systemd[1]: Unmounting /etc/group...1080machine # [ 18.557535] systemd[1]: Unmounting /etc/passwd...1081machine # [ 18.558287] systemd[1]: Unmounting /etc/shadow...1082machine # [ 18.559074] systemd[1]: Unmounting /etc/subgid...1083machine # [ 18.566527] systemd[1]: Unmounting /etc/subuid...1084machine # [ 18.576480] make-initrd-ng[890]: Warning: Couldn't satisfy dependency libcrypt.so.1 for "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/systemd/libsystemd-shared-261.so"1085machine # [ 18.581678] systemd[1]: Unmounting /run/keys...1086machine # [ 18.589198] make-initrd-ng[890]: Warning: Couldn't satisfy dependency libcrypt.so.1.1 for "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/systemd/libsystemd-shared-261.so"1087machine # [ 18.594312] systemd[1]: Unmounting /run/secrets-for-users.d...1088machine # [ 18.614184] systemd[1]: Unmounting /run/wrappers...1089machine # [ 18.640265] systemd[1]: Unmounting /var/lib/sops-nix...1090machine # [ 18.642556] systemd[1]: generate-shutdown-ramfs.service: Deactivated successfully.1091machine # [ 18.653628] systemd[1]: Finished Generate shutdown ramfs.1092machine # [ 18.662833] systemd[1]: firewall.service: Deactivated successfully.1093machine # [ 18.678532] systemd[1]: Stopped Firewall.1094machine # [ 18.707553] systemd[1]: etc-group.mount: Deactivated successfully.1095machine # [ 18.714209] systemd[1]: Unmounted /etc/group.1096machine # [ 18.715025] systemd[1]: etc-passwd.mount: Deactivated successfully.1097machine # [ 18.720186] systemd[1]: Unmounted /etc/passwd.1098machine # [ 18.722092] systemd[1]: etc-shadow.mount: Deactivated successfully.1099machine # [ 18.725313] systemd[1]: Unmounted /etc/shadow.1100machine # [ 18.726860] systemd[1]: etc-subgid.mount: Deactivated successfully.1101machine # [ 18.728429] systemd[1]: Unmounted /etc/subgid.1102machine # [ 18.730141] systemd[1]: etc-subuid.mount: Deactivated successfully.1103machine # [ 18.733817] systemd[1]: Unmounted /etc/subuid.1104machine # [ 18.734652] systemd[1]: run-keys.mount: Deactivated successfully.1105machine # [ 18.736267] systemd[1]: Unmounted /run/keys.1106machine # [ 18.736972] systemd[1]: run-secrets\x2dfor\x2dusers.d.mount: Deactivated successfully.1107machine # [ 18.740177] systemd[1]: Unmounted /run/secrets-for-users.d.1108machine # [ 18.742514] systemd[1]: run-wrappers.mount: Deactivated successfully.1109machine # [ 18.744462] systemd[1]: Unmounted /run/wrappers.1110machine # [ 18.752594] systemd[1]: var-lib-sops\x2dnix.mount: Deactivated successfully.1111machine # [ 18.755284] systemd[1]: Unmounted /var/lib/sops-nix.1112machine # [ 18.757123] systemd[1]: Stopped target Preparation for Local File Systems.1113machine # [ 18.760302] systemd[1]: Stopped target Swaps.1114machine # [ 18.761039] systemd[1]: Reached target Unmount All Filesystems.1115machine # [ 18.761902] systemd[1]: systemd-modules-load.service: Deactivated successfully.1116machine # [ 18.762950] systemd[1]: Stopped Load Kernel Modules.1117machine # [ 18.763685] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1118machine # [ 18.769163] systemd[1]: Stopped Create Static Device Nodes in /dev.1119machine # [ 18.770097] systemd[1]: userborn.service: Deactivated successfully.1120machine # [ 18.771015] systemd[1]: Stopped Manage Users and Groups.1121machine # [ 18.771796] systemd[1]: systemd-remount-fs.service: Deactivated successfully.1122machine # [ 18.777528] systemd[1]: Stopped Remount Root and Kernel File Systems.1123machine # [ 18.780007] systemd[1]: systemd-fsck-root.service: Deactivated successfully.1124machine # [ 18.781221] systemd[1]: Stopped File System Check on Root Device.1125machine # [ 18.782115] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1126machine # [ 18.783386] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1127machine # [ 18.784861] systemd[1]: Reached target System Shutdown.1128machine # [ 18.785654] systemd[1]: Reached target Late Shutdown Services.1129machine # [ 18.786539] systemd[1]: systemd-poweroff.service: Deactivated successfully.1130machine # [ 18.787559] systemd[1]: Finished System Power Off.1131machine # [ 18.788807] systemd[1]: Reached target System Power Off.1132machine # [ 18.789602] systemd[1]: Shutting down.1133machine # [ 18.970565] systemd-shutdown[1]: Syncing filesystems and block devices.1134machine # [ 18.978938] systemd-shutdown[1]: Sending SIGTERM to remaining processes...1135machine # [ 18.985832] systemd-journald[268]: Received SIGTERM from PID 1 (systemd-shutdow).1136machine # [ 19.016900] systemd-shutdown[1]: Sending SIGKILL to remaining processes...1137machine # [ 19.023112] systemd-shutdown[1]: Unmounting file systems.1138machine # [ 19.027244] (sd-umount)[935]: Unmounting '/run/credentials/systemd-journald.service'.1139machine # [ 19.028525] (sd-remount)[936]: 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'.1140machine # [ 19.042139] (sd-remount)[937]: 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'.1141machine # [ 19.043348] (sd-remount)[938]: Remounting '/tmp/shared' read-only with options ''.1142machine # [ 19.044519] (sd-umount)[939]: Unmounting '/tmp/shared'.1143machine # [ 19.055896] (sd-umount)[940]: Unmounting '/nix/.ro-store'.1144machine # [ 19.056901] (sd-remount)[941]: Remounting '/tmp/xchg' read-only with options ''.1145machine # [ 19.060997] (sd-umount)[942]: Unmounting '/tmp/xchg'.1146machine # [ 19.062426] (sd-umount)[943]: Unmounting '/nix/.rw-store'.1147machine # [ 19.063387] (sd-remount)[944]: Remounting '/' read-only with options ''.1148machine # [ 19.071320] EXT4-fs (vda): re-mounted a385634c-12c1-4af9-9d37-619e8ce47fc2 ro.1149machine # [ 19.072873] systemd-shutdown[1]: All filesystems unmounted.1150machine # [ 19.072987] systemd-shutdown[1]: Deactivating swaps.1151machine # [ 19.078510] systemd-shutdown[1]: All swaps deactivated.1152machine # [ 19.078534] systemd-shutdown[1]: Detaching loop devices.1153machine # [ 19.088988] systemd-shutdown[1]: All loop devices detached.1154machine # [ 19.091082] systemd-shutdown[1]: Stopping MD devices.1155machine # [ 19.091347] systemd-shutdown[1]: All MD devices stopped.1156machine # [ 19.092141] systemd-shutdown[1]: Detaching DM devices.1157machine # [ 19.097196] systemd-shutdown[1]: All DM devices detached.1158machine # [ 19.097221] systemd-shutdown[1]: All filesystems, swaps, loop devices, MD devices and DM devices detached.1159machine # [ 19.434651] systemd-shutdown[1]: Successfully changed into root pivot.1160machine # [ 19.434676] systemd-shutdown[1]: Entering exitrd...1161machine # [ 19.447511] shutdown[1]: Syncing filesystems and block devices.1162machine # [ 19.448676] shutdown[1]: Sending SIGTERM to remaining processes...1163machine # [ 19.455740] shutdown[1]: Sending SIGKILL to remaining processes...1164machine # [ 19.460648] shutdown[1]: Unmounting file systems.1165machine # [ 19.464403] (sd-umoun[946]: Unmounting '/run/credentials'.1166machine # [ 19.466895] (sd-umoun[947]: Unmounting '/oldroot/sys/fs/fuse/connections'.1167machine # [ 19.468154] (sd-umoun[948]: Unmounting '/oldroot/sys/kernel/config'.1168machine # [ 19.472021] (sd-umoun[949]: Unmounting '/oldroot/sys/kernel/tracing'.1169machine # [ 19.474493] (sd-umoun[950]: Unmounting '/oldroot/dev/hugepages'.1170machine # [ 19.475696] (sd-umoun[951]: Unmounting '/oldroot/sys/kernel/debug'.1171machine # [ 19.476851] (sd-umoun[952]: Unmounting '/oldroot/dev/mqueue'.1172machine # [ 19.482251] (sd-umoun[953]: Unmounting '/oldroot/sys/fs/bpf'.1173machine # [ 19.483378] (sd-umoun[954]: Unmounting '/oldroot/sys/fs/pstore'.1174machine # [ 19.484570] (sd-umoun[955]: Unmounting '/oldroot/sys/fs/cgroup'.1175machine # [ 19.489781] (sd-umoun[956]: Unmounting '/oldroot/sys/kernel/security'.1176machine # [ 19.490913] (sd-umoun[957]: Unmounting '/oldroot/nix/store'.1177machine # [ 19.492110] (sd-umoun[958]: Unmounting '/oldroot/sys'.1178machine # [ 19.496872] (sd-umoun[959]: Unmounting '/oldroot/proc'.1179machine # [ 19.499978] (sd-umoun[960]: Unmounting '/oldroot/dev/shm'.1180machine # [ 19.502294] (sd-umoun[961]: Unmounting '/oldroot/dev/pts'.1181machine # [ 19.503833] (sd-umoun[962]: Unmounting '/oldroot/dev'.1182machine # [ 19.507586] (sd-umoun[963]: Unmounting '/oldroot/nix/store'.1183machine # [ 19.550208] (sd-umoun[964]: Unmounting '/oldroot/run'.1184machine # [ 19.551471] (sd-umoun[965]: Unmounting '/oldroot'.1185machine # [ 19.555394] EXT4-fs (vda): unmounting filesystem a385634c-12c1-4af9-9d37-619e8ce47fc2.1186machine # [ 19.556750] shutdown[1]: All filesystems unmounted.1187machine # [ 19.560270] shutdown[1]: Deactivating swaps.1188machine # [ 19.560643] shutdown[1]: All swaps deactivated.1189machine # [ 19.563291] shutdown[1]: Detaching loop devices.1190machine # [ 19.566522] shutdown[1]: All loop devices detached.1191machine # [ 19.566836] shutdown[1]: Stopping MD devices.1192machine # [ 19.567718] shutdown[1]: All MD devices stopped.1193machine # [ 19.568268] shutdown[1]: Detaching DM devices.1194machine # [ 19.572796] shutdown[1]: All DM devices detached.1195machine # [ 19.574626] shutdown[1]: All filesystems, swaps, loop devices, MD devices and DM devices detached.1196machine # [ 19.575269] shutdown[1]: Syncing filesystems and block devices.1197machine # [ 19.576316] shutdown[1]: Powering off.1198machine # [ 19.609277] Console: switching to colour dummy device 80x251199machine # [ 19.618217] Flash device refused suspend due to active operation (state 20)1200machine # [ 19.618233] Flash device refused suspend due to active operation (state 20)1201machine # [ 19.620949] reboot: Power down1202machine # [2026-11-02T22:07:05Z INFO virtiofsd] Client disconnected, shutting down1203machine # [2026-11-02T22:07:05Z INFO virtiofsd] Client disconnected, shutting down1204machine # [2026-11-02T22:07:05Z INFO virtiofsd] Client disconnected, shutting down1205machine: (finished: waiting for the VM to power off, in 1.71 seconds)1206machine: starting vm1207machine # Starting virtiofs daemons...1208machine: QEMU running (pid 91)1209machine # [2026-11-02T22:07:05Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)1210machine: waiting for unit multi-user.target1211machine # [2026-11-02T22:07:05Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether1212machine: waiting for the VM to finish booting1213machine # [2026-11-02T22:07:05Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)1214machine # [2026-11-02T22:07:05Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether1215machine # [2026-11-02T22:07:05Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)1216machine # [2026-11-02T22:07:05Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether1217machine # [2026-11-02T22:07:05Z INFO virtiofsd] Waiting for vhost-user socket connection...1218machine # [2026-11-02T22:07:05Z INFO virtiofsd] Waiting for vhost-user socket connection...1219machine # [2026-11-02T22:07:05Z INFO virtiofsd] Waiting for vhost-user socket connection...1220machine # [2026-11-02T22:07:05Z INFO virtiofsd] Client connected, servicing requests1221machine # [2026-11-02T22:07:05Z INFO virtiofsd] Client connected, servicing requests1222machine # [2026-11-02T22:07:05Z INFO virtiofsd] Client connected, servicing requests1223machine # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]1224machine # [ 0.000000] Linux version 6.18.56 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT @17917251721225machine # [ 0.000000] KASLR enabled1226machine # [ 0.000000] random: crng init done1227machine # [ 0.000000] Machine model: linux,dummy-virt1228machine # [ 0.000000] efi: UEFI not found.1229machine # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT1230machine # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]1231machine # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fded700-0x7fdf0e7f]1232machine # [ 0.000000] Zone ranges:1233machine # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]1234machine # [ 0.000000] DMA32 empty1235machine # [ 0.000000] Normal empty1236machine # [ 0.000000] Device empty1237machine # [ 0.000000] Movable zone start for each node1238machine # [ 0.000000] Early memory node ranges1239machine # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]1240machine # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]1241machine # [ 0.000000] cma: Reserved 32 MiB at 0x000000007cc000001242machine # [ 0.000000] psci: probing for conduit method from DT.1243machine # [ 0.000000] psci: PSCIv1.3 detected in firmware.1244machine # [ 0.000000] psci: Using standard PSCI v0.2 function IDs1245machine # [ 0.000000] psci: Trusted OS migration not required1246machine # [ 0.000000] psci: SMC Calling Convention v1.11247machine # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)1248machine # [ 0.000000] percpu: Embedded 76 pages/cpu s186904 r8192 d116200 u3112961249machine # [ 0.000000] Detected PIPT I-cache on CPU01250machine # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)1251machine # [ 0.000000] CPU features: detected: GICv3 CPU interface1252machine # [ 0.000000] CPU features: detected: Spectre-v41253machine # [ 0.000000] CPU features: detected: Spectre-BHB1254machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_381255machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_231256machine # [ 0.000000] alternatives: applying boot alternatives1257machine # [ 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/p41vvs3llgr64zp4qm88gxlyhw3lmk24-nixos-system-machine-test/init regInfo=/nix/.ro-store/1rdfdsq95qhpz6y8py9ggfx0c17avcl3-closure-info/registration console=ttyAMA0,115200n8 console=tty01258machine # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/1rdfdsq95qhpz6y8py9ggfx0c17avcl3-closure-info/registration", will be passed to user space.1259machine # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes1260machine # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)1261machine # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)1262machine # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB1263machine # [ 0.000000] software IO TLB: area num 1.1264machine # [ 0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB)1265machine # [ 0.000000] Fallback order for Node 0: 01266machine # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 2621441267machine # [ 0.000000] Policy zone: DMA1268machine # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off1269machine # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=11270machine # [ 0.000000] allocated 2097152 bytes of page_ext1271machine # [ 0.000000] ftrace: allocating 75049 entries in 294 pages1272machine # [ 0.000000] ftrace: allocated 294 pages with 4 groups1273machine # [ 0.000000] rcu: Hierarchical RCU implementation.1274machine # [ 0.000000] rcu: RCU event tracing is enabled.1275machine # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=1.1276machine # [ 0.000000] Trampoline variant of Tasks RCU enabled.1277machine # [ 0.000000] Rude variant of Tasks RCU enabled.1278machine # [ 0.000000] Tracing variant of Tasks RCU enabled.1279machine # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.1280machine # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=11281machine # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.1282machine # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.1283machine # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.1284machine # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 01285machine # [ 0.000000] GICv3: 256 SPIs implemented1286machine # [ 0.000000] GICv3: 0 Extended SPIs implemented1287machine # [ 0.000000] Root IRQ handler: gic_handle_irq1288machine # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI1289machine # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=01290machine # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a00001291machine # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]1292machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)1293machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)1294machine # [ 0.000000] GICv3: using LPI property table @0x0000000044d100001295machine # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d200001296machine # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.1297machine # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns1298machine # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).1299machine # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns1300machine # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns1301machine # [ 0.000030] arm-pv: using stolen time PV1302machine # [ 0.000418] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)1303machine # [ 0.000605] Console: colour dummy device 80x251304machine # [ 0.000613] printk: legacy console [tty0] enabled1305machine # [ 0.000803] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)1306machine # [ 0.000810] pid_max: default: 32768 minimum: 3011307machine # [ 0.000882] LSM: initializing lsm=capability,landlock,yama,bpf,ima1308machine # [ 0.001071] landlock: Up and running.1309machine # [ 0.001075] Yama: becoming mindful.1310machine # [ 0.001540] LSM support for eBPF active1311machine # [ 0.001655] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)1312machine # [ 0.001676] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)1313machine # [ 0.003659] rcu: Hierarchical SRCU implementation.1314machine # [ 0.003665] rcu: Max phase no-delay instances is 1000.1315machine # [ 0.004927] fsl-mc MSI: its@8080000 domain created1316machine # [ 0.005051] EFI services will not be available.1317machine # [ 0.005123] smp: Bringing up secondary CPUs ...1318machine # [ 0.005132] smp: Brought up 1 node, 1 CPU1319machine # [ 0.005135] SMP: Total of 1 processors activated.1320machine # [ 0.005138] CPU: All CPU(s) started at EL11321machine # [ 0.005148] CPU features: detected: Branch Target Identification1322machine # [ 0.005152] CPU features: detected: ARMv8.4 Translation Table Level1323machine # [ 0.005155] CPU features: detected: Instruction cache invalidation not required for I/D coherence1324machine # [ 0.005159] CPU features: detected: Data cache clean to the PoU not required for I/D coherence1325machine # [ 0.005166] CPU features: detected: Common not Private translations1326machine # [ 0.005169] CPU features: detected: CRC32 instructions1327machine # [ 0.005172] CPU features: detected: Data cache clean to Point of Deep Persistence1328machine # [ 0.005175] CPU features: detected: Data cache clean to Point of Persistence1329machine # [ 0.005178] CPU features: detected: Data independent timing control (DIT)1330machine # [ 0.005181] CPU features: detected: E0PD1331machine # [ 0.005184] CPU features: detected: Enhanced Counter Virtualization1332machine # [ 0.005187] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)1333machine # [ 0.005190] CPU features: detected: Enhanced Virtualization Traps1334machine # [ 0.005194] CPU features: detected: Fine Grained Traps1335machine # [ 0.005197] CPU features: detected: Generic authentication (architected QARMA5 algorithm)1336machine # [ 0.005202] CPU features: detected: RCpc load-acquire (LDAPR)1337machine # [ 0.005205] CPU features: detected: LSE atomic instructions1338machine # [ 0.005208] CPU features: detected: Privileged Access Never1339machine # [ 0.005210] CPU features: detected: PMUv31340machine # [ 0.005213] CPU features: detected: RAS Extension Support1341machine # [ 0.005216] CPU features: detected: RASv1p1 Extension Support1342machine # [ 0.005219] CPU features: detected: Random Number Generator1343machine # [ 0.005224] CPU features: detected: Speculation barrier (SB)1344machine # [ 0.005226] CPU features: detected: Stage-2 Force Write-Back1345machine # [ 0.005229] CPU features: detected: TLB range maintenance instructions1346machine # [ 0.005234] CPU features: detected: Speculative Store Bypassing Safe (SSBS)1347machine # [ 0.005272] alternatives: applying system-wide alternatives1348machine # [ 0.008242] CPU features: detected: BBM Level 2 without TLB conflict abort1349machine # [ 0.008413] Memory: 893100K/1048576K available (24512K kernel code, 7102K rwdata, 26572K rodata, 4736K init, 1184K bss, 114152K reserved, 32768K cma-reserved)1350machine # [ 0.008745] devtmpfs: initialized1351machine # [ 0.010570] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)1352machine # [ 0.010600] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).1353machine # [ 0.010797] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL1354machine # [ 0.010802] 0 pages in range for non-PLT usage1355machine # [ 0.010803] 508192 pages in range for PLT usage1356machine # [ 0.010916] pinctrl core: initialized pinctrl subsystem1357machine # [ 0.011831] DMI not present or invalid.1358machine # [ 0.015368] NET: Registered PF_NETLINK/PF_ROUTE protocol family1359machine # [ 0.017811] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations1360machine # [ 0.017960] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations1361machine # [ 0.018113] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations1362machine # [ 0.018137] audit: initializing netlink subsys (disabled)1363machine # [ 0.018942] thermal_sys: Registered thermal governor 'fair_share'1364machine # [ 0.018945] thermal_sys: Registered thermal governor 'bang_bang'1365machine # [ 0.018948] thermal_sys: Registered thermal governor 'step_wise'1366machine # [ 0.018951] thermal_sys: Registered thermal governor 'user_space'1367machine # [ 0.018954] thermal_sys: Registered thermal governor 'power_allocator'1368machine # [ 0.018981] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=11369machine # [ 0.018990] cpuidle: using governor ladder1370machine # [ 0.018996] cpuidle: using governor menu1371machine # [ 0.019188] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.1372machine # [ 0.019204] ASID allocator initialised with 65536 entries1373machine # [ 0.020471] Serial: AMBA PL011 UART driver1374machine # [ 0.026087] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev11375machine # [ 0.026220] printk: console [ttyAMA0] enabled1376machine # [ 0.155090] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages1377machine # [ 0.155099] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page1378machine # [ 0.155103] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages1379machine # [ 0.155106] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page1380machine # [ 0.155109] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages1381machine # [ 0.155111] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page1382machine # [ 0.155114] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages1383machine # [ 0.155117] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page1384machine # [ 0.156283] fbcon: Taking over console1385machine # [ 0.156292] ACPI: Interpreter disabled.1386machine # [ 0.158779] iommu: Default domain type: Translated1387machine # [ 0.158783] iommu: DMA domain TLB invalidation policy: strict mode1388machine # [ 0.168245] SCSI subsystem initialized1389machine # [ 0.168929] usbcore: registered new interface driver usbfs1390machine # [ 0.168959] usbcore: registered new interface driver hub1391machine # [ 0.168972] usbcore: registered new device driver usb1392machine # [ 0.169269] pps_core: LinuxPPS API ver. 1 registered1393machine # [ 0.169273] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>1394machine # [ 0.169281] PTP clock support registered1395machine # [ 0.169328] EDAC MC: Ver: 3.0.01396machine # [ 0.169514] scmi_core: SCMI protocol bus registered1397machine # [ 0.171983] FPGA manager framework1398machine # [ 0.178334] vgaarb: loaded1399machine # [ 0.178612] clocksource: Switched to clocksource arch_sys_counter1400machine # [ 0.185538] VFS: Disk quotas dquot_6.6.01401machine # [ 0.185571] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)1402machine # [ 0.188223] netfs: FS-Cache loaded1403machine # [ 0.188340] pnp: PnP ACPI: disabled1404machine # [ 0.193657] NET: Registered PF_INET protocol family1405machine # [ 0.193804] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)1406machine # [ 0.223182] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)1407machine # [ 0.223214] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)1408machine # [ 0.223236] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)1409machine # [ 0.223276] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)1410machine # [ 0.223348] TCP: Hash tables configured (established 8192 bind 8192)1411machine # [ 0.223449] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)1412machine # [ 0.223502] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)1413machine # [ 0.223523] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)1414machine # [ 0.223594] NET: Registered PF_UNIX/PF_LOCAL protocol family1415machine # [ 0.223613] NET: Registered PF_XDP protocol family1416machine # [ 0.223627] PCI: CLS 0 bytes, default 641417machine # [ 0.223971] Trying to unpack rootfs image as initramfs...1418machine # [ 0.236604] kvm [1]: HYP mode not available1419machine # [ 0.329520] Initialise system trusted keyrings1420machine # [ 0.329646] workingset: timestamp_bits=42 max_order=18 bucket_order=01421machine # [ 0.330000] squashfs: version 4.0 (2009/01/31) Phillip Lougher1422machine # [ 0.330050] 9p: Installing v9fs 9p2000 file system support1423machine # [ 0.353020] Key type asymmetric registered1424machine # [ 0.353034] Asymmetric key parser 'x509' registered1425machine # [ 0.353109] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)1426machine # [ 0.362677] io scheduler mq-deadline registered1427machine # [ 0.362687] io scheduler kyber registered1428machine # [ 0.367964] pl061_gpio 9030000.pl061: PL061 GPIO chip registered1429machine # [ 0.371433] ledtrig-cpu: registered to indicate activity on CPUs1430machine # [ 0.371857] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:1431machine # [ 0.371873] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x00000000001432machine # [ 0.371883] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x00100000001433machine # [ 0.371889] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x80000000001434machine # [ 0.371909] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits1435machine # [ 0.371933] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]1436machine # [ 0.372010] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:001437machine # [ 0.372018] pci_bus 0000:00: root bus resource [bus 00-ff]1438machine # [ 0.372022] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]1439machine # [ 0.372025] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]1440machine # [ 0.372029] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]1441machine # [ 0.372090] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint1442machine # [ 0.372555] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint1443machine # [ 0.372745] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]1444machine # [ 0.372758] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]1445machine # [ 0.372784] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1446machine # [ 0.372796] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]1447machine # [ 0.373271] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint1448machine # [ 0.373459] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]1449machine # [ 0.373470] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]1450machine # [ 0.373497] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1451machine # [ 0.373962] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint1452machine # [ 0.374146] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]1453machine # [ 0.374157] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]1454machine # [ 0.374182] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1455machine # [ 0.406710] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint1456machine # [ 0.406907] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]1457machine # [ 0.406919] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]1458machine # [ 0.406945] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1459machine # [ 0.406957] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]1460machine # [ 0.407470] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint1461machine # [ 0.407660] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]1462machine # [ 0.407685] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1463machine # [ 0.408211] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint1464machine # [ 0.408400] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]1465machine # [ 0.408426] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1466machine # [ 0.408836] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint1467machine # [ 0.409017] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]1468machine # [ 0.409266] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint1469machine # [ 0.409453] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]1470machine # [ 0.409479] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1471machine # [ 0.409942] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint1472machine # [ 0.410128] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]1473machine # [ 0.410154] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1474machine # [ 0.410635] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint1475machine # [ 0.410822] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]1476machine # [ 0.410848] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1477machine # [ 0.411324] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint1478machine # [ 0.411585] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]1479machine # [ 0.411597] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]1480machine # [ 0.411623] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1481machine # [ 0.412108] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint1482machine # [ 0.412294] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]1483machine # [ 0.412306] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]1484machine # [ 0.412331] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]1485machine # [ 0.412933] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned1486machine # [ 0.412939] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned1487machine # [ 0.412943] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned1488machine # [ 0.412987] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned1489machine # [ 0.413031] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned1490machine # [ 0.413076] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned1491machine # [ 0.413120] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned1492machine # [ 0.413163] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned1493machine # [ 0.413207] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned1494machine # [ 0.413251] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned1495machine # [ 0.413297] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned1496machine # [ 0.413340] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned1497machine # [ 0.413405] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned1498machine # [ 0.413447] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned1499machine # [ 0.413465] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned1500machine # [ 0.413482] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned1501machine # [ 0.413499] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned1502machine # [ 0.413517] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned1503machine # [ 0.413534] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned1504machine # [ 0.413552] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned1505machine # [ 0.413570] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned1506machine # [ 0.413588] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned1507machine # [ 0.413606] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned1508machine # [ 0.413624] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned1509machine # [ 0.413642] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned1510machine # [ 0.413659] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned1511machine # [ 0.413676] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned1512machine # [ 0.413693] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned1513machine # [ 0.413710] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned1514machine # [ 0.413727] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned1515machine # [ 0.413745] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned1516machine # [ 0.413766] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]1517machine # [ 0.413771] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]1518machine # [ 0.413774] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]1519machine # [ 0.414658] pci 0000:00:07.0: enabling device (0000 -> 0002)1520machine # [ 0.497230] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)1521machine # [ 0.507214] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)1522machine # [ 0.509509] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)1523machine # [ 0.513099] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)1524machine # [ 0.522807] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)1525machine # [ 0.524971] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)1526machine # [ 0.528574] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)1527machine # [ 0.530279] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)1528machine # [ 0.539972] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)1529machine # [ 0.541874] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)1530machine # [ 0.545805] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)1531machine # [ 0.559017] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled1532machine # [ 0.560640] msm_serial: driver initialized1533machine # [ 0.560783] SuperH (H)SCI(F) driver initialized1534machine # [ 0.560840] STM32 USART driver initialized1535machine # [ 0.596181] loop: module loaded1536machine # [ 0.596348] virtio_blk virtio2: 1/0/0 default/read/poll queues1537machine # [ 0.597096] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1538machine # [ 0.601496] megasas: 07.734.00.00-rc11539machine # [ 0.602219] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]1540machine # [ 0.623781] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001541machine # [ 0.623798] Intel/Sharp Extended Query Table at 0x00311542machine # [ 0.625433] Using buffer write method1543machine # [ 0.625463] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]1544machine # [ 0.630584] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001545machine # [ 0.630597] Intel/Sharp Extended Query Table at 0x00311546machine # [ 0.634608] Using buffer write method1547machine # [ 0.634638] Concatenating MTD devices:1548machine # [ 0.634641] (0): "0.flash"1549machine # [ 0.634643] (1): "0.flash"1550machine # [ 0.634645] into device "0.flash"1551machine # [ 0.880019] Freeing initrd memory: 26908K1552machine # [ 0.886223] tun: Universal TUN/TAP device driver, 1.61553machine # [ 0.889966] thunder_xcv, ver 1.01554machine # [ 0.889991] thunder_bgx, ver 1.01555machine # [ 0.890008] nicpf, ver 1.01556machine # [ 0.890587] e1000: Intel(R) PRO/1000 Network Driver1557machine # [ 0.890592] e1000: Copyright (c) 1999-2006 Intel Corporation.1558machine # [ 0.893293] e1000e: Intel(R) PRO/1000 Network Driver1559machine # [ 0.893300] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.1560machine # [ 0.893334] igb: Intel(R) Gigabit Ethernet Network Driver1561machine # [ 0.893338] igb: Copyright (c) 2007-2014 Intel Corporation.1562machine # [ 0.893357] igbvf: Intel(R) Gigabit Virtual Function Network Driver1563machine # [ 0.893361] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.1564machine # [ 0.893508] sky2: driver version 1.301565machine # [ 0.900016] usbcore: registered new interface driver usb-storage1566machine # [ 0.900152] usbcore: registered new interface driver usbserial_generic1567machine # [ 0.900164] usbserial: USB Serial support registered for generic1568machine # [ 0.900773] hv_vmbus: registering driver hyperv_keyboard1569machine # [ 0.902003] ehci-pci 0000:00:07.0: EHCI Host Controller1570machine # [ 0.902020] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 11571machine # [ 0.902181] ehci-pci 0000:00:07.0: irq 16, io mem 0x100860001572machine # [ 0.902475] rtc-pl031 9010000.pl031: registered as rtc01573machine # [ 0.902499] rtc-pl031 9010000.pl031: setting system clock to 2026-11-02T22:07:06 UTC (1793657226)1574machine # [ 0.910053] i2c_dev: i2c /dev entries driver1575machine # [ 0.910659] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.001576machine # [ 0.910946] hub 1-0:1.0: USB hub found1577machine # [ 0.910963] hub 1-0:1.0: 6 ports detected1578machine # [ 0.916317] sdhci: Secure Digital Host Controller Interface driver1579machine # [ 0.916323] sdhci: Copyright(c) Pierre Ossman1580machine # [ 0.916601] Synopsys Designware Multimedia Card Interface Driver1581machine # [ 0.916989] sdhci-pltfm: SDHCI platform and OF driver helper1582machine # [ 0.918554] hid: raw HID events driver (C) Jiri Kosina1583machine # [ 0.922268] usbcore: registered new interface driver usbhid1584machine # [ 0.922273] usbhid: USB HID core driver1585machine # [ 0.924729] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available1586machine # [ 0.926317] drop_monitor: Initializing network drop monitor service1587machine # [ 0.926435] NET: Registered PF_INET6 protocol family1588machine # [ 0.929540] Segment Routing with IPv61589machine # [ 0.929552] In-situ OAM (IOAM) with IPv61590machine # [ 0.929583] NET: Registered PF_PACKET protocol family1591machine # [ 0.929635] 9pnet: Installing 9P2000 support1592machine # [ 0.929672] Key type dns_resolver registered1593machine # [ 0.938344] registered taskstats version 11594machine # [ 0.938492] Loading compiled-in X.509 certificates1595machine # [ 0.947134] Demotion targets for Node 0: null1596machine # [ 0.947233] Key type .fscrypt registered1597machine # [ 0.947236] Key type fscrypt-provisioning registered1598machine # [ 0.947324] ima: No TPM chip found, activating TPM-bypass!1599machine # [ 0.947342] ima: Allocated hash algorithm: sha11600machine # [ 0.947365] ima: No architecture policies found1601machine # [ 0.947899] input: gpio-keys as /devices/platform/gpio-keys/input/input01602machine # [ 0.969238] clk: Disabling unused clocks1603machine # [ 0.969249] PM: genpd: Disabling unused power domains1604machine # [ 0.973329] Freeing unused kernel memory: 4736K1605machine # [ 0.973485] Run /init as init process1606machine # [ 0.993021] systemd[1]: Successfully made /usr/ read-only.1607machine # [ 1.158656] usb 1-1: new high-speed USB device number 2 using ehci-pci1608machine # [ 1.308395] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input11609machine # [ 1.326882] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1610machine # [ 1.326905] systemd[1]: Detected virtualization qemu.1611machine # [ 1.326942] systemd[1]: Detected architecture arm64.1612machine # [ 1.326950] systemd[1]: Running in initrd.1613machine # [ 1.327455] systemd[1]: Initializing machine ID from random generator.1614machine # [ 1.327597] systemd[1]: Hostname set to <machine>.1615machine # [ 1.394801] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input01616machine # [ 1.450846] systemd[1]: bpf-restrict-fs: LSM BPF program attached1617machine # [ 1.507969] systemd[1]: Queued start job for default target Initrd Default Target.1618machine # [ 1.516691] systemd[1]: Created slice Slice /system/modprobe.1619machine # [ 1.516856] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1620machine # [ 1.516884] systemd[1]: Expecting device /dev/disk/by-label/nixos...1621machine # [ 1.516907] systemd[1]: Reached target Path Units.1622machine # [ 1.516923] systemd[1]: Reached target Slice Units.1623machine # [ 1.516940] systemd[1]: Reached target Swaps.1624machine # [ 1.516957] systemd[1]: Reached target Timer Units.1625machine # [ 1.517085] systemd[1]: Listening on D-Bus System Message Bus Socket.1626machine # [ 1.517232] systemd[1]: Listening on Journal Socket (/dev/log).1627machine # [ 1.517381] systemd[1]: Listening on Journal Sockets.1628machine # [ 1.517495] systemd[1]: Listening on udev Control Socket.1629machine # [ 1.517566] systemd[1]: Listening on udev Kernel Socket.1630machine # [ 1.517582] systemd[1]: Reached target Socket Units.1631machine # [ 1.518581] usb 1-2: new high-speed USB device number 3 using ehci-pci1632machine # [ 1.529756] systemd[1]: Starting Create List of Static Device Nodes...1633machine # [ 1.529811] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1634machine # [ 1.535114] systemd[1]: Mounting Kernel Configuration File System...1635machine # [ 1.541568] systemd[1]: Starting Journal Service...1636machine # [ 1.549536] systemd[1]: Starting Load Kernel Modules...1637machine # [ 1.549619] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1638machine # [ 1.576857] systemd[1]: Starting Coldplug All udev Devices...1639machine # [ 1.592830] systemd-journald[71]: Collecting audit messages is disabled.1640machine # [ 1.597264] systemd[1]: Finished Create List of Static Device Nodes.1641machine # [ 1.597930] systemd[1]: Mounted Kernel Configuration File System.1642machine # [ 1.615868] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1643machine # [ 1.631644] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.1644machine # [ 1.650895] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev1645machine # [ 1.663293] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1646machine # [ 1.669962] [drm] pci: virtio-gpu-pci detected at 0000:00:05.01647machine # [ 1.670199] [drm] features: -virgl +edid -resource_blob -host_visible1648machine # [ 1.670202] [drm] features: -context_init1649machine # [ 1.673434] systemd[1]: Starting Create Static Device Nodes in /dev...1650machine # [ 1.683310] [drm] number of scanouts: 11651machine # [ 1.683325] [drm] number of cap sets: 01652machine # [ 1.684250] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic1653machine # [ 1.684258] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 01654machine # [ 1.692559] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input21655machine # [ 1.692690] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input01656machine # [ 1.718955] Console: switching to colour frame buffer device 160x501657machine # [ 1.726793] systemd[1]: Finished Create Static Device Nodes in /dev.1658machine # [ 1.727171] systemd[1]: Reached target Preparation for Local File Systems.1659machine # [ 1.727195] systemd[1]: Reached target Local File Systems.1660machine # [ 1.735031] systemd[1]: Starting Rule-based Manager for Device Events and Files...1661machine # [ 1.740289] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device1662machine # [ 1.751810] systemd[1]: Finished Load Kernel Modules.1663machine # [ 1.766787] systemd[1]: Starting Apply Kernel Variables...1664machine # [ 1.786120] systemd[1]: Started Journal Service.1665machine # [ 1.784368] systemd-modules-load[72]: Inserted module 'dm_mod'1666machine # [ 1.785779] systemd-modules-load[72]: Module 'virtio_balloon' is built in1667machine # [ 1.800308] systemd-modules-load[72]: Module 'virtio_console' is built in1668machine # [ 1.802905] systemd-modules-load[72]: Inserted module 'virtio_gpu'1669machine # [ 1.805292] systemd-modules-load[72]: Module 'virtio_rng' is built in1670machine # [ 1.809019] systemd[1]: Starting Create System Files and Directories...1671machine # [ 1.818824] systemd[1]: Finished Apply Kernel Variables.1672machine # [ 1.825541] systemd[1]: Finished Create System Files and Directories.1673machine # [ 1.833528] systemd-udevd[78]: Using default interface naming scheme 'v261'.1674machine # [ 1.864749] systemd[1]: Started Rule-based Manager for Device Events and Files.1675machine # [ 1.932954] systemd[1]: Starting Virtual Console Setup...1676machine # [ 2.008480] systemd-vconsole-setup[100]: Configuration of first virtual console was skipped, ignoring remaining ones.1677machine # [ 2.016185] systemd[1]: Finished Virtual Console Setup.1678machine # [ 2.639853] systemd[1]: Finished Coldplug All udev Devices.1679machine # [ 2.640951] systemd[1]: Reached target System Initialization.1680machine # [ 2.641832] systemd[1]: Reached target Basic System.1681machine # [ 2.814198] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.1682machine # [ 2.816789] (udev-worker)[93]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1683machine # [ 2.821886] (udev-worker)[93]: Network interface NamePolicy= disabled on kernel command line.1684machine # [ 2.896548] systemd[1]: Found device /dev/disk/by-label/nixos.1685machine # [ 2.898341] systemd[1]: Reached target Initrd Root Device.1686machine # [ 2.902609] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1687machine # [ 2.955970] systemd-fsck[109]: nixos: clean, 246/65536 files, 17373/262144 blocks1688machine # [ 2.961170] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1689machine # [ 2.968248] systemd[1]: Mounting /sysroot...1690machine # [ 3.022294] EXT4-fs (vda): mounted filesystem a385634c-12c1-4af9-9d37-619e8ce47fc2 r/w with ordered data mode. Quota mode: none.1691machine # [ 3.008900] systemd[1]: Mounted /sysroot.1692machine # [ 3.013877] systemd[1]: Reached target Initrd Root File System.1693machine # [ 3.024443] systemd[1]: Starting Mountpoints Configured in the Real Root...1694machine # [ 3.040697] systemd-sysroot-fstab-check[117]: /sysroot should be mounted in the initrd, will request daemon-reload.1695machine # [ 3.046835] systemd[1]: Reload requested from client PID 117 ('systemd-sysroot') (unit initrd-parse-etc.service)...1696machine # [ 3.049724] systemd[1]: Reloading...1697machine # [ 3.264127] systemd[1]: Reloading finished in 214 ms.1698machine # [ 3.294113] systemd-sysroot-fstab-check[117]: Requesting initrd-fs.target/start/replace...1699machine # [ 3.296795] systemd-sysroot-fstab-check[117]: Requesting swap.target/start/replace...1700machine # [ 3.304546] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1701machine # [ 3.306381] systemd[1]: Finished Mountpoints Configured in the Real Root.1702machine # [ 3.312130] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1703machine # [ 3.574861] systemd[1]: Mounting /sysroot/nix/.ro-store...1704machine # [ 3.585799] systemd[1]: Mounting /sysroot/nix/.rw-store...1705machine # [ 3.597350] systemd[1]: Mounting /sysroot/run...1706machine # [ 3.623549] systemd[1]: Mounting /sysroot/tmp/shared...1707machine # [ 3.638503] systemd[1]: Mounting /sysroot/tmp/xchg...1708machine # [ 3.674042] systemd[1]: Mounted /sysroot/nix/.rw-store.1709machine # [ 3.701675] fuse: init (API version 7.45)1710machine # [ 3.707542] virtiofs virtio6: discovered new tag: nix-store1711machine # [ 3.708325] virtiofs virtio6: virtio_fs_setup_dax: No cache capability1712machine # [ 3.724223] virtiofs virtio7: discovered new tag: shared1713machine # [ 3.724980] virtiofs virtio7: virtio_fs_setup_dax: No cache capability1714machine # [ 3.734775] virtiofs virtio8: discovered new tag: xchg1715machine # [ 3.735517] virtiofs virtio8: virtio_fs_setup_dax: No cache capability1716machine # [ 3.722773] systemd[1]: Starting rw-sysroot-nix-store.service...1717machine # [ 3.731919] systemd[1]: Mounted /sysroot/nix/.ro-store.1718machine # [ 3.747689] systemd[1]: Mounted /sysroot/run.1719machine # [ 3.749115] systemd[1]: Mounted /sysroot/tmp/shared.1720machine # [ 3.750998] systemd[1]: Mounted /sysroot/tmp/xchg.1721machine # [ 3.770840] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1722machine # [ 3.771967] systemd[1]: Finished rw-sysroot-nix-store.service.1723machine # [ 4.238798] (udev-worker)[91]: mtd0ro: Failed to find and pin callout binary "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/udev/mtd_probe": No such file or directory1724machine # [ 4.245888] (udev-worker)[91]: mtd0ro: /etc/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 directory1725machine # [ 4.270233] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1726machine # [ 4.276903] systemd[1]: Stopped Virtual Console Setup.1727machine # [ 4.277745] systemd[1]: Stopping Virtual Console Setup...1728machine # [ 4.279039] systemd[1]: Starting Virtual Console Setup...1729machine # [ 4.292799] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1730machine # [ 4.294370] systemd[1]: Stopped Virtual Console Setup.1731machine # [ 4.298498] systemd[1]: Starting Virtual Console Setup...1732machine # [ 4.325891] systemd-vconsole-setup[153]: Configuration of first virtual console was skipped, ignoring remaining ones.1733machine # [ 4.329503] systemd[1]: Finished Virtual Console Setup.1734machine # [ 4.575967] systemd[1]: Mounting /sysroot/nix/store...1735machine # [ 4.616912] systemd[1]: Mounted /sysroot/nix/store.1736machine # [ 4.622252] systemd[1]: Mounting /sysroot/var/lib/sops-nix...1737machine # [ 4.629737] systemd[1]: Starting Find NixOS closure...1738machine # [ 4.668917] systemd[1]: Mounted /sysroot/var/lib/sops-nix.1739machine # [ 4.672635] systemd[1]: Reached target Initrd File Systems.1740machine # [ 4.680496] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1741machine # [ 4.692357] systemd[1]: Finished Find NixOS closure.1742machine # [ 4.707445] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1743machine # [ 4.709025] systemd[1]: Reached target Initrd Default Target.1744machine # [ 4.712547] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1745machine # [ 4.738961] systemd[1]: Stopped target Initrd Default Target.1746machine # [ 4.740743] systemd[1]: Stopped target Basic System.1747machine # [ 4.744119] systemd[1]: Stopped target Initrd Root Device.1748machine # [ 4.745593] systemd[1]: Stopped target Path Units.1749machine # [ 4.746459] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1750machine # [ 4.749082] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1751machine # [ 4.752159] systemd[1]: Stopped target Slice Units.1752machine # [ 4.753777] systemd[1]: Stopped target Socket Units.1753machine # [ 4.756877] systemd[1]: Stopped target System Initialization.1754machine # [ 4.760775] systemd[1]: Stopped target Swaps.1755machine # [ 4.764879] systemd[1]: Stopped target Timer Units.1756machine # [ 4.765765] systemd[1]: dbus.socket: Deactivated successfully.1757machine # [ 4.766634] systemd[1]: Closed D-Bus System Message Bus Socket.1758machine # [ 4.767508] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1759machine # [ 4.778226] systemd[1]: Stopped Find NixOS closure.1760machine # [ 4.779716] systemd[1]: Starting rw-sysroot-nix-store.service...1761machine # [ 4.787531] systemd[1]: systemd-sysctl.service: Deactivated successfully.1762machine # [ 4.791629] systemd[1]: Stopped Apply Kernel Variables.1763machine # [ 4.793851] systemd[1]: systemd-modules-load.service: Deactivated successfully.1764machine # [ 4.795939] systemd[1]: Stopped Load Kernel Modules.1765machine # [ 4.798024] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1766machine # [ 4.801149] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1767machine # [ 4.803348] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1768machine # [ 4.808253] systemd[1]: Stopped Create System Files and Directories.1769machine # [ 4.809179] systemd[1]: Stopped target Local File Systems.1770machine # [ 4.809982] systemd[1]: Stopped target Preparation for Local File Systems.1771machine # [ 4.810946] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1772machine # [ 4.811948] systemd[1]: Stopped Coldplug All udev Devices.1773machine # [ 4.813061] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1774machine # [ 4.814206] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1775machine # [ 4.815251] systemd[1]: Stopped Virtual Console Setup.1776machine # [ 4.815999] systemd[1]: initrd-cleanup.service: Deactivated successfully.1777machine # [ 4.817041] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1778machine # [ 4.817988] systemd[1]: systemd-udevd.service: Deactivated successfully.1779machine # [ 4.818940] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1780machine # [ 4.819946] systemd[1]: systemd-udevd.service: Consumed 1.499s CPU time over 3.076s wall clock time, 24.7M memory peak.1781machine # [ 4.824237] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1782machine # [ 4.826857] systemd[1]: Finished rw-sysroot-nix-store.service.1783machine # [ 4.828698] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1784machine # [ 4.832198] systemd[1]: Closed udev Control Socket.1785machine # [ 4.833025] systemd[1]: Starting Cleanup udev Database...1786machine # [ 4.836182] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1787machine # [ 4.837301] systemd[1]: Stopped Create Static Device Nodes in /dev.1788machine # [ 4.838266] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1789machine # [ 4.844218] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1790machine # [ 4.845255] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1791machine # [ 4.846305] systemd[1]: Stopped Create List of Static Device Nodes.1792machine # [ 4.873555] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1793machine # [ 4.876115] systemd[1]: Finished Cleanup udev Database.1794machine # [ 4.877380] systemd[1]: Reached target Switch Root.1795machine # [ 4.880155] systemd[1]: Starting NixOS Activation...1796machine # [ 4.948196] initrd-nixos-activation-start[178]: booting system configuration /nix/store/p41vvs3llgr64zp4qm88gxlyhw3lmk24-nixos-system-machine-test1797machine # [ 4.978887] initrd-nixos-activation-start[178]: running activation script...1798machine # [ 5.044857] initrd-nixos-activation-start[201]: setting up /etc...1799machine # [ 5.260111] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1800machine # [ 5.261319] systemd[1]: Finished NixOS Activation.1801machine # [ 5.263159] systemd[1]: Starting Switch Root...1802machine # [ 5.282979] systemd[1]: Switching root.1803machine # [ 5.467619] systemd-journald[71]: Received SIGTERM from PID 1 (systemd).1804machine # [ 5.965786] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1805machine # [ 5.965845] systemd[1]: Detected virtualization qemu.1806machine # [ 5.965898] systemd[1]: Detected architecture arm64.1807machine # [ 6.099858] systemd[1]: bpf-restrict-fs: LSM BPF program attached1808machine # [ 6.471905] systemd[1]: initrd-switch-root.service: Deactivated successfully.1809machine # [ 6.472293] systemd[1]: Stopped initrd-switch-root.service.1810machine # [ 6.474438] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1811machine # [ 6.479828] systemd[1]: Created slice Slice /system/getty.1812machine # [ 6.481111] systemd[1]: Created slice User and Session Slice.1813machine # [ 6.481615] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1814machine # [ 6.482099] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1815machine # [ 6.482509] systemd[1]: Expecting device /dev/hvc0...1816machine # [ 6.487170] systemd[1]: Expecting device /dev/ttyAMA0...1817machine # [ 6.487520] systemd[1]: Reached target Local Encrypted Volumes.1818machine # [ 6.487773] systemd[1]: Stopped target initrd-fs.target.1819machine # [ 6.488005] systemd[1]: Stopped target initrd-root-fs.target.1820machine # [ 6.488320] systemd[1]: Stopped target initrd-switch-root.target.1821machine # [ 6.488559] systemd[1]: Reached target Virtual Machines and Containers.1822machine # [ 6.488801] systemd[1]: Reached target Path Units.1823machine # [ 6.489038] systemd[1]: Reached target Remote File Systems.1824machine # [ 6.489260] systemd[1]: Reached target Slice Units.1825machine # [ 6.489485] systemd[1]: Reached target Swaps.1826machine # [ 6.498174] systemd[1]: Listening on Query the User Interactively for a Password.1827machine # [ 6.501418] systemd[1]: Listening on Process Core Dump Socket.1828machine # [ 6.503635] systemd[1]: Listening on Credential Encryption/Decryption.1829machine # [ 6.505204] systemd[1]: Listening on Factory Reset Management.1830machine # [ 6.505696] systemd[1]: Listening on Hostname Service Socket.1831machine # [ 6.506341] systemd[1]: Listening on Journal Audit Socket.1832machine # [ 6.511295] systemd[1]: Listening on Console Output Muting Service Socket.1833machine # [ 6.511874] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1834machine # [ 6.512318] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1835machine # [ 6.512715] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1836machine # [ 6.520212] systemd[1]: Listening on Disk Repartitioning Service Socket.1837machine # [ 6.520699] systemd[1]: Listening on udev Control Socket.1838machine # [ 6.521192] systemd[1]: Listening on udev Varlink Socket.1839machine # [ 6.525698] systemd[1]: Mounting Huge Pages File System...1840machine # [ 6.529429] systemd[1]: Mounting POSIX Message Queue File System...1841machine # [ 6.539149] systemd[1]: Mounting Kernel Debug File System...1842machine # [ 6.551248] systemd[1]: Mounting Kernel Trace File System...1843machine # [ 6.560407] systemd[1]: Starting Create List of Static Device Nodes...1844machine # [ 6.563620] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1845machine # [ 6.576299] systemd[1]: Mounting Kernel Configuration File System...1846machine # [ 6.579604] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1847machine # [ 6.585683] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1848machine # [ 6.586146] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1849machine # [ 6.610089] systemd[1]: Mounting FUSE Control File System...1850machine # [ 6.637294] systemd[1]: Starting sops-install-secrets-for-users.service...1851machine # [ 6.637662] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671852machine # [ 6.671231] systemd[1]: Starting Journal Service...1853machine # [ 6.688294] systemd[1]: Starting Load Kernel Modules...1854machine # [ 6.696192] systemd[1]: Starting Remount Root and Kernel File Systems...1855machine # [ 6.697244] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1856machine # [ 6.715518] systemd[1]: Starting Coldplug All udev Devices...1857machine # [ 6.730191] systemd[1]: Mounted Huge Pages File System.1858machine # [ 6.749364] systemd[1]: Mounted POSIX Message Queue File System.1859machine # [ 6.749908] systemd[1]: Mounted Kernel Debug File System.1860machine # [ 6.750286] systemd[1]: Mounted Kernel Trace File System.1861machine # [ 6.769144] systemd[1]: Finished Create List of Static Device Nodes.1862machine # [ 6.772692] systemd[1]: Mounted Kernel Configuration File System.1863machine # [ 6.773149] systemd[1]: Mounted FUSE Control File System.1864machine # [ 6.779221] systemd-journald[266]: Collecting audit messages is enabled.1865machine # [ 6.788740] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1866machine # [ 6.804801] systemd[1]: Queued start job for default target Multi-User System.1867machine # [ 6.823597] systemd[1]: Started Journal Service.1868machine # [ 6.811496] systemd[1]: systemd-journald.service: Deactivated successfully.[ 6.827429] EXT4-fs (vda): re-mounted a385634c-12c1-4af9-9d37-619e8ce47fc2.1869machine # 1870machine # [ 6.818812] systemd-modules-load[267]: Module 'atkbd' is built in1871machine # [ 6.825235] systemd-modules-load[267]: Module 'loop' is built in1872machine # [ 6.834516] systemd[1]: Finished Remount Root and Kernel File Systems.1873machine # [ 6.840561] systemd[1]: Finished Load Kernel Modules.1874machine # [ 6.853920] systemd[1]: Listening on Disk Image Download Service Socket.1875machine # [ 6.864227] systemd[1]: Starting Firewall...1876machine # [ 6.869799] systemd[1]: Starting Flush Journal to Persistent Storage...1877machine # [ 6.870807] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1878machine # [ 6.879245] systemd[1]: Starting Load/Save OS Random Seed...1879machine # [ 6.889692] systemd[1]: Starting Apply Kernel Variables...1880machine # [ 6.890561] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1881machine # [ 6.891780] systemd[1]: Import legacy update-users-groups.pl state for userborn skipped, unmet condition check ConditionPathExists=!/var/lib/userborn1882machine # [ 7.001008] systemd-journald[266]: Received client request to flush runtime journal.1883machine # [ 7.066544] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1884machine # [ 7.073510] systemd[1]: Finished Load/Save OS Random Seed.1885machine # [ 7.074464] systemd[1]: First Boot Complete skipped, unmet condition check ConditionFirstBoot=yes1886machine # [ 7.082367] systemd[1]: Finished Flush Journal to Persistent Storage.1887machine # [ 7.131521] systemd[1]: Finished Apply Kernel Variables.1888machine # [ 7.197518] systemd[1]: Finished sops-install-secrets-for-users.service.1889machine # [ 7.209795] systemd[1]: Starting Manage Users and Groups...1890machine # [ 7.265244] umount[301]: umount: /etc/group: not mounted.1891machine # [ 7.317252] umount[308]: umount: /etc/passwd: not mounted.1892machine # [ 7.374103] umount[315]: umount: /etc/shadow: not mounted.1893machine # [ 7.436932] umount[321]: umount: /etc/subuid: not mounted.1894machine # [ 7.492200] umount[328]: umount: /etc/subgid: not mounted.1895machine # [ 7.811943] systemd[1]: Finished Manage Users and Groups.1896machine # [ 7.822707] systemd[1]: Starting Journal Log Access Socket...1897machine # [ 7.833006] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1898machine # [ 7.835822] systemd[1]: Starting Create Static Device Nodes in /dev...1899machine # [ 7.840373] systemd[1]: Listening on Journal Log Access Socket.1900machine # [ 7.968052] systemd-oomd[373]: No swap; memory pressure usage will be degraded1901machine # [ 7.972131] systemd[1]: Finished Create Static Device Nodes in /dev.1902machine # [ 7.973127] systemd[1]: Reached target Preparation for Local File Systems.1903machine # [ 7.984861] systemd[1]: Starting Rule-based Manager for Device Events and Files...1904machine # [ 7.986076] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1905machine # [ 8.080861] systemd-udevd[383]: Using default interface naming scheme 'v261'.1906machine # [ 8.204111] systemd[1]: Started Rule-based Manager for Device Events and Files.1907machine # [ 8.360762] systemd[1]: Finished Coldplug All udev Devices.1908machine # [ 8.461149] systemd[1]: Mounting /run/wrappers...1909machine # [ 8.515584] systemd[1]: Mounted /run/wrappers.1910machine # [ 8.518352] systemd[1]: Reached target Local File Systems.1911machine # [ 8.522796] systemd[1]: Listening on Boot Loader Control Service Socket.1912machine # [ 8.530298] systemd[1]: Starting register-nix-paths.service...1913machine # [ 8.536001] systemd[1]: Starting Create SUID/SGID Wrappers...1914machine # [ 8.537795] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1915machine # [ 8.539090] systemd[1]: Save Transient machine-id to Disk skipped, unmet condition check ConditionPathIsMountPoint=/etc/machine-id1916machine # [ 8.549330] systemd[1]: Starting Create System Files and Directories...1917machine # [ 8.579904] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1918machine # [ 8.620519] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1919machine # [ 8.744429] systemd[1]: Finished Create System Files and Directories.1920machine # [ 8.748524] systemd[1]: Rebuild Journal Catalog skipped, unmet condition check ConditionNeedsUpdate=/var1921machine # [ 8.756973] systemd[1]: Update is Completed skipped, no trigger condition checks were met.1922machine # [ 8.763779] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1923machine # [ 8.864562] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1924machine # [ 9.070818] systemd[1]: Finished Firewall.1925machine # [ 9.076106] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1926machine # [ 9.163418] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1927machine # [ 9.311033] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1928machine # [ 9.314471] systemd[1]: Finished Create SUID/SGID Wrappers.1929machine # [ 9.323788] systemd[1]: Finished register-nix-paths.service.1930machine # [ 9.327048] systemd[1]: Reached target System Initialization.1931machine # [ 9.327902] systemd[1]: Started Discard unused filesystem blocks once a week.1932machine # [ 9.332418] systemd[1]: Started Daily Cleanup of Temporary Directories.1933machine # [ 9.333400] systemd[1]: Reached target Timer Units.1934machine # [ 9.334125] systemd[1]: Listening on D-Bus System Message Bus Socket.1935machine # [ 9.335045] systemd[1]: Listening on Nix Daemon Socket.1936machine # [ 9.335815] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1937machine # [ 9.345739] systemd[1]: Reached target Socket Units.1938machine # [ 9.349494] systemd[1]: Reached target Basic System.1939machine # [ 9.350983] systemd[1]: Started backdoor.service.1940machine # [ 9.356428] systemd[1]: Import lastlog data into lastlog2 database skipped, unmet condition check ConditionPathExists=!/var/lib/lastlog/lastlog2.db1941machine # [ 9.360721] (udev-worker)[401]: Network interface NamePolicy= disabled on kernel command line.1942machine # [ 9.362202] (udev-worker)[399]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1943machine # [ 9.374603] (udev-worker)[399]: Network interface NamePolicy= disabled on kernel command line.1944machine # [ 9.375821] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1945machine # [ 9.386189] systemd[1]: Starting Post-Boot Actions...1946machine # [ 9.387055] systemd[1]: Started Reset console on configuration changes.1947machine # [ 9.397006] systemd[1]: Starting resolvconf update...1948machine # [ 9.448580] systemd[1]: Starting D-Bus System Message Bus...1949machine # [ 9.462795] systemd[1]: Started Name Service Cache Daemon (nsncd).1950machine # [ 9.470950] systemd[1]: Reached target Host and Network Name Lookups.1951machine # [ 9.478735] systemd[1]: Reached target User and Group Name Lookups.1952machine # connecting to host...1953machine # [ 9.517769] systemd[1]: Starting User Login Management...1954machine # [ 9.523337] nsncd[505]: Nov 02 22:07:15.071 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1955machine # [ 9.559012] systemd[1]: Finished Post-Boot Actions.1956machine: Guest shell says: b'Spawning backdoor root shell...\n'1957machine: connected to guest root shell1958machine: (connecting took 9.86 seconds)1959machine: (finished: waiting for the VM to finish booting, in 9.86 seconds)1960machine # [ 9.737524] dbus-broker-launch[512]: Looking up NSS user entry for 'systemd-timesync'...1961machine # [ 9.776836] systemd-logind[525]: New seat seat0.1962machine # [ 9.805910] systemd-logind[525]: Watching system buttons on /dev/input/event0 (gpio-keys)1963machine # [ 9.836119] systemd[1]: Started User Login Management.1964machine # [ 9.843730] systemd[1]: Condition check resulted in Virtio network device being skipped.1965machine # [ 9.850641] dbus-broker-launch[512]: NSS returned no entry for 'systemd-timesync'1966machine # [ 9.851716] dbus-broker-launch[512]: Invalid user-name in /nix/store/ind8c6j91pfsiipb81amn45yml2vsyyc-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1967machine # [ 9.870826] systemd[1]: Starting linger-users.service...1968machine # [ 9.871704] systemd[1]: Stopped target Host and Network Name Lookups.1969machine # [ 9.881830] systemd[1]: Stopping Host and Network Name Lookups...1970machine # [ 9.882738] systemd[1]: Stopped target User and Group Name Lookups.1971machine # [ 9.883637] systemd[1]: Stopping User and Group Name Lookups...1972machine # [ 9.898203] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...1973machine # [ 9.899187] systemd[1]: nscd.service: Deactivated successfully.1974machine # [ 9.910306] systemd[1]: Stopped Name Service Cache Daemon (nsncd).1975machine # [ 9.920131] systemd[1]: Started D-Bus System Message Bus.1976machine # [ 9.946239] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1977machine # [ 9.962328] dbus-broker-launch[512]: Ready1978machine # [ 9.982284] systemd[1]: linger-users.service: Deactivated successfully.1979machine # [ 9.983270] systemd[1]: Finished linger-users.service.1980machine # [ 10.028191] systemd[1]: Finished resolvconf update.1981machine # [ 10.032247] systemd[1]: Reached target Preparation for Network.1982machine # [ 10.042649] systemd[1]: Starting DHCP Client...1983machine # [ 10.048580] systemd[1]: Starting Address configuration of eth1...1984machine # [ 10.054588] nsncd[592]: Nov 02 22:07:15.660 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1985machine # [ 10.063942] systemd[1]: Starting Extra networking commands....1986machine # [ 10.068928] systemd[1]: Started Name Service Cache Daemon (nsncd).1987machine # [ 10.090773] mousedev: PS/2 mouse device common for all mice1988machine # [ 10.083766] systemd[1]: Reached target Host and Network Name Lookups.1989machine # [ 10.085044] systemd[1]: Reached target User and Group Name Lookups.1990machine # [ 10.220962] network-addresses-eth1-start[605]: adding address 192.168.1.1/24... done1991machine # [ 10.245614] network-addresses-eth1-start[605]: adding address 2001:db8:1::1/64... done1992machine # [ 10.284177] systemd[1]: Finished Address configuration of eth1.1993machine # [ 10.354815] dhcpcd[624]: dhcpcd-10.3.2 starting1994machine # [ 10.367514] dhcpcd[674]: dev: loaded udev1995machine # [ 10.372000] dhcpcd[674]: DUID 00:01:00:01:32:7b:c6:00:52:54:00:12:34:561996machine # [ 10.401697] systemd[1]: Finished Extra networking commands..1997machine # [ 10.423925] 8021q: 802.1Q VLAN Support v1.81998machine # [ 10.424352] 8021q: adding VLAN 0 to HW filter on device eth11999machine # [ 10.412645] systemd[1]: Reached target Network.2000machine # [ 10.415393] systemd[1]: Starting Permit User Sessions...2001machine # [ 10.441247] systemd-logind[525]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)2002machine # [ 10.496312] systemd[1]: Finished Permit User Sessions.2003machine # [ 10.507462] systemd[1]: Started Getty on tty1.2004machine # [ 10.508248] systemd[1]: Reached target Login Prompts.2005machine # [ 10.560364] cfg80211: Loading compiled-in X.509 certificates for regulatory database2006machine # [ 10.608451] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'2007machine # [ 10.608900] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'2008machine # [ 10.610257] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -22009machine # [ 10.610568] cfg80211: failed to load regulatory.db2010machine # [ 10.667631] dhcpcd[674]: eth0: waiting for carrier[ 10.684721] 8021q: adding VLAN 0 to HW filter on device eth02011machine # 2012machine # [ 10.671393] dhcpcd[674]: libudev: received NULL device2013machine # [ 10.673682] dhcpcd[674]: libudev: received NULL device2014machine # [ 10.674461] dhcpcd[674]: eth0: carrier acquired2015machine # [ 10.684164] dhcpcd[674]: eth0: IAID 00:12:34:562016machine # [ 10.684884] dhcpcd[674]: eth0: adding address fe80::5054:ff:fe12:34562017machine # [ 11.290813] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input32018machine # [ 11.583166] systemd[1]: Starting Virtual Console Setup...2019machine # [ 11.608991] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.2020machine # [ 11.612086] systemd[1]: Stopped Virtual Console Setup.2021machine # [ 11.641818] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.2022machine # [ 11.646118] systemd[1]: Starting Virtual Console Setup...2023machine # [ 11.682641] systemd-logind[525]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)2024machine # [ 11.759435] systemd-vconsole-setup[723]: Configuration of first virtual console was skipped, ignoring remaining ones.2025machine # [ 11.762651] systemd[1]: Finished Virtual Console Setup.2026machine # [ 12.009003] dhcpcd[674]: eth0: rebinding lease of 10.0.2.152027machine # [ 12.020539] dhcpcd[674]: eth0: probing address 10.0.2.15/242028machine # [ 12.741731] dhcpcd[674]: eth0: soliciting an IPv6 router2029machine # [ 12.742552] dhcpcd[674]: eth0: Router Advertisement from fe80::22030machine # [ 12.742716] dhcpcd[674]: eth0: adding address fec0::5054:ff:fe12:3456/642031machine # [ 12.742791] dhcpcd[674]: eth0: adding route to fec0::/642032machine # [ 12.742858] dhcpcd[674]: eth0: adding default route via fe80::22033machine # [ 16.679632] dhcpcd[674]: eth0: leased 10.0.2.15 for 86400 seconds2034machine # [ 16.681916] dhcpcd[674]: eth0: adding route to 10.0.2.0/242035machine # [ 16.683171] dhcpcd[674]: eth0: adding default route via 10.0.2.22036machine # [ 16.780818] systemd[1]: Started DHCP Client.2037machine # [ 16.782843] systemd[1]: Reached target Multi-User System.2038machine # [ 16.784243] systemd[1]: Startup finished in 959ms (kernel) + 4.570s (initrd) + 11.254s (userspace) = 16.783s.2039machine: (finished: waiting for unit multi-user.target, in 17.79 seconds)2040machine: must succeed: getent shadow example-user | grep -q :test_value:2041machine: (finished: must succeed: getent shadow example-user | grep -q :test_value:, in 0.03 seconds)2042machine: must succeed: journalctl -b -1 --no-pager -o cat _PID=12043machine: (finished: must succeed: journalctl -b -1 --no-pager -o cat _PID=1, in 0.02 seconds)2044(finished: run the VM test script, in 38.78 seconds)2045test script finished in 38.82s2046cleanup2047kill QemuMachine (pid 91)2048machine # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/81ag9nxz1flw3xjkv1vvqg8y2ipx2ins-python3-3.14.7/bin/python3.14)2049machine # [2026-11-02T22:07:23Z INFO virtiofsd] Client disconnected, shutting down2050machine # [2026-11-02T22:07:23Z INFO virtiofsd] Client disconnected, shutting down2051machine # [2026-11-02T22:07:23Z INFO virtiofsd] Client disconnected, shutting down2052(finished: cleanup, in 0.16 seconds)