vm-test-run-systemd-boot-edk2-uefi-shell
checks.aarch64-linux.systemd-boot-edk2-uefi-shell
· build #27
· 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 script7machine: must succeed: test -e /boot/loader/entries/edk2-uefi-shell.conf8machine: waiting for the VM to finish booting9machine: starting vm10machine # Disk image does not exist, creating the virtualisation disk image...11machine: QEMU running (pid 45)12machine # Formatting '/build/vm-state-machine/tmp.15T1cvRe62', fmt=raw size=107374182413machine # mke2fs 1.47.4 (6-Mar-2025)14machine # Discarding device blocks: 0/262144 done15machine # Creating filesystem with 262144 4k blocks and 65536 inodes16machine # Filesystem UUID: 9f28dcd3-b612-49b7-ae80-a9f17ea16f1e17machine # Superblock backups stored on blocks:18machine # 32768, 98304, 163840, 22937619machine # 20machine # Allocating group tables: 0/8 done21machine # Writing inode tables: 0/8 done22machine # Creating journal (8192 blocks): done23machine # Writing superblocks and filesystem accounting information: 0/8 done24machine # 25machine # Virtualisation disk image created.26machine # Formatting '/build/vm-state-machine/machine-esp.qcow2', fmt=qcow2 cluster_size=65536 extended_l2=off compression_type=zlib size=273695232 backing_file=/nix/store/4ma884dk745lgvbf0w09v7if4cjhdsa0-machine-esp-image/esp.qcow2 backing_fmt=qcow2 lazy_refcounts=off refcount_bits=1627machine # UEFI firmware (version built at 00:00:00 on Jan 1 1980)28machine: Guest shell says: b'\x1b[2J\x1b[001;001H\x1b[=3h\x1b[2J\x1b[001;001H\x1b[2J\x1b[001;001H\x1b[8;042;160t\x1b[2J\x1b[001;001H'29machine # BdsDxe: loading Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x7,0x0)30machine # BdsDxe: starting Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x7,0x0)31machine: Guest shell says: b'BdsDxe: loading Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x7,0x0)\r\nBdsDxe: starting Boot0002 "UEFI Misc Device" from Pc'32machine: Guest shell says: b'iRoot(0x0)/Pci(0x7,0x0)\r\n'33machine: Guest shell says: b'\r \r\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m\x1b[2J\x1b[001;001H\x1b[020;063H\x1b[1m\x1b[30m\x1b[47m\x1b[0m\x1b[30m\x1b[47m NixOS \x1b[021;063'34machine: Guest shell says: b'H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m EDK2 UEFI Shell \x1b[022;063H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m Reboot Into Firmware I'35machine: Guest shell says: b'nterface \x1b[024;001H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m Boot '36machine: Guest shell says: b'in 5s.'37machine: Guest shell says: b' \x1b[023;060H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m----------------'38machine: Guest shell says: b'--------------------------'39machine: Guest shell says: b'\x1b[024;001H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m Boot in 4s. '40machine: Guest shell says: b' \x1b[023;060H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m---------------------'41machine: Guest shell says: b'---------------------'42machine: Guest shell says: b'\x1b[024;001H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m Boot in 3s. '43machine: Guest shell says: b' \x1b[023;060H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m'44machine: Guest shell says: b'------------------------------------------'45machine: Guest shell says: b'\x1b[024;001H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m Boot in 2s. '46machine: Guest shell says: b' \x1b[023;060H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m---------------------'47machine: Guest shell says: b'---------------------'48machine: Guest shell says: b'\x1b[024;001H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m Boot in 1s. '49machine: Guest shell says: b' \x1b[023;060H\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m'50machine: Guest shell says: b'------------------------------------------'51machine: Guest shell says: b'\x1b[1m\x1b[37m\x1b[40m\x1b[0m\x1b[37m\x1b[40m\x1b[2J\x1b[001;001H'52machine # NixOS EDK2 UEFI Shell Reboot Into Firmware Interface Boot in 5s. ------------------------------------------ Boot in 4s. ------------------------------------------ Boot in 3s. ------------------------------------------ Boot in 2s. ------------------------------------------ Boot in 1s. ------------------------------------------[ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]53machine # [ 0.000000] Linux version 6.18.49 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Wed Sep 2 12:31:51 UTC 202654machine # [ 0.000000] KASLR enabled55machine # [ 0.000000] efi: EFI v2.7 by EDK II56machine # [ 0.000000] efi: SMBIOS 3.0=0x47d60000 MEMATTR=0x45b13018 ACPI 2.0=0x47ff3018 RNG=0x47ff3198 INITRD=0x45b0b398 MEMRESERVE=0x45b0d51857machine # [ 0.000000] random: crng init done58machine # [ 0.000000] ACPI: Early table checksum verification disabled59machine # [ 0.000000] ACPI: RSDP 0x0000000047FF3018 000024 (v02 BOCHS )60machine # [ 0.000000] ACPI: XSDT 0x0000000047FF3F18 00006C (v01 BOCHS BXPC 00000001 01000013)61machine # [ 0.000000] ACPI: FACP 0x0000000047FF3B18 000114 (v06 BOCHS BXPC 00000001 BXPC 00000001)62machine # [ 0.000000] ACPI: DSDT 0x0000000047FF1018 0015A5 (v02 BOCHS BXPC 00000001 BXPC 00000001)63machine # [ 0.000000] ACPI: APIC 0x0000000047FF3C98 0000B8 (v04 BOCHS BXPC 00000001 BXPC 00000001)64machine # [ 0.000000] ACPI: PPTT 0x0000000047FF3D98 000060 (v02 BOCHS BXPC 00000001 BXPC 00000001)65machine # [ 0.000000] ACPI: GTDT 0x0000000047FF3098 000068 (v03 BOCHS BXPC 00000001 BXPC 00000001)66machine # [ 0.000000] ACPI: MCFG 0x0000000047FF3A98 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001)67machine # [ 0.000000] ACPI: SPCR 0x0000000047FF3E98 000050 (v02 BOCHS BXPC 00000001 BXPC 00000001)68machine # [ 0.000000] ACPI: DBG2 0x0000000047FF3818 000057 (v00 BOCHS BXPC 00000001 BXPC 00000001)69machine # [ 0.000000] ACPI: IORT 0x0000000047FF3898 000080 (v05 BOCHS BXPC 00000001 BXPC 00000001)70machine # [ 0.000000] ACPI: BGRT 0x0000000047FF3998 000038 (v01 INTEL EDK2 00000002 01000013)71machine # [ 0.000000] ACPI: SPCR: console: pl011,mmio32,0x9000000,960072machine # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]73machine # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fdf2880-0x7fdf5fff]74machine # [ 0.000000] Zone ranges:75machine # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]76machine # [ 0.000000] DMA32 empty77machine # [ 0.000000] Normal empty78machine # [ 0.000000] Device empty79machine # [ 0.000000] Movable zone start for each node80machine # [ 0.000000] Early memory node ranges81machine # [ 0.000000] node 0: [mem 0x0000000040000000-0x0000000045fdffff]82machine # [ 0.000000] node 0: [mem 0x0000000045fe0000-0x000000004605ffff]83machine # [ 0.000000] node 0: [mem 0x0000000046060000-0x000000004609ffff]84machine # [ 0.000000] node 0: [mem 0x00000000460a0000-0x00000000462affff]85machine # [ 0.000000] node 0: [mem 0x00000000462b0000-0x00000000462bffff]86machine # [ 0.000000] node 0: [mem 0x00000000462c0000-0x00000000463dffff]87machine # [ 0.000000] node 0: [mem 0x00000000463e0000-0x0000000047bbffff]88machine # [ 0.000000] node 0: [mem 0x0000000047bc0000-0x0000000047feffff]89machine # [ 0.000000] node 0: [mem 0x0000000047ff0000-0x000000007fffffff]90machine # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]91machine # [ 0.000000] cma: Reserved 32 MiB at 0x000000007cc0000092machine # [ 0.000000] psci: probing for conduit method from ACPI.93machine # [ 0.000000] psci: PSCIv1.3 detected in firmware.94machine # [ 0.000000] psci: Using standard PSCI v0.2 function IDs95machine # [ 0.000000] psci: Trusted OS migration not required96machine # [ 0.000000] psci: SMC Calling Convention v1.197machine # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)98machine # [ 0.000000] percpu: Embedded 76 pages/cpu s186648 r8192 d116456 u31129699machine # [ 0.000000] Detected PIPT I-cache on CPU0100machine # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)101machine # [ 0.000000] CPU features: detected: GICv3 CPU interface102machine # [ 0.000000] CPU features: detected: Spectre-v4103machine # [ 0.000000] CPU features: detected: Spectre-BHB104machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_38105machine # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_23106machine # [ 0.000000] alternatives: applying boot alternatives107machine # [ 0.000000] Kernel command line: initrd=\EFI\nixos\4ymblb1g8ccralh3r0d5i8admngkclb8-initrd-linux-6.18.49-initrd.efi init=/nix/store/fbck25a40cyk8dvqgm4bs9naa48j4y7x-nixos-system-machine-test/init console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf108machine # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes109machine # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)110machine # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)111machine # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB112machine # [ 0.000000] software IO TLB: area num 1.113machine # [ 0.000000] software IO TLB: mapped [mem 0x000000007ca80000-0x000000007cb80000] (1MB)114machine # [ 0.000000] Fallback order for Node 0: 0115machine # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144116machine # [ 0.000000] Policy zone: DMA117machine # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off118machine # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1119machine # [ 0.000000] allocated 2097152 bytes of page_ext120machine # [ 0.000000] ftrace: allocating 74886 entries in 294 pages121machine # [ 0.000000] ftrace: allocated 294 pages with 4 groups122machine # [ 0.000000] rcu: Hierarchical RCU implementation.123machine # [ 0.000000] rcu: RCU event tracing is enabled.124machine # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.125machine # [ 0.000000] Trampoline variant of Tasks RCU enabled.126machine # [ 0.000000] Rude variant of Tasks RCU enabled.127machine # [ 0.000000] Tracing variant of Tasks RCU enabled.128machine # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.129machine # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1130machine # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.131machine # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.132machine # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.133machine # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0134machine # [ 0.000000] GICv3: 256 SPIs implemented135machine # [ 0.000000] GICv3: 0 Extended SPIs implemented136machine # [ 0.000000] Root IRQ handler: gic_handle_irq137machine # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI138machine # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0139machine # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000140machine # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]141machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @408e0000 (indirect, esz 8, psz 64K, shr 1)142machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @408f0000 (flat, esz 8, psz 64K, shr 1)143machine # [ 0.000000] GICv3: using LPI property table @0x0000000040910000144machine # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000040920000145machine # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.146machine # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns147machine # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).148machine # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns149machine # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns150machine # [ 0.000031] arm-pv: using stolen time PV151machine # [ 0.000422] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)152machine # [ 0.000520] Console: colour dummy device 80x25153machine # [ 0.000524] printk: legacy console [tty0] enabled154machine # [ 0.000750] ACPI: Core revision 20250807155machine # [ 0.000828] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)156machine # [ 0.000836] pid_max: default: 32768 minimum: 301157machine # [ 0.000900] LSM: initializing lsm=capability,landlock,yama,bpf,ima158machine # [ 0.001055] landlock: Up and running.159machine # [ 0.001058] Yama: becoming mindful.160machine # [ 0.001525] LSM support for eBPF active161machine # [ 0.001648] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)162machine # [ 0.001656] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)163machine # [ 0.002849] rcu: Hierarchical SRCU implementation.164machine # [ 0.002854] rcu: Max phase no-delay instances is 1000.165machine # [ 0.003561] fsl-mc MSI: ITS@0x8080000 domain created166machine # [ 0.003584] Remapping and enabling EFI services.167machine # [ 0.003711] smp: Bringing up secondary CPUs ...168machine # [ 0.003727] smp: Brought up 1 node, 1 CPU169machine # [ 0.003731] SMP: Total of 1 processors activated.170machine # [ 0.003734] CPU: All CPU(s) started at EL1171machine # [ 0.003745] CPU features: detected: Branch Target Identification172machine # [ 0.003749] CPU features: detected: ARMv8.4 Translation Table Level173machine # [ 0.003752] CPU features: detected: Instruction cache invalidation not required for I/D coherence174machine # [ 0.003756] CPU features: detected: Data cache clean to the PoU not required for I/D coherence175machine # [ 0.003760] CPU features: detected: Common not Private translations176machine # [ 0.003763] CPU features: detected: CRC32 instructions177machine # [ 0.003766] CPU features: detected: Data cache clean to Point of Deep Persistence178machine # [ 0.003769] CPU features: detected: Data cache clean to Point of Persistence179machine # [ 0.003772] CPU features: detected: Data independent timing control (DIT)180machine # [ 0.003775] CPU features: detected: E0PD181machine # [ 0.003778] CPU features: detected: Enhanced Counter Virtualization182machine # [ 0.003781] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)183machine # [ 0.003784] CPU features: detected: Enhanced Virtualization Traps184machine # [ 0.003787] CPU features: detected: Fine Grained Traps185machine # [ 0.003791] CPU features: detected: Generic authentication (architected QARMA5 algorithm)186machine # [ 0.003797] CPU features: detected: RCpc load-acquire (LDAPR)187machine # [ 0.003800] CPU features: detected: LSE atomic instructions188machine # [ 0.003803] CPU features: detected: Privileged Access Never189machine # [ 0.003805] CPU features: detected: PMUv3190machine # [ 0.003808] CPU features: detected: RAS Extension Support191machine # [ 0.003811] CPU features: detected: RASv1p1 Extension Support192machine # [ 0.003813] CPU features: detected: Random Number Generator193machine # [ 0.003816] CPU features: detected: Speculation barrier (SB)194machine # [ 0.003819] CPU features: detected: Stage-2 Force Write-Back195machine # [ 0.003821] CPU features: detected: TLB range maintenance instructions196machine # [ 0.003826] CPU features: detected: Speculative Store Bypassing Safe (SSBS)197machine # [ 0.003867] alternatives: applying system-wide alternatives198machine # [ 0.006621] CPU features: detected: BBM Level 2 without TLB conflict abort199machine # [ 0.006746] Memory: 887272K/1048576K available (24448K kernel code, 7090K rwdata, 26344K rodata, 4736K init, 1107K bss, 120020K reserved, 32768K cma-reserved)200machine # [ 0.007064] devtmpfs: initialized201machine # [ 0.008038] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)202machine # [ 0.008053] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).203machine # [ 0.008236] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL204machine # [ 0.008242] 0 pages in range for non-PLT usage205machine # [ 0.008243] 508288 pages in range for PLT usage206machine # [ 0.008322] pinctrl core: initialized pinctrl subsystem207machine # [ 0.008921] SMBIOS 3.0.0 present.208machine # [ 0.008927] DMI: QEMU KVM Virtual Machine, BIOS unknown 02/02/2022209machine # [ 0.008935] DMI: Memory slots populated: 1/1210machine # [ 0.010270] NET: Registered PF_NETLINK/PF_ROUTE protocol family211machine # [ 0.010950] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations212machine # [ 0.011093] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations213machine # [ 0.011247] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations214machine # [ 0.011267] audit: initializing netlink subsys (disabled)215machine # [ 0.011698] thermal_sys: Registered thermal governor 'fair_share'216machine # [ 0.011700] thermal_sys: Registered thermal governor 'bang_bang'217machine # [ 0.011704] thermal_sys: Registered thermal governor 'step_wise'218machine # [ 0.011706] thermal_sys: Registered thermal governor 'user_space'219machine # [ 0.011709] thermal_sys: Registered thermal governor 'power_allocator'220machine # [ 0.011734] audit: type=2000 audit(0.008:1): state=initialized audit_enabled=0 res=1221machine # [ 0.011746] cpuidle: using governor ladder222machine # [ 0.011754] cpuidle: using governor menu223machine # [ 0.011911] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.224machine # [ 0.011934] ASID allocator initialised with 65536 entries225machine # [ 0.012649] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5226machine # [ 0.012851] Serial: AMBA PL011 UART driver227machine # [ 0.018914] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages228machine # [ 0.018921] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page229machine # [ 0.018924] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages230machine # [ 0.018927] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page231machine # [ 0.018930] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages232machine # [ 0.018932] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page233machine # [ 0.018935] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages234machine # [ 0.018938] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page235machine # [ 0.019773] fbcon: Taking over console236machine # [ 0.019808] ACPI: Added _OSI(Module Device)237machine # [ 0.019812] ACPI: Added _OSI(Processor Device)238machine # [ 0.019814] ACPI: Added _OSI(Processor Aggregator Device)239machine # [ 0.020788] ACPI: 1 ACPI AML tables successfully acquired and loaded240machine # [ 0.026775] ACPI: Interpreter enabled241machine # [ 0.026780] ACPI: Using GIC for interrupt routing242machine # [ 0.026811] ACPI: MCFG table detected, 1 entries243machine # [ 0.030638] ACPI: CPU0 has been hot-added244machine # [ 0.031096] ARMH0011:00: ttyAMA0 at MMIO 0x9000000 (irq = 12, base_baud = 0) is a SBSA245machine # [ 0.031173] printk: console [ttyAMA0] enabled246machine # [ 0.092112] ACPI: PCI: Interrupt link L000 configured for IRQ 35247machine # [ 0.092128] ACPI: PCI: Interrupt link L001 configured for IRQ 36248machine # [ 0.092141] ACPI: PCI: Interrupt link L002 configured for IRQ 37249machine # [ 0.092153] ACPI: PCI: Interrupt link L003 configured for IRQ 38250machine # [ 0.092171] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])251machine # [ 0.092210] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]252machine # [ 0.092296] acpi PNP0A08:00: _OSC: platform does not support [LTR]253machine # [ 0.092392] acpi PNP0A08:00: _OSC: OS now controls [PCIeHotplug PME AER PCIeCapability]254machine # [ 0.092643] acpi PNP0A08:00: ECAM area [mem 0x4010000000-0x401fffffff] reserved by PNP0C02:00255machine # [ 0.092664] acpi PNP0A08:00: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]256machine # [ 0.092688] ACPI: Remapped I/O 0x000000003eff0000 to [io 0x0000-0xffff window]257machine # [ 0.093055] PCI host bridge to bus 0000:00258machine # [ 0.093083] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff window]259machine # [ 0.093088] pci_bus 0000:00: root bus resource [io 0x0000-0xffff window]260machine # [ 0.093092] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff window]261machine # [ 0.093096] pci_bus 0000:00: root bus resource [bus 00-ff]262machine # [ 0.093099] PCI: OF: of_root node is NULL, cannot create PCI host bridge node263machine # [ 0.093147] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint264machine # [ 0.093627] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint265machine # [ 0.093806] pci 0000:00:01.0: BAR 0 [io 0x0220-0x023f]266machine # [ 0.093818] pci 0000:00:01.0: BAR 1 [mem 0x1004c000-0x1004cfff]267machine # [ 0.093843] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]268machine # [ 0.093855] pci 0000:00:01.0: ROM [mem 0xfffc0000-0xffffffff pref]269machine # [ 0.094340] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint270machine # [ 0.095262] pci 0000:00:02.0: BAR 0 [io 0x0200-0x021f]271machine # [ 0.095277] pci 0000:00:02.0: BAR 1 [mem 0x1004b000-0x1004bfff]272machine # [ 0.095303] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]273machine # [ 0.095906] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint274machine # [ 0.096088] pci 0000:00:03.0: BAR 0 [io 0x0140-0x017f]275machine # [ 0.096099] pci 0000:00:03.0: BAR 1 [mem 0x1004a000-0x1004afff]276machine # [ 0.096124] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]277machine # [ 0.096622] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint278machine # [ 0.096796] pci 0000:00:04.0: BAR 0 [io 0x01e0-0x01ff]279machine # [ 0.096807] pci 0000:00:04.0: BAR 1 [mem 0x10049000-0x10049fff]280machine # [ 0.096832] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]281machine # [ 0.213076] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint282machine # [ 0.213270] pci 0000:00:05.0: BAR 0 [io 0x01c0-0x01df]283machine # [ 0.213287] pci 0000:00:05.0: BAR 1 [mem 0x10048000-0x10048fff]284machine # [ 0.213317] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]285machine # [ 0.213822] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint286machine # [ 0.214634] pci 0000:00:06.0: BAR 0 [io 0x0080-0x00ff]287machine # [ 0.214656] pci 0000:00:06.0: BAR 1 [mem 0x10047000-0x10047fff]288machine # [ 0.214686] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]289machine # [ 0.215238] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint290machine # [ 0.223143] pci 0000:00:07.0: BAR 0 [io 0x0000-0x007f]291machine # [ 0.223167] pci 0000:00:07.0: BAR 1 [mem 0x10046000-0x10046fff]292machine # [ 0.223198] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]293machine # [ 0.223723] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint294machine # [ 0.223905] pci 0000:00:08.0: BAR 0 [io 0x01a0-0x01bf]295machine # [ 0.223922] pci 0000:00:08.0: BAR 1 [mem 0x10045000-0x10045fff]296machine # [ 0.223952] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]297machine # [ 0.223970] pci 0000:00:08.0: ROM [mem 0xfffc0000-0xffffffff pref]298machine # [ 0.230519] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint299machine # [ 0.231588] pci 0000:00:09.0: BAR 1 [mem 0x10044000-0x10044fff]300machine # [ 0.231626] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]301machine # [ 0.232147] pci 0000:00:0a.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint302machine # [ 0.232332] pci 0000:00:0a.0: BAR 1 [mem 0x10043000-0x10043fff]303machine # [ 0.232362] pci 0000:00:0a.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]304machine # [ 0.238256] pci 0000:00:0b.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint305machine # [ 0.239057] pci 0000:00:0b.0: BAR 0 [mem 0x10042000-0x10042fff]306machine # [ 0.239370] pci 0000:00:0c.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint307machine # [ 0.240113] pci 0000:00:0c.0: BAR 0 [io 0x0100-0x013f]308machine # [ 0.240133] pci 0000:00:0c.0: BAR 1 [mem 0x10041000-0x10041fff]309machine # [ 0.240164] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]310machine # [ 0.240702] pci 0000:00:0d.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint311machine # [ 0.247093] pci 0000:00:0d.0: BAR 0 [io 0x0180-0x019f]312machine # [ 0.247116] pci 0000:00:0d.0: BAR 1 [mem 0x10040000-0x10040fff]313machine # [ 0.247148] pci 0000:00:0d.0: BAR 4 [mem 0x800002c000-0x800002ffff 64bit pref]314machine # [ 0.247708] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned315machine # [ 0.247720] pci 0000:00:08.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned316machine # [ 0.247727] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned317machine # [ 0.247774] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned318machine # [ 0.247821] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned319machine # [ 0.247868] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned320machine # [ 0.247915] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned321machine # [ 0.247962] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned322machine # [ 0.248009] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned323machine # [ 0.248057] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned324machine # [ 0.248107] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned325machine # [ 0.249127] pci 0000:00:0a.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned326machine # [ 0.249185] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned327machine # [ 0.249234] pci 0000:00:0d.0: BAR 4 [mem 0x800002c000-0x800002ffff 64bit pref]: assigned328machine # [ 0.249281] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned329machine # [ 0.249304] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned330machine # [ 0.249326] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned331machine # [ 0.249348] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned332machine # [ 0.249371] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned333machine # [ 0.249394] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned334machine # [ 0.249417] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned335machine # [ 0.249441] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned336machine # [ 0.249464] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned337machine # [ 0.250025] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned338machine # [ 0.273932] pci 0000:00:0b.0: BAR 0 [mem 0x1008a000-0x1008afff]: assigned339machine # [ 0.274468] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned340machine # [ 0.274495] pci 0000:00:0d.0: BAR 1 [mem 0x1008c000-0x1008cfff]: assigned341machine # [ 0.274519] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned342machine # [ 0.275018] pci 0000:00:07.0: BAR 0 [io 0x1080-0x10ff]: assigned343machine # [ 0.275511] pci 0000:00:03.0: BAR 0 [io 0x1100-0x113f]: assigned344machine # [ 0.275538] pci 0000:00:0c.0: BAR 0 [io 0x1140-0x117f]: assigned345machine # [ 0.276039] pci 0000:00:01.0: BAR 0 [io 0x1180-0x119f]: assigned346machine # [ 0.276065] pci 0000:00:02.0: BAR 0 [io 0x11a0-0x11bf]: assigned347machine # [ 0.276755] pci 0000:00:04.0: BAR 0 [io 0x11c0-0x11df]: assigned348machine # [ 0.276783] pci 0000:00:05.0: BAR 0 [io 0x11e0-0x11ff]: assigned349machine # [ 0.276807] pci 0000:00:08.0: BAR 0 [io 0x1200-0x121f]: assigned350machine # [ 0.276831] pci 0000:00:0d.0: BAR 0 [io 0x1220-0x123f]: assigned351machine # [ 0.277329] pci_bus 0000:00: resource 4 [mem 0x10000000-0x3efeffff window]352machine # [ 0.277343] pci_bus 0000:00: resource 5 [io 0x0000-0xffff window]353machine # [ 0.277350] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff window]354machine # [ 0.293135] iommu: Default domain type: Translated355machine # [ 0.293151] iommu: DMA domain TLB invalidation policy: strict mode356machine # [ 0.294695] SCSI subsystem initialized357machine # [ 0.295334] ACPI: bus type USB registered358machine # [ 0.295389] usbcore: registered new interface driver usbfs359machine # [ 0.295412] usbcore: registered new interface driver hub360machine # [ 0.295430] usbcore: registered new device driver usb361machine # [ 0.295633] pps_core: LinuxPPS API ver. 1 registered362machine # [ 0.295641] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>363machine # [ 0.295657] PTP clock support registered364machine # [ 0.295701] EDAC MC: Ver: 3.0.0365machine # [ 0.300877] scmi_core: SCMI protocol bus registered366machine # [ 0.301610] efivars: Registered efivars operations367machine # [ 0.302598] FPGA manager framework368machine # [ 0.303455] vgaarb: loaded369machine # [ 0.304058] clocksource: Switched to clocksource arch_sys_counter370machine # [ 0.304394] VFS: Disk quotas dquot_6.6.0371machine # [ 0.304425] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)372machine # [ 0.307972] netfs: FS-Cache loaded373machine # [ 0.308585] pnp: PnP ACPI init374machine # [ 0.308785] system 00:00: [mem 0x4010000000-0x401fffffff window] could not be reserved375machine # [ 0.308844] pnp: PnP ACPI: found 1 devices376machine # [ 0.313755] NET: Registered PF_INET protocol family377machine # [ 0.313820] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)378machine # [ 0.333989] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)379machine # [ 0.334037] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)380machine # [ 0.334066] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)381machine # [ 0.334108] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)382machine # [ 0.334185] TCP: Hash tables configured (established 8192 bind 8192)383machine # [ 0.334262] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)384machine # [ 0.334295] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)385machine # [ 0.334321] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)386machine # [ 0.334403] NET: Registered PF_UNIX/PF_LOCAL protocol family387machine # [ 0.334430] NET: Registered PF_XDP protocol family388machine # [ 0.335180] PCI: CLS 0 bytes, default 64389machine # [ 0.335403] Trying to unpack rootfs image as initramfs...390machine # [ 0.349556] kvm [1]: HYP mode not available391machine # [ 0.444998] Initialise system trusted keyrings392machine # [ 0.445740] workingset: timestamp_bits=42 max_order=18 bucket_order=0393machine # [ 0.446975] squashfs: version 4.0 (2009/01/31) Phillip Lougher394machine # [ 0.452131] 9p: Installing v9fs 9p2000 file system support395machine # [ 0.472109] Key type asymmetric registered396machine # [ 0.472137] Asymmetric key parser 'x509' registered397machine # [ 0.472213] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)398machine # [ 0.480113] io scheduler mq-deadline registered399machine # [ 0.480137] io scheduler kyber registered400machine # [ 0.484621] ledtrig-cpu: registered to indicate activity on CPUs401machine # [ 0.486547] input: Power Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0C:00/input/input0402machine # [ 0.486611] ACPI: button: Power Button [PWRB]403machine # [ 0.511195] ACPI: \_SB_.L001: Enabled at IRQ 36404machine # [ 0.511254] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)405machine # [ 0.521795] ACPI: \_SB_.L002: Enabled at IRQ 37406machine # [ 0.522071] virtio-pci 0000:00:02.0: enabling device (0005 -> 0007)407machine # [ 0.523514] ACPI: \_SB_.L003: Enabled at IRQ 38408machine # [ 0.523546] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)409machine # [ 0.528438] ACPI: \_SB_.L000: Enabled at IRQ 35410machine # [ 0.528483] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)411machine # [ 0.530765] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)412machine # [ 0.540809] virtio-pci 0000:00:06.0: enabling device (0005 -> 0007)413machine # [ 0.542575] virtio-pci 0000:00:07.0: enabling device (0005 -> 0007)414machine # [ 0.552316] virtio-pci 0000:00:08.0: enabling device (0000 -> 0003)415machine # [ 0.556832] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)416machine # [ 0.559009] virtio-pci 0000:00:0c.0: enabling device (0005 -> 0007)417machine # [ 0.568857] virtio-pci 0000:00:0d.0: enabling device (0005 -> 0007)418machine # [ 0.584508] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled419machine # [ 0.586260] msm_serial: driver initialized420machine # [ 0.586375] SuperH (H)SCI(F) driver initialized421machine # [ 0.586417] STM32 USART driver initialized422machine # [ 0.606306] ACPI: bus type drm_connector registered423machine # [ 0.614385] loop: module loaded424machine # [ 0.614561] virtio_blk virtio5: 1/0/0 default/read/poll queues425machine # [ 0.615218] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)426machine # [ 0.620296] virtio_blk virtio6: 1/0/0 default/read/poll queues427machine # [ 0.620958] virtio_blk virtio6: [vdb] 534561 512-byte logical blocks (274 MB/261 MiB)428machine # [ 0.660122] vdb: vdb1429machine # [ 0.661374] megasas: 07.734.00.00-rc1430machine # [ 0.663574] tun: Universal TUN/TAP device driver, 1.6431machine # [ 0.666482] thunder_xcv, ver 1.0432machine # [ 0.666519] thunder_bgx, ver 1.0433machine # [ 0.666544] nicpf, ver 1.0434machine # [ 0.667064] e1000: Intel(R) PRO/1000 Network Driver435machine # [ 0.667073] e1000: Copyright (c) 1999-2006 Intel Corporation.436machine # [ 0.667098] e1000e: Intel(R) PRO/1000 Network Driver437machine # [ 0.667106] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.438machine # [ 0.667140] igb: Intel(R) Gigabit Ethernet Network Driver439machine # [ 0.667148] igb: Copyright (c) 2007-2014 Intel Corporation.440machine # [ 0.667173] igbvf: Intel(R) Gigabit Virtual Function Network Driver441machine # [ 0.667183] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.442machine # [ 0.667313] sky2: driver version 1.30443machine # [ 0.677156] usbcore: registered new interface driver usb-storage444machine # [ 0.677216] usbcore: registered new interface driver usbserial_generic445machine # [ 0.677233] usbserial: USB Serial support registered for generic446machine # [ 0.677750] hv_vmbus: registering driver hyperv_keyboard447machine # [ 0.678756] ehci-pci 0000:00:0b.0: EHCI Host Controller448machine # [ 0.678786] ehci-pci 0000:00:0b.0: new USB bus registered, assigned bus number 1449machine # [ 0.679095] ehci-pci 0000:00:0b.0: irq 47, io mem 0x1008a000450machine # [ 0.684913] rtc-efi rtc-efi.0: registered as rtc0451machine # [ 0.685561] rtc-efi rtc-efi.0: setting system clock to 2026-09-07T13:34:45 UTC (1788788085)452machine # [ 0.685884] i2c_dev: i2c /dev entries driver453machine # [ 0.689779] sdhci: Secure Digital Host Controller Interface driver454machine # [ 0.689793] sdhci: Copyright(c) Pierre Ossman455machine # [ 0.690015] Synopsys Designware Multimedia Card Interface Driver456machine # [ 0.690353] sdhci-pltfm: SDHCI platform and OF driver helper457machine # [ 0.691251] pstore: Using crash dump compression: deflate458machine # [ 0.691260] pstore: Registered efi_pstore as persistent store backend459machine # [ 0.695327] ehci-pci 0000:00:0b.0: USB 2.0 started, EHCI 1.00460machine # [ 0.695646] hub 1-0:1.0: USB hub found461machine # [ 0.695674] hub 1-0:1.0: 6 ports detected462machine # [ 0.704991] hid: raw HID events driver (C) Jiri Kosina463machine # [ 0.705286] usbcore: registered new interface driver usbhid464machine # [ 0.705295] usbhid: USB HID core driver465machine # [ 0.707944] hw perfevents: enabled with armv8_pmuv3_0 PMU driver, 11 (0,800003ff) counters available466machine # [ 0.710410] drop_monitor: Initializing network drop monitor service467machine # [ 0.710625] NET: Registered PF_INET6 protocol family468machine # [ 0.712555] Segment Routing with IPv6469machine # [ 0.712578] In-situ OAM (IOAM) with IPv6470machine # [ 0.712616] NET: Registered PF_PACKET protocol family471machine # [ 0.720124] 9pnet: Installing 9P2000 support472machine # [ 0.722336] Key type dns_resolver registered473machine # [ 0.736760] registered taskstats version 1474machine # [ 0.736946] Loading compiled-in X.509 certificates475machine # [ 0.756392] Demotion targets for Node 0: null476machine # [ 0.757272] Key type .fscrypt registered477machine # [ 0.757289] Key type fscrypt-provisioning registered478machine # [ 0.757404] ima: No TPM chip found, activating TPM-bypass!479machine # [ 0.757425] ima: Allocated hash algorithm: sha1480machine # [ 0.757452] ima: No architecture policies found481machine # [ 0.794356] clk: Disabling unused clocks482machine # [ 0.794397] PM: genpd: Disabling unused power domains483machine # [ 0.952137] usb 1-1: new high-speed USB device number 2 using ehci-pci484machine # [ 0.966529] Freeing initrd memory: 26104K485machine # [ 0.970096] Freeing unused kernel memory: 4736K486machine # [ 0.970310] Run /init as init process487machine # [ 0.988465] fuse: init (API version 7.45)488machine # [ 1.000465] systemd[1]: Successfully made /usr/ read-only.489machine # [ 1.104533] input: QEMU QEMU USB Keyboard as /devices/pci0000:00/0000:00:0b.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1490machine # [ 1.176519] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0b.0-1/input0491machine # [ 1.300142] usb 1-2: new high-speed USB device number 3 using ehci-pci492machine # [ 1.335376] systemd[1]: systemd 262-9457f81 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)493machine # [ 1.347385] systemd[1]: Detected virtualization kvm.494machine # [ 1.349417] systemd[1]: Detected architecture arm64.495machine # [ 1.351268] systemd[1]: Running in initrd.496machine # [ 1.353946] systemd[1]: Initializing machine ID from random generator.497machine # [ 1.356766] systemd[1]: Hostname set to <machine>.498machine # [ 1.492370] input: QEMU QEMU USB Tablet as /devices/pci0000:00/0000:00:0b.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2499machine # [ 1.494767] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0b.0-2/input0500machine # [ 1.522291] systemd[1]: bpf-restrict-fs: LSM BPF program attached501machine # [ 1.579619] systemd[1]: Queued start job for default target Initrd Default Target.502machine # [ 1.589940] systemd[1]: Created slice Slice /system/modprobe.503machine # [ 1.590858] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.504machine # [ 1.591848] systemd[1]: Expecting device /dev/disk/by-label/nixos...505machine # [ 1.592718] systemd[1]: Reached target Path Units.506machine # [ 1.593345] systemd[1]: Reached target Slice Units.507machine # [ 1.593965] systemd[1]: Reached target Swaps.508machine # [ 1.594528] systemd[1]: Reached target Timer Units.509machine # [ 1.595279] systemd[1]: Listening on D-Bus System Message Bus Socket.510machine # [ 1.596171] systemd[1]: Listening on Journal Socket (/dev/log).511machine # [ 1.597035] systemd[1]: Listening on Journal Sockets.512machine # [ 1.597821] systemd[1]: Listening on udev Kernel Socket.513machine # [ 1.598491] systemd[1]: Reached target Socket Units.514machine # [ 1.600362] systemd[1]: Starting Create List of Static Device Nodes...515machine # [ 1.607618] systemd[1]: Starting Load Kernel Module 9pnet_virtio...516machine # [ 1.608636] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs517machine # [ 1.621294] systemd[1]: Mounting Kernel Configuration File System...518machine # [ 1.639856] systemd[1]: Starting Journal Service...519machine # [ 1.652474] systemd[1]: Starting Load Kernel Modules...520machine # [ 1.664224] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os521machine # [ 1.666717] systemd[1]: Starting Coldplug All udev Devices...522machine # [ 1.686338] systemd-journald[73]: Collecting audit messages is disabled.523machine # [ 1.692562] systemd[1]: Finished Create List of Static Device Nodes.524machine # [ 1.693609] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.525machine # [ 1.693912] systemd[1]: Finished Load Kernel Module 9pnet_virtio.526machine # [ 1.694155] systemd[1]: Mounted Kernel Configuration File System.527machine # [ 1.702759] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.528machine # [ 1.712506] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...529machine # [ 1.716225] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev530machine # [ 1.720855] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0531machine # [ 1.721128] [drm] features: -virgl +edid -resource_blob -host_visible532machine # [ 1.721140] [drm] features: -context_init533machine # [ 1.721892] [drm] number of scanouts: 1534machine # [ 1.721912] [drm] number of cap sets: 0535machine # [ 1.736793] virtio-pci 0000:00:09.0: [drm] Registered 1 planes with drm panic536machine # [ 1.736821] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0537machine # [ 1.757289] Console: switching to colour frame buffer device 160x50538machine # [ 1.784780] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.539machine # [ 1.787392] systemd[1]: Starting Create Static Device Nodes in /dev...540machine # [ 1.796863] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device541machine # [ 1.820398] systemd[1]: Finished Load Kernel Modules.542machine # [ 1.823933] systemd[1]: Starting Apply Kernel Variables...543machine # [ 1.860492] systemd[1]: Finished Create Static Device Nodes in /dev.544machine # [ 1.860980] systemd[1]: Reached target Preparation for Local File Systems.545machine # [ 1.861045] systemd[1]: Reached target Local File Systems.546machine # [ 1.866266] systemd[1]: Starting Rule-based Manager for Device Events and Files...547machine # [ 1.852369] systemd-modules-load[75]: Inserted module 'dm_mod'548machine # [ 1.856288] systemd-modules-load[75]: Module 'virtio_balloon' is built in549machine # [ 1.889574] systemd[1]: Started Journal Service.550machine # [ 1.861366] systemd-modules-load[75]: Module 'virtio_console' is built in551machine # [ 1.864288] systemd-modules-load[75]: Inserted module 'virtio_gpu'552machine # [ 1.872394] systemd-modules-load[75]: Module 'virtio_rng' is built in553machine # [ 1.876422] systemd[1]: Starting Create System Files and Directories...554machine # [ 1.893674] systemd[1]: Finished Apply Kernel Variables.555machine # [ 1.924889] systemd[1]: Finished Create System Files and Directories.556machine # [ 1.933555] systemd-udevd[80]: Using default interface naming scheme 'v261'.557machine # [ 1.968127] systemd[1]: Started Rule-based Manager for Device Events and Files.558machine # [ 2.028244] systemd[1]: Starting Virtual Console Setup...559machine # [ 2.072602] systemd-vconsole-setup[102]: Configuration of first virtual console was skipped, ignoring remaining ones.560machine # [ 2.080605] systemd[1]: Finished Virtual Console Setup.561machine # [ 2.745345] systemd[1]: Finished Coldplug All udev Devices.562machine # [ 2.746947] systemd[1]: Reached target System Initialization.563machine # [ 2.747781] systemd[1]: Reached target Basic System.564machine # [ 2.879928] (udev-worker)[93]: Network interface NamePolicy= disabled on kernel command line.565machine # [ 2.913630] (udev-worker)[95]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.566machine # [ 2.918919] (udev-worker)[95]: Network interface NamePolicy= disabled on kernel command line.567machine # [ 2.964729] systemd[1]: Found device /dev/disk/by-label/nixos.568machine # [ 2.966591] systemd[1]: Reached target Initrd Root Device.569machine # [ 2.972667] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...570machine # [ 3.018919] systemd-fsck[110]: nixos: clean, 12/65536 files, 13019/262144 blocks571machine # [ 3.024408] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.572machine # [ 3.029939] systemd[1]: Mounting /sysroot...573machine # [ 3.094888] EXT4-fs (vda): mounted filesystem 9f28dcd3-b612-49b7-ae80-a9f17ea16f1e r/w with ordered data mode. Quota mode: none.574machine # [ 3.069115] systemd[1]: Mounted /sysroot.575machine # [ 3.072592] systemd[1]: Reached target Initrd Root File System.576machine # [ 3.077808] systemd[1]: Starting Mountpoints Configured in the Real Root...577machine # [ 3.103683] systemd-sysroot-fstab-check[118]: /sysroot should be mounted in the initrd, will request daemon-reload.578machine # [ 3.115944] systemd[1]: Reload requested from client PID 118 ('systemd-sysroot') (unit initrd-parse-etc.service)...579machine # [ 3.119410] systemd[1]: Reloading...580machine # [ 3.329854] systemd[1]: Reloading finished in 213 ms.581machine # [ 3.364742] systemd-sysroot-fstab-check[118]: Requesting initrd-fs.target/start/replace...582machine # [ 3.370875] systemd-sysroot-fstab-check[118]: Requesting swap.target/start/replace...583machine # [ 3.385722] systemd[1]: initrd-parse-etc.service: Deactivated successfully.584machine # [ 3.388209] systemd[1]: Finished Mountpoints Configured in the Real Root.585machine # [ 3.392163] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.586machine # [ 3.399887] systemd[1]: Starting Load Kernel Module 9pnet_virtio...587machine # [ 3.428706] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.588machine # [ 3.430320] systemd[1]: Finished Load Kernel Module 9pnet_virtio.589machine # [ 3.689881] systemd[1]: Mounting /sysroot/nix/.ro-store...590machine # [ 3.775146] systemd[1]: Mounting /sysroot/nix/.rw-store...591machine # [ 3.839406] systemd[1]: Mounting /sysroot/run...592machine # [ 3.850695] systemd[1]: Mounting /sysroot/tmp/shared...593machine # [ 3.897984] systemd[1]: Mounting /sysroot/tmp/xchg...594machine # [ 3.926948] systemd[1]: Mounted /sysroot/nix/.rw-store.595machine # [ 3.954504] systemd[1]: Starting rw-sysroot-nix-store.service...596machine # [ 3.961066] systemd[1]: Mounted /sysroot/nix/.ro-store.597machine # [ 3.969595] systemd[1]: Mounted /sysroot/run.598machine # [ 3.972206] systemd[1]: Mounted /sysroot/tmp/shared.599machine # [ 3.983548] systemd[1]: Mounted /sysroot/tmp/xchg.600machine # [ 3.993656] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.601machine # [ 3.995032] systemd[1]: Finished rw-sysroot-nix-store.service.602machine # [ 4.640155] systemd[1]: Mounting /sysroot/nix/store...603machine # [ 4.657834] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.604machine # [ 4.660472] systemd[1]: Stopped Virtual Console Setup.605machine # [ 4.662446] systemd[1]: Stopping Virtual Console Setup...606machine # [ 4.671338] systemd[1]: Starting Virtual Console Setup...607machine # [ 4.689345] systemd[1]: Mounted /sysroot/nix/store.608machine # [ 4.690895] systemd[1]: Reached target Initrd File Systems.609machine # [ 4.697399] systemd[1]: Starting Find NixOS closure...610machine # [ 4.711825] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...611machine # [ 4.713898] systemd-vconsole-setup[154]: Configuration of first virtual console was skipped, ignoring remaining ones.612machine # [ 4.727217] systemd[1]: Finished Virtual Console Setup.613machine # [ 4.728117] systemd[1]: sysroot-run-credentials-systemd\x2dvconsole\x2dsetup.service.mount: Deactivated successfully.614machine # [ 4.739206] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.615machine # [ 4.740693] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.616machine # [ 4.751367] systemd[1]: Finished Find NixOS closure.617machine # [ 4.753587] systemd[1]: Reached target Initrd Default Target.618machine # [ 4.754745] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...619machine # [ 4.775247] systemd[1]: Stopped target Initrd Default Target.620machine # [ 4.777159] systemd[1]: Stopped target Basic System.621machine # [ 4.778153] systemd[1]: Stopped target Initrd Root Device.622machine # [ 4.779197] systemd[1]: Stopped target Path Units.623machine # [ 4.780142] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.624machine # [ 4.784328] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.625machine # [ 4.786966] systemd[1]: Stopped target Slice Units.626machine # [ 4.788873] systemd[1]: Stopped target Socket Units.627machine # [ 4.790015] systemd[1]: Stopped target System Initialization.628machine # [ 4.792271] systemd[1]: Stopped target Swaps.629machine # [ 4.793522] systemd[1]: Stopped target Timer Units.630machine # [ 4.796148] systemd[1]: dbus.socket: Deactivated successfully.631machine # [ 4.797020] systemd[1]: Closed D-Bus System Message Bus Socket.632machine # [ 4.798921] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.633machine # [ 4.803353] systemd[1]: Stopped Find NixOS closure.634machine # [ 4.804191] systemd[1]: Starting Load Kernel Module 9pnet_virtio...635machine # [ 4.805152] systemd[1]: Starting rw-sysroot-nix-store.service...636machine # [ 4.810997] systemd[1]: systemd-sysctl.service: Deactivated successfully.637machine # [ 4.820242] systemd[1]: Stopped Apply Kernel Variables.638machine # [ 4.826860] systemd[1]: systemd-modules-load.service: Deactivated successfully.639machine # [ 4.828372] systemd[1]: Stopped Load Kernel Modules.640machine # [ 4.835640] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.641machine # [ 4.838758] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.642machine # [ 4.841166] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.643machine # [ 4.843103] systemd[1]: Stopped Create System Files and Directories.644machine # [ 4.846451] systemd[1]: Stopped target Local File Systems.645machine # [ 4.848437] systemd[1]: Stopped target Preparation for Local File Systems.646machine # [ 4.851072] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.647machine # [ 4.855054] systemd[1]: Stopped Coldplug All udev Devices.648machine # [ 4.855886] systemd[1]: Stopping Rule-based Manager for Device Events and Files...649machine # [ 4.857382] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.650machine # [ 4.860154] systemd[1]: Stopped Virtual Console Setup.651machine # [ 4.860962] systemd[1]: initrd-cleanup.service: Deactivated successfully.652machine # [ 4.862689] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.653machine # [ 4.866267] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.654machine # [ 4.867412] systemd[1]: Finished Load Kernel Module 9pnet_virtio.655machine # [ 4.868419] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.656machine # [ 4.869462] systemd[1]: Finished rw-sysroot-nix-store.service.657machine # [ 4.870311] systemd[1]: systemd-udevd.service: Deactivated successfully.658machine # [ 4.871274] systemd[1]: Stopped Rule-based Manager for Device Events and Files.659machine # [ 4.876247] systemd[1]: systemd-udevd.service: Consumed 1.635s CPU time over 3.015s wall clock time, 22.7M memory peak.660machine # [ 4.880346] systemd[1]: Starting Cleanup udev Database...661machine # [ 4.881331] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.662machine # [ 4.884214] systemd[1]: Stopped Create Static Device Nodes in /dev.663machine # [ 4.885152] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.664machine # [ 4.888121] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.665machine # [ 4.889147] systemd[1]: kmod-static-nodes.service: Deactivated successfully.666machine # [ 4.892148] systemd[1]: Stopped Create List of Static Device Nodes.667machine # [ 4.922450] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.668machine # [ 4.925383] systemd[1]: Finished Cleanup udev Database.669machine # [ 4.926622] systemd[1]: Reached target Switch Root.670machine # [ 4.928139] systemd[1]: Starting NixOS Activation...671machine # [ 5.099285] initrd-nixos-activation-start[178]: booting system configuration /nix/store/fbck25a40cyk8dvqgm4bs9naa48j4y7x-nixos-system-machine-test672machine # [ 5.165533] initrd-nixos-activation-start[178]: running activation script...673machine # [ 5.592111] initrd-nixos-activation-start[201]: setting up /etc...674machine # [ 5.865207] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.675machine # [ 5.867936] systemd[1]: Finished NixOS Activation.676machine # [ 5.869263] systemd[1]: Starting Switch Root...677machine # [ 5.891828] systemd[1]: Switching root.678machine # [ 6.105725] systemd-journald[73]: Received SIGTERM from PID 1 (systemd).679machine # [ 6.301044] NET: Registered PF_VSOCK protocol family680machine # [ 6.698636] systemd[1]: systemd 262-9457f81 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)681machine # [ 6.710551] systemd[1]: Detected virtualization kvm.682machine # [ 6.714295] systemd[1]: Detected architecture arm64.683machine # [ 6.885926] systemd[1]: bpf-restrict-fs: LSM BPF program attached684machine # [ 7.744468] systemd[1]: initrd-switch-root.service: Deactivated successfully.685machine # [ 7.746873] systemd[1]: Stopped initrd-switch-root.service.686machine # [ 7.749258] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.687machine # [ 7.752729] systemd[1]: Created slice Slice /system/getty.688machine # [ 7.755328] systemd[1]: Created slice Slice /system/systemd-fsck.689machine # [ 7.757180] systemd[1]: Created slice User and Session Slice.690machine # [ 7.758503] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.691machine # [ 7.760353] systemd[1]: Started Forward Password Requests to Wall Directory Watch.692machine # [ 7.762863] systemd[1]: Expecting device /dev/disk/by-label/ESP...693machine # [ 7.763976] systemd[1]: Expecting device /dev/hvc0...694machine # [ 7.765458] systemd[1]: Expecting device /dev/ttyAMA0...695machine # [ 7.766959] systemd[1]: Reached target Local Encrypted Volumes.696machine # [ 7.768610] systemd[1]: Stopped target initrd-fs.target.697machine # [ 7.770860] systemd[1]: Stopped target initrd-root-fs.target.698machine # [ 7.771925] systemd[1]: Stopped target initrd-switch-root.target.699machine # [ 7.773564] systemd[1]: Reached target Virtual Machines and Containers.700machine # [ 7.775947] systemd[1]: Reached target Path Units.701machine # [ 7.776903] systemd[1]: Reached target Remote File Systems.702machine # [ 7.778354] systemd[1]: Reached target Slice Units.703machine # [ 7.779720] systemd[1]: Reached target Swaps.704machine # [ 7.783910] systemd[1]: Listening on Query the User Interactively for a Password.705machine # [ 7.788382] systemd[1]: Listening on Process Core Dump Socket.706machine # [ 7.792276] systemd[1]: Listening on Credential Encryption/Decryption.707machine # [ 7.795856] systemd[1]: Listening on Factory Reset Management.708machine # [ 7.797789] systemd[1]: Listening on Hostname Service Socket.709machine # [ 7.802832] systemd[1]: Starting Journal Log Access Socket...710machine # [ 7.804865] systemd[1]: Listening on Journal Audit Socket.711machine # [ 7.808556] systemd[1]: Listening on Console Output Muting Service Socket.712machine # [ 7.810122] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.713machine # [ 7.811738] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os714machine # [ 7.813664] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki715machine # [ 7.824894] systemd[1]: Listening on Disk Repartitioning Service Socket.716machine # [ 7.826256] systemd[1]: Listening on udev Varlink Socket.717machine # [ 7.830393] systemd[1]: Mounting Huge Pages File System...718machine # [ 7.834726] systemd[1]: Mounting POSIX Message Queue File System...719machine # [ 7.841963] systemd[1]: Mounting Kernel Debug File System...720machine # [ 7.850706] systemd[1]: Mounting Kernel Trace File System...721machine # [ 7.864497] systemd[1]: Starting Create List of Static Device Nodes...722machine # [ 7.874894] systemd[1]: Starting Load Kernel Module 9pnet_virtio...723machine # [ 7.876772] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs724machine # [ 7.888991] systemd[1]: Mounting Kernel Configuration File System...725machine # [ 7.890397] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm726machine # [ 7.894224] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore727machine # [ 7.896412] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse728machine # [ 7.913709] systemd[1]: Mounting FUSE Control File System...729machine # [ 7.916566] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67730machine # [ 7.951664] systemd[1]: Starting Journal Service...731machine # [ 7.994755] systemd[1]: Starting Load Kernel Modules...732machine # [ 8.032578] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...733machine # [ 8.053265] systemd-journald[273]: Collecting audit messages is enabled.734machine # [ 8.027734] systemd[1]: Queued start job for default target Multi-User System.[ 8.065542] systemd[1]: Starting Remount Root and Kernel File Systems...735machine # [ 8.065911] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os736machine # 737machine # [ 8.038997] systemd[1]: systemd-journald.service: Deactivated successfully.738machine # [ 8.079599] systemd[1]: Starting Coldplug All udev Devices...739machine # [ 8.089763] systemd[1]: Started Journal Service.740machine # [ 8.083185] systemd[1]: Listening on Journal Log Access Socket.741machine # [ 8.090850] systemd-modules-load[274]: Module 'atkbd' is built in742machine # [ 8.093448] systemd-modules-load[274]: Module 'loop' is built in743machine # [ 8.095524] systemd[1]: Mounted Huge Pages File System.744machine # [ 8.101281] systemd[1]: Mounted POSIX Message Queue File System.745machine # [ 8.107152] systemd[1]: Mounted Kernel Debug File System.746machine # [ 8.112789] systemd[1]: Mounted Kernel Trace File System.747machine # [ 8.113587] systemd[1]: Finished Create List of Static Device Nodes.748machine # [ 8.114451] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.749machine # [ 8.115431] systemd[1]: Finished Load Kernel Module 9pnet_virtio.750machine # [ 8.126883] systemd[1]: Mounted Kernel Configuration File System.751machine # [ 8.129474] systemd[1]: Mounted FUSE Control File System.752machine # [ 8.132340] systemd[1]: Finished Load Kernel Modules.753machine # [ 8.147502] systemd[1]: Starting Firewall...754machine # [ 8.151010] systemd[1]: Starting Apply Kernel Variables...755machine # [ 8.165133] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...756machine # [ 8.200321] EXT4-fs (vda): re-mounted 9f28dcd3-b612-49b7-ae80-a9f17ea16f1e.757machine # [ 8.189834] systemd[1]: Finished Remount Root and Kernel File Systems.758machine # [ 8.200859] systemd-oomd[276]: No swap; memory pressure usage will be degraded759machine # [ 8.206258] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.760machine # [ 8.210223] systemd[1]: Listening on Disk Image Download Service Socket.761machine # [ 8.228254] systemd[1]: Starting Flush Journal to Persistent Storage...762machine # [ 8.230770] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore763machine # [ 8.238036] systemd[1]: Starting Load/Save OS Random Seed...764machine # [ 8.244956] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os765machine # [ 8.349606] systemd-journald[273]: Received client request to flush runtime journal.766machine # [ 8.384418] systemd[1]: Finished Load/Save OS Random Seed.767machine # [ 8.388975] systemd[1]: First Boot Complete skipped, unmet condition check ConditionFirstBoot=yes768machine # [ 8.396313] systemd[1]: Finished Apply Kernel Variables.769machine # [ 8.397111] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.770machine # [ 8.401661] systemd[1]: Finished Flush Journal to Persistent Storage.771machine # [ 8.405217] systemd[1]: Starting Create Static Device Nodes in /dev...772machine # [ 8.518710] systemd[1]: Finished Create Static Device Nodes in /dev.773machine # [ 8.521097] systemd[1]: Reached target Preparation for Local File Systems.774machine # [ 8.527911] systemd[1]: Starting Rule-based Manager for Device Events and Files...775machine # [ 8.652353] systemd-udevd[315]: Using default interface naming scheme 'v261'.776machine # [ 8.720809] systemd[1]: Mounting /run/wrappers...777machine # [ 8.790191] systemd[1]: Mounted /run/wrappers.778machine # [ 8.802543] systemd[1]: Starting Create SUID/SGID Wrappers...779machine # [ 8.846465] systemd[1]: Started Rule-based Manager for Device Events and Files.780machine # [ 9.595724] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.781machine # [ 9.605697] systemd[1]: Finished Create SUID/SGID Wrappers.782machine # [ 9.895347] systemd[1]: Finished Coldplug All udev Devices.783machine # [ 9.951429] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs784machine # [ 9.972133] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse785machine # [ 9.978496] systemd[1]: Finished Firewall.786machine # [ 10.069566] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.787machine # [ 10.099752] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.788machine # [ 10.125682] (udev-worker)[343]: Network interface NamePolicy= disabled on kernel command line.789machine # [ 10.128853] (udev-worker)[344]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.790machine # [ 10.133071] (udev-worker)[344]: Network interface NamePolicy= disabled on kernel command line.791machine # [ 10.247221] systemd[1]: Condition check resulted in Virtio network device being skipped.792machine # [ 10.249578] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore793machine # [ 10.253858] systemd[1]: Starting Create SUID/SGID Wrappers...794machine # [ 10.256453] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67795machine # [ 10.265195] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore796machine # [ 10.266762] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os797machine # [ 10.267997] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os798machine # [ 10.342090] systemd[1]: Condition check resulted in /dev/disk/by-label/ESP being skipped.799machine # [ 10.350012] systemd[1]: Starting File System Check on /dev/disk/by-label/ESP...800machine # [ 10.465378] systemd-fsck[492]: fsck.fat 4.2 (2021-01-31)801machine # [ 10.468702] systemd-fsck[492]: /dev/vdb1: 27 files, 22602/66398 clusters802machine # [ 10.476452] systemd[1]: Finished File System Check on /dev/disk/by-label/ESP.803machine # [ 10.486343] systemd[1]: Mounting /boot...804machine # [ 10.587522] systemd[1]: Mounted /boot.805machine # [ 10.589615] systemd[1]: Reached target Local File Systems.806machine # [ 10.595372] systemd[1]: Listening on Boot Loader Control Service Socket.807machine # [ 10.601216] systemd[1]: Starting register-nix-paths.service...808machine # [ 10.617538] systemd[1]: Starting Update Boot Loader Random Seed...809machine # [ 10.623628] systemd[1]: Save Transient machine-id to Disk skipped, unmet condition check ConditionPathIsMountPoint=/etc/machine-id810machine # [ 10.632715] systemd[1]: Starting Create System Files and Directories...811machine # [ 10.722318] bootctl[516]: Mount point '/boot' which backs the random seed file is world accessible, which is a security hole! 812machine # [ 10.737251] bootctl[516]: Random seed file '/boot/loader/random-seed' is world accessible, which is a security hole!813machine # [ 10.741568] bootctl[516]: Random seed file /boot/loader/random-seed successfully refreshed (32 bytes).814machine # [ 10.752559] bootctl[516]: Successfully initialized system token in EFI variable with 32 bytes.815machine # [ 10.762971] systemd[1]: Finished Update Boot Loader Random Seed.816machine # [ 10.825587] systemd[1]: Finished Create System Files and Directories.817machine # [ 10.842401] systemd[1]: Starting Rebuild Journal Catalog...818machine # [ 10.848780] systemd[1]: Starting Record System Boot/Shutdown in UTMP...819machine # [ 10.930431] mousedev: PS/2 mouse device common for all mice820machine # [ 10.957855] systemd[1]: Finished Record System Boot/Shutdown in UTMP.821machine # [ 11.010936] systemd[1]: Finished Rebuild Journal Catalog.822machine # [ 11.020645] systemd[1]: Starting Update is Completed...823machine # [ 11.023949] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.824machine # [ 11.028464] systemd[1]: Finished Create SUID/SGID Wrappers.825machine # [ 11.082045] systemd[1]: Finished Update is Completed.826machine # [ 11.707398] systemd[1]: Finished register-nix-paths.service.827machine # [ 11.709839] systemd[1]: Reached target System Initialization.828machine # [ 11.712500] systemd[1]: Started Discard unused filesystem blocks once a week.829machine # [ 11.714593] systemd[1]: Started Daily Cleanup of Temporary Directories.830machine # [ 11.716561] systemd[1]: Reached target Timer Units.831machine # [ 11.718760] systemd[1]: Listening on D-Bus System Message Bus Socket.832machine # [ 11.721366] systemd[1]: Listening on Nix Daemon Socket.833machine # [ 11.724282] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.834machine # [ 11.731144] systemd[1]: Reached target Socket Units.835machine # [ 11.732393] systemd[1]: Reached target Basic System.836machine # [ 11.734308] systemd[1]: Started backdoor.service.837machine # [ 11.736209] systemd[1]: Starting install-boot-loader.service...838machine # [ 11.745465] systemd[1]: Starting Import lastlog data into lastlog2 database...839machine # [ 11.752525] systemd[1]: Starting Name Service Cache Daemon (nsncd)...840machine # [ 11.765698] systemd[1]: Starting Post-Boot Actions...841machine # [ 11.800198] systemd[1]: Started Reset console on configuration changes.842machine # [ 11.832271] systemd[1]: Starting resolvconf update...843machine # connecting to host...844machine # [ 11.869942] bootctl[576]: Created directory "/boot/EFI".845machine # [ 11.876371] bootctl[576]: Created directory "/boot/EFI/systemd".846machine # [ 11.884938] bootctl[576]: Created directory "/boot/EFI/BOOT".847machine # [ 11.885781] bootctl[576]: Created directory "/boot/loader".848machine # [ 11.886651] bootctl[576]: Created directory "/boot/loader/keys".849machine # [ 11.887542] bootctl[576]: Created directory "/boot/loader".850machine # [ 11.909840] bootctl[576]: Created directory "/boot/loader/entries".851machine # [ 11.910740] bootctl[576]: Created directory "/boot/EFI".852machine # [ 11.911443] bootctl[576]: Created directory "/boot/EFI/Linux".853machine # [ 11.926696] bootctl[576]: Copied "/nix/store/x4i8f5p0japrw9j9zrdx7z9lf5387qn3-systemd-262-9457f81/lib/systemd/boot/efi/systemd-bootaa64.efi" to "/boot/EFI/systemd/systemd-bootaa64.efi".854machine: Guest shell says: b'Spawning backdoor root shell...\n'855machine # [ 11.944319] bootctl[576]: Copied "/nix/store/x4i8f5p0japrw9j9zrdx7z9lf5387qn3-systemd-262-9457f81/lib/systemd/boot/efi/systemd-bootaa64.efi" to "/boot/EFI/BOOT/BOOTAA64.EFI".856machine # [ 11.964288] bootctl[576]: Mount point '/boot' which backs the random seed file is world accessible, which is a security hole! 857machine # [ 11.965927] bootctl[576]: Random seed file '/boot/loader/random-seed' is world accessible, which is a security hole!858machine: connected to guest root shell859machine # [ 11.981566] bootctl[576]: Random seed file /boot/loader/random-seed successfully refreshed (32 bytes).860machine: (connecting took 23.78 seconds)861machine: (finished: waiting for the VM to finish booting, in 24.10 seconds)862machine # [ 11.992873] systemd[1]: Starting D-Bus System Message Bus...863machine # [ 11.993695] systemd[1]: Finished Post-Boot Actions.864machine # [ 12.006544] nsncd[565]: Sep 07 13:34:56.852 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"865machine # [ 12.032437] bootctl[576]: Created EFI boot entry "Linux Boot Manager".866machine # [ 12.033398] systemd[1]: Started Name Service Cache Daemon (nsncd).867machine # [ 12.046665] systemd[1]: Reached target Host and Network Name Lookups.868machine # [ 12.061201] systemd[1]: Reached target User and Group Name Lookups.869machine # [ 12.062073] systemd[1]: Starting User Login Management...870machine: (finished: must succeed: test -e /boot/loader/entries/edk2-uefi-shell.conf, in 24.20 seconds)871machine: must succeed: test -e /boot/efi/edk2-uefi-shell/shell.efi872machine # [ 12.081689] systemd[1]: Finished Import lastlog data into lastlog2 database.873machine # [ 12.118734] bootctl[576]: Created EFI boot entry "Fallback Linux Boot Manager".874machine: (finished: must succeed: test -e /boot/efi/edk2-uefi-shell/shell.efi, in 0.09 seconds)875(finished: run the VM test script, in 24.29 seconds)876machine # [ 12.210233] systemd[1]: Finished install-boot-loader.service.877machine # [ 12.262429] dbus-broker-launch[587]: Looking up NSS user entry for 'systemd-timesync'...878machine # [ 12.273862] dbus-broker-launch[587]: NSS returned no entry for 'systemd-timesync'879machine # [ 12.278213] dbus-broker-launch[587]: Invalid user-name in /nix/store/7m946q9rkgad779cqy94cakqf9qfhh1p-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"880test script finished in 24.41s881cleanup882kill QemuMachine (pid 45)883machine # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/lfh101cfjj8p8npcari9hk0lbqi33yvh-python3-3.14.7/bin/python3.14)884(finished: cleanup, in 0.14 seconds)885additionally exposed symbols:886 machine,887 vlan1,888 start_all, test_script, machines, machines_qemu, machines_nspawn, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, BaseMachine, QemuMachine, NspawnMachine, t, debug, dump_machine_ssh