nixbot

builds

succeeded vm-test-run-wifi aarch64-linux.wifi · build #93 · raw

1Machine state will be reset. To keep it, pass --keep-machine-state2start all VLans3(finished: start all VLans, in 0.00 seconds)4Test will time out and terminate in 3600 seconds5run the VM test script6additionally exposed symbols:7 second, test,8 vlan1,9 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_ssh10start all VMs11second: starting vm12test: starting vm13second: QEMU running (pid 48)14second # Disk image does not exist, creating the virtualisation disk image...15test: QEMU running (pid 47)16second # Formatting '/build/vm-state-second/tmp.WzWGKRzLKn', fmt=raw size=107374182417test # Disk image does not exist, creating the virtualisation disk image...18second # mke2fs 1.47.4 (6-Mar-2025)19(finished: start all VMs, in 0.44 seconds)20second # Discarding device blocks: 0/262144 done21test: waiting for unit NetworkManager.service22second # Creating filesystem with 262144 4k blocks and 65536 inodes23test: waiting for the VM to finish booting24test # Formatting '/build/vm-state-test/tmp.mG8DzQt54I', fmt=raw size=107374182425second # Filesystem UUID: 53107085-f639-48f6-a272-2fe7ea214f7c26test # mke2fs 1.47.4 (6-Mar-2025)27second # Superblock backups stored on blocks:28test # Discarding device blocks: 0/262144 done29second # 32768, 98304, 163840, 22937630test # Creating filesystem with 262144 4k blocks and 65536 inodes31second # 32test # Filesystem UUID: 364e614a-97ec-489e-a7c4-800ffbe0fdba33second # Allocating group tables: 0/8 done34test # Superblock backups stored on blocks:35second # Writing inode tables: 0/8 done36test # 32768, 98304, 163840, 22937637second # Creating journal (8192 blocks): done38test # 39second # Writing superblocks and filesystem accounting information: 0/8 done40test # Allocating group tables: 0/8 done41second # 42test # Writing inode tables: 0/8 done43second # Virtualisation disk image created.44test # Creating journal (8192 blocks): done45test # Writing superblocks and filesystem accounting information: 0/8 done46test # 47test # Virtualisation disk image created.48second # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1]49second # [ 0.000000] Linux version 6.18.39 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Sat Jul 18 14:53:38 UTC 202650second # [ 0.000000] KASLR enabled51second # [ 0.000000] random: crng init done52second # [ 0.000000] Machine model: linux,dummy-virt53second # [ 0.000000] efi: UEFI not found.54second # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT55second # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]56second # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc07740-0x7fc0aebf]57second # [ 0.000000] Zone ranges:58second # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]59second # [ 0.000000] DMA32 empty60second # [ 0.000000] Normal empty61second # [ 0.000000] Device empty62second # [ 0.000000] Movable zone start for each node63second # [ 0.000000] Early memory node ranges64second # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]65second # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]66second # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca0000067second # [ 0.000000] psci: probing for conduit method from DT.68second # [ 0.000000] psci: PSCIv1.3 detected in firmware.69second # [ 0.000000] psci: Using standard PSCI v0.2 function IDs70second # [ 0.000000] psci: Trusted OS migration not required71second # [ 0.000000] psci: SMC Calling Convention v1.172second # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)73second # [ 0.000000] percpu: Embedded 76 pages/cpu s186392 r8192 d116712 u31129674second # [ 0.000000] Detected PIPT I-cache on CPU075second # [ 0.000000] CPU features: detected: GICv3 CPU interface76second # [ 0.000000] CPU features: detected: Spectre-v477second # [ 0.000000] CPU features: detected: Spectre-BHB78second # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR79second # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)80second # [ 0.000000] CPU features: detected: ARM erratum 141804081second # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion82second # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing83second # [ 0.000000] alternatives: applying boot alternatives84second # [ 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/clnc0c6f4rw1gbxkcp6fy228f5zj64lx-nixos-system-second-test/init regInfo=/nix/store/8fzxrsswi4rf0rafrhi8wvmrp0zi5r28-closure-info/registration console=ttyAMA0,115200n8 console=tty085second # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/8fzxrsswi4rf0rafrhi8wvmrp0zi5r28-closure-info/registration", will be passed to user space.86second # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes87second # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)88second # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)89second # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB90second # [ 0.000000] software IO TLB: area num 1.91second # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)92second # [ 0.000000] Fallback order for Node 0: 093second # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 26214494second # [ 0.000000] Policy zone: DMA95second # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off96second # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=197second # [ 0.000000] allocated 2097152 bytes of page_ext98second # [ 0.000000] ftrace: allocating 74716 entries in 292 pages99second # [ 0.000000] ftrace: allocated 292 pages with 3 groups100second # [ 0.000000] rcu: Hierarchical RCU implementation.101second # [ 0.000000] rcu: RCU event tracing is enabled.102second # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.103second # [ 0.000000] Trampoline variant of Tasks RCU enabled.104second # [ 0.000000] Rude variant of Tasks RCU enabled.105second # [ 0.000000] Tracing variant of Tasks RCU enabled.106second # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.107test # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1]108second # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1109second # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.110second # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.111second # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.112second # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0113second # [ 0.000000] GICv3: 256 SPIs implemented114second # [ 0.000000] GICv3: 0 Extended SPIs implemented115second # [ 0.000000] Root IRQ handler: gic_handle_irq116second # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI117second # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0118second # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000119second # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]120second # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44ce0000 (indirect, esz 8, psz 64K, shr 1)121test # [ 0.000000] Linux version 6.18.39 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Sat Jul 18 14:53:38 UTC 2026122test # [ 0.000000] KASLR enabled123test # [ 0.000000] random: crng init done124test # [ 0.000000] Machine model: linux,dummy-virt125test # [ 0.000000] efi: UEFI not found.126test # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT127test # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]128test # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc07740-0x7fc0aebf]129test # [ 0.000000] Zone ranges:130test # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]131test # [ 0.000000] DMA32 empty132test # [ 0.000000] Normal empty133test # [ 0.000000] Device empty134test # [ 0.000000] Movable zone start for each node135test # [ 0.000000] Early memory node ranges136test # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]137test # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]138test # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca00000139second # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44cf0000 (flat, esz 8, psz 64K, shr 1)140test # [ 0.000000] psci: probing for conduit method from DT.141second # [ 0.000000] GICv3: using LPI property table @0x0000000044d00000142second # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d10000143second # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.144test # [ 0.000000] psci: PSCIv1.3 detected in firmware.145test # [ 0.000000] psci: Using standard PSCI v0.2 function IDs146test # [ 0.000000] psci: Trusted OS migration not required147test # [ 0.000000] psci: SMC Calling Convention v1.1148second # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns149test # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)150second # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040151test # [ 0.000000] percpu: Embedded 76 pages/cpu s186392 r8192 d116712 u311296152test # [ 0.000000] Detected PIPT I-cache on CPU0153second # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).154test # [ 0.000000] CPU features: detected: GICv3 CPU interface155test # [ 0.000000] CPU features: detected: Spectre-v4156second # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns157test # [ 0.000000] CPU features: detected: Spectre-BHB158second # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns159test # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR160second # [ 0.000054] arm-pv: using stolen time PV161test # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)162test # [ 0.000000] CPU features: detected: ARM erratum 1418040163test # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion164test # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing165test # [ 0.000000] alternatives: applying boot alternatives166second # [ 0.000370] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)167second # [ 0.000651] Console: colour dummy device 80x25168second # [ 0.000669] printk: legacy console [tty0] enabled169second # [ 0.000883] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)170second # [ 0.000889] pid_max: default: 32768 minimum: 301171second # [ 0.000969] LSM: initializing lsm=capability,landlock,yama,bpf,ima172second # [ 0.001092] landlock: Up and running.173second # [ 0.001094] Yama: becoming mindful.174second # [ 0.001477] LSM support for eBPF active175test # [ 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/1sjcbiq44q1hb8m92s40nq890rasbs20-nixos-system-test-test/init regInfo=/nix/store/n67gv775sxnzdmpvss4xh8p4chnf2fpq-closure-info/registration console=ttyAMA0,115200n8 console=tty0176second # [ 0.001638] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)177second # [ 0.001661] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)178test # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/n67gv775sxnzdmpvss4xh8p4chnf2fpq-closure-info/registration", will be passed to user space.179test # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes180test # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)181test # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)182second # [ 0.003380] cacheinfo: Unable to detect cache hierarchy for CPU 0183second # [ 0.004292] rcu: Hierarchical SRCU implementation.184second # [ 0.004297] rcu: Max phase no-delay instances is 1000.185second # [ 0.005252] fsl-mc MSI: its@8080000 domain created186second # [ 0.005405] EFI services will not be available.187second # [ 0.005500] smp: Bringing up secondary CPUs ...188second # [ 0.005537] smp: Brought up 1 node, 1 CPU189test # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB190second # [ 0.005541] SMP: Total of 1 processors activated.191test # [ 0.000000] software IO TLB: area num 1.192second # [ 0.005543] CPU: All CPU(s) started at EL1193second # [ 0.005555] CPU features: detected: 32-bit EL0 Support194test # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)195test # [ 0.000000] Fallback order for Node 0: 0196second # [ 0.005560] CPU features: detected: Data cache clean to the PoU not required for I/D coherence197test # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144198second # [ 0.005563] CPU features: detected: Common not Private translations199test # [ 0.000000] Policy zone: DMA200second # [ 0.005565] CPU features: detected: CRC32 instructions201test # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off202second # [ 0.005567] CPU features: detected: Data cache clean to Point of Persistence203test # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1204test # [ 0.000000] allocated 2097152 bytes of page_ext205second # [ 0.005569] CPU features: detected: Enhanced Virtualization Traps206test # [ 0.000000] ftrace: allocating 74716 entries in 292 pages207second # [ 0.005579] CPU features: detected: RCpc load-acquire (LDAPR)208test # [ 0.000000] ftrace: allocated 292 pages with 3 groups209second # [ 0.005581] CPU features: detected: LSE atomic instructions210test # [ 0.000000] rcu: Hierarchical RCU implementation.211second # [ 0.005583] CPU features: detected: Privileged Access Never212test # [ 0.000000] rcu: RCU event tracing is enabled.213second # [ 0.005585] CPU features: detected: PMUv3214test # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.215second # [ 0.005587] CPU features: detected: RAS Extension Support216test # [ 0.000000] Trampoline variant of Tasks RCU enabled.217test # [ 0.000000] Rude variant of Tasks RCU enabled.218test # [ 0.000000] Tracing variant of Tasks RCU enabled.219test # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.220test # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1221second # [ 0.005590] CPU features: detected: Speculative Store Bypassing Safe (SSBS)222second # [ 0.005612] alternatives: applying system-wide alternatives223second # [ 0.006981] CPU features: detected: Hardware dirty bit management on CPU0224second # [ 0.007151] Memory: 891548K/1048576K available (24384K kernel code, 7086K rwdata, 26308K rodata, 4736K init, 1102K bss, 115744K reserved, 32768K cma-reserved)225test # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.226test # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.227test # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.228second # [ 0.007643] devtmpfs: initialized229second # [ 0.009125] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)230second # [ 0.009148] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).231second # [ 0.009279] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL232test # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0233second # [ 0.009283] 0 pages in range for non-PLT usage234second # [ 0.009283] 508320 pages in range for PLT usage235second # [ 0.009406] pinctrl core: initialized pinctrl subsystem236second # [ 0.010180] DMI not present or invalid.237second # [ 0.013737] NET: Registered PF_NETLINK/PF_ROUTE protocol family238test # [ 0.000000] GICv3: 256 SPIs implemented239test # [ 0.000000] GICv3: 0 Extended SPIs implemented240test # [ 0.000000] Root IRQ handler: gic_handle_irq241test # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI242test # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0243test # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000244second # [ 0.016199] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations245test # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]246second # [ 0.016339] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations247test # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cd0000 (indirect, esz 8, psz 64K, shr 1)248second # [ 0.016489] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations249second # [ 0.016515] audit: initializing netlink subsys (disabled)250test # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44ce0000 (flat, esz 8, psz 64K, shr 1)251second # [ 0.017120] thermal_sys: Registered thermal governor 'fair_share'252test # [ 0.000000] GICv3: using LPI property table @0x0000000044cf0000253second # [ 0.017122] thermal_sys: Registered thermal governor 'bang_bang'254test # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d10000255second # [ 0.017125] thermal_sys: Registered thermal governor 'step_wise'256test # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.257second # [ 0.017127] thermal_sys: Registered thermal governor 'user_space'258second # [ 0.017129] thermal_sys: Registered thermal governor 'power_allocator'259test # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns260test # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040261second # [ 0.017169] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1262test # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).263second # [ 0.017185] cpuidle: using governor ladder264test # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns265second # [ 0.017191] cpuidle: using governor menu266test # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns267second # [ 0.017302] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.268test # [ 0.000050] arm-pv: using stolen time PV269second # [ 0.017322] ASID allocator initialised with 32768 entries270second # [ 0.018008] Serial: AMBA PL011 UART driver271test # [ 0.000367] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)272test # [ 0.000628] Console: colour dummy device 80x25273second # [ 0.021212] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1274test # [ 0.000645] printk: legacy console [tty0] enabled275second # [ 0.021355] printk: console [ttyAMA0] enabled276test # [ 0.000851] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)277test # [ 0.000856] pid_max: default: 32768 minimum: 301278test # [ 0.000937] LSM: initializing lsm=capability,landlock,yama,bpf,ima279test # [ 0.001099] landlock: Up and running.280test # [ 0.001101] Yama: becoming mindful.281test # [ 0.001464] LSM support for eBPF active282test # [ 0.001583] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)283test # [ 0.001603] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)284test # [ 0.003271] cacheinfo: Unable to detect cache hierarchy for CPU 0285test # [ 0.004111] rcu: Hierarchical SRCU implementation.286test # [ 0.004116] rcu: Max phase no-delay instances is 1000.287test # [ 0.005067] fsl-mc MSI: its@8080000 domain created288test # [ 0.005221] EFI services will not be available.289test # [ 0.005357] smp: Bringing up secondary CPUs ...290test # [ 0.005391] smp: Brought up 1 node, 1 CPU291second # [ 0.088666] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages292test # [ 0.005395] SMP: Total of 1 processors activated.293second # [ 0.088690] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page294test # [ 0.005397] CPU: All CPU(s) started at EL1295test # [ 0.005408] CPU features: detected: 32-bit EL0 Support296second # [ 0.088694] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages297second # [ 0.088700] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page298test # [ 0.005411] CPU features: detected: Data cache clean to the PoU not required for I/D coherence299second # [ 0.088703] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages300test # [ 0.005413] CPU features: detected: Common not Private translations301test # [ 0.005416] CPU features: detected: CRC32 instructions302second # [ 0.088706] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page303test # [ 0.005418] CPU features: detected: Data cache clean to Point of Persistence304second # [ 0.088710] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages305test # [ 0.005420] CPU features: detected: Enhanced Virtualization Traps306second # [ 0.088713] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page307test # [ 0.005430] CPU features: detected: RCpc load-acquire (LDAPR)308test # [ 0.005432] CPU features: detected: LSE atomic instructions309test # [ 0.005434] CPU features: detected: Privileged Access Never310test # [ 0.005436] CPU features: detected: PMUv3311test # [ 0.005438] CPU features: detected: RAS Extension Support312second # [ 0.093630] fbcon: Taking over console313second # [ 0.093656] ACPI: Interpreter disabled.314test # [ 0.005442] CPU features: detected: Speculative Store Bypassing Safe (SSBS)315test # [ 0.005462] alternatives: applying system-wide alternatives316test # [ 0.006828] CPU features: detected: Hardware dirty bit management on CPU0317test # [ 0.006980] Memory: 891592K/1048576K available (24384K kernel code, 7086K rwdata, 26308K rodata, 4736K init, 1102K bss, 115748K reserved, 32768K cma-reserved)318test # [ 0.007423] devtmpfs: initialized319test # [ 0.008932] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)320test # [ 0.008956] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).321test # [ 0.009076] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL322test # [ 0.009079] 0 pages in range for non-PLT usage323test # [ 0.009080] 508320 pages in range for PLT usage324test # [ 0.009212] pinctrl core: initialized pinctrl subsystem325test # [ 0.009978] DMI not present or invalid.326test # [ 0.013467] NET: Registered PF_NETLINK/PF_ROUTE protocol family327test # [ 0.015719] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations328second # [ 0.100733] iommu: Default domain type: Translated329test # [ 0.015853] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations330second # [ 0.100744] iommu: DMA domain TLB invalidation policy: strict mode331second # [ 0.101037] SCSI subsystem initialized332test # [ 0.016005] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations333test # [ 0.016030] audit: initializing netlink subsys (disabled)334second # [ 0.102370] usbcore: registered new interface driver usbfs335test # [ 0.016623] thermal_sys: Registered thermal governor 'fair_share'336second # [ 0.102405] usbcore: registered new interface driver hub337test # [ 0.016625] thermal_sys: Registered thermal governor 'bang_bang'338test # [ 0.016628] thermal_sys: Registered thermal governor 'step_wise'339second # [ 0.102415] usbcore: registered new device driver usb340second # [ 0.102619] pps_core: LinuxPPS API ver. 1 registered341test # [ 0.016630] thermal_sys: Registered thermal governor 'user_space'342second # [ 0.102626] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>343test # [ 0.016632] thermal_sys: Registered thermal governor 'power_allocator'344second # [ 0.102631] PTP clock support registered345second # [ 0.102667] EDAC MC: Ver: 3.0.0346test # [ 0.016665] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1347test # [ 0.016679] cpuidle: using governor ladder348test # [ 0.016684] cpuidle: using governor menu349second # [ 0.105532] scmi_core: SCMI protocol bus registered350test # [ 0.016792] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.351test # [ 0.016812] ASID allocator initialised with 32768 entries352second # [ 0.106237] FPGA manager framework353test # [ 0.017469] Serial: AMBA PL011 UART driver354second # [ 0.107214] vgaarb: loaded355test # [ 0.020716] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1356test # [ 0.020881] printk: console [ttyAMA0] enabled357second # [ 0.107632] clocksource: Switched to clocksource arch_sys_counter358second # [ 0.108098] VFS: Disk quotas dquot_6.6.0359second # [ 0.108128] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)360second # [ 0.109805] netfs: FS-Cache loaded361second # [ 0.109915] pnp: PnP ACPI: disabled362test # [ 0.088874] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages363test # [ 0.088895] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page364test # [ 0.088900] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages365test # [ 0.088906] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page366test # [ 0.088909] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages367test # [ 0.088912] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page368test # [ 0.088915] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages369test # [ 0.088918] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page370test # [ 0.093555] fbcon: Taking over console371test # [ 0.093584] ACPI: Interpreter disabled.372test # [ 0.094795] iommu: Default domain type: Translated373test # [ 0.094805] iommu: DMA domain TLB invalidation policy: strict mode374second # [ 0.117543] NET: Registered PF_INET protocol family375second # [ 0.117757] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)376test # [ 0.100901] SCSI subsystem initialized377test # [ 0.101476] usbcore: registered new interface driver usbfs378test # [ 0.101509] usbcore: registered new interface driver hub379test # [ 0.101519] usbcore: registered new device driver usb380test # [ 0.101730] pps_core: LinuxPPS API ver. 1 registered381test # [ 0.101736] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>382test # [ 0.101742] PTP clock support registered383test # [ 0.101782] EDAC MC: Ver: 3.0.0384test # [ 0.104559] scmi_core: SCMI protocol bus registered385test # [ 0.105256] FPGA manager framework386test # [ 0.106215] vgaarb: loaded387test # [ 0.106614] clocksource: Switched to clocksource arch_sys_counter388test # [ 0.107022] VFS: Disk quotas dquot_6.6.0389test # [ 0.107049] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)390test # [ 0.108862] netfs: FS-Cache loaded391test # [ 0.108968] pnp: PnP ACPI: disabled392test # [ 0.116398] NET: Registered PF_INET protocol family393second # [ 0.146236] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)394test # [ 0.116600] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)395second # [ 0.146267] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)396second # [ 0.146282] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)397second # [ 0.146325] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)398second # [ 0.146393] TCP: Hash tables configured (established 8192 bind 8192)399second # [ 0.146520] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)400second # [ 0.146576] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)401second # [ 0.146626] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)402second # [ 0.146736] NET: Registered PF_UNIX/PF_LOCAL protocol family403second # [ 0.146773] NET: Registered PF_XDP protocol family404second # [ 0.146796] PCI: CLS 0 bytes, default 64405second # [ 0.152471] Trying to unpack rootfs image as initramfs...406second # [ 0.156220] kvm [1]: HYP mode not available407test # [ 0.145374] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)408test # [ 0.145406] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)409test # [ 0.145420] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)410test # [ 0.145461] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)411test # [ 0.145529] TCP: Hash tables configured (established 8192 bind 8192)412test # [ 0.145619] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)413test # [ 0.145678] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)414test # [ 0.145728] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)415test # [ 0.145869] NET: Registered PF_UNIX/PF_LOCAL protocol family416test # [ 0.145906] NET: Registered PF_XDP protocol family417test # [ 0.145930] PCI: CLS 0 bytes, default 64418test # [ 0.146138] Trying to unpack rootfs image as initramfs...419test # [ 0.160053] kvm [1]: HYP mode not available420second # [ 0.222406] Initialise system trusted keyrings421second # [ 0.227691] workingset: timestamp_bits=42 max_order=18 bucket_order=0422second # [ 0.228718] squashfs: version 4.0 (2009/01/31) Phillip Lougher423second # [ 0.229193] 9p: Installing v9fs 9p2000 file system support424second # [ 0.248527] Key type asymmetric registered425second # [ 0.248552] Asymmetric key parser 'x509' registered426second # [ 0.248615] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)427test # [ 0.226289] Initialise system trusted keyrings428test # [ 0.226832] workingset: timestamp_bits=42 max_order=18 bucket_order=0429test # [ 0.227731] squashfs: version 4.0 (2009/01/31) Phillip Lougher430test # [ 0.228195] 9p: Installing v9fs 9p2000 file system support431second # [ 0.255690] io scheduler mq-deadline registered432second # [ 0.255708] io scheduler kyber registered433second # [ 0.258534] pl061_gpio 9030000.pl061: PL061 GPIO chip registered434second # [ 0.259296] ledtrig-cpu: registered to indicate activity on CPUs435second # [ 0.259608] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:436second # [ 0.260600] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000437second # [ 0.260640] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000438second # [ 0.260647] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000439second # [ 0.260677] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits440second # [ 0.260700] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]441second # [ 0.260772] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00442second # [ 0.260789] pci_bus 0000:00: root bus resource [bus 00-ff]443second # [ 0.260794] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]444second # [ 0.260798] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]445second # [ 0.260802] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]446second # [ 0.260899] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint447second # [ 0.261330] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint448second # [ 0.261452] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]449second # [ 0.261464] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]450second # [ 0.261485] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]451second # [ 0.261495] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]452second # [ 0.261789] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint453second # [ 0.261910] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]454second # [ 0.261920] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]455second # [ 0.261940] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]456second # [ 0.262236] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint457second # [ 0.262355] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f]458second # [ 0.262366] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]459second # [ 0.262386] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]460test # [ 0.251067] Key type asymmetric registered461second # [ 0.262676] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint462test # [ 0.251093] Asymmetric key parser 'x509' registered463second # [ 0.262793] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]464test # [ 0.251150] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)465second # [ 0.262804] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]466test # [ 0.252398] io scheduler mq-deadline registered467second # [ 0.262823] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]468test # [ 0.252407] io scheduler kyber registered469second # [ 0.263115] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint470second # [ 0.263232] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f]471second # [ 0.263242] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]472second # [ 0.263262] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]473second # [ 0.263547] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint474test # [ 0.258743] pl061_gpio 9030000.pl061: PL061 GPIO chip registered475test # [ 0.259528] ledtrig-cpu: registered to indicate activity on CPUs476test # [ 0.259845] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:477test # [ 0.259867] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000478test # [ 0.259888] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000479test # [ 0.259894] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000480test # [ 0.259921] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits481test # [ 0.259943] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]482test # [ 0.260023] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00483test # [ 0.260041] pci_bus 0000:00: root bus resource [bus 00-ff]484test # [ 0.260046] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]485second # [ 0.287715] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f]486second # [ 0.287737] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]487second # [ 0.287758] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]488second # [ 0.288119] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint489test # [ 0.260050] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]490test # [ 0.260054] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]491test # [ 0.260122] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint492second # [ 0.288246] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f]493test # [ 0.260542] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint494second # [ 0.288257] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff]495test # [ 0.260662] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]496test # [ 0.260673] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]497test # [ 0.260692] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]498test # [ 0.260703] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]499test # [ 0.260997] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint500second # [ 0.288277] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]501test # [ 0.261114] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]502second # [ 0.288291] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref]503test # [ 0.261124] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]504second # [ 0.288630] pci 0000:00:08.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint505test # [ 0.261144] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]506second # [ 0.288755] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]507test # [ 0.261420] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint508second # [ 0.288775] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]509test # [ 0.261535] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f]510second # [ 0.289076] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint511test # [ 0.261547] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]512second # [ 0.289200] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]513test # [ 0.261566] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]514second # [ 0.289220] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]515test # [ 0.261855] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint516test # [ 0.261971] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]517second # [ 0.289474] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint518test # [ 0.261982] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]519second # [ 0.289593] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff]520test # [ 0.262001] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]521second # [ 0.289769] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint522test # [ 0.262281] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint523second # [ 0.290075] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]524test # [ 0.262396] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f]525second # [ 0.290088] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]526test # [ 0.262406] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]527second # [ 0.290108] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]528test # [ 0.262426] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]529second # [ 0.290409] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint530second # [ 0.290531] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]531second # [ 0.290542] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]532second # [ 0.290562] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]533second # [ 0.290980] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned534second # [ 0.290992] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned535second # [ 0.290997] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned536second # [ 0.291031] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned537second # [ 0.291063] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned538second # [ 0.291093] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned539second # [ 0.291125] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned540second # [ 0.291155] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned541second # [ 0.291186] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned542second # [ 0.291217] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned543second # [ 0.291247] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned544second # [ 0.291278] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned545test # [ 0.282792] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint546test # [ 0.282927] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f]547second # [ 0.291363] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned548test # [ 0.282938] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]549second # [ 0.291396] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned550test # [ 0.282959] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]551second # [ 0.291411] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned552test # [ 0.283267] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint553second # [ 0.291425] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned554test # [ 0.283400] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f]555second # [ 0.291439] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned556test # [ 0.283412] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff]557second # [ 0.291453] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned558test # [ 0.283432] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]559second # [ 0.291467] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned560test # [ 0.283446] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref]561second # [ 0.291481] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned562test # [ 0.283786] pci 0000:00:08.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint563second # [ 0.291495] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned564test # [ 0.283911] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]565test # [ 0.283930] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]566second # [ 0.291509] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned567second # [ 0.291523] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned568test # [ 0.284226] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint569second # [ 0.291537] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned570test # [ 0.284349] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]571second # [ 0.291551] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned572test # [ 0.284368] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]573second # [ 0.291565] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned574test # [ 0.284617] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint575second # [ 0.291579] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned576test # [ 0.284732] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff]577second # [ 0.291593] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned578test # [ 0.284892] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint579second # [ 0.291607] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned580test # [ 0.285101] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]581second # [ 0.291620] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned582test # [ 0.285115] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]583second # [ 0.291650] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned584test # [ 0.285134] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]585second # [ 0.291664] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned586test # [ 0.285429] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint587second # [ 0.291677] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned588test # [ 0.285550] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]589second # [ 0.291691] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned590test # [ 0.285560] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]591second # [ 0.291711] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]592test # [ 0.285579] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]593second # [ 0.291717] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]594test # [ 0.285988] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned595second # [ 0.291721] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]596test # [ 0.286000] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned597second # [ 0.292441] pci 0000:00:0a.0: enabling device (0000 -> 0002)598test # [ 0.286005] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned599test # [ 0.286037] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned600test # [ 0.286069] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned601test # [ 0.286100] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned602test # [ 0.286131] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned603test # [ 0.286161] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned604test # [ 0.286191] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned605test # [ 0.286223] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned606test # [ 0.286254] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned607test # [ 0.286284] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned608test # [ 0.286353] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned609test # [ 0.286385] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned610test # [ 0.286399] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned611test # [ 0.286413] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned612test # [ 0.286427] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned613second # [ 0.328816] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)614test # [ 0.286441] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned615second # [ 0.330695] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)616test # [ 0.286455] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned617test # [ 0.286469] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned618test # [ 0.286483] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned619test # [ 0.286498] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned620test # [ 0.286511] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned621test # [ 0.286526] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned622test # [ 0.286540] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned623test # [ 0.286553] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned624test # [ 0.286567] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned625test # [ 0.286581] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned626test # [ 0.286595] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned627test # [ 0.286608] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned628second # [ 0.341101] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)629second # [ 0.342837] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)630test # [ 0.318687] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned631test # [ 0.318704] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned632test # [ 0.318718] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned633test # [ 0.318733] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned634test # [ 0.318759] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]635test # [ 0.318766] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]636test # [ 0.318770] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]637test # [ 0.319496] pci 0000:00:0a.0: enabling device (0000 -> 0002)638test # [ 0.329146] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)639second # [ 0.357038] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)640second # [ 0.358765] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003)641second # [ 0.361486] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003)642second # [ 0.363436] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)643test # [ 0.339133] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)644test # [ 0.341067] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)645second # [ 0.373039] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)646second # [ 0.374822] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)647second # [ 0.377729] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)648test # [ 0.351123] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)649test # [ 0.354266] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)650test # [ 0.356001] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003)651test # [ 0.357833] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003)652second # [ 0.385237] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled653second # [ 0.386696] msm_serial: driver initialized654second # [ 0.386781] SuperH (H)SCI(F) driver initialized655second # [ 0.386816] STM32 USART driver initialized656test # [ 0.367843] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)657test # [ 0.369666] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)658test # [ 0.379306] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)659test # [ 0.382129] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)660second # [ 0.409935] loop: module loaded661second # [ 0.410085] virtio_blk virtio5: 1/0/0 default/read/poll queues662second # [ 0.410650] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)663test # [ 0.391338] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled664test # [ 0.392857] msm_serial: driver initialized665test # [ 0.392945] SuperH (H)SCI(F) driver initialized666test # [ 0.392981] STM32 USART driver initialized667second # [ 0.416069] megasas: 07.734.00.00-rc1668second # [ 0.416599] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]669second # [ 0.418888] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000670second # [ 0.418933] Intel/Sharp Extended Query Table at 0x0031671second # [ 0.428607] Using buffer write method672second # [ 0.428671] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]673second # [ 0.431285] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000674second # [ 0.431306] Intel/Sharp Extended Query Table at 0x0031675second # [ 0.434673] Using buffer write method676second # [ 0.434700] Concatenating MTD devices:677second # [ 0.434703] (0): "0.flash"678second # [ 0.434705] (1): "0.flash"679second # [ 0.434708] into device "0.flash"680test # [ 0.415076] loop: module loaded681test # [ 0.415206] virtio_blk virtio5: 1/0/0 default/read/poll queues682test # [ 0.415714] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)683test # [ 0.418968] megasas: 07.734.00.00-rc1684test # [ 0.419541] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]685test # [ 0.421635] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000686test # [ 0.421654] Intel/Sharp Extended Query Table at 0x0031687test # [ 0.431160] Using buffer write method688test # [ 0.431196] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]689test # [ 0.433779] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000690test # [ 0.433798] Intel/Sharp Extended Query Table at 0x0031691test # [ 0.443112] Using buffer write method692test # [ 0.443140] Concatenating MTD devices:693test # [ 0.443143] (0): "0.flash"694test # [ 0.443146] (1): "0.flash"695test # [ 0.443149] into device "0.flash"696second # [ 0.656434] Freeing initrd memory: 27072K697second # [ 0.663220] tun: Universal TUN/TAP device driver, 1.6698second # [ 0.665896] thunder_xcv, ver 1.0699second # [ 0.665920] thunder_bgx, ver 1.0700second # [ 0.665932] nicpf, ver 1.0701second # [ 0.666222] e1000: Intel(R) PRO/1000 Network Driver702second # [ 0.666230] e1000: Copyright (c) 1999-2006 Intel Corporation.703second # [ 0.666248] e1000e: Intel(R) PRO/1000 Network Driver704second # [ 0.666253] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.705second # [ 0.666268] igb: Intel(R) Gigabit Ethernet Network Driver706second # [ 0.666272] igb: Copyright (c) 2007-2014 Intel Corporation.707second # [ 0.666283] igbvf: Intel(R) Gigabit Virtual Function Network Driver708second # [ 0.666286] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.709second # [ 0.666350] sky2: driver version 1.30710second # [ 0.667135] usbcore: registered new interface driver usb-storage711second # [ 0.667250] usbcore: registered new interface driver usbserial_generic712second # [ 0.667260] usbserial: USB Serial support registered for generic713second # [ 0.667540] hv_vmbus: registering driver hyperv_keyboard714test # [ 0.649985] Freeing initrd memory: 27076K715second # [ 0.674297] ehci-pci 0000:00:0a.0: EHCI Host Controller716second # [ 0.674342] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1717second # [ 0.674615] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000718second # [ 0.676622] rtc-pl031 9010000.pl031: registered as rtc0719second # [ 0.676663] rtc-pl031 9010000.pl031: setting system clock to 2026-07-24T05:19:33 UTC (1784870373)720second # [ 0.676826] i2c_dev: i2c /dev entries driver721second # [ 0.679487] sdhci: Secure Digital Host Controller Interface driver722second # [ 0.679503] sdhci: Copyright(c) Pierre Ossman723test # [ 0.656862] tun: Universal TUN/TAP device driver, 1.6724test # [ 0.659447] thunder_xcv, ver 1.0725test # [ 0.659475] thunder_bgx, ver 1.0726test # [ 0.659487] nicpf, ver 1.0727test # [ 0.659781] e1000: Intel(R) PRO/1000 Network Driver728test # [ 0.659788] e1000: Copyright (c) 1999-2006 Intel Corporation.729test # [ 0.659805] e1000e: Intel(R) PRO/1000 Network Driver730test # [ 0.659811] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.731test # [ 0.659826] igb: Intel(R) Gigabit Ethernet Network Driver732test # [ 0.659829] igb: Copyright (c) 2007-2014 Intel Corporation.733test # [ 0.659839] igbvf: Intel(R) Gigabit Virtual Function Network Driver734test # [ 0.659843] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.735test # [ 0.659906] sky2: driver version 1.30736test # [ 0.660712] usbcore: registered new interface driver usb-storage737test # [ 0.660794] usbcore: registered new interface driver usbserial_generic738test # [ 0.660803] usbserial: USB Serial support registered for generic739test # [ 0.661087] hv_vmbus: registering driver hyperv_keyboard740test # [ 0.662094] ehci-pci 0000:00:0a.0: EHCI Host Controller741test # [ 0.662130] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1742test # [ 0.662312] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000743test # [ 0.669268] rtc-pl031 9010000.pl031: registered as rtc0744test # [ 0.669308] rtc-pl031 9010000.pl031: setting system clock to 2026-07-24T05:19:33 UTC (1784870373)745test # [ 0.669479] i2c_dev: i2c /dev entries driver746test # [ 0.671154] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00747test # [ 0.671658] hub 1-0:1.0: USB hub found748test # [ 0.671694] hub 1-0:1.0: 6 ports detected749test # [ 0.673800] sdhci: Secure Digital Host Controller Interface driver750test # [ 0.673815] sdhci: Copyright(c) Pierre Ossman751test # [ 0.673952] Synopsys Designware Multimedia Card Interface Driver752test # [ 0.674120] sdhci-pltfm: SDHCI platform and OF driver helper753second # [ 0.680455] Synopsys Designware Multimedia Card Interface Driver754test # [ 0.676634] hid: raw HID events driver (C) Jiri Kosina755second # [ 0.680645] sdhci-pltfm: SDHCI platform and OF driver helper756test # [ 0.676777] usbcore: registered new interface driver usbhid757second # [ 0.681540] hid: raw HID events driver (C) Jiri Kosina758second # [ 0.681683] usbcore: registered new interface driver usbhid759second # [ 0.681688] usbhid: USB HID core driver760second # [ 0.725755] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00761second # [ 0.726132] hub 1-0:1.0: USB hub found762second # [ 0.726186] hub 1-0:1.0: 6 ports detected763test # [ 0.676782] usbhid: USB HID core driver764test # [ 0.700778] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available765test # [ 0.701527] drop_monitor: Initializing network drop monitor service766second # [ 0.727481] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available767test # [ 0.701692] NET: Registered PF_INET6 protocol family768test # [ 0.703876] Segment Routing with IPv6769test # [ 0.703895] In-situ OAM (IOAM) with IPv6770test # [ 0.703941] NET: Registered PF_PACKET protocol family771second # [ 0.728981] drop_monitor: Initializing network drop monitor service772second # [ 0.729155] NET: Registered PF_INET6 protocol family773second # [ 0.730637] Segment Routing with IPv6774second # [ 0.730656] In-situ OAM (IOAM) with IPv6775second # [ 0.730704] NET: Registered PF_PACKET protocol family776test # [ 0.704884] 9pnet: Installing 9P2000 support777test # [ 0.706701] Key type dns_resolver registered778test # [ 0.710329] registered taskstats version 1779test # [ 0.710484] Loading compiled-in X.509 certificates780second # [ 0.731754] 9pnet: Installing 9P2000 support781second # [ 0.733241] Key type dns_resolver registered782second # [ 0.736704] registered taskstats version 1783second # [ 0.736877] Loading compiled-in X.509 certificates784test # [ 0.715892] Demotion targets for Node 0: null785test # [ 0.715975] Key type .fscrypt registered786test # [ 0.715981] Key type fscrypt-provisioning registered787test # [ 0.716075] ima: No TPM chip found, activating TPM-bypass!788test # [ 0.716088] ima: Allocated hash algorithm: sha1789second # [ 0.741998] Demotion targets for Node 0: null790test # [ 0.716133] ima: No architecture policies found791second # [ 0.742079] Key type .fscrypt registered792second # [ 0.742085] Key type fscrypt-provisioning registered793test # [ 0.718627] input: gpio-keys as /devices/platform/gpio-keys/input/input0794second # [ 0.742177] ima: No TPM chip found, activating TPM-bypass!795second # [ 0.742189] ima: Allocated hash algorithm: sha1796second # [ 0.742234] ima: No architecture policies found797second # [ 0.745101] input: gpio-keys as /devices/platform/gpio-keys/input/input0798test # [ 0.728737] clk: Disabling unused clocks799test # [ 0.728762] PM: genpd: Disabling unused power domains800second # [ 0.755400] clk: Disabling unused clocks801second # [ 0.755425] PM: genpd: Disabling unused power domains802test # [ 0.731865] Freeing unused kernel memory: 4736K803test # [ 0.731948] Run /init as init process804second # [ 0.758633] Freeing unused kernel memory: 4736K805second # [ 0.758723] Run /init as init process806test # [ 0.753314] systemd[1]: Successfully made /usr/ read-only.807second # [ 0.778547] systemd[1]: Successfully made /usr/ read-only.808test # [ 0.922659] usb 1-1: new high-speed USB device number 2 using ehci-pci809second # [ 0.971682] usb 1-1: new high-speed USB device number 2 using ehci-pci810test # [ 1.074747] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1811test # [ 1.088297] systemd[1]: systemd 261 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)812second # [ 1.113098] systemd[1]: systemd 261 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)813test # [ 1.094845] systemd[1]: Detected virtualization qemu.814second # [ 1.119576] systemd[1]: Detected virtualization qemu.815test # [ 1.095929] systemd[1]: Detected architecture arm64.816second # [ 1.121098] systemd[1]: Detected architecture arm64.817test # [ 1.096932] systemd[1]: Running in initrd.818second # [ 1.122306] systemd[1]: Running in initrd.819test # [ 1.098751] systemd[1]: Initializing machine ID from random generator.820test # [ 1.100351] systemd[1]: Hostname set to <test>.821second # [ 1.124364] systemd[1]: Initializing machine ID from random generator.822second # [ 1.126336] systemd[1]: Hostname set to <second>.823second # [ 1.135941] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1824test # [ 1.154843] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0825second # [ 1.219847] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0826test # [ 1.274654] usb 1-2: new high-speed USB device number 3 using ehci-pci827second # [ 1.339671] usb 1-2: new high-speed USB device number 3 using ehci-pci828test # [ 1.371480] systemd[1]: bpf-restrict-fs: LSM BPF program attached829second # [ 1.404713] systemd[1]: bpf-restrict-fs: LSM BPF program attached830test # [ 1.424037] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2831test # [ 1.425945] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0832second # [ 1.478653] systemd[1]: Queued start job for default target Initrd Default Target.833test # [ 1.462352] systemd[1]: Queued start job for default target Initrd Default Target.834second # [ 1.490892] systemd[1]: Created slice Slice /system/modprobe.835second # [ 1.492366] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.836second # [ 1.493631] systemd[1]: Expecting device /dev/disk/by-label/nixos...837second # [ 1.494552] systemd[1]: Reached target Path Units.838second # [ 1.495574] systemd[1]: Reached target Slice Units.839second # [ 1.496413] systemd[1]: Reached target Swaps.840test # [ 1.472699] systemd[1]: Created slice Slice /system/modprobe.841second # [ 1.497208] systemd[1]: Reached target Timer Units.842test # [ 1.473669] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.843test # [ 1.474686] systemd[1]: Expecting device /dev/disk/by-label/nixos...844second # [ 1.498372] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2845test # [ 1.475520] systemd[1]: Reached target Path Units.846test # [ 1.476139] systemd[1]: Reached target Slice Units.847test # [ 1.476817] systemd[1]: Reached target Swaps.848second # [ 1.498493] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0849test # [ 1.477389] systemd[1]: Reached target Timer Units.850second # [ 1.502404] systemd[1]: Listening on D-Bus System Message Bus Socket.851test # [ 1.478235] systemd[1]: Listening on D-Bus System Message Bus Socket.852test # [ 1.479292] systemd[1]: Listening on Journal Socket (/dev/log).853test # [ 1.480196] systemd[1]: Listening on Journal Sockets.854test # [ 1.480955] systemd[1]: Listening on udev Control Socket.855second # [ 1.503724] systemd[1]: Listening on Journal Socket (/dev/log).856test # [ 1.481773] systemd[1]: Listening on udev Kernel Socket.857second # [ 1.503929] systemd[1]: Listening on Journal Sockets.858test # [ 1.482472] systemd[1]: Reached target Socket Units.859second # [ 1.504064] systemd[1]: Listening on udev Control Socket.860second # [ 1.504215] systemd[1]: Listening on udev Kernel Socket.861second # [ 1.504259] systemd[1]: Reached target Socket Units.862second # [ 1.509515] systemd[1]: Starting Create List of Static Device Nodes...863test # [ 1.484596] systemd[1]: Starting Create List of Static Device Nodes...864test # [ 1.494464] systemd[1]: Starting Load Kernel Module 9pnet_virtio...865second # [ 1.519810] systemd[1]: Starting Load Kernel Module 9pnet_virtio...866test # [ 1.495505] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs867second # [ 1.521117] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs868second # [ 1.524037] systemd[1]: Mounting Kernel Configuration File System...869test # [ 1.503564] systemd[1]: Mounting Kernel Configuration File System...870second # [ 1.536674] systemd[1]: Starting Journal Service...871test # [ 1.518809] systemd[1]: Starting Journal Service...872test # [ 1.526801] systemd[1]: Starting Load Kernel Modules...873test # [ 1.527613] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os874second # [ 1.553484] systemd[1]: Starting Load Kernel Modules...875second # [ 1.553610] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os876test # [ 1.539393] systemd[1]: Starting Coldplug All udev Devices...877second # [ 1.583994] systemd[1]: Starting Coldplug All udev Devices...878test # [ 1.558696] systemd[1]: Finished Create List of Static Device Nodes.879test # [ 1.560074] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.880test # [ 1.560320] systemd[1]: Finished Load Kernel Module 9pnet_virtio.881test # [ 1.560549] systemd[1]: Mounted Kernel Configuration File System.882test # [ 1.564021] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...883second # [ 1.591968] systemd[1]: Finished Create List of Static Device Nodes.884second # [ 1.592811] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.885second # [ 1.593007] systemd[1]: Finished Load Kernel Module 9pnet_virtio.886test # [ 1.577026] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.887second # [ 1.603561] systemd-journald[73]: Collecting audit messages is disabled.888test # [ 1.584984] systemd-journald[73]: Collecting audit messages is disabled.889test # [ 1.594690] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev890second # [ 1.626133] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.891test # [ 1.602527] [drm] pci: virtio-gpu-pci detected at 0000:00:08.0892second # [ 1.631771] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...893test # [ 1.610986] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.894test # [ 1.612551] systemd[1]: Starting Create Static Device Nodes in /dev...895second # [ 1.640068] systemd[1]: Mounted Kernel Configuration File System.896test # [ 1.615286] [drm] features: -virgl +edid -resource_blob -host_visible897test # [ 1.615297] [drm] features: -context_init898test # [ 1.615747] [drm] number of scanouts: 1899test # [ 1.615761] [drm] number of cap sets: 0900second # [ 1.640674] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev901second # [ 1.645197] [drm] pci: virtio-gpu-pci detected at 0000:00:08.0902test # [ 1.619413] virtio-pci 0000:00:08.0: [drm] Registered 1 planes with drm panic903second # [ 1.645553] [drm] features: -virgl +edid -resource_blob -host_visible904test # [ 1.619426] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:08.0 on minor 0905second # [ 1.645559] [drm] features: -context_init906second # [ 1.645999] [drm] number of scanouts: 1907second # [ 1.646014] [drm] number of cap sets: 0908second # [ 1.660221] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.909second # [ 1.661840] systemd[1]: Starting Create Static Device Nodes in /dev...910second # [ 1.664042] virtio-pci 0000:00:08.0: [drm] Registered 1 planes with drm panic911second # [ 1.664055] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:08.0 on minor 0912test # [ 1.643010] Console: switching to colour frame buffer device 160x50913test # [ 1.658998] systemd[1]: Finished Create Static Device Nodes in /dev.914test # [ 1.659129] systemd[1]: Reached target Preparation for Local File Systems.915test # [ 1.659152] systemd[1]: Reached target Local File Systems.916test # [ 1.661452] systemd[1]: Starting Rule-based Manager for Device Events and Files...917test # [ 1.666692] virtio-pci 0000:00:08.0: [drm] fb0: virtio_gpudrmfb frame buffer device918second # [ 1.689536] Console: switching to colour frame buffer device 160x50919second # [ 1.694569] virtio-pci 0000:00:08.0: [drm] fb0: virtio_gpudrmfb frame buffer device920second # [ 1.699125] systemd[1]: Started Journal Service.921second # [ 1.698205] systemd-modules-load[75]: Inserted module 'dm_mod'922test # [ 1.675365] systemd-modules-load[74]: Inserted module 'dm_mod'923test # [ 1.676110] systemd-modules-load[74]: Module 'virtio_balloon' is built in924test # [ 1.676878] systemd-modules-load[74]: Module 'virtio_console' is built in925test # [ 1.677500] systemd-modules-load[74]: Inserted module 'virtio_gpu'926test # [ 1.678044] systemd-modules-load[74]: Module 'virtio_rng' is built in927test # [ 1.685585] systemd[1]: Finished Load Kernel Modules.928second # [ 1.699682] systemd-modules-load[75]: Module 'virtio_balloon' is built in929second # [ 1.704387] systemd-modules-load[75]: Module 'virtio_console' is built in930test # [ 1.686855] systemd[1]: Started Journal Service.931second # [ 1.707797] systemd-modules-load[75]: Inserted module 'virtio_gpu'932second # [ 1.708565] systemd-modules-load[75]: Module 'virtio_rng' is built in933second # [ 1.709939] systemd[1]: Finished Create Static Device Nodes in /dev.934second # [ 1.710611] systemd[1]: Finished Load Kernel Modules.935second # [ 1.713793] systemd[1]: Reached target Preparation for Local File Systems.936second # [ 1.714382] systemd[1]: Reached target Local File Systems.937second # [ 1.724363] systemd[1]: Starting Apply Kernel Variables...938test # [ 1.704339] systemd[1]: Starting Apply Kernel Variables...939second # [ 1.737772] systemd[1]: Starting Create System Files and Directories...940test # [ 1.717146] systemd[1]: Starting Create System Files and Directories...941test # [ 1.724603] systemd-udevd[80]: Using default interface naming scheme 'v261'.942second # [ 1.752713] systemd[1]: Starting Rule-based Manager for Device Events and Files...943second # [ 1.755181] systemd[1]: Finished Apply Kernel Variables.944test # [ 1.741490] systemd[1]: Finished Apply Kernel Variables.945second # [ 1.773089] systemd[1]: Finished Create System Files and Directories.946test # [ 1.752795] systemd[1]: Finished Create System Files and Directories.947test # [ 1.757990] systemd[1]: Started Rule-based Manager for Device Events and Files.948second # [ 1.799280] systemd-udevd[87]: Using default interface naming scheme 'v261'.949second # [ 1.816267] systemd[1]: Started Rule-based Manager for Device Events and Files.950test # [ 1.799301] systemd[1]: Starting Virtual Console Setup...951test # [ 1.828322] systemd-vconsole-setup[103]: Configuration of first virtual console was skipped, ignoring remaining ones.952test # [ 1.830319] systemd[1]: Finished Virtual Console Setup.953second # [ 1.859387] systemd[1]: Starting Virtual Console Setup...954second # [ 1.888376] systemd-vconsole-setup[102]: Configuration of first virtual console was skipped, ignoring remaining ones.955second # [ 1.890594] systemd[1]: Finished Virtual Console Setup.956test # [ 2.037414] systemd[1]: Finished Coldplug All udev Devices.957test # [ 2.037974] systemd[1]: Reached target System Initialization.958test # [ 2.038432] systemd[1]: Reached target Basic System.959second # [ 2.105240] systemd[1]: Finished Coldplug All udev Devices.960second # [ 2.105813] systemd[1]: Reached target System Initialization.961second # [ 2.106278] systemd[1]: Reached target Basic System.962test # [ 2.141085] (udev-worker)[95]: Network interface NamePolicy= disabled on kernel command line.963test # [ 2.152839] (udev-worker)[93]: Network interface NamePolicy= disabled on kernel command line.964second # [ 2.202673] (udev-worker)[100]: Network interface NamePolicy= disabled on kernel command line.965second # [ 2.222901] (udev-worker)[101]: Network interface NamePolicy= disabled on kernel command line.966test # [ 2.200912] systemd[1]: Found device /dev/disk/by-label/nixos.967test # [ 2.208500] systemd[1]: Reached target Initrd Root Device.968test # [ 2.215544] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...969test # [ 2.252678] systemd-fsck[111]: nixos: clean, 12/65536 files, 13019/262144 blocks970second # [ 2.291066] systemd[1]: Found device /dev/disk/by-label/nixos.971second # [ 2.295204] systemd[1]: Reached target Initrd Root Device.972second # [ 2.297620] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...973test # [ 2.293260] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.974second # [ 2.330298] systemd-fsck[110]: nixos: clean, 12/65536 files, 13019/262144 blocks975second # [ 2.336978] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.976test # [ 2.536100] systemd[1]: Mounting /sysroot...977second # [ 2.577907] systemd[1]: Mounting /sysroot...978test # [ 2.565030] EXT4-fs (vda): mounted filesystem 364e614a-97ec-489e-a7c4-800ffbe0fdba r/w with ordered data mode. Quota mode: none.979test # [ 2.563937] systemd[1]: Mounted /sysroot.980test # [ 2.565576] systemd[1]: Reached target Initrd Root File System.981test # [ 2.568438] systemd[1]: Starting Mountpoints Configured in the Real Root...982second # [ 2.609775] EXT4-fs (vda): mounted filesystem 53107085-f639-48f6-a272-2fe7ea214f7c r/w with ordered data mode. Quota mode: none.983second # [ 2.609392] systemd[1]: Mounted /sysroot.984second # [ 2.609812] systemd[1]: Reached target Initrd Root File System.985test # [ 2.586635] systemd-sysroot-fstab-check[119]: /sysroot should be mounted in the initrd, will request daemon-reload.986second # [ 2.612088] systemd[1]: Starting Mountpoints Configured in the Real Root...987test # [ 2.592346] systemd[1]: Reload requested from client PID 119 ('systemd-sysroot') (unit initrd-parse-etc.service)...988test # [ 2.595196] systemd[1]: Reloading...989second # [ 2.630639] systemd-sysroot-fstab-check[118]: /sysroot should be mounted in the initrd, will request daemon-reload.990second # [ 2.635257] systemd[1]: Reload requested from client PID 118 ('systemd-sysroot') (unit initrd-parse-etc.service)...991second # [ 2.638484] systemd[1]: Reloading...992test # [ 2.758451] systemd[1]: Reloading finished in 163 ms.993test # [ 2.776194] systemd-sysroot-fstab-check[119]: Requesting initrd-fs.target/start/replace...994test # [ 2.777831] systemd-sysroot-fstab-check[119]: Requesting swap.target/start/replace...995second # [ 2.802513] systemd[1]: Reloading finished in 165 ms.996test # [ 2.779532] systemd[1]: Starting Load Kernel Module 9pnet_virtio...997test # [ 2.787811] systemd[1]: initrd-parse-etc.service: Deactivated successfully.998test # [ 2.796132] systemd[1]: Finished Mountpoints Configured in the Real Root.999test # [ 2.796733] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1000test # [ 2.800514] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1001test # [ 2.801946] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1002second # [ 2.830158] systemd-sysroot-fstab-check[118]: Requesting initrd-fs.target/start/replace...1003second # [ 2.832685] systemd-sysroot-fstab-check[118]: Requesting swap.target/start/replace...1004second # [ 2.836692] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1005second # [ 2.837714] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1006second # [ 2.841203] systemd[1]: Finished Mountpoints Configured in the Real Root.1007second # [ 2.842186] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1008second # [ 2.860678] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1009second # [ 2.861862] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1010test # [ 2.963896] (udev-worker)[95]: mtd0ro: Failed to find and pin callout binary "/nix/store/z2nxjmk4666nbka3hgyxlg13prrnvx38-systemd-261/lib/udev/mtd_probe": No such file or directory1011test # [ 2.967486] (udev-worker)[95]: mtd0ro: /nix/store/z2nxjmk4666nbka3hgyxlg13prrnvx38-systemd-261/lib/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory1012test # [ 2.982310] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1013test # [ 2.984287] systemd[1]: Stopped Virtual Console Setup.1014test # [ 2.985202] systemd[1]: Stopping Virtual Console Setup...1015test # [ 2.989008] systemd[1]: Starting Virtual Console Setup...1016test # [ 3.001458] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1017test # [ 3.002089] systemd[1]: Stopped Virtual Console Setup.1018test # [ 3.004140] systemd[1]: Starting Virtual Console Setup...1019second # [ 3.038179] (udev-worker)[101]: mtd0ro: Failed to find and pin callout binary "/nix/store/z2nxjmk4666nbka3hgyxlg13prrnvx38-systemd-261/lib/udev/mtd_probe": No such file or directory1020test # [ 3.016385] systemd-vconsole-setup[142]: Configuration of first virtual console was skipped, ignoring remaining ones.1021test # [ 3.018291] systemd[1]: Finished Virtual Console Setup.1022second # [ 3.042888] (udev-worker)[101]: mtd0ro: /nix/store/z2nxjmk4666nbka3hgyxlg13prrnvx38-systemd-261/lib/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory1023second # [ 3.054912] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1024second # [ 3.056335] systemd[1]: Stopped Virtual Console Setup.1025second # [ 3.057770] systemd[1]: Stopping Virtual Console Setup...1026second # [ 3.060235] systemd[1]: Starting Virtual Console Setup...1027second # [ 3.082606] systemd-vconsole-setup[139]: Configuration of first virtual console was skipped, ignoring remaining ones.1028second # [ 3.084835] systemd[1]: Finished Virtual Console Setup.1029test # [ 3.538689] systemd[1]: Mounting /sysroot/nix/.ro-store...1030test # [ 3.549609] systemd[1]: Mounting /sysroot/nix/.rw-store...1031test # [ 3.552154] systemd[1]: Mounting /sysroot/run...1032second # [ 3.579417] systemd[1]: Mounting /sysroot/nix/.ro-store...1033second # [ 3.588077] systemd[1]: Mounting /sysroot/nix/.rw-store...1034test # [ 3.564854] systemd[1]: Mounting /sysroot/tmp/shared...1035second # [ 3.593062] systemd[1]: Mounting /sysroot/run...1036second # [ 3.609181] systemd[1]: Mounting /sysroot/tmp/shared...1037test # [ 3.588336] systemd[1]: Mounting /sysroot/tmp/xchg...1038second # [ 3.615952] systemd[1]: Mounting /sysroot/tmp/xchg...1039second # [ 3.622444] systemd[1]: Mounted /sysroot/nix/.ro-store.1040second # [ 3.632675] systemd[1]: Mounted /sysroot/nix/.rw-store.1041test # [ 3.614993] systemd[1]: Mounted /sysroot/nix/.rw-store.1042test # [ 3.618551] systemd[1]: Mounted /sysroot/run.1043test # [ 3.620440] systemd[1]: Mounted /sysroot/nix/.ro-store.1044second # [ 3.645446] systemd[1]: Starting rw-sysroot-nix-store.service...1045test # [ 3.630592] systemd[1]: Starting rw-sysroot-nix-store.service...1046second # [ 3.657739] systemd[1]: Mounted /sysroot/run.1047test # [ 3.635893] systemd[1]: Mounted /sysroot/tmp/shared.1048second # [ 3.660273] systemd[1]: Mounted /sysroot/tmp/shared.1049test # [ 3.637701] systemd[1]: Mounted /sysroot/tmp/xchg.1050second # [ 3.661135] systemd[1]: Mounted /sysroot/tmp/xchg.1051second # [ 3.665197] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1052second # [ 3.666217] systemd[1]: Finished rw-sysroot-nix-store.service.1053test # [ 3.651685] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1054test # [ 3.653028] systemd[1]: Finished rw-sysroot-nix-store.service.1055test # [ 3.655251] systemd[1]: Mounting /sysroot/nix/store...1056test # [ 3.682827] systemd[1]: Mounted /sysroot/nix/store.1057test # [ 3.684351] systemd[1]: Reached target Initrd File Systems.1058test # [ 3.686137] systemd[1]: Starting Find NixOS closure...1059test # [ 3.692222] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1060test # [ 3.704926] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1061test # [ 3.722188] systemd[1]: Finished Find NixOS closure.1062test # [ 3.723361] systemd[1]: Reached target Initrd Default Target.1063test # [ 3.725376] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1064test # [ 3.748310] systemd[1]: Stopped target Initrd Default Target.1065test # [ 3.749321] systemd[1]: Stopped target Basic System.1066test # [ 3.752124] systemd[1]: Stopped target Initrd Root Device.1067test # [ 3.753003] systemd[1]: Stopped target Path Units.1068test # [ 3.753561] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1069test # [ 3.754370] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1070test # [ 3.756100] systemd[1]: Stopped target Slice Units.1071test # [ 3.757817] systemd[1]: Stopped target Socket Units.1072test # [ 3.760126] systemd[1]: Stopped target System Initialization.1073test # [ 3.760953] systemd[1]: Stopped target Swaps.1074test # [ 3.761415] systemd[1]: Stopped target Timer Units.1075test # [ 3.764108] systemd[1]: dbus.socket: Deactivated successfully.1076test # [ 3.764969] systemd[1]: Closed D-Bus System Message Bus Socket.1077test # [ 3.765526] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1078test # [ 3.766619] systemd[1]: Stopped Find NixOS closure.1079test # [ 3.768111] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1080test # [ 3.770355] systemd[1]: Starting rw-sysroot-nix-store.service...1081test # [ 3.770929] systemd[1]: systemd-sysctl.service: Deactivated successfully.1082test # [ 3.771826] systemd[1]: Stopped Apply Kernel Variables.1083test # [ 3.773520] systemd[1]: systemd-modules-load.service: Deactivated successfully.1084test # [ 3.781194] systemd[1]: Stopped Load Kernel Modules.1085test # [ 3.781680] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1086test # [ 3.782410] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1087test # [ 3.783050] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1088test # [ 3.783641] systemd[1]: Stopped Create System Files and Directories.1089test # [ 3.790908] systemd[1]: Stopped target Local File Systems.1090test # [ 3.792197] systemd[1]: Stopped target Preparation for Local File Systems.1091test # [ 3.793784] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1092test # [ 3.794392] systemd[1]: Stopped Coldplug All udev Devices.1093test # [ 3.794846] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1094test # [ 3.795429] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1095test # [ 3.804122] systemd[1]: Stopped Virtual Console Setup.1096test # [ 3.804591] systemd[1]: initrd-cleanup.service: Deactivated successfully.1097test # [ 3.805178] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1098test # [ 3.806190] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1099test # [ 3.807530] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1100test # [ 3.810880] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1101test # [ 3.811458] systemd[1]: Finished rw-sysroot-nix-store.service.1102test # [ 3.811921] systemd[1]: systemd-udevd.service: Deactivated successfully.1103test # [ 3.812976] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1104test # [ 3.813737] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1105test # [ 3.814499] systemd[1]: Closed udev Control Socket.1106test # [ 3.814947] systemd[1]: Starting Cleanup udev Database...1107test # [ 3.815392] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1108test # [ 3.815988] systemd[1]: Stopped Create Static Device Nodes in /dev.1109test # [ 3.816528] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1110test # [ 3.817177] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1111test # [ 3.817745] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1112test # [ 3.818293] systemd[1]: Stopped Create List of Static Device Nodes.1113test # [ 3.834677] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1114test # [ 3.836568] systemd[1]: Finished Cleanup udev Database.1115test # [ 3.837068] systemd[1]: Reached target Switch Root.1116test # [ 3.838066] systemd[1]: Starting NixOS Activation...1117test # [ 3.987979] initrd-nixos-activation-start[180]: booting system configuration /nix/store/1sjcbiq44q1hb8m92s40nq890rasbs20-nixos-system-test-test1118test # [ 4.039981] initrd-nixos-activation-start[180]: running activation script...1119test # [ 4.430357] initrd-nixos-activation-start[203]: setting up /etc...1120second # [ 4.579457] systemd[1]: Mounting /sysroot/nix/store...1121second # [ 4.625654] systemd[1]: Mounted /sysroot/nix/store.1122second # [ 4.627809] systemd[1]: Reached target Initrd File Systems.1123second # [ 4.631702] systemd[1]: Starting Find NixOS closure...1124second # [ 4.640371] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1125second # [ 4.681871] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1126second # [ 4.686150] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1127test # [ 4.669140] initrd-nixos-activation-start[203]: setting up age secrets...1128second # [ 4.702966] systemd[1]: Finished Find NixOS closure.1129second # [ 4.705114] systemd[1]: Reached target Initrd Default Target.1130second # [ 4.707269] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1131second # [ 4.736269] systemd[1]: initrd-cleanup.service: Deactivated successfully.1132second # [ 4.737786] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1133second # [ 4.742294] systemd[1]: Stopped target Initrd Default Target.1134second # [ 4.744218] systemd[1]: Stopped target Basic System.1135second # [ 4.746381] systemd[1]: Stopped target Initrd Root Device.1136second # [ 4.747027] systemd[1]: Stopped target Path Units.1137second # [ 4.747576] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1138second # [ 4.749794] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1139second # [ 4.752169] systemd[1]: Stopped target Slice Units.1140second # [ 4.752941] systemd[1]: Stopped target Socket Units.1141second # [ 4.753463] systemd[1]: Stopped target System Initialization.1142second # [ 4.754036] systemd[1]: Stopped target Swaps.1143second # [ 4.754497] systemd[1]: Stopped target Timer Units.1144second # [ 4.754998] systemd[1]: dbus.socket: Deactivated successfully.1145second # [ 4.755572] systemd[1]: Closed D-Bus System Message Bus Socket.1146second # [ 4.760275] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1147second # [ 4.763063] systemd[1]: Stopped Find NixOS closure.1148second # [ 4.763568] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1149second # [ 4.768217] systemd[1]: Starting rw-sysroot-nix-store.service...1150second # [ 4.768782] systemd[1]: systemd-sysctl.service: Deactivated successfully.1151second # [ 4.769373] systemd[1]: Stopped Apply Kernel Variables.1152second # [ 4.769844] systemd[1]: systemd-modules-load.service: Deactivated successfully.1153second # [ 4.770462] systemd[1]: Stopped Load Kernel Modules.1154second # [ 4.770907] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1155second # [ 4.771582] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1156second # [ 4.776467] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1157second # [ 4.777103] systemd[1]: Stopped Create System Files and Directories.1158second # [ 4.777638] systemd[1]: Stopped target Local File Systems.1159second # [ 4.778115] systemd[1]: Stopped target Preparation for Local File Systems.1160second # [ 4.778677] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1161second # [ 4.779274] systemd[1]: Stopped Coldplug All udev Devices.1162second # [ 4.779746] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1163second # [ 4.789306] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1164second # [ 4.789973] systemd[1]: Stopped Virtual Console Setup.1165second # [ 4.795759] systemd[1]: systemd-udevd.service: Deactivated successfully.1166second # [ 4.799982] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1167second # [ 4.800718] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1168second # [ 4.801316] systemd[1]: Closed udev Control Socket.1169second # [ 4.801793] systemd[1]: Starting Cleanup udev Database...1170second # [ 4.802266] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1171second # [ 4.802949] systemd[1]: Stopped Create Static Device Nodes in /dev.1172second # [ 4.804170] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1173second # [ 4.805328] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1174second # [ 4.805935] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1175second # [ 4.806505] systemd[1]: Stopped Create List of Static Device Nodes.1176second # [ 4.807021] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1177second # [ 4.813592] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1178second # [ 4.814151] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1179second # [ 4.814754] systemd[1]: Finished rw-sysroot-nix-store.service.1180second # [ 4.830208] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1181second # [ 4.830897] systemd[1]: Finished Cleanup udev Database.1182second # [ 4.831643] systemd[1]: Reached target Switch Root.1183second # [ 4.836887] systemd[1]: Starting NixOS Activation...1184test # [ 4.912383] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1185test # [ 4.914085] systemd[1]: Finished NixOS Activation.1186test # [ 4.914812] systemd[1]: Starting Switch Root...1187test # [ 4.932987] systemd[1]: Switching root.1188second # [ 4.998437] initrd-nixos-activation-start[177]: booting system configuration /nix/store/clnc0c6f4rw1gbxkcp6fy228f5zj64lx-nixos-system-second-test1189second # [ 5.058089] initrd-nixos-activation-start[177]: running activation script...1190test # [ 5.097689] systemd-journald[73]: Received SIGTERM from PID 1 (systemd).1191second # [ 5.465098] initrd-nixos-activation-start[200]: setting up /etc...1192test # [ 5.652288] systemd[1]: systemd 261 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)1193test # [ 5.659349] systemd[1]: Detected virtualization qemu.1194test # [ 5.660498] systemd[1]: Detected architecture arm64.1195test # [ 5.662134] systemd[1]: Detected first boot.1196test # [ 5.667282] systemd[1]: Initializing machine ID from random generator.1197second # [ 5.693291] initrd-nixos-activation-start[200]: setting up age secrets...1198test # [ 5.937344] systemd[1]: bpf-restrict-fs: LSM BPF program attached1199second # [ 5.971541] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1200second # [ 5.973372] systemd[1]: Finished NixOS Activation.1201second # [ 5.974080] systemd[1]: Starting Switch Root...1202second # [ 5.988833] systemd[1]: Switching root.1203test # [ 6.109559] systemd[1]: Applying preset policy.1204second # [ 6.165852] systemd-journald[73]: Received SIGTERM from PID 1 (systemd).1205test # [ 6.620321] systemd[1]: Populated /etc with preset unit settings.1206second # [ 6.776617] systemd[1]: systemd 261 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)1207second # [ 6.780057] systemd[1]: Detected virtualization qemu.1208second # [ 6.781111] systemd[1]: Detected architecture arm64.1209second # [ 6.782452] systemd[1]: Detected first boot.1210second # [ 6.786009] systemd[1]: Initializing machine ID from random generator.1211second # [ 7.042384] systemd[1]: bpf-restrict-fs: LSM BPF program attached1212test # [ 7.101500] systemd[1]: initrd-switch-root.service: Deactivated successfully.1213test # [ 7.102346] systemd[1]: Stopped initrd-switch-root.service.1214test # [ 7.104259] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1215test # [ 7.106891] systemd[1]: Created slice Slice /system/getty.1216test # [ 7.108207] systemd[1]: Created slice User and Session Slice.1217test # [ 7.109162] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1218test # [ 7.110509] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1219test # [ 7.111631] systemd[1]: Expecting device /dev/hvc0...1220test # [ 7.112514] systemd[1]: Expecting device /dev/ttyAMA0...1221test # [ 7.113443] systemd[1]: Reached target Local Encrypted Volumes.1222test # [ 7.114903] systemd[1]: Stopped target initrd-fs.target.1223test # [ 7.116240] systemd[1]: Stopped target initrd-root-fs.target.1224test # [ 7.117568] systemd[1]: Stopped target initrd-switch-root.target.1225test # [ 7.118967] systemd[1]: Reached target Virtual Machines and Containers.1226test # [ 7.119957] systemd[1]: Reached target Path Units.1227test # [ 7.121278] systemd[1]: Reached target Remote File Systems.1228test # [ 7.122531] systemd[1]: Reached target Slice Units.1229test # [ 7.123789] systemd[1]: Reached target Swaps.1230test # [ 7.127633] systemd[1]: Listening on Query the User Interactively for a Password.1231test # [ 7.131922] systemd[1]: Listening on Process Core Dump Socket.1232test # [ 7.135217] systemd[1]: Listening on Credential Encryption/Decryption.1233test # [ 7.138479] systemd[1]: Listening on Factory Reset Management.1234test # [ 7.139478] systemd[1]: Listening on Hostname Service Socket.1235test # [ 7.143695] systemd[1]: Starting Journal Log Access Socket...1236test # [ 7.145147] systemd[1]: Listening on Journal Audit Socket.1237second # [ 7.170290] systemd[1]: Applying preset policy.1238test # [ 7.148796] systemd[1]: Listening on Console Output Muting Service Socket.1239test # [ 7.149908] systemd[1]: Listening on Network Management Metrics Varlink Socket.1240test # [ 7.151358] systemd[1]: Listening on Network Management Varlink Socket.1241test # [ 7.152812] systemd[1]: Listening on Network Management Netlink Socket.1242test # [ 7.154402] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1243test # [ 7.155886] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1244test # [ 7.157503] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1245test # [ 7.167523] systemd[1]: Listening on Disk Repartitioning Service Socket.1246test # [ 7.168526] systemd[1]: Listening on Resolve Monitor Varlink Socket.1247test # [ 7.169530] systemd[1]: Listening on Resolve Service Varlink Socket.1248test # [ 7.170525] systemd[1]: Listening on udev Control Socket.1249test # [ 7.171545] systemd[1]: Listening on udev Varlink Socket.1250test # [ 7.177058] systemd[1]: Mounting Huge Pages File System...1251test # [ 7.180808] systemd[1]: Mounting POSIX Message Queue File System...1252test # [ 7.190932] systemd[1]: Mounting Kernel Debug File System...1253test # [ 7.195100] systemd[1]: Mounting Kernel Trace File System...1254test # [ 7.207601] systemd[1]: Starting Create List of Static Device Nodes...1255test # [ 7.217288] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1256test # [ 7.220489] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1257test # [ 7.225589] systemd[1]: Mounting Kernel Configuration File System...1258test # [ 7.227946] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1259test # [ 7.229585] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1260test # [ 7.245654] systemd[1]: Starting Load Kernel Module fuse...1261test # [ 7.247525] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671262test # [ 7.296704] systemd[1]: Starting Journal Service...1263test # [ 7.320952] systemd[1]: Starting Load Kernel Modules...1264test # [ 7.353561] fuse: init (API version 7.45)1265test # [ 7.355994] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1266test # [ 7.373125] systemd[1]: Starting Remount Root and Kernel File Systems...1267test # [ 7.376367] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1268test # [ 7.397828] systemd[1]: Starting Coldplug All udev Devices...1269test # [ 7.408054] systemd[1]: Listening on Journal Log Access Socket.1270test # [ 7.419452] systemd[1]: Mounted Huge Pages File System.1271test # [ 7.422511] systemd[1]: Mounted POSIX Message Queue File System.1272test # [ 7.428387] systemd[1]: Mounted Kernel Debug File System.1273test # [ 7.432036] systemd[1]: Mounted Kernel Trace File System.1274test # [ 7.442547] systemd-journald[325]: Collecting audit messages is enabled.1275test # [ 7.445848] systemd[1]: Finished Create List of Static Device Nodes.1276test # [ 7.446544] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1277test # [ 7.455097] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1278test # [ 7.455723] systemd[1]: Mounted Kernel Configuration File System.1279test # [ 7.456206] systemd[1]: modprobe@fuse.service: Deactivated successfully.1280test # [ 7.456644] systemd[1]: Finished Load Kernel Module fuse.1281test # [ 7.457204] systemd[1]: Finished Load Kernel Modules.1282test # [ 7.455599] systemd[1]: Queued start job for default target Multi-User System.1283test # [ 7.456725] systemd[1]: systemd-journald.service: Deactivated successfully.1284test # [ 7.457672] systemd-modules-load[326]: Module 'atkbd' is built in1285test # [ 7.467359] systemd[1]: Mounting FUSE Control File System...1286test # [ 7.464918] systemd-modules-load[326]: Module 'ctr' is built in1287test # [ 7.469970] systemd-modules-load[326]: Module 'loop' is built in1288test # [ 7.486960] systemd[1]: Starting Firewall...1289test # [ 7.501355] EXT4-fs (vda): re-mounted 364e614a-97ec-489e-a7c4-800ffbe0fdba.1290test # [ 7.509544] systemd[1]: Starting Apply Kernel Variables...1291test # [ 7.523809] systemd-oomd[327]: No swap; memory pressure usage will be degraded1292test # [ 7.538042] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1293test # [ 7.547057] systemd[1]: Started Journal Service.1294test # [ 7.568094] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1295test # [ 7.575848] systemd[1]: Finished Remount Root and Kernel File Systems.1296second # [ 7.630121] systemd[1]: Populated /etc with preset unit settings.1297test # [ 7.611160] systemd[1]: Finished Apply Kernel Variables.1298test # [ 7.631670] systemd[1]: Mounted FUSE Control File System.1299test # [ 7.642321] systemd[1]: Listening on Disk Image Download Service Socket.1300test # [ 7.644796] systemd[1]: Starting Flush Journal to Persistent Storage...1301test # [ 7.646197] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1302test # [ 7.653831] systemd[1]: Starting Load/Save OS Random Seed...1303test # [ 7.681454] systemd[1]: Starting Network Name Resolution...1304test # [ 7.682046] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1305test # [ 7.690531] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1306test # [ 7.731986] systemd-journald[325]: Received client request to flush runtime journal.1307test # [ 7.817332] systemd[1]: Starting Create Static Device Nodes in /dev...1308test # [ 7.823132] systemd[1]: Finished Load/Save OS Random Seed.1309test # [ 7.823662] systemd[1]: Reached target First Boot Complete.1310test # [ 7.826577] systemd[1]: Finished Flush Journal to Persistent Storage.1311test # [ 7.868036] systemd[1]: Finished Create Static Device Nodes in /dev.1312test # [ 7.869073] systemd[1]: Reached target Preparation for Local File Systems.1313test # [ 7.871705] systemd[1]: Starting Rule-based Manager for Device Events and Files...1314test # [ 7.877896] systemd-resolved[356]: Positive Trust Anchors:1315test # [ 7.883988] systemd-resolved[356]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d1316test # [ 7.885907] systemd-resolved[356]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b161317test # [ 7.886743] systemd-resolved[356]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test1318test # [ 7.996290] systemd-udevd[372]: Using default interface naming scheme 'v261'.1319second # [ 8.088292] systemd[1]: initrd-switch-root.service: Deactivated successfully.1320second # [ 8.089127] systemd[1]: Stopped initrd-switch-root.service.1321second # [ 8.091046] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1322second # [ 8.094030] systemd[1]: Created slice Slice /system/getty.1323second # [ 8.095519] systemd[1]: Created slice User and Session Slice.1324second # [ 8.096842] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1325second # [ 8.097574] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1326second # [ 8.098688] systemd[1]: Expecting device /dev/hvc0...1327second # [ 8.098718] systemd[1]: Expecting device /dev/ttyAMA0...1328second # [ 8.098747] systemd[1]: Reached target Local Encrypted Volumes.1329second # [ 8.098778] systemd[1]: Stopped target initrd-fs.target.1330second # [ 8.099235] systemd[1]: Stopped target initrd-root-fs.target.1331second # [ 8.099534] systemd[1]: Stopped target initrd-switch-root.target.1332second # [ 8.102482] systemd[1]: Reached target Virtual Machines and Containers.1333second # [ 8.103470] systemd[1]: Reached target Path Units.1334second # [ 8.104898] systemd[1]: Reached target Remote File Systems.1335second # [ 8.105769] systemd[1]: Reached target Slice Units.1336second # [ 8.107133] systemd[1]: Reached target Swaps.1337second # [ 8.110895] systemd[1]: Listening on Query the User Interactively for a Password.1338second # [ 8.115246] systemd[1]: Listening on Process Core Dump Socket.1339second # [ 8.118778] systemd[1]: Listening on Credential Encryption/Decryption.1340second # [ 8.122400] systemd[1]: Listening on Factory Reset Management.1341second # [ 8.123923] systemd[1]: Listening on Hostname Service Socket.1342second # [ 8.128406] systemd[1]: Starting Journal Log Access Socket...1343second # [ 8.130391] systemd[1]: Listening on Journal Audit Socket.1344second # [ 8.134082] systemd[1]: Listening on Console Output Muting Service Socket.1345second # [ 8.135939] systemd[1]: Listening on Network Management Metrics Varlink Socket.1346second # [ 8.137683] systemd[1]: Listening on Network Management Varlink Socket.1347test # [ 8.108538] systemd[1]: Mounting /run/wrappers...1348second # [ 8.139282] systemd[1]: Listening on Network Management Netlink Socket.1349second # [ 8.141622] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1350second # [ 8.143176] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1351second # [ 8.144923] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1352second # [ 8.155187] systemd[1]: Listening on Disk Repartitioning Service Socket.1353second # [ 8.156310] systemd[1]: Listening on Resolve Monitor Varlink Socket.1354second # [ 8.157325] systemd[1]: Listening on Resolve Service Varlink Socket.1355second # [ 8.158336] systemd[1]: Listening on udev Control Socket.1356second # [ 8.159297] systemd[1]: Listening on udev Varlink Socket.1357second # [ 8.162658] systemd[1]: Mounting Huge Pages File System...1358second # [ 8.166531] systemd[1]: Mounting POSIX Message Queue File System...1359test # [ 8.137618] systemd-resolved[356]: Using system hostname 'test'.1360second # [ 8.173591] systemd[1]: Mounting Kernel Debug File System...1361test # [ 8.145665] systemd[1]: Started Network Name Resolution.1362second # [ 8.180654] systemd[1]: Mounting Kernel Trace File System...1363second # [ 8.190386] systemd[1]: Starting Create List of Static Device Nodes...1364second # [ 8.196838] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1365second # [ 8.198554] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1366test # [ 8.176967] systemd[1]: Mounted /run/wrappers.1367test # [ 8.177589] systemd[1]: Reached target Local File Systems.1368second # [ 8.209156] systemd[1]: Mounting Kernel Configuration File System...1369second # [ 8.210386] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1370second # [ 8.214226] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1371test # [ 8.185491] systemd[1]: Listening on Boot Loader Control Service Socket.1372test # [ 8.188328] systemd[1]: Starting register-nix-paths.service...1373test # [ 8.200210] systemd[1]: Starting Create SUID/SGID Wrappers...1374test # [ 8.200828] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1375second # [ 8.232927] systemd[1]: Starting Load Kernel Module fuse...1376second # [ 8.234560] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671377test # [ 8.205373] systemd[1]: Starting Save Transient machine-id to Disk...1378test # [ 8.230915] systemd[1]: Starting Create System Files and Directories...1379second # [ 8.313734] systemd[1]: Starting Journal Service...1380second # [ 8.351747] systemd[1]: Starting Load Kernel Modules...1381test # [ 8.322227] systemd[1]: Started Rule-based Manager for Device Events and Files.1382test # [ 8.357503] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1383second # [ 8.387507] fuse: init (API version 7.45)1384second # [ 8.394195] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1385test # [ 8.369841] systemd[1]: Finished Save Transient machine-id to Disk.1386second # [ 8.412654] systemd[1]: Starting Remount Root and Kernel File Systems...1387second # [ 8.414969] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1388test # [ 8.410743] systemd[1]: Finished Create System Files and Directories.1389second # [ 8.442272] systemd[1]: Starting Coldplug All udev Devices...1390test # [ 8.425454] systemd[1]: Starting Rebuild Journal Catalog...1391second # [ 8.456572] systemd[1]: Listening on Journal Log Access Socket.1392test # [ 8.428656] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1393second # [ 8.462718] systemd-journald[300]: Collecting audit messages is enabled.1394second # [ 8.467918] systemd[1]: Mounted Huge Pages File System.1395second # [ 8.469025] systemd[1]: Queued start job for default target Multi-User System.1396second # [ 8.479958] systemd[1]: Started Journal Service.1397second # [ 8.474257] systemd[1]: systemd-journald.service: Deactivated successfully.1398second # [ 8.475137] systemd-modules-load[301]: Module 'atkbd' is built in1399second # [ 8.475782] systemd-modules-load[301]: Module 'ctr' is built in1400second # [ 8.483150] systemd-modules-load[301]: Module 'loop' is built in1401second # [ 8.487595] systemd[1]: Mounted POSIX Message Queue File System.1402second # [ 8.492995] systemd[1]: Mounted Kernel Debug File System.1403second # [ 8.498037] systemd[1]: Mounted Kernel Trace File System.1404second # [ 8.502036] systemd[1]: Finished Create List of Static Device Nodes.1405second # [ 8.502742] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1406second # [ 8.503473] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1407second # [ 8.511762] systemd[1]: Mounted Kernel Configuration File System.1408second # [ 8.514741] systemd[1]: modprobe@fuse.service: Deactivated successfully.1409second # [ 8.517329] systemd[1]: Finished Load Kernel Module fuse.1410second # [ 8.520301] systemd[1]: Finished Load Kernel Modules.1411second # [ 8.528431] EXT4-fs (vda): re-mounted 53107085-f639-48f6-a272-2fe7ea214f7c.1412second # [ 8.532179] systemd[1]: Mounting FUSE Control File System...1413second # [ 8.539307] systemd[1]: Starting Firewall...1414second # [ 8.548174] systemd[1]: Starting Apply Kernel Variables...1415second # [ 8.565081] systemd-oomd[302]: No swap; memory pressure usage will be degraded1416test # [ 8.559747] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1417second # [ 8.584553] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1418second # [ 8.586238] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1419second # [ 8.590962] systemd[1]: Finished Remount Root and Kernel File Systems.1420second # [ 8.617779] systemd[1]: Listening on Disk Image Download Service Socket.1421second # [ 8.631868] systemd[1]: Starting Flush Journal to Persistent Storage...1422second # [ 8.636458] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1423second # [ 8.646698] systemd[1]: Starting Load/Save OS Random Seed...1424second # [ 8.657239] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1425test # [ 8.641770] systemd[1]: Finished Coldplug All udev Devices.1426test # [ 8.645446] systemd[1]: Finished Rebuild Journal Catalog.1427test # [ 8.660788] systemd[1]: Starting Update is Completed...1428second # [ 8.720631] systemd[1]: Finished Apply Kernel Variables.1429second # [ 8.740482] systemd[1]: Starting Network Name Resolution...1430test # [ 8.733064] systemd[1]: Finished Update is Completed.1431second # [ 8.770771] systemd-journald[300]: Received client request to flush runtime journal.1432second # [ 8.834837] systemd[1]: Mounted FUSE Control File System.1433second # [ 8.841505] systemd[1]: Finished Load/Save OS Random Seed.1434second # [ 8.844951] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1435second # [ 8.847799] systemd[1]: Reached target First Boot Complete.1436second # [ 8.849958] systemd[1]: Starting Create Static Device Nodes in /dev...1437second # [ 8.857586] systemd[1]: Finished Flush Journal to Persistent Storage.1438test # [ 8.897743] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1439second # [ 8.941998] systemd[1]: Finished Create Static Device Nodes in /dev.1440second # [ 8.942644] systemd[1]: Reached target Preparation for Local File Systems.1441second # [ 8.944960] systemd-resolved[328]: Positive Trust Anchors:1442second # [ 8.946297] systemd-resolved[328]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d1443second # [ 8.956372] systemd-resolved[328]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b161444second # [ 8.957290] systemd-resolved[328]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test1445second # [ 8.981941] systemd[1]: Starting Rule-based Manager for Device Events and Files...1446second # [ 9.085887] systemd[1]: Mounting /run/wrappers...1447second # [ 9.092452] systemd-udevd[343]: Using default interface naming scheme 'v261'.1448test # [ 9.118475] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1449test # [ 9.122494] systemd[1]: Finished Create SUID/SGID Wrappers.1450second # [ 9.171721] systemd[1]: Mounted /run/wrappers.1451second # [ 9.173086] systemd[1]: Reached target Local File Systems.1452second # [ 9.180430] systemd[1]: Listening on Boot Loader Control Service Socket.1453second # [ 9.192385] systemd[1]: Starting register-nix-paths.service...1454second # [ 9.199789] systemd[1]: Starting Create SUID/SGID Wrappers...1455second # [ 9.200870] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1456second # [ 9.219466] systemd[1]: Starting Save Transient machine-id to Disk...1457second # [ 9.252503] systemd-resolved[328]: Using system hostname 'second'.1458test # [ 9.231783] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1459second # [ 9.266168] systemd[1]: Starting Create System Files and Directories...1460second # [ 9.266878] systemd[1]: Started Network Name Resolution.1461test # [ 9.281911] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1462second # [ 9.375746] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1463second # [ 9.382649] systemd[1]: Finished Save Transient machine-id to Disk.1464test # [ 9.435048] systemd[1]: Finished Firewall.1465test # [ 9.436101] systemd[1]: Reached target Preparation for Network.1466second # [ 9.460706] systemd[1]: Finished Create System Files and Directories.1467test # [ 9.438512] systemd[1]: Listening on Network Management Resolve Hook Socket.1468test # [ 9.444559] systemd[1]: Starting Network Management...1469test # [ 9.446644] systemd[1]: Finished register-nix-paths.service.1470test # [ 9.448658] systemd[1]: Reached target System Initialization.1471second # [ 9.473619] systemd[1]: Starting Rebuild Journal Catalog...1472test # [ 9.451113] systemd[1]: Started Discard unused filesystem blocks once a week.1473test # [ 9.456577] systemd[1]: Started Daily Cleanup of Temporary Directories.1474test # [ 9.457187] systemd[1]: Reached target Timer Units.1475test # [ 9.461960] systemd[1]: Listening on D-Bus System Message Bus Socket.1476test # [ 9.463980] systemd[1]: Listening on Nix Daemon Socket.1477test # [ 9.473967] systemd[1]: Listening on Authorization Manager Agent Helper.1478second # [ 9.497319] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1479test # [ 9.474897] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1480test # [ 9.477255] systemd[1]: Reached target Socket Units.1481test # [ 9.480459] systemd[1]: Starting D-Bus System Message Bus...1482second # [ 9.514134] systemd[1]: Started Rule-based Manager for Device Events and Files.1483second # [ 9.598323] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1484test # [ 9.590888] (udev-worker)[460]: Network interface NamePolicy= disabled on kernel command line.1485test # [ 9.600997] (udev-worker)[464]: Network interface NamePolicy= disabled on kernel command line.1486second # [ 9.685556] systemd[1]: Finished Rebuild Journal Catalog.1487test # [ 9.668228] cfg80211: Loading compiled-in X.509 certificates for regulatory database1488test # [ 9.666589] dbus-broker-launch[550]: Looking up NSS user entry for 'systemd-timesync'...1489test # [ 9.677995] dbus-broker-launch[550]: NSS returned no entry for 'systemd-timesync'1490test # [ 9.680506] dbus-broker-launch[550]: Invalid user-name in /nix/store/v75lm2dz2mrsmfqk5r627pn549ggxlva-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1491second # [ 9.705289] systemd[1]: Starting Update is Completed...1492test # [ 9.704149] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1493test # [ 9.704666] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1494test # [ 9.722098] dbus-broker-launch[550]: Ignoring duplicate name 'org.freedesktop.nm_dispatcher' in service file '/nix/store/xgs4xjlwr0cqq20q5pf50b6rh69dp7yp-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_dispatcher.service'1495test # [ 9.724225] dbus-broker-launch[550]: Ignoring duplicate name 'org.freedesktop.nm_priv_helper' in service file '/nix/store/xgs4xjlwr0cqq20q5pf50b6rh69dp7yp-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_priv_helper.service'1496test # [ 9.727694] dbus-broker-launch[550]: Ignoring duplicate name 'org.freedesktop.ModemManager1' in service file '/nix/store/q3gr23jczqdkab4ynasfyv5pk0907sly-modemmanager-1.24.2/share/dbus-1/system-services/org.freedesktop.ModemManager1.service'1497test # [ 9.735565] dbus-broker-launch[550]: Ignoring duplicate name 'org.freedesktop.PolicyKit1' in service file '/nix/store/50h0k21qqr8489rim5ww9gp74lvl1i34-polkit-127/share/dbus-1/system-services/org.freedesktop.PolicyKit1.service'1498test # [ 9.742779] systemd[1]: Started D-Bus System Message Bus.1499second # [ 9.767911] systemd[1]: Finished Update is Completed.1500second # [ 9.777074] systemd[1]: Finished Coldplug All udev Devices.1501test # [ 9.761327] systemd-networkd[547]: /etc/systemd/network/99-ethernet-default-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.1502test # [ 9.770940] systemd-networkd[547]: /etc/systemd/network/99-wireless-client-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.1503test # [ 9.777484] systemd-networkd[547]: lo: Link UP1504test # [ 9.777936] systemd-networkd[547]: lo: Gained carrier1505test # [ 9.778372] systemd-networkd[547]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1506test # [ 9.779572] systemd-networkd[547]: eth1: Configuring with /etc/systemd/network/40-eth1.network.1507test # [ 9.793062] systemd-networkd[547]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1508test # [ 9.796441] systemd-networkd[547]: eth1: Link UP1509test # [ 9.797913] systemd-networkd[547]: eth1: Gained carrier1510test # [ 9.801303] systemd-networkd[547]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1511test # [ 9.807152] dbus-broker-launch[550]: Ready1512test # [ 9.810242] systemd[1]: Started Network Management.1513test # [ 9.810722] systemd[1]: Reached target Basic System.1514test # [ 9.814671] systemd[1]: Starting Network Manager Script Dispatcher Service...1515test # [ 9.818464] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1516test # [ 9.831593] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1517test # [ 9.848856] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1518test # [ 9.881382] systemd[1]: Starting Network Manager...1519test # [ 9.900177] systemd[1]: Started backdoor.service.1520test # [ 9.910845] mousedev: PS/2 mouse device common for all mice1521test # [ 9.932071] systemd[1]: Starting Import lastlog data into lastlog2 database...1522test # [ 9.960385] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1523test # [ 9.963449] 6zad8qjsgcihj3d5ws39j6s93s5yrjm7-wifi-secrets[561]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1524test # [ 9.972340] bfrwvyg79my69yafr053q6bzx4lix24v-wifi-secrets[560]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1525test # [ 9.978376] vx4skfrgyqk0f8j1mp5lv936zif6nn10-wifi-secrets[562]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1526test # [ 9.993761] systemd[1]: Starting Post-Boot Actions...1527second # [ 10.047083] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1528test # [ 10.039159] systemd[1]: Started Reset console on configuration changes.1529test # [ 10.081471] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...1530second # [ 10.153924] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1531second # [ 10.155432] systemd[1]: Finished Create SUID/SGID Wrappers.1532test # [ 10.135426] systemd[1]: NetworkManager-setup-secrets-wg-test-all.service: Deactivated successfully.1533test # [ 10.144792] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1534test # [ 10.145423] systemd[1]: NetworkManager-setup-secrets-wg-test-one.service: Deactivated successfully.1535test # [ 10.146135] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1536test # [ 10.146700] systemd[1]: NetworkManager-setup-secrets-wg-test-open.service: Deactivated successfully.1537test # [ 10.147414] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1538test # connecting to host...1539test: Guest shell says: b'Spawning backdoor root shell...\n'1540test # [ 10.211849] systemd[1]: Finished Post-Boot Actions.1541test: connected to guest root shell1542test: (connecting took 10.49 seconds)1543test: (finished: waiting for the VM to finish booting, in 10.49 seconds)1544test # [ 10.250350] nsncd[569]: Jul 24 05:19:43.086 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1545test # [ 10.257818] systemd[1]: Started Name Service Cache Daemon (nsncd).1546test # [ 10.258457] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.1547test # [ 10.259025] systemd[1]: Started Network Manager Script Dispatcher Service.1548test # [ 10.265902] systemd[1]: Finished Import lastlog data into lastlog2 database.1549test # [ 10.269144] systemd[1]: Reached target Host and Network Name Lookups.1550test # [ 10.269706] systemd[1]: Reached target User and Group Name Lookups.1551test # [ 10.284082] systemd[1]: Starting User Login Management...1552second # [ 10.329938] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1553second # [ 10.377865] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1554test # [ 10.398062] systemd[1]: Starting Hostname Service...1555test # [ 10.429438] systemd-logind[616]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)1556second # [ 10.455272] systemd[1]: Finished register-nix-paths.service.1557second # [ 10.457237] systemd[1]: Reached target System Initialization.1558test # [ 10.433729] systemd-logind[616]: Watching system buttons on /dev/input/event0 (gpio-keys)1559test # [ 10.436825] systemd-logind[616]: New seat seat0.1560second # [ 10.460133] systemd[1]: Started Discard unused filesystem blocks once a week.1561test # [ 10.437324] systemd[1]: Started User Login Management.1562second # [ 10.462910] systemd[1]: Started Daily Cleanup of Temporary Directories.1563second # [ 10.465683] systemd[1]: Reached target Timer Units.1564test # [ 10.442068] systemd[1]: Starting linger-users.service...1565second # [ 10.466967] systemd[1]: Listening on D-Bus System Message Bus Socket.1566second # [ 10.470272] systemd[1]: Listening on Nix Daemon Socket.1567second # [ 10.472268] systemd[1]: Listening on Authorization Manager Agent Helper.1568second # [ 10.473992] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1569second # [ 10.476891] systemd[1]: Reached target Socket Units.1570second # [ 10.479223] systemd[1]: Starting D-Bus System Message Bus...1571second # [ 10.534241] systemd[1]: Finished Firewall.1572second # [ 10.535137] systemd[1]: Reached target Preparation for Network.1573second # [ 10.537643] systemd[1]: Listening on Network Management Resolve Hook Socket.1574test # [ 10.516799] systemd[1]: linger-users.service: Deactivated successfully.1575test # [ 10.517415] systemd[1]: Finished linger-users.service.1576second # [ 10.542540] systemd[1]: Starting Network Management...1577test # [ 10.533416] systemd[1]: Started Hostname Service.1578second # [ 10.647093] dbus-broker-launch[516]: Looking up NSS user entry for 'systemd-timesync'...1579test # [ 10.625456] systemd-networkd[547]: eth0: Link UP1580test # [ 10.625910] systemd-networkd[547]: eth0: Gained carrier1581second # [ 10.657804] dbus-broker-launch[516]: NSS returned no entry for 'systemd-timesync'1582second # [ 10.658676] dbus-broker-launch[516]: Invalid user-name in /nix/store/v75lm2dz2mrsmfqk5r627pn549ggxlva-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1583test # [ 10.645462] systemd[1]: Started Network Manager.1584test # [ 10.647781] systemd[1]: Reached target Network.1585test # [ 10.651407] systemd[1]: Starting Ensure that NetworkManager declarative profiles are created...1586test # [ 10.666289] systemd[1]: Starting Permit User Sessions...1587second # [ 10.702618] dbus-broker-launch[516]: Ignoring duplicate name 'org.freedesktop.nm_dispatcher' in service file '/nix/store/xgs4xjlwr0cqq20q5pf50b6rh69dp7yp-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_dispatcher.service'1588second # [ 10.709084] dbus-broker-launch[516]: Ignoring duplicate name 'org.freedesktop.nm_priv_helper' in service file '/nix/store/xgs4xjlwr0cqq20q5pf50b6rh69dp7yp-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_priv_helper.service'1589second # [ 10.717356] dbus-broker-launch[516]: Ignoring duplicate name 'org.freedesktop.ModemManager1' in service file '/nix/store/q3gr23jczqdkab4ynasfyv5pk0907sly-modemmanager-1.24.2/share/dbus-1/system-services/org.freedesktop.ModemManager1.service'1590second # [ 10.725207] dbus-broker-launch[516]: Ignoring duplicate name 'org.freedesktop.PolicyKit1' in service file '/nix/store/50h0k21qqr8489rim5ww9gp74lvl1i34-polkit-127/share/dbus-1/system-services/org.freedesktop.PolicyKit1.service'1591second # [ 10.731970] systemd[1]: Started D-Bus System Message Bus.1592second # [ 10.735209] (udev-worker)[450]: Network interface NamePolicy= disabled on kernel command line.1593second # [ 10.740392] (udev-worker)[460]: Network interface NamePolicy= disabled on kernel command line.1594second # [ 10.780906] cfg80211: Loading compiled-in X.509 certificates for regulatory database1595second # [ 10.787012] dbus-broker-launch[516]: Ready1596second # [ 10.791249] systemd[1]: Reached target Basic System.1597second # [ 10.797054] systemd[1]: Starting Network Manager Script Dispatcher Service...1598second # [ 10.805530] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1599second # [ 10.818460] systemd[1]: Starting Network Manager...1600test # [ 10.802715] systemd[1]: Finished Permit User Sessions.1601second # [ 10.832476] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1602second # [ 10.832998] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1603second # [ 10.844957] systemd[1]: Started backdoor.service.1604test # [ 10.823416] systemd[1]: Started Getty on tty1.1605test # [ 10.825849] systemd[1]: Reached target Login Prompts.1606second # [ 10.876995] systemd[1]: Starting Import lastlog data into lastlog2 database...1607test # [ 10.881978] systemd-resolved[356]: eth0: Bus client set default route setting: yes1608test # [ 10.885212] systemd-resolved[356]: eth0: Bus client set DNS server list to: 10.0.2.31609second # [ 10.908424] systemd-networkd[523]: /etc/systemd/network/99-ethernet-default-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.1610second # [ 10.921570] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1611second # [ 10.931820] systemd-networkd[523]: /etc/systemd/network/99-wireless-client-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.1612second # [ 10.944132] systemd-networkd[523]: lo: Link UP1613second # [ 10.948315] systemd-networkd[523]: lo: Gained carrier1614second # [ 10.955836] systemd[1]: Starting Post-Boot Actions...1615test # [ 10.933929] systemd[1]: NetworkManager-ensure-profiles.service: Deactivated successfully.1616test # [ 10.936903] systemd[1]: Finished Ensure that NetworkManager declarative profiles are created.1617test # [ 10.949665] systemd[1]: Reached target Multi-User System.1618test # [ 10.952861] systemd[1]: Startup finished in 730ms (kernel) + 4.439s (initrd) + 5.780s (userspace) = 10.950s.1619second # [ 11.000545] systemd[1]: Started Reset console on configuration changes.1620second # [ 11.010784] bfrwvyg79my69yafr053q6bzx4lix24v-wifi-secrets[531]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1621second # [ 11.022522] systemd[1]: Started Network Management.1622second # connecting to host...1623second # [ 11.043357] systemd-networkd[523]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1624second # [ 11.058029] systemd-networkd[523]: eth1: Configuring with /etc/systemd/network/40-eth1.network.1625test # [ 11.044734] systemd-networkd[547]: eth1: Gained IPv6LL1626second # [ 11.069403] systemd-networkd[523]: eth1: Link UP1627second # [ 11.075860] systemd-networkd[523]: eth1: Gained carrier1628second # [ 11.082482] systemd-networkd[523]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1629second # [ 11.093075] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...1630second # [ 11.093822] systemd[1]: NetworkManager-setup-secrets-wg-test-all.service: Deactivated successfully.1631second # [ 11.094598] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1632second # [ 11.149097] systemd[1]: Finished Post-Boot Actions.1633second # [ 11.166881] systemd[1]: Started Name Service Cache Daemon (nsncd).1634second # [ 11.173552] nsncd[539]: Jul 24 05:19:44.000 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1635second # [ 11.194252] systemd[1]: Reached target Host and Network Name Lookups.1636second # [ 11.197846] systemd[1]: Reached target User and Group Name Lookups.1637second # [ 11.217650] systemd[1]: Starting User Login Management...1638second # [ 11.221419] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.1639second # [ 11.242117] systemd[1]: Started Network Manager Script Dispatcher Service.1640second # [ 11.250863] systemd[1]: Finished Import lastlog data into lastlog2 database.1641second # [ 11.280798] mousedev: PS/2 mouse device common for all mice1642second # [ 11.308454] systemd[1]: Starting Hostname Service...1643second # [ 11.388326] systemd-logind[570]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)1644second # [ 11.389630] systemd-logind[570]: Watching system buttons on /dev/input/event0 (gpio-keys)1645second # [ 11.390271] systemd-logind[570]: New seat seat0.1646second # [ 11.397401] systemd[1]: Started User Login Management.1647second # [ 11.400596] systemd[1]: Starting linger-users.service...1648second # [ 11.467064] systemd[1]: Started Hostname Service.1649second # [ 11.470845] systemd[1]: linger-users.service: Deactivated successfully.1650second # [ 11.473405] systemd[1]: Finished linger-users.service.1651test # [ 11.466967] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:09.0/virtio8/input/input31652test: (finished: waiting for unit NetworkManager.service, in 11.72 seconds)1653test: must succeed: cat /run/NetworkManager/system-connections/one.nmconnection1654test: (finished: must succeed: cat /run/NetworkManager/system-connections/one.nmconnection, in 0.04 seconds)1655test: must succeed: cat /run/secrets/NetworkManager/wifi-secrets1656second # [ 11.552559] systemd-networkd[523]: eth0: Link UP1657second # [ 11.553028] systemd-networkd[523]: eth0: Gained carrier1658second # [ 11.572473] systemd[1]: Started Network Manager.1659second # [ 11.574453] systemd[1]: Reached target Network.1660test: (finished: must succeed: cat /run/secrets/NetworkManager/wifi-secrets, in 0.04 seconds)1661test: must succeed: cat /run/NetworkManager/system-connections/open.nmconnection1662second # [ 11.580146] systemd[1]: Starting Ensure that NetworkManager declarative profiles are created...1663second # [ 11.588814] systemd[1]: Starting Permit User Sessions...1664test: (finished: must succeed: cat /run/NetworkManager/system-connections/open.nmconnection, in 0.03 seconds)1665(finished: run the VM test script, in 12.27 seconds)1666test script finished in 12.32s1667cleanup1668kill QemuMachine (pid 48)1669second # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/ymm5c1kb7p2r6331bgcdxijayqhcbvqy-python3-3.14.6/bin/python3.14)1670test # [ 11.774572] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1671kill QemuMachine (pid 47)1672test # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/ymm5c1kb7p2r6331bgcdxijayqhcbvqy-python3-3.14.6/bin/python3.14)1673(finished: cleanup, in 0.24 seconds)