vm-test-run-wifi
checks.aarch64-linux.wifi
· build #565
· 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 # Disk image does not exist, creating the virtualisation disk image...14second: QEMU running (pid 15)15second # Formatting '/build/vm-state-second/tmp.7xQVLuzLR7', fmt=raw size=107374182416test # Disk image does not exist, creating the virtualisation disk image...17second # mke2fs 1.47.4 (6-Mar-2025)18test # Formatting '/build/vm-state-test/tmp.a05SQrng04', fmt=raw size=107374182419second # Discarding device blocks: 0/262144 done20test # mke2fs 1.47.4 (6-Mar-2025)21second # Creating filesystem with 262144 4k blocks and 65536 inodes22second # Filesystem UUID: 101b7992-002c-4d68-b56e-3d08df224ebb23test: QEMU running (pid 14)24test # Discarding device blocks: 0/262144 done25second # Superblock backups stored on blocks:26test # Creating filesystem with 262144 4k blocks and 65536 inodes27second # 32768, 98304, 163840, 22937628test # Filesystem UUID: 6860c9da-8862-410c-a7e5-28a7cb01be4929second # 30test # Superblock backups stored on blocks:31second # Allocating group tables: 0/8 done32second # Writing inode tables: 0/8 done33(finished: start all VMs, in 0.55 seconds)34test # 32768, 98304, 163840, 22937635second # Creating journal (8192 blocks): done36second # Writing superblocks and filesystem accounting information: 0/8 done37test # 38second # 39test # Allocating group tables: 0/8 done40second # Virtualisation disk image created.41test # Writing inode tables: 0/8 done42test: waiting for unit NetworkManager.service43test # Creating journal (8192 blocks): done44test: waiting for the VM to finish booting45test # 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.48 (nixbld@localhost) (gcc (GCC) 15.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Fri Aug 28 06:22:54 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.69test # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1]70second # [ 0.000000] psci: Using standard PSCI v0.2 function IDs71second # [ 0.000000] psci: Trusted OS migration not required72second # [ 0.000000] psci: SMC Calling Convention v1.173test # [ 0.000000] Linux version 6.18.48 (nixbld@localhost) (gcc (GCC) 15.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Fri Aug 28 06:22:54 UTC 202674test # [ 0.000000] KASLR enabled75second # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)76test # [ 0.000000] random: crng init done77test # [ 0.000000] Machine model: linux,dummy-virt78second # [ 0.000000] percpu: Embedded 76 pages/cpu s186328 r8192 d116776 u31129679test # [ 0.000000] efi: UEFI not found.80second # [ 0.000000] Detected PIPT I-cache on CPU081test # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT82second # [ 0.000000] CPU features: detected: GICv3 CPU interface83second # [ 0.000000] CPU features: detected: Spectre-v484test # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]85second # [ 0.000000] CPU features: detected: Spectre-BHB86test # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc07740-0x7fc0aebf]87second # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR88test # [ 0.000000] Zone ranges:89second # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)90test # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]91second # [ 0.000000] CPU features: detected: ARM erratum 141804092test # [ 0.000000] DMA32 empty93test # [ 0.000000] Normal empty94second # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion95test # [ 0.000000] Device empty96test # [ 0.000000] Movable zone start for each node97second # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing98test # [ 0.000000] Early memory node ranges99second # [ 0.000000] alternatives: applying boot alternatives100test # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]101test # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]102test # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca00000103test # [ 0.000000] psci: probing for conduit method from DT.104test # [ 0.000000] psci: PSCIv1.3 detected in firmware.105second # [ 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/mqrk7mnq0c1pzx0a17lgr5i6b2pcqsp4-nixos-system-second-test/init regInfo=/nix/store/avbnw62jw7nn32fiz75sxki9d24y7x3p-closure-info/registration console=ttyAMA0,115200n8 console=tty0106test # [ 0.000000] psci: Using standard PSCI v0.2 function IDs107test # [ 0.000000] psci: Trusted OS migration not required108test # [ 0.000000] psci: SMC Calling Convention v1.1109second # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/avbnw62jw7nn32fiz75sxki9d24y7x3p-closure-info/registration", will be passed to user space.110second # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes111test # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)112second # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)113test # [ 0.000000] percpu: Embedded 76 pages/cpu s186328 r8192 d116776 u311296114test # [ 0.000000] Detected PIPT I-cache on CPU0115second # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)116test # [ 0.000000] CPU features: detected: GICv3 CPU interface117second # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB118test # [ 0.000000] CPU features: detected: Spectre-v4119second # [ 0.000000] software IO TLB: area num 1.120test # [ 0.000000] CPU features: detected: Spectre-BHB121second # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)122second # [ 0.000000] Fallback order for Node 0: 0123test # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR124second # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144125second # [ 0.000000] Policy zone: DMA126test # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)127test # [ 0.000000] CPU features: detected: ARM erratum 1418040128second # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off129test # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion130second # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1131second # [ 0.000000] allocated 2097152 bytes of page_ext132test # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing133second # [ 0.000000] ftrace: allocating 74760 entries in 294 pages134test # [ 0.000000] alternatives: applying boot alternatives135second # [ 0.000000] ftrace: allocated 294 pages with 4 groups136second # [ 0.000000] rcu: Hierarchical RCU implementation.137second # [ 0.000000] rcu: RCU event tracing is enabled.138second # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.139second # [ 0.000000] Trampoline variant of Tasks RCU enabled.140second # [ 0.000000] Rude variant of Tasks RCU enabled.141second # [ 0.000000] Tracing variant of Tasks RCU enabled.142test # [ 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/b6rjxxx5hzzmb6gdicva5bdla102ph72-nixos-system-test-test/init regInfo=/nix/store/7r6sdpmanjc7vcdw8ir1rmcx2mipx22i-closure-info/registration console=ttyAMA0,115200n8 console=tty0143second # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.144second # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1145test # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/7r6sdpmanjc7vcdw8ir1rmcx2mipx22i-closure-info/registration", will be passed to user space.146second # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.147test # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes148second # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.149test # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)150second # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.151test # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)152second # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0153second # [ 0.000000] GICv3: 256 SPIs implemented154test # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB155second # [ 0.000000] GICv3: 0 Extended SPIs implemented156test # [ 0.000000] software IO TLB: area num 1.157second # [ 0.000000] Root IRQ handler: gic_handle_irq158test # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)159second # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI160second # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0161second # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000162test # [ 0.000000] Fallback order for Node 0: 0163second # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]164test # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144165test # [ 0.000000] Policy zone: DMA166second # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)167test # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off168second # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)169test # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1170second # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000171test # [ 0.000000] allocated 2097152 bytes of page_ext172second # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000173test # [ 0.000000] ftrace: allocating 74760 entries in 294 pages174second # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.175test # [ 0.000000] ftrace: allocated 294 pages with 4 groups176test # [ 0.000000] rcu: Hierarchical RCU implementation.177second # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns178test # [ 0.000000] rcu: RCU event tracing is enabled.179second # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040180test # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.181second # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).182test # [ 0.000000] Trampoline variant of Tasks RCU enabled.183test # [ 0.000000] Rude variant of Tasks RCU enabled.184second # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns185test # [ 0.000000] Tracing variant of Tasks RCU enabled.186second # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns187test # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.188second # [ 0.000063] arm-pv: using stolen time PV189test # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1190second # [ 0.000418] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)191second # [ 0.000741] Console: colour dummy device 80x25192test # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.193second # [ 0.000760] printk: legacy console [tty0] enabled194test # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.195second # [ 0.000978] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)196second # [ 0.000983] pid_max: default: 32768 minimum: 301197test # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.198test # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0199second # [ 0.001066] LSM: initializing lsm=capability,landlock,yama,bpf,ima200second # [ 0.001194] landlock: Up and running.201test # [ 0.000000] GICv3: 256 SPIs implemented202second # [ 0.001196] Yama: becoming mindful.203test # [ 0.000000] GICv3: 0 Extended SPIs implemented204second # [ 0.001582] LSM support for eBPF active205test # [ 0.000000] Root IRQ handler: gic_handle_irq206second # [ 0.001735] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)207test # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI208test # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0209second # [ 0.001755] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)210test # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000211second # [ 0.003610] cacheinfo: Unable to detect cache hierarchy for CPU 0212test # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]213second # [ 0.004463] rcu: Hierarchical SRCU implementation.214second # [ 0.004469] rcu: Max phase no-delay instances is 1000.215test # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)216second # [ 0.005412] fsl-mc MSI: its@8080000 domain created217second # [ 0.005562] EFI services will not be available.218test # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)219second # [ 0.005653] smp: Bringing up secondary CPUs ...220second # [ 0.005688] smp: Brought up 1 node, 1 CPU221test # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000222second # [ 0.005691] SMP: Total of 1 processors activated.223second # [ 0.005692] CPU: All CPU(s) started at EL1224test # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000225second # [ 0.005706] CPU features: detected: 32-bit EL0 Support226test # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.227second # [ 0.005709] CPU features: detected: Data cache clean to the PoU not required for I/D coherence228test # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns229second # [ 0.005711] CPU features: detected: Common not Private translations230test # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040231second # [ 0.005713] CPU features: detected: CRC32 instructions232test # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).233second # [ 0.005715] CPU features: detected: Data cache clean to Point of Persistence234second # [ 0.005718] CPU features: detected: Enhanced Virtualization Traps235test # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns236second # [ 0.005730] CPU features: detected: RCpc load-acquire (LDAPR)237test # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns238second # [ 0.005732] CPU features: detected: LSE atomic instructions239test # [ 0.000078] arm-pv: using stolen time PV240second # [ 0.005734] CPU features: detected: Privileged Access Never241second # [ 0.005736] CPU features: detected: PMUv3242test # [ 0.000717] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)243second # [ 0.005738] CPU features: detected: RAS Extension Support244test # [ 0.001042] Console: colour dummy device 80x25245second # [ 0.005741] CPU features: detected: Speculative Store Bypassing Safe (SSBS)246test # [ 0.001062] printk: legacy console [tty0] enabled247second # [ 0.005762] alternatives: applying system-wide alternatives248test # [ 0.001301] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)249second # [ 0.007138] CPU features: detected: Hardware dirty bit management on CPU0250test # [ 0.001307] pid_max: default: 32768 minimum: 301251test # [ 0.001396] LSM: initializing lsm=capability,landlock,yama,bpf,ima252second # [ 0.007346] Memory: 893156K/1048576K available (24320K kernel code, 7086K rwdata, 26340K rodata, 4736K init, 1103K bss, 114100K reserved, 32768K cma-reserved)253test # [ 0.001546] landlock: Up and running.254second # [ 0.007841] devtmpfs: initialized255test # [ 0.001548] Yama: becoming mindful.256test # [ 0.002144] LSM support for eBPF active257second # [ 0.009405] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)258test # [ 0.002338] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)259second # [ 0.009427] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).260test # [ 0.002359] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)261second # [ 0.009567] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL262second # [ 0.009570] 0 pages in range for non-PLT usage263test # [ 0.004544] cacheinfo: Unable to detect cache hierarchy for CPU 0264second # [ 0.009571] 508336 pages in range for PLT usage265test # [ 0.005334] rcu: Hierarchical SRCU implementation.266second # [ 0.009689] pinctrl core: initialized pinctrl subsystem267test # [ 0.005339] rcu: Max phase no-delay instances is 1000.268second # [ 0.010836] DMI not present or invalid.269test # [ 0.006375] fsl-mc MSI: its@8080000 domain created270second # [ 0.014764] NET: Registered PF_NETLINK/PF_ROUTE protocol family271test # [ 0.006537] EFI services will not be available.272test # [ 0.006640] smp: Bringing up secondary CPUs ...273second # [ 0.017243] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations274test # [ 0.006676] smp: Brought up 1 node, 1 CPU275second # [ 0.017394] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations276test # [ 0.006679] SMP: Total of 1 processors activated.277test # [ 0.006681] CPU: All CPU(s) started at EL1278second # [ 0.017566] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations279test # [ 0.006693] CPU features: detected: 32-bit EL0 Support280second # [ 0.017584] audit: initializing netlink subsys (disabled)281test # [ 0.006696] CPU features: detected: Data cache clean to the PoU not required for I/D coherence282second # [ 0.018192] thermal_sys: Registered thermal governor 'fair_share'283second # [ 0.018195] thermal_sys: Registered thermal governor 'bang_bang'284test # [ 0.006699] CPU features: detected: Common not Private translations285test # [ 0.006701] CPU features: detected: CRC32 instructions286second # [ 0.018198] thermal_sys: Registered thermal governor 'step_wise'287second # [ 0.018200] thermal_sys: Registered thermal governor 'user_space'288test # [ 0.006703] CPU features: detected: Data cache clean to Point of Persistence289second # [ 0.018202] thermal_sys: Registered thermal governor 'power_allocator'290test # [ 0.006705] CPU features: detected: Enhanced Virtualization Traps291test # [ 0.006716] CPU features: detected: RCpc load-acquire (LDAPR)292second # [ 0.018232] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1293test # [ 0.006718] CPU features: detected: LSE atomic instructions294second # [ 0.018248] cpuidle: using governor ladder295second # [ 0.018253] cpuidle: using governor menu296test # [ 0.006720] CPU features: detected: Privileged Access Never297test # [ 0.006722] CPU features: detected: PMUv3298second # [ 0.018367] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.299test # [ 0.006724] CPU features: detected: RAS Extension Support300second # [ 0.018389] ASID allocator initialised with 32768 entries301second # [ 0.019091] Serial: AMBA PL011 UART driver302test # [ 0.006728] CPU features: detected: Speculative Store Bypassing Safe (SSBS)303test # [ 0.006750] alternatives: applying system-wide alternatives304second # [ 0.022214] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1305second # [ 0.022352] printk: console [ttyAMA0] enabled306test # [ 0.008229] CPU features: detected: Hardware dirty bit management on CPU0307test # [ 0.008425] Memory: 893172K/1048576K available (24320K kernel code, 7086K rwdata, 26340K rodata, 4736K init, 1103K bss, 114088K reserved, 32768K cma-reserved)308test # [ 0.008962] devtmpfs: initialized309test # [ 0.010720] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)310test # [ 0.010749] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).311test # [ 0.010917] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL312test # [ 0.010920] 0 pages in range for non-PLT usage313test # [ 0.010921] 508336 pages in range for PLT usage314test # [ 0.011064] pinctrl core: initialized pinctrl subsystem315test # [ 0.011943] DMI not present or invalid.316test # [ 0.015699] NET: Registered PF_NETLINK/PF_ROUTE protocol family317test # [ 0.018376] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations318test # [ 0.018538] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations319test # [ 0.018711] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations320test # [ 0.018730] audit: initializing netlink subsys (disabled)321test # [ 0.019403] thermal_sys: Registered thermal governor 'fair_share'322test # [ 0.019405] thermal_sys: Registered thermal governor 'bang_bang'323second # [ 0.097159] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages324test # [ 0.019409] thermal_sys: Registered thermal governor 'step_wise'325second # [ 0.097180] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page326test # [ 0.019411] thermal_sys: Registered thermal governor 'user_space'327second # [ 0.097188] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages328test # [ 0.019413] thermal_sys: Registered thermal governor 'power_allocator'329second # [ 0.097191] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page330test # [ 0.019449] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1331second # [ 0.097194] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages332test # [ 0.019462] cpuidle: using governor ladder333test # [ 0.019468] cpuidle: using governor menu334second # [ 0.097197] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page335test # [ 0.019586] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.336second # [ 0.097201] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages337test # [ 0.019611] ASID allocator initialised with 32768 entries338second # [ 0.097204] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page339test # [ 0.020370] Serial: AMBA PL011 UART driver340test # [ 0.023780] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1341test # [ 0.023967] printk: console [ttyAMA0] enabled342second # [ 0.102262] fbcon: Taking over console343second # [ 0.102280] ACPI: Interpreter disabled.344second # [ 0.103536] iommu: Default domain type: Translated345second # [ 0.103547] iommu: DMA domain TLB invalidation policy: strict mode346second # [ 0.104757] SCSI subsystem initialized347test # [ 0.104334] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages348test # [ 0.104357] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page349test # [ 0.104364] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages350test # [ 0.104367] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page351test # [ 0.104371] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages352test # [ 0.104374] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page353test # [ 0.104377] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages354second # [ 0.113400] usbcore: registered new interface driver usbfs355second # [ 0.113441] usbcore: registered new interface driver hub356test # [ 0.104380] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page357second # [ 0.113460] usbcore: registered new device driver usb358second # [ 0.113675] pps_core: LinuxPPS API ver. 1 registered359second # [ 0.113680] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>360second # [ 0.113686] PTP clock support registered361second # [ 0.113716] EDAC MC: Ver: 3.0.0362test # [ 0.109596] fbcon: Taking over console363test # [ 0.109616] ACPI: Interpreter disabled.364second # [ 0.116902] scmi_core: SCMI protocol bus registered365test # [ 0.110943] iommu: Default domain type: Translated366test # [ 0.110954] iommu: DMA domain TLB invalidation policy: strict mode367second # [ 0.117715] FPGA manager framework368test # [ 0.112149] SCSI subsystem initialized369second # [ 0.118741] vgaarb: loaded370second # [ 0.119191] clocksource: Switched to clocksource arch_sys_counter371test # [ 0.112747] usbcore: registered new interface driver usbfs372test # [ 0.112781] usbcore: registered new interface driver hub373test # [ 0.112798] usbcore: registered new device driver usb374test # [ 0.113008] pps_core: LinuxPPS API ver. 1 registered375test # [ 0.113015] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>376test # [ 0.113021] PTP clock support registered377test # [ 0.113057] EDAC MC: Ver: 3.0.0378test # [ 0.116085] scmi_core: SCMI protocol bus registered379test # [ 0.116932] FPGA manager framework380second # [ 0.124584] VFS: Disk quotas dquot_6.6.0381second # [ 0.124620] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)382second # [ 0.127027] netfs: FS-Cache loaded383second # [ 0.127147] pnp: PnP ACPI: disabled384test # [ 0.124758] vgaarb: loaded385second # [ 0.129597] NET: Registered PF_INET protocol family386test # [ 0.125241] clocksource: Switched to clocksource arch_sys_counter387second # [ 0.129787] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)388test # [ 0.130564] VFS: Disk quotas dquot_6.6.0389test # [ 0.130603] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)390test # [ 0.133148] netfs: FS-Cache loaded391test # [ 0.133605] pnp: PnP ACPI: disabled392test # [ 0.135753] NET: Registered PF_INET protocol family393test # [ 0.135945] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)394second # [ 0.153849] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)395second # [ 0.153881] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)396second # [ 0.153895] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)397second # [ 0.153933] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)398second # [ 0.154001] TCP: Hash tables configured (established 8192 bind 8192)399second # [ 0.154094] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)400second # [ 0.154153] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)401second # [ 0.154180] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)402second # [ 0.154319] NET: Registered PF_UNIX/PF_LOCAL protocol family403second # [ 0.154356] NET: Registered PF_XDP protocol family404second # [ 0.154377] PCI: CLS 0 bytes, default 64405second # [ 0.154575] Trying to unpack rootfs image as initramfs...406second # [ 0.165717] kvm [1]: HYP mode not available407test # [ 0.160319] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)408test # [ 0.160353] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)409test # [ 0.160367] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)410test # [ 0.160407] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)411test # [ 0.160476] TCP: Hash tables configured (established 8192 bind 8192)412test # [ 0.160571] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)413test # [ 0.160603] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)414test # [ 0.160626] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)415test # [ 0.160746] NET: Registered PF_UNIX/PF_LOCAL protocol family416test # [ 0.160778] NET: Registered PF_XDP protocol family417test # [ 0.160801] PCI: CLS 0 bytes, default 64418test # [ 0.161024] Trying to unpack rootfs image as initramfs...419test # [ 0.175581] kvm [1]: HYP mode not available420second # [ 0.239569] Initialise system trusted keyrings421second # [ 0.240095] workingset: timestamp_bits=42 max_order=18 bucket_order=0422second # [ 0.241080] squashfs: version 4.0 (2009/01/31) Phillip Lougher423second # [ 0.241606] 9p: Installing v9fs 9p2000 file system support424test # [ 0.241975] Initialise system trusted keyrings425test # [ 0.242504] workingset: timestamp_bits=42 max_order=18 bucket_order=0426test # [ 0.243491] squashfs: version 4.0 (2009/01/31) Phillip Lougher427test # [ 0.244029] 9p: Installing v9fs 9p2000 file system support428second # [ 0.261057] Key type asymmetric registered429second # [ 0.261085] Asymmetric key parser 'x509' registered430second # [ 0.261151] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)431second # [ 0.267254] io scheduler mq-deadline registered432second # [ 0.267274] io scheduler kyber registered433test # [ 0.263400] Key type asymmetric registered434test # [ 0.263430] Asymmetric key parser 'x509' registered435second # [ 0.270201] pl061_gpio 9030000.pl061: PL061 GPIO chip registered436test # [ 0.263495] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)437second # [ 0.270992] ledtrig-cpu: registered to indicate activity on CPUs438second # [ 0.271862] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:439test # [ 0.269310] io scheduler mq-deadline registered440test # [ 0.269330] io scheduler kyber registered441second # [ 0.271889] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000442second # [ 0.271904] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000443second # [ 0.271910] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000444second # [ 0.271940] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits445second # [ 0.271968] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]446test # [ 0.272333] pl061_gpio 9030000.pl061: PL061 GPIO chip registered447second # [ 0.272039] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00448test # [ 0.273156] ledtrig-cpu: registered to indicate activity on CPUs449second # [ 0.272058] pci_bus 0000:00: root bus resource [bus 00-ff]450second # [ 0.272063] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]451second # [ 0.272067] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]452second # [ 0.272070] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]453second # [ 0.272147] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint454second # [ 0.272570] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint455second # [ 0.272684] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]456second # [ 0.272694] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]457test # [ 0.274083] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:458second # [ 0.272713] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]459test # [ 0.274113] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000460second # [ 0.272724] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]461test # [ 0.274127] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000462second # [ 0.272995] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint463second # [ 0.273103] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]464test # [ 0.274133] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000465second # [ 0.273114] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]466test # [ 0.274168] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits467second # [ 0.273133] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]468test # [ 0.274196] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]469second # [ 0.273399] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint470test # [ 0.274272] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00471second # [ 0.273506] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f]472test # [ 0.274290] pci_bus 0000:00: root bus resource [bus 00-ff]473second # [ 0.273516] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]474test # [ 0.274295] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]475second # [ 0.273535] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]476test # [ 0.274299] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]477second # [ 0.273809] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint478test # [ 0.274303] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]479second # [ 0.273916] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]480test # [ 0.274381] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint481second # [ 0.273926] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]482test # [ 0.274784] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint483second # [ 0.273945] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]484test # [ 0.274901] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]485second # [ 0.274216] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint486test # [ 0.274912] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]487second # [ 0.274322] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f]488test # [ 0.274932] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]489second # [ 0.274332] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]490test # [ 0.274945] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]491second # [ 0.274352] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]492test # [ 0.275224] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint493second # [ 0.274618] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint494test # [ 0.275336] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]495second # [ 0.274727] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f]496test # [ 0.275346] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]497second # [ 0.274737] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]498test # [ 0.275367] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]499second # [ 0.274756] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]500test # [ 0.275644] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint501second # [ 0.275033] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint502second # [ 0.275141] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f]503test # [ 0.275755] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f]504second # [ 0.275151] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff]505test # [ 0.275766] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]506second # [ 0.275173] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]507test # [ 0.275785] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]508second # [ 0.275184] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref]509test # [ 0.276069] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint510test # [ 0.276182] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]511test # [ 0.276193] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]512test # [ 0.276212] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]513test # [ 0.276504] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint514test # [ 0.276615] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f]515test # [ 0.276625] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]516test # [ 0.276645] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]517test # [ 0.276920] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint518test # [ 0.277033] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f]519test # [ 0.277044] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]520test # [ 0.277064] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]521second # [ 0.303631] pci 0000:00:08.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint522second # [ 0.303759] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]523second # [ 0.303778] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]524second # [ 0.304052] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint525second # [ 0.304164] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]526second # [ 0.304183] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]527second # [ 0.304447] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint528second # [ 0.304556] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff]529second # [ 0.304719] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint530second # [ 0.304870] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]531second # [ 0.304882] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]532second # [ 0.305081] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]533second # [ 0.305364] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint534second # [ 0.305475] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]535second # [ 0.305486] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]536second # [ 0.305505] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]537second # [ 0.305894] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned538second # [ 0.305905] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned539second # [ 0.305910] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned540second # [ 0.305943] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned541second # [ 0.305973] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned542second # [ 0.306004] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned543second # [ 0.306034] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned544second # [ 0.306064] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned545second # [ 0.306095] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned546test # [ 0.309480] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint547second # [ 0.306130] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned548test # [ 0.309615] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f]549test # [ 0.309628] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff]550second # [ 0.306159] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned551test # [ 0.309652] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]552second # [ 0.306188] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned553test # [ 0.309664] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref]554second # [ 0.306244] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned555test # [ 0.309967] pci 0000:00:08.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint556second # [ 0.306273] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned557test # [ 0.310083] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]558second # [ 0.306287] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned559test # [ 0.310102] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]560second # [ 0.306341] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned561test # [ 0.310384] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint562second # [ 0.306357] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned563test # [ 0.310497] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]564second # [ 0.306371] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned565test # [ 0.310515] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]566second # [ 0.306387] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned567test # [ 0.310764] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint568second # [ 0.306403] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned569test # [ 0.310873] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff]570second # [ 0.306418] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned571test # [ 0.311040] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint572second # [ 0.306433] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned573test # [ 0.311282] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]574second # [ 0.306448] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned575test # [ 0.311295] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]576second # [ 0.306463] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned577test # [ 0.311316] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]578second # [ 0.306477] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned579test # [ 0.311599] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint580second # [ 0.306492] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned581test # [ 0.311712] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]582second # [ 0.306507] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned583test # [ 0.311723] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]584second # [ 0.306521] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned585test # [ 0.311742] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]586second # [ 0.306535] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned587second # [ 0.306556] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned588test # [ 0.312148] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned589second # [ 0.306571] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned590test # [ 0.312158] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned591second # [ 0.306586] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned592test # [ 0.312163] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned593second # [ 0.306600] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned594test # [ 0.312196] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned595second # [ 0.306615] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned596second # [ 0.306633] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]597test # [ 0.312226] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned598second # [ 0.306639] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]599test # [ 0.312257] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned600second # [ 0.306643] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]601test # [ 0.312286] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned602test # [ 0.312315] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned603test # [ 0.312346] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned604test # [ 0.312378] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned605test # [ 0.312407] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned606test # [ 0.312436] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned607test # [ 0.312500] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned608test # [ 0.312532] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned609test # [ 0.312546] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned610test # [ 0.312560] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned611test # [ 0.312575] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned612test # [ 0.312591] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned613test # [ 0.312606] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned614test # [ 0.312621] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned615second # [ 0.343389] pci 0000:00:0a.0: enabling device (0000 -> 0002)616test # [ 0.312640] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned617test # [ 0.312655] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned618test # [ 0.312670] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned619test # [ 0.312685] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned620test # [ 0.312700] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned621test # [ 0.312714] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned622test # [ 0.312729] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned623test # [ 0.312744] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned624test # [ 0.312759] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned625test # [ 0.312780] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned626test # [ 0.312795] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned627test # [ 0.312810] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned628test # [ 0.312825] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned629test # [ 0.312840] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned630second # [ 0.349763] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)631test # [ 0.312860] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]632test # [ 0.312866] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]633test # [ 0.312870] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]634test # [ 0.313560] pci 0000:00:0a.0: enabling device (0000 -> 0002)635test # [ 0.352286] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)636second # [ 0.359732] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)637second # [ 0.361410] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)638test # [ 0.362431] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)639test # [ 0.365128] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)640second # [ 0.371291] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)641second # [ 0.373045] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)642second # [ 0.374715] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003)643second # [ 0.376738] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003)644second # [ 0.378641] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)645test # [ 0.374293] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)646test # [ 0.376298] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003)647test # [ 0.379581] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003)648second # [ 0.388363] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)649second # [ 0.390312] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)650test # [ 0.385365] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003)651test # [ 0.387890] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)652second # [ 0.400366] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)653test # [ 0.394181] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)654test # [ 0.396026] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)655second # [ 0.404310] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled656second # [ 0.405779] msm_serial: driver initialized657second # [ 0.405852] SuperH (H)SCI(F) driver initialized658second # [ 0.405898] STM32 USART driver initialized659test # [ 0.406258] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)660test # [ 0.413953] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled661second # [ 0.426521] loop: module loaded662second # [ 0.426656] virtio_blk virtio5: 1/0/0 default/read/poll queues663test # [ 0.415513] msm_serial: driver initialized664test # [ 0.415604] SuperH (H)SCI(F) driver initialized665test # [ 0.415641] STM32 USART driver initialized666second # [ 0.431302] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)667second # [ 0.435601] megasas: 07.734.00.00-rc1668second # [ 0.436037] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]669test # [ 0.438622] loop: module loaded670test # [ 0.438763] virtio_blk virtio5: 1/0/0 default/read/poll queues671test # [ 0.439339] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)672second # [ 0.448184] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000673second # [ 0.448234] Intel/Sharp Extended Query Table at 0x0031674second # [ 0.449970] Using buffer write method675second # [ 0.450036] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]676test # [ 0.445664] megasas: 07.734.00.00-rc1677test # [ 0.446167] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]678second # [ 0.459701] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000679second # [ 0.459727] Intel/Sharp Extended Query Table at 0x0031680second # [ 0.461178] Using buffer write method681second # [ 0.461211] Concatenating MTD devices:682second # [ 0.461216] (0): "0.flash"683second # [ 0.461219] (1): "0.flash"684second # [ 0.461221] into device "0.flash"685test # [ 0.462234] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000686test # [ 0.462311] Intel/Sharp Extended Query Table at 0x0031687test # [ 0.464044] Using buffer write method688test # [ 0.464112] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]689test # [ 0.479008] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000690test # [ 0.479039] Intel/Sharp Extended Query Table at 0x0031691test # [ 0.481108] Using buffer write method692test # [ 0.481141] Concatenating MTD devices:693test # [ 0.481146] (0): "0.flash"694test # [ 0.481149] (1): "0.flash"695test # [ 0.481151] into device "0.flash"696second # [ 0.654869] Freeing initrd memory: 25492K697second # [ 0.661759] tun: Universal TUN/TAP device driver, 1.6698second # [ 0.664437] thunder_xcv, ver 1.0699second # [ 0.664466] thunder_bgx, ver 1.0700second # [ 0.664478] nicpf, ver 1.0701second # [ 0.664760] e1000: Intel(R) PRO/1000 Network Driver702second # [ 0.664768] e1000: Copyright (c) 1999-2006 Intel Corporation.703second # [ 0.664788] e1000e: Intel(R) PRO/1000 Network Driver704second # [ 0.664793] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.705second # [ 0.664806] igb: Intel(R) Gigabit Ethernet Network Driver706second # [ 0.664810] igb: Copyright (c) 2007-2014 Intel Corporation.707second # [ 0.664821] igbvf: Intel(R) Gigabit Virtual Function Network Driver708second # [ 0.664825] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.709second # [ 0.664914] sky2: driver version 1.30710second # [ 0.665667] usbcore: registered new interface driver usb-storage711second # [ 0.665790] usbcore: registered new interface driver usbserial_generic712second # [ 0.665799] usbserial: USB Serial support registered for generic713second # [ 0.666074] hv_vmbus: registering driver hyperv_keyboard714second # [ 0.673559] ehci-pci 0000:00:0a.0: EHCI Host Controller715second # [ 0.673599] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1716second # [ 0.673833] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000717second # [ 0.675543] rtc-pl031 9010000.pl031: registered as rtc0718second # [ 0.675587] rtc-pl031 9010000.pl031: setting system clock to 2026-09-02T15:08:19 UTC (1788361699)719second # [ 0.675790] i2c_dev: i2c /dev entries driver720test # [ 0.671212] Freeing initrd memory: 25480K721second # [ 0.678590] sdhci: Secure Digital Host Controller Interface driver722second # [ 0.678604] sdhci: Copyright(c) Pierre Ossman723second # [ 0.678734] Synopsys Designware Multimedia Card Interface Driver724second # [ 0.678892] sdhci-pltfm: SDHCI platform and OF driver helper725second # [ 0.681639] hid: raw HID events driver (C) Jiri Kosina726second # [ 0.681804] usbcore: registered new interface driver usbhid727second # [ 0.681809] usbhid: USB HID core driver728second # [ 0.683561] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00729test # [ 0.678069] tun: Universal TUN/TAP device driver, 1.6730second # [ 0.683927] hub 1-0:1.0: USB hub found731second # [ 0.683957] hub 1-0:1.0: 6 ports detected732second # [ 0.685323] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available733second # [ 0.686064] drop_monitor: Initializing network drop monitor service734test # [ 0.680758] thunder_xcv, ver 1.0735second # [ 0.686234] NET: Registered PF_INET6 protocol family736test # [ 0.680792] thunder_bgx, ver 1.0737test # [ 0.680804] nicpf, ver 1.0738test # [ 0.681129] e1000: Intel(R) PRO/1000 Network Driver739second # [ 0.688575] Segment Routing with IPv6740test # [ 0.681138] e1000: Copyright (c) 1999-2006 Intel Corporation.741second # [ 0.688612] In-situ OAM (IOAM) with IPv6742test # [ 0.681158] e1000e: Intel(R) PRO/1000 Network Driver743second # [ 0.688669] NET: Registered PF_PACKET protocol family744test # [ 0.681163] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.745test # [ 0.681177] igb: Intel(R) Gigabit Ethernet Network Driver746test # [ 0.681180] igb: Copyright (c) 2007-2014 Intel Corporation.747test # [ 0.681191] igbvf: Intel(R) Gigabit Virtual Function Network Driver748second # [ 0.689817] 9pnet: Installing 9P2000 support749test # [ 0.681194] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.750test # [ 0.685638] sky2: driver version 1.30751second # [ 0.691852] Key type dns_resolver registered752test # [ 0.686486] usbcore: registered new interface driver usb-storage753second # [ 0.695064] registered taskstats version 1754test # [ 0.686586] usbcore: registered new interface driver usbserial_generic755test # [ 0.686595] usbserial: USB Serial support registered for generic756test # [ 0.686888] hv_vmbus: registering driver hyperv_keyboard757test # [ 0.687960] ehci-pci 0000:00:0a.0: EHCI Host Controller758test # [ 0.687997] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1759test # [ 0.688222] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000760test # [ 0.692140] rtc-pl031 9010000.pl031: registered as rtc0761second # [ 0.695567] Loading compiled-in X.509 certificates762test # [ 0.692183] rtc-pl031 9010000.pl031: setting system clock to 2026-09-02T15:08:19 UTC (1788361699)763test # [ 0.692364] i2c_dev: i2c /dev entries driver764second # [ 0.700607] Demotion targets for Node 0: null765second # [ 0.700690] Key type .fscrypt registered766second # [ 0.700697] Key type fscrypt-provisioning registered767second # [ 0.700800] ima: No TPM chip found, activating TPM-bypass!768second # [ 0.700813] ima: Allocated hash algorithm: sha1769second # [ 0.700865] ima: No architecture policies found770test # [ 0.695561] sdhci: Secure Digital Host Controller Interface driver771test # [ 0.695580] sdhci: Copyright(c) Pierre Ossman772second # [ 0.703851] input: gpio-keys as /devices/platform/gpio-keys/input/input0773test # [ 0.695717] Synopsys Designware Multimedia Card Interface Driver774test # [ 0.695891] sdhci-pltfm: SDHCI platform and OF driver helper775test # [ 0.696838] hid: raw HID events driver (C) Jiri Kosina776test # [ 0.697001] usbcore: registered new interface driver usbhid777test # [ 0.697006] usbhid: USB HID core driver778test # [ 0.700083] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00779test # [ 0.700954] hub 1-0:1.0: USB hub found780test # [ 0.701319] hub 1-0:1.0: 6 ports detected781test # [ 0.702459] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available782test # [ 0.703285] drop_monitor: Initializing network drop monitor service783test # [ 0.703465] NET: Registered PF_INET6 protocol family784test # [ 0.705754] Segment Routing with IPv6785test # [ 0.705782] In-situ OAM (IOAM) with IPv6786test # [ 0.705848] NET: Registered PF_PACKET protocol family787second # [ 0.714249] clk: Disabling unused clocks788test # [ 0.706943] 9pnet: Installing 9P2000 support789second # [ 0.714274] PM: genpd: Disabling unused power domains790test # [ 0.708661] Key type dns_resolver registered791second # [ 0.717598] Freeing unused kernel memory: 4736K792second # [ 0.717694] Run /init as init process793test # [ 0.712389] registered taskstats version 1794test # [ 0.712554] Loading compiled-in X.509 certificates795test # [ 0.718060] Demotion targets for Node 0: null796test # [ 0.718161] Key type .fscrypt registered797test # [ 0.718168] Key type fscrypt-provisioning registered798test # [ 0.718315] ima: No TPM chip found, activating TPM-bypass!799test # [ 0.718330] ima: Allocated hash algorithm: sha1800test # [ 0.718397] ima: No architecture policies found801test # [ 0.721148] input: gpio-keys as /devices/platform/gpio-keys/input/input0802second # [ 0.737667] systemd[1]: Successfully made /usr/ read-only.803test # [ 0.732235] clk: Disabling unused clocks804test # [ 0.732267] PM: genpd: Disabling unused power domains805test # [ 0.735574] Freeing unused kernel memory: 4736K806test # [ 0.735672] Run /init as init process807test # [ 0.755748] systemd[1]: Successfully made /usr/ read-only.808second # [ 0.931243] usb 1-1: new high-speed USB device number 2 using ehci-pci809test # [ 0.949292] usb 1-1: new high-speed USB device number 2 using ehci-pci810second # [ 1.072457] systemd[1]: systemd 260.2 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)811second # [ 1.079654] systemd[1]: Detected virtualization qemu.812second # [ 1.081072] systemd[1]: Detected architecture arm64.813second # [ 1.082381] systemd[1]: Running in initrd.814second # [ 1.084767] systemd[1]: Initializing machine ID from random generator.815second # [ 1.087016] systemd[1]: Hostname set to <second>.816second # [ 1.094014] 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/input1817test # [ 1.090468] systemd[1]: systemd 260.2 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)818test # [ 1.097655] systemd[1]: Detected virtualization qemu.819test # [ 1.099196] systemd[1]: Detected architecture arm64.820test # [ 1.100537] systemd[1]: Running in initrd.821test # [ 1.102672] systemd[1]: Initializing machine ID from random generator.822test # [ 1.104786] systemd[1]: Hostname set to <test>.823test # [ 1.114124] 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/input1824second # [ 1.179430] 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.199727] systemd[1]: Queued start job for default target Initrd Default Target.826test # [ 1.201470] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0827second # [ 1.208985] systemd[1]: Created slice Slice /system/modprobe.828second # [ 1.209925] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.829second # [ 1.211029] systemd[1]: Expecting device /dev/disk/by-label/nixos...830second # [ 1.212217] systemd[1]: Reached target Path Units.831second # [ 1.212869] systemd[1]: Reached target Slice Units.832second # [ 1.213563] systemd[1]: Reached target Swaps.833second # [ 1.214195] systemd[1]: Reached target Timer Units.834second # [ 1.215073] systemd[1]: Listening on D-Bus System Message Bus Socket.835second # [ 1.216271] systemd[1]: Listening on Journal Socket (/dev/log).836second # [ 1.217260] systemd[1]: Listening on Journal Sockets.837second # [ 1.218105] systemd[1]: Listening on udev Control Socket.838second # [ 1.218993] systemd[1]: Listening on udev Kernel Socket.839second # [ 1.219823] systemd[1]: Reached target Socket Units.840test # [ 1.213451] systemd[1]: Queued start job for default target Initrd Default Target.841second # [ 1.222004] systemd[1]: Starting Create List of Static Device Nodes...842test # [ 1.222826] systemd[1]: Created slice Slice /system/modprobe.843test # [ 1.223626] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.844test # [ 1.224434] systemd[1]: Expecting device /dev/disk/by-label/nixos...845second # [ 1.230760] systemd[1]: Starting Load Kernel Module 9pnet_virtio...846test # [ 1.225055] systemd[1]: Reached target Path Units.847test # [ 1.225554] systemd[1]: Reached target Slice Units.848test # [ 1.226046] systemd[1]: Reached target Swaps.849test # [ 1.226476] systemd[1]: Reached target Timer Units.850test # [ 1.227107] systemd[1]: Listening on D-Bus System Message Bus Socket.851second # [ 1.231780] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs852test # [ 1.227924] systemd[1]: Listening on Journal Socket (/dev/log).853second # [ 1.234461] systemd[1]: Mounting Kernel Configuration File System...854test # [ 1.228645] systemd[1]: Listening on Journal Sockets.855test # [ 1.229353] systemd[1]: Listening on udev Control Socket.856test # [ 1.230018] systemd[1]: Listening on udev Kernel Socket.857test # [ 1.230578] systemd[1]: Reached target Socket Units.858test # [ 1.232290] systemd[1]: Starting Create List of Static Device Nodes...859test # [ 1.237794] systemd[1]: Starting Load Kernel Module 9pnet_virtio...860second # [ 1.244310] systemd[1]: Starting Journal Service...861test # [ 1.238473] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs862test # [ 1.244761] systemd[1]: Mounting Kernel Configuration File System...863test # [ 1.253404] systemd[1]: Starting Journal Service...864second # [ 1.265184] systemd[1]: Starting Load Kernel Modules...865second # [ 1.265254] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki866second # [ 1.271416] systemd[1]: Starting Coldplug All udev Devices...867test # [ 1.269479] systemd[1]: Starting Load Kernel Modules...868test # [ 1.270336] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki869second # [ 1.284200] systemd[1]: Finished Create List of Static Device Nodes.870second # [ 1.285019] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.871second # [ 1.287384] systemd[1]: Finished Load Kernel Module 9pnet_virtio.872test # [ 1.280406] systemd[1]: Starting Coldplug All udev Devices...873second # [ 1.288222] systemd[1]: Mounted Kernel Configuration File System.874test # [ 1.282423] systemd[1]: Finished Create List of Static Device Nodes.875test # [ 1.283803] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.876test # [ 1.290874] systemd[1]: Finished Load Kernel Module 9pnet_virtio.877test # [ 1.291643] systemd[1]: Mounted Kernel Configuration File System.878second # [ 1.295624] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...879second # [ 1.299668] usb 1-2: new high-speed USB device number 3 using ehci-pci880test # [ 1.301539] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...881test # [ 1.302517] systemd-journald[73]: Collecting audit messages is disabled.882test # [ 1.321327] usb 1-2: new high-speed USB device number 3 using ehci-pci883second # [ 1.333161] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.884second # [ 1.336476] systemd-journald[73]: Collecting audit messages is disabled.885second # [ 1.347669] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.886test # [ 1.341739] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.887second # [ 1.349251] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev888second # [ 1.350891] systemd[1]: Starting Create Static Device Nodes in /dev...889test # [ 1.345595] systemd[1]: Starting Create Static Device Nodes in /dev...890test # [ 1.351527] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.891second # [ 1.363595] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0892second # [ 1.363808] [drm] features: -virgl +edid -resource_blob -host_visible893test # [ 1.361342] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev894second # [ 1.363814] [drm] features: -context_init895second # [ 1.364277] [drm] number of scanouts: 1896second # [ 1.364292] [drm] number of cap sets: 0897second # [ 1.379539] virtio-pci 0000:00:09.0: [drm] Registered 1 planes with drm panic898second # [ 1.379558] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0899test # [ 1.375998] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0900test # [ 1.376227] [drm] features: -virgl +edid -resource_blob -host_visible901test # [ 1.376233] [drm] features: -context_init902test # [ 1.376721] [drm] number of scanouts: 1903test # [ 1.376739] [drm] number of cap sets: 0904test # [ 1.389619] virtio-pci 0000:00:09.0: [drm] Registered 1 planes with drm panic905test # [ 1.389637] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0906second # [ 1.399298] systemd[1]: Finished Create Static Device Nodes in /dev.907second # [ 1.399629] systemd[1]: Reached target Preparation for Local File Systems.908second # [ 1.399662] systemd[1]: Reached target Local File Systems.909second # [ 1.402538] systemd[1]: Starting Rule-based Manager for Device Events and Files...910test # [ 1.397719] systemd[1]: Finished Create Static Device Nodes in /dev.911test # [ 1.398126] systemd[1]: Reached target Preparation for Local File Systems.912test # [ 1.398164] systemd[1]: Reached target Local File Systems.913test # [ 1.400979] systemd[1]: Starting Rule-based Manager for Device Events and Files...914second # [ 1.406899] Console: switching to colour frame buffer device 160x50915second # [ 1.409940] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device916test # [ 1.399443] systemd-modules-load[74]: Inserted module 'dm_mod'917test # [ 1.409621] systemd[1]: Started Journal Service.918test # [ 1.400906] systemd-modules-load[74]: Module 'virtio_balloon' is built in919second # [ 1.422151] systemd[1]: Finished Load Kernel Modules.920test # [ 1.417633] Console: switching to colour frame buffer device 160x50921second # [ 1.427652] systemd[1]: Starting Apply Kernel Variables...922test # [ 1.421357] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device923test # [ 1.414230] systemd-modules-load[74]: Module 'virtio_console' is built in924test # [ 1.420208] systemd-modules-load[74]: Inserted module 'virtio_gpu'925test # [ 1.421307] systemd-modules-load[74]: Module 'virtio_rng' is built in926second # [ 1.436352] systemd-modules-load[74]: Inserted module 'dm_mod'927second # [ 1.437105] systemd-modules-load[74]: Module 'virtio_balloon' is built in928second # [ 1.445403] systemd[1]: Started Journal Service.929second # [ 1.441876] systemd-modules-load[74]: Module 'virtio_console' is built in930second # [ 1.444577] systemd-modules-load[74]: Inserted module 'virtio_gpu'931test # [ 1.438343] systemd[1]: Starting Create System Files and Directories...932second # [ 1.455144] 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/input2933second # [ 1.455368] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0934test # [ 1.444116] systemd[1]: Finished Load Kernel Modules.935second # [ 1.460370] systemd-modules-load[74]: Module 'virtio_rng' is built in936second # [ 1.461132] systemd[1]: Starting Create System Files and Directories...937test # [ 1.461078] systemd[1]: Starting Apply Kernel Variables...938test # [ 1.475983] 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/input2939second # [ 1.477684] systemd[1]: Finished Apply Kernel Variables.940test # [ 1.483740] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0941second # [ 1.491226] systemd-udevd[80]: Using default interface naming scheme 'v260'.942test # [ 1.492725] systemd[1]: Finished Create System Files and Directories.943test # [ 1.493537] systemd[1]: Finished Apply Kernel Variables.944test # [ 1.495908] systemd-udevd[81]: Using default interface naming scheme 'v260'.945second # [ 1.508856] systemd[1]: Finished Create System Files and Directories.946second # [ 1.520762] systemd[1]: Started Rule-based Manager for Device Events and Files.947test # [ 1.518865] systemd[1]: Started Rule-based Manager for Device Events and Files.948second # [ 1.574732] systemd[1]: Starting Virtual Console Setup...949test # [ 1.580616] systemd[1]: Starting Virtual Console Setup...950second # [ 1.624443] systemd-vconsole-setup[103]: Configuration of first virtual console was skipped, ignoring remaining ones.951second # [ 1.626868] systemd[1]: Finished Virtual Console Setup.952test # [ 1.628437] systemd-vconsole-setup[104]: Configuration of first virtual console was skipped, ignoring remaining ones.953test # [ 1.630812] systemd[1]: Finished Virtual Console Setup.954second # [ 1.896094] systemd[1]: Finished Coldplug All udev Devices.955second # [ 1.896673] systemd[1]: Reached target System Initialization.956second # [ 1.897194] systemd[1]: Reached target Basic System.957test # [ 1.896795] systemd[1]: Finished Coldplug All udev Devices.958test # [ 1.897393] systemd[1]: Reached target System Initialization.959test # [ 1.897889] systemd[1]: Reached target Basic System.960second # [ 1.987515] (udev-worker)[100]: Network interface NamePolicy= disabled on kernel command line.961second # [ 2.009473] (udev-worker)[94]: Network interface NamePolicy= disabled on kernel command line.962test # [ 2.006801] (udev-worker)[94]: Network interface NamePolicy= disabled on kernel command line.963test # [ 2.010709] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.964second # [ 2.053026] systemd[1]: Found device /dev/disk/by-label/nixos.965second # [ 2.055129] systemd[1]: Reached target Initrd Root Device.966second # [ 2.057613] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...967test # [ 2.065268] systemd[1]: Found device /dev/disk/by-label/nixos.968test # [ 2.069618] systemd[1]: Reached target Initrd Root Device.969test # [ 2.075482] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...970second # [ 2.102305] systemd-fsck[112]: nixos: clean, 12/65536 files, 13019/262144 blocks971test # [ 2.116418] systemd-fsck[113]: nixos: clean, 12/65536 files, 13019/262144 blocks972second # [ 2.131499] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.973test # [ 2.124776] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.974second # [ 2.278854] systemd[1]: Mounting /sysroot...975test # [ 2.273608] systemd[1]: Mounting /sysroot...976second # [ 2.314242] EXT4-fs (vda): mounted filesystem 101b7992-002c-4d68-b56e-3d08df224ebb r/w with ordered data mode. Quota mode: none.977test # [ 2.310996] EXT4-fs (vda): mounted filesystem 6860c9da-8862-410c-a7e5-28a7cb01be49 r/w with ordered data mode. Quota mode: none.978second # [ 2.312116] systemd[1]: Mounted /sysroot.979second # [ 2.313659] systemd[1]: Reached target Initrd Root File System.980test # [ 2.305999] systemd[1]: Mounted /sysroot.981test # [ 2.307337] systemd[1]: Reached target Initrd Root File System.982second # [ 2.317242] systemd[1]: Starting Mountpoints Configured in the Real Root...983test # [ 2.311951] systemd[1]: Starting Mountpoints Configured in the Real Root...984second # [ 2.339349] systemd-sysroot-fstab-check[120]: /sysroot should be mounted in the initrd, will request daemon-reload.985test # [ 2.331640] systemd-sysroot-fstab-check[121]: /sysroot should be mounted in the initrd, will request daemon-reload.986second # [ 2.344854] systemd[1]: Reload requested from client PID 120 ('systemd-sysroot') (unit initrd-parse-etc.service)...987test # [ 2.336646] systemd[1]: Reload requested from client PID 121 ('systemd-sysroot') (unit initrd-parse-etc.service)...988test # [ 2.339443] systemd[1]: Reloading...989second # [ 2.347923] systemd[1]: Reloading...990second # [ 2.531788] systemd[1]: Reloading finished in 184 ms.991test # [ 2.525086] systemd[1]: Reloading finished in 185 ms.992second # [ 2.539852] systemd-sysroot-fstab-check[120]: Requesting initrd-fs.target/start/replace...993second # [ 2.542630] systemd-sysroot-fstab-check[120]: Requesting swap.target/start/replace...994second # [ 2.544819] systemd[1]: Starting Load Kernel Module 9pnet_virtio...995test # [ 2.536900] systemd-sysroot-fstab-check[121]: Requesting initrd-fs.target/start/replace...996test # [ 2.540319] systemd-sysroot-fstab-check[121]: Requesting swap.target/start/replace...997test # [ 2.544115] systemd[1]: Starting Load Kernel Module 9pnet_virtio...998second # [ 2.552700] systemd[1]: initrd-parse-etc.service: Deactivated successfully.999second # [ 2.553917] systemd[1]: Finished Mountpoints Configured in the Real Root.1000second # [ 2.556111] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1001test # [ 2.548061] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1002test # [ 2.550830] systemd[1]: Finished Mountpoints Configured in the Real Root.1003test # [ 2.552121] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1004second # [ 2.567875] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1005second # [ 2.569060] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1006test # [ 2.568126] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1007test # [ 2.569173] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1008second # [ 2.902304] (udev-worker)[100]: mtd0ro: Failed to find and pin callout binary "/nix/store/2pprwd9bdjg4ssiam65rgjqfy64h0hbd-systemd-260.2/lib/udev/mtd_probe": No such file or directory1009second # [ 2.904720] (udev-worker)[100]: mtd0ro: /nix/store/2pprwd9bdjg4ssiam65rgjqfy64h0hbd-systemd-260.2/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 directory1010test # [ 2.905409] (udev-worker)[93]: mtd0ro: Failed to find and pin callout binary "/nix/store/2pprwd9bdjg4ssiam65rgjqfy64h0hbd-systemd-260.2/lib/udev/mtd_probe": No such file or directory1011test # [ 2.908058] (udev-worker)[93]: mtd0ro: /nix/store/2pprwd9bdjg4ssiam65rgjqfy64h0hbd-systemd-260.2/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 directory1012second # [ 2.919159] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1013second # [ 2.921091] systemd[1]: Stopped Virtual Console Setup.1014second # [ 2.927290] systemd[1]: Stopping Virtual Console Setup...1015second # [ 2.927807] systemd[1]: Starting Virtual Console Setup...1016test # [ 2.924706] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1017test # [ 2.926348] systemd[1]: Stopped Virtual Console Setup.1018test # [ 2.927179] systemd[1]: Stopping Virtual Console Setup...1019test # [ 2.933718] systemd[1]: Starting Virtual Console Setup...1020second # [ 2.947436] systemd-vconsole-setup[141]: Configuration of first virtual console was skipped, ignoring remaining ones.1021second # [ 2.950055] systemd[1]: Finished Virtual Console Setup.1022test # [ 2.955118] systemd-vconsole-setup[142]: Configuration of first virtual console was skipped, ignoring remaining ones.1023test # [ 2.957644] systemd[1]: Finished Virtual Console Setup.1024test # [ 3.274591] systemd[1]: Mounting /sysroot/nix/.ro-store...1025second # [ 3.283024] systemd[1]: Mounting /sysroot/nix/.ro-store...1026second # [ 3.292323] systemd[1]: Mounting /sysroot/nix/.rw-store...1027test # [ 3.285092] systemd[1]: Mounting /sysroot/nix/.rw-store...1028test # [ 3.286007] systemd[1]: Mounting /sysroot/run...1029test # [ 3.292923] systemd[1]: Mounting /sysroot/tmp/shared...1030test # [ 3.300169] systemd[1]: Mounting /sysroot/tmp/xchg...1031second # [ 3.308326] systemd[1]: Mounting /sysroot/run...1032second # [ 3.312254] systemd[1]: Mounting /sysroot/tmp/shared...1033test # [ 3.313758] systemd[1]: Mounted /sysroot/nix/.rw-store.1034second # [ 3.327893] systemd[1]: Mounting /sysroot/tmp/xchg...1035test # [ 3.328227] systemd[1]: Starting rw-sysroot-nix-store.service...1036test # [ 3.330312] systemd[1]: Mounted /sysroot/nix/.ro-store.1037test # [ 3.333075] systemd[1]: Mounted /sysroot/run.1038test # [ 3.336848] systemd[1]: Mounted /sysroot/tmp/shared.1039test # [ 3.340970] systemd[1]: Mounted /sysroot/tmp/xchg.1040second # [ 3.364336] systemd[1]: Mounted /sysroot/nix/.ro-store.1041test # [ 3.356814] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1042test # [ 3.357891] systemd[1]: Finished rw-sysroot-nix-store.service.1043test # [ 3.364321] systemd[1]: Mounting /sysroot/nix/store...1044second # [ 3.374059] systemd[1]: Mounted /sysroot/nix/.rw-store.1045second # [ 3.375151] systemd[1]: Mounted /sysroot/run.1046second # [ 3.387862] systemd[1]: Starting rw-sysroot-nix-store.service...1047second # [ 3.391642] systemd[1]: Mounted /sysroot/tmp/shared.1048second # [ 3.392591] systemd[1]: Mounted /sysroot/tmp/xchg.1049test # [ 3.398490] systemd[1]: Mounted /sysroot/nix/store.1050test # [ 3.399285] systemd[1]: Reached target Initrd File Systems.1051test # [ 3.401106] systemd[1]: Starting Find NixOS closure...1052test # [ 3.408190] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1053second # [ 3.419844] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1054second # [ 3.420863] systemd[1]: Finished rw-sysroot-nix-store.service.1055second # [ 3.421857] systemd[1]: Mounting /sysroot/nix/store...1056test # [ 3.427552] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1057test # [ 3.438821] systemd[1]: Finished Find NixOS closure.1058test # [ 3.440174] systemd[1]: Reached target Initrd Default Target.1059second # [ 3.448723] systemd[1]: Mounted /sysroot/nix/store.1060test # [ 3.441136] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1061second # [ 3.449527] systemd[1]: Reached target Initrd File Systems.1062second # [ 3.451063] systemd[1]: Starting Find NixOS closure...1063second # [ 3.456158] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1064test # [ 3.462551] systemd[1]: initrd-cleanup.service: Deactivated successfully.1065test # [ 3.463439] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1066test # [ 3.465723] systemd[1]: Stopped target Initrd Default Target.1067test # [ 3.466595] systemd[1]: Stopped target Basic System.1068test # [ 3.468217] systemd[1]: Stopped target Initrd Root Device.1069test # [ 3.468806] systemd[1]: Stopped target Path Units.1070test # [ 3.470039] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1071test # [ 3.470744] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1072test # [ 3.471411] systemd[1]: Stopped target Slice Units.1073test # [ 3.471895] systemd[1]: Stopped target Socket Units.1074second # [ 3.480501] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1075test # [ 3.476213] systemd[1]: Stopped target System Initialization.1076test # [ 3.476765] systemd[1]: Stopped target Swaps.1077test # [ 3.477183] systemd[1]: Stopped target Timer Units.1078test # [ 3.477622] systemd[1]: dbus.socket: Deactivated successfully.1079test # [ 3.478121] systemd[1]: Closed D-Bus System Message Bus Socket.1080test # [ 3.478638] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1081test # [ 3.479299] systemd[1]: Stopped Find NixOS closure.1082test # [ 3.479728] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1083second # [ 3.492376] systemd[1]: Finished Find NixOS closure.1084test # [ 3.484248] systemd[1]: Starting rw-sysroot-nix-store.service...1085test # [ 3.484895] systemd[1]: systemd-sysctl.service: Deactivated successfully.1086second # [ 3.493607] systemd[1]: Reached target Initrd Default Target.1087second # [ 3.495469] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1088test # [ 3.487710] systemd[1]: Stopped Apply Kernel Variables.1089test # [ 3.490068] systemd[1]: systemd-modules-load.service: Deactivated successfully.1090test # [ 3.491935] systemd[1]: Stopped Load Kernel Modules.1091test # [ 3.494244] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1092test # [ 3.495525] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1093test # [ 3.496441] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1094test # [ 3.497121] systemd[1]: Stopped Create System Files and Directories.1095test # [ 3.497695] systemd[1]: Stopped target Local File Systems.1096test # [ 3.498206] systemd[1]: Stopped target Preparation for Local File Systems.1097test # [ 3.498831] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1098test # [ 3.499477] systemd[1]: Stopped Coldplug All udev Devices.1099test # [ 3.499990] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1100test # [ 3.510504] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1101second # [ 3.519415] systemd[1]: Stopped target Initrd Default Target.1102test # [ 3.512381] systemd[1]: Stopped Virtual Console Setup.1103second # [ 3.520849] systemd[1]: Stopped target Basic System.1104second # [ 3.521711] systemd[1]: Stopped target Initrd Root Device.1105second # [ 3.524259] systemd[1]: Stopped target Path Units.1106test # [ 3.516509] systemd[1]: systemd-udevd.service: Deactivated successfully.1107second # [ 3.524911] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1108test # [ 3.517277] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1109test # [ 3.517967] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1110test # [ 3.518629] systemd[1]: Closed udev Control Socket.1111second # [ 3.526985] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1112test # [ 3.519098] systemd[1]: Starting Cleanup udev Database...1113second # [ 3.527745] systemd[1]: Stopped target Slice Units.1114test # [ 3.520330] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1115second # [ 3.529793] systemd[1]: Stopped target Socket Units.1116test # [ 3.522047] systemd[1]: Stopped Create Static Device Nodes in /dev.1117second # [ 3.530541] systemd[1]: Stopped target System Initialization.1118test # [ 3.523253] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1119second # [ 3.532145] systemd[1]: Stopped target Swaps.1120test # [ 3.525321] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1121test # [ 3.526130] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1122test # [ 3.526820] systemd[1]: Stopped Create List of Static Device Nodes.1123test # [ 3.527424] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1124second # [ 3.536125] systemd[1]: Stopped target Timer Units.1125test # [ 3.528185] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1126second # [ 3.536659] systemd[1]: dbus.socket: Deactivated successfully.1127test # [ 3.528776] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1128second # [ 3.537227] systemd[1]: Closed D-Bus System Message Bus Socket.1129test # [ 3.529422] systemd[1]: Finished rw-sysroot-nix-store.service.1130second # [ 3.537785] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1131second # [ 3.538514] systemd[1]: Stopped Find NixOS closure.1132second # [ 3.539066] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1133second # [ 3.543082] systemd[1]: Starting rw-sysroot-nix-store.service...1134second # [ 3.544486] systemd[1]: systemd-sysctl.service: Deactivated successfully.1135second # [ 3.547036] systemd[1]: Stopped Apply Kernel Variables.1136second # [ 3.550981] systemd[1]: systemd-modules-load.service: Deactivated successfully.1137second # [ 3.553619] systemd[1]: Stopped Load Kernel Modules.1138second # [ 3.554206] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1139second # [ 3.554948] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1140second # [ 3.555671] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1141test # [ 3.550400] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1142test # [ 3.551581] systemd[1]: Finished Cleanup udev Database.1143second # [ 3.560347] systemd[1]: Stopped Create System Files and Directories.1144second # [ 3.562461] systemd[1]: Stopped target Local File Systems.1145second # [ 3.563127] systemd[1]: Stopped target Preparation for Local File Systems.1146test # [ 3.555068] systemd[1]: Reached target Switch Root.1147second # [ 3.563830] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1148test # [ 3.555880] systemd[1]: Starting NixOS Activation...1149second # [ 3.572192] systemd[1]: Stopped Coldplug All udev Devices.1150second # [ 3.572779] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1151second # [ 3.573610] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1152second # [ 3.574405] systemd[1]: Stopped Virtual Console Setup.1153second # [ 3.574907] systemd[1]: initrd-cleanup.service: Deactivated successfully.1154second # [ 3.575495] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1155second # [ 3.581148] systemd[1]: systemd-udevd.service: Deactivated successfully.1156second # [ 3.582662] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1157second # [ 3.584129] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1158second # [ 3.588299] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1159second # [ 3.588921] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1160second # [ 3.589587] systemd[1]: Closed udev Control Socket.1161second # [ 3.590061] systemd[1]: Starting Cleanup udev Database...1162second # [ 3.590574] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1163second # [ 3.591263] systemd[1]: Stopped Create Static Device Nodes in /dev.1164second # [ 3.591831] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1165second # [ 3.594811] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1166second # [ 3.595570] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1167second # [ 3.596341] systemd[1]: Stopped Create List of Static Device Nodes.1168second # [ 3.596946] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1169second # [ 3.597621] systemd[1]: Finished rw-sysroot-nix-store.service.1170second # [ 3.618406] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1171second # [ 3.620896] systemd[1]: Finished Cleanup udev Database.1172second # [ 3.621470] systemd[1]: Reached target Switch Root.1173second # [ 3.622540] systemd[1]: Starting NixOS Activation...1174test # [ 3.758118] initrd-nixos-activation-start[179]: booting system configuration /nix/store/b6rjxxx5hzzmb6gdicva5bdla102ph72-nixos-system-test-test1175test # [ 3.827333] initrd-nixos-activation-start[179]: running activation script...1176second # [ 3.841716] initrd-nixos-activation-start[179]: booting system configuration /nix/store/mqrk7mnq0c1pzx0a17lgr5i6b2pcqsp4-nixos-system-second-test1177second # [ 3.916134] initrd-nixos-activation-start[179]: running activation script...1178test # [ 4.312907] initrd-nixos-activation-start[202]: setting up /etc...1179second # [ 4.432502] initrd-nixos-activation-start[202]: setting up /etc...1180test # [ 4.602073] initrd-nixos-activation-start[202]: setting up age secrets...1181second # [ 4.716286] initrd-nixos-activation-start[202]: setting up age secrets...1182test # [ 4.867813] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1183test # [ 4.869872] systemd[1]: Finished NixOS Activation.1184test # [ 4.872067] systemd[1]: Starting Switch Root...1185test # [ 4.885201] systemd[1]: Switching root.1186second # [ 4.937986] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1187second # [ 4.939806] systemd[1]: Finished NixOS Activation.1188test # [ 4.942344] systemd-journald[73]: Received SIGTERM from PID 1 (systemd).1189second # [ 4.944150] systemd[1]: Starting Switch Root...1190second # [ 4.961356] systemd[1]: Switching root.1191second # [ 5.017182] systemd-journald[73]: Received SIGTERM from PID 1 (systemd).1192test # [ 5.541115] systemd[1]: systemd 260.2 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.548968] systemd[1]: Detected virtualization qemu.1194test # [ 5.550944] systemd[1]: Detected architecture arm64.1195test # [ 5.553308] systemd[1]: Detected first boot.1196test # [ 5.558631] systemd[1]: Initializing machine ID from random generator.1197second # [ 5.618931] systemd[1]: systemd 260.2 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)1198second # [ 5.626639] systemd[1]: Detected virtualization qemu.1199second # [ 5.629043] systemd[1]: Detected architecture arm64.1200second # [ 5.630302] systemd[1]: Detected first boot.1201second # [ 5.636219] systemd[1]: Initializing machine ID from random generator.1202test # [ 5.859000] systemd[1]: bpf-restrict-fs: LSM BPF program attached1203second # [ 5.940605] systemd[1]: bpf-restrict-fs: LSM BPF program attached1204test # [ 6.057418] systemd[1]: Applying preset policy.1205second # [ 6.124518] systemd[1]: Applying preset policy.1206test # [ 6.520783] systemd[1]: Populated /etc with preset unit settings.1207second # [ 6.570460] systemd[1]: Populated /etc with preset unit settings.1208test # [ 7.040084] systemd[1]: initrd-switch-root.service: Deactivated successfully.1209test # [ 7.040980] systemd[1]: Stopped initrd-switch-root.service.1210test # [ 7.043252] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1211test # [ 7.045502] systemd[1]: Created slice Slice /system/getty.1212test # [ 7.047134] systemd[1]: Created slice User and Session Slice.1213test # [ 7.048421] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1214test # [ 7.050078] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1215test # [ 7.051468] systemd[1]: Expecting device /dev/hvc0...1216test # [ 7.052521] systemd[1]: Expecting device /dev/ttyAMA0...1217test # [ 7.053733] systemd[1]: Reached target Local Encrypted Volumes.1218test # [ 7.055356] systemd[1]: Stopped target initrd-fs.target.1219test # [ 7.056865] systemd[1]: Stopped target initrd-root-fs.target.1220test # [ 7.058428] systemd[1]: Stopped target initrd-switch-root.target.1221test # [ 7.060029] systemd[1]: Reached target Virtual Machines and Containers.1222test # [ 7.061702] systemd[1]: Reached target Path Units.1223test # [ 7.063170] systemd[1]: Reached target Remote File Systems.1224test # [ 7.064676] systemd[1]: Reached target Slice Units.1225test # [ 7.066197] systemd[1]: Reached target Swaps.1226test # [ 7.071050] systemd[1]: Listening on Process Core Dump Socket.1227test # [ 7.075045] systemd[1]: Listening on Credential Encryption/Decryption.1228test # [ 7.080024] systemd[1]: Starting Journal Log Access Socket...1229test # [ 7.081750] systemd[1]: Listening on Journal Audit Socket.1230test # [ 7.082963] systemd[1]: Listening on Network Management Metrics Varlink Socket.1231test # [ 7.084752] systemd[1]: Listening on Network Management Netlink Socket.1232test # [ 7.086649] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1233test # [ 7.088257] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1234test # [ 7.090556] systemd[1]: Listening on udev Control Socket.1235test # [ 7.095605] systemd[1]: Mounting Huge Pages File System...1236second # [ 7.106559] systemd[1]: initrd-switch-root.service: Deactivated successfully.1237test # [ 7.099929] systemd[1]: Mounting POSIX Message Queue File System...1238second # [ 7.107519] systemd[1]: Stopped initrd-switch-root.service.1239second # [ 7.110294] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1240test # [ 7.105031] systemd[1]: Mounting Kernel Debug File System...1241second # [ 7.112329] systemd[1]: Created slice Slice /system/getty.1242second # [ 7.113377] systemd[1]: Created slice User and Session Slice.1243second # [ 7.114189] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1244second # [ 7.116282] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1245second # [ 7.117574] systemd[1]: Expecting device /dev/hvc0...1246second # [ 7.118596] systemd[1]: Expecting device /dev/ttyAMA0...1247second # [ 7.119721] systemd[1]: Reached target Local Encrypted Volumes.1248test # [ 7.113783] systemd[1]: Mounting Kernel Trace File System...1249second # [ 7.121413] systemd[1]: Stopped target initrd-fs.target.1250second # [ 7.122880] systemd[1]: Stopped target initrd-root-fs.target.1251second # [ 7.124513] systemd[1]: Stopped target initrd-switch-root.target.1252second # [ 7.126135] systemd[1]: Reached target Virtual Machines and Containers.1253second # [ 7.127840] systemd[1]: Reached target Path Units.1254second # [ 7.128733] systemd[1]: Reached target Remote File Systems.1255second # [ 7.130295] systemd[1]: Reached target Slice Units.1256test # [ 7.123934] systemd[1]: Starting Create List of Static Device Nodes...1257second # [ 7.131840] systemd[1]: Reached target Swaps.1258second # [ 7.137051] systemd[1]: Listening on Process Core Dump Socket.1259test # [ 7.134762] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1260second # [ 7.141237] systemd[1]: Listening on Credential Encryption/Decryption.1261test # [ 7.136750] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1262second # [ 7.146511] systemd[1]: Starting Journal Log Access Socket...1263second # [ 7.148749] systemd[1]: Listening on Journal Audit Socket.1264second # [ 7.149844] systemd[1]: Listening on Network Management Metrics Varlink Socket.1265second # [ 7.151731] systemd[1]: Listening on Network Management Netlink Socket.1266second # [ 7.152984] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1267test # [ 7.147482] systemd[1]: Mounting Kernel Configuration File System...1268second # [ 7.154055] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1269second # [ 7.156501] systemd[1]: Listening on udev Control Socket.1270test # [ 7.152593] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1271second # [ 7.160819] systemd[1]: Mounting Huge Pages File System...1272test # [ 7.155638] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1273second # [ 7.165185] systemd[1]: Mounting POSIX Message Queue File System...1274second # [ 7.172260] systemd[1]: Mounting Kernel Debug File System...1275test # [ 7.166884] systemd[1]: Starting Load Kernel Module fuse...1276test # [ 7.168822] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671277second # [ 7.181019] systemd[1]: Mounting Kernel Trace File System...1278second # [ 7.192487] systemd[1]: Starting Create List of Static Device Nodes...1279second # [ 7.201190] systemd[1]: Starting Load Kernel Module 9pnet_virtio...1280second # [ 7.202690] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1281second # [ 7.211128] systemd[1]: Mounting Kernel Configuration File System...1282second # [ 7.212241] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1283second # [ 7.215482] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1284second # [ 7.227367] systemd[1]: Starting Load Kernel Module fuse...1285second # [ 7.229112] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671286test # [ 7.254860] systemd[1]: Starting Journal Service...1287test # [ 7.283445] systemd[1]: Starting Load Kernel Modules...1288second # [ 7.304282] systemd[1]: Starting Journal Service...1289test # [ 7.316913] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1290test # [ 7.323816] fuse: init (API version 7.45)1291second # [ 7.332614] systemd[1]: Starting Load Kernel Modules...1292test # [ 7.342007] systemd[1]: Starting Remount Root and Kernel File Systems...1293test # [ 7.346079] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki1294second # [ 7.360196] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1295second # [ 7.367523] fuse: init (API version 7.45)1296second # [ 7.378207] systemd[1]: Starting Remount Root and Kernel File Systems...1297second # [ 7.381937] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki1298test # [ 7.375844] systemd[1]: Starting Coldplug All udev Devices...1299test # [ 7.389126] systemd[1]: Listening on Journal Log Access Socket.1300test # [ 7.395423] systemd[1]: Mounted Huge Pages File System.1301second # [ 7.402082] systemd[1]: Starting Coldplug All udev Devices...1302test # [ 7.403666] systemd[1]: Mounted POSIX Message Queue File System.1303test # [ 7.408018] systemd[1]: Mounted Kernel Debug File System.1304test # [ 7.413720] systemd-journald[322]: Collecting audit messages is enabled.1305second # [ 7.427048] systemd[1]: Listening on Journal Log Access Socket.1306test # [ 7.420870] systemd[1]: Started Journal Service.1307second # [ 7.429013] systemd[1]: Mounted Huge Pages File System.1308second # [ 7.432443] systemd[1]: Mounted POSIX Message Queue File System.1309test # [ 7.407984] systemd[1]: Queued start job for default target Multi-User System.1310second # [ 7.435347] systemd[1]: Mounted Kernel Debug File System.1311test # [ 7.423737] systemd[1]: systemd-journald.service: Deactivated successfully.1312second # [ 7.438607] systemd[1]: Mounted Kernel Trace File System.1313test # [ 7.431023] systemd[1]: Mounted Kernel Trace File System.1314test # [ 7.431659] systemd[1]: Finished Create List of Static Device Nodes.1315test # [ 7.434486] systemd-modules-load[323]: Module 'atkbd' is built in1316second # [ 7.448609] systemd[1]: Finished Create List of Static Device Nodes.1317second # [ 7.449282] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1318test # [ 7.440185] systemd-modules-load[323]: Module 'ctr' is built in1319second # [ 7.455780] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1320second # [ 7.456401] systemd[1]: Mounted Kernel Configuration File System.1321second # [ 7.456869] systemd[1]: modprobe@fuse.service: Deactivated successfully.1322test # [ 7.444829] systemd-modules-load[323]: Module 'loop' is built in1323test # [ 7.447209] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.1324second # [ 7.464779] systemd[1]: Finished Load Kernel Module fuse.1325test # [ 7.451596] systemd[1]: Finished Load Kernel Module 9pnet_virtio.1326second # [ 7.473001] systemd[1]: Finished Load Kernel Modules.1327test # [ 7.460351] systemd[1]: Mounted Kernel Configuration File System.1328test # [ 7.461135] systemd[1]: modprobe@fuse.service: Deactivated successfully.1329test # [ 7.471139] EXT4-fs (vda): re-mounted 6860c9da-8862-410c-a7e5-28a7cb01be49.1330second # [ 7.480269] systemd[1]: Mounting FUSE Control File System...1331test # [ 7.469058] systemd[1]: Finished Load Kernel Module fuse.1332test # [ 7.469675] systemd[1]: Mounting FUSE Control File System...1333test # [ 7.470188] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1334test # [ 7.470832] systemd[1]: Finished Load Kernel Modules.1335second # [ 7.483978] systemd-journald[302]: Collecting audit messages is enabled.1336second # [ 7.494956] systemd[1]: Starting Firewall...1337test # [ 7.482690] systemd[1]: Finished Remount Root and Kernel File Systems.1338second # [ 7.491327] systemd[1]: Queued start job for default target Multi-User System.1339second # [ 7.495414] systemd[1]: systemd-journald.service: Deactivated successfully.1340second # [ 7.504286] systemd-modules-load[303]: Module 'atkbd' is built in1341second # [ 7.504965] systemd-modules-load[303]: Module 'ctr' is built in1342second # [ 7.505599] systemd-modules-load[303]: Module 'loop' is built in1343test # [ 7.497409] systemd-oomd[324]: No swap; memory pressure usage will be degraded1344second # [ 7.519330] EXT4-fs (vda): re-mounted 101b7992-002c-4d68-b56e-3d08df224ebb.1345second # [ 7.522192] systemd[1]: Starting Apply Kernel Variables...1346test # [ 7.513922] systemd[1]: Starting Firewall...1347test # [ 7.515764] systemd[1]: Starting Flush Journal to Persistent Storage...1348test # [ 7.519848] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1349test # [ 7.528886] systemd[1]: Starting Load/Save OS Random Seed...1350second # [ 7.544756] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1351second # [ 7.552762] systemd[1]: Started Journal Service.1352test # [ 7.542351] systemd[1]: Starting Apply Kernel Variables...1353test # [ 7.544621] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki1354second # [ 7.565509] systemd-oomd[304]: No swap; memory pressure usage will be degraded1355second # [ 7.570989] systemd[1]: Finished Remount Root and Kernel File Systems.1356test # [ 7.573286] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1357second # [ 7.584456] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1358test # [ 7.613140] systemd[1]: Mounted FUSE Control File System.1359second # [ 7.627573] systemd[1]: Mounted FUSE Control File System.1360second # [ 7.642116] systemd[1]: Starting Flush Journal to Persistent Storage...1361second # [ 7.642870] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1362second # [ 7.651349] systemd[1]: Starting Load/Save OS Random Seed...1363second # [ 7.653351] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki1364test # [ 7.659140] systemd-journald[322]: Received client request to flush runtime journal.1365second # [ 7.702658] systemd[1]: Finished Apply Kernel Variables.1366second # [ 7.716541] systemd[1]: Starting Network Name Resolution...1367second # [ 7.754361] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1368second # [ 7.765094] systemd-journald[302]: Received client request to flush runtime journal.1369second # [ 7.877938] systemd[1]: Starting Create Static Device Nodes in /dev...1370second # [ 7.887380] systemd[1]: Finished Load/Save OS Random Seed.1371test # [ 7.881253] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1372second # [ 7.890687] systemd[1]: Reached target First Boot Complete.1373second # [ 7.894020] systemd[1]: Finished Flush Journal to Persistent Storage.1374test # [ 7.886563] systemd[1]: Starting Create Static Device Nodes in /dev...1375test # [ 7.889705] systemd[1]: Finished Apply Kernel Variables.1376second # [ 7.902284] systemd-resolved[332]: Positive Trust Anchors:1377test # [ 7.895946] systemd[1]: Starting Network Name Resolution...1378second # [ 7.905427] systemd-resolved[332]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d1379test # [ 7.900982] systemd[1]: Finished Create Static Device Nodes in /dev.1380test # [ 7.901583] systemd[1]: Reached target Preparation for Local File Systems.1381test # [ 7.902174] systemd[1]: Starting Rule-based Manager for Device Events and Files...1382test # [ 7.902809] systemd[1]: Finished Load/Save OS Random Seed.1383second # [ 7.910764] systemd-resolved[332]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b161384test # [ 7.903319] systemd[1]: Reached target First Boot Complete.1385test # [ 7.908841] systemd-resolved[353]: Positive Trust Anchors:1386second # [ 7.916545] systemd-resolved[332]: 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 test1387test # [ 7.911387] systemd-resolved[353]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d1388test # [ 7.918405] systemd-resolved[353]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b161389test # [ 7.924271] systemd-resolved[353]: 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 test1390second # [ 7.951064] systemd[1]: Finished Create Static Device Nodes in /dev.1391second # [ 7.951831] systemd[1]: Reached target Preparation for Local File Systems.1392second # [ 7.952990] systemd[1]: Starting Rule-based Manager for Device Events and Files...1393test # [ 7.947876] systemd[1]: Finished Flush Journal to Persistent Storage.1394test # [ 7.969506] systemd-udevd[356]: Using default interface naming scheme 'v260'.1395test # [ 8.035619] systemd[1]: Mounting /run/wrappers...1396second # [ 8.057245] systemd-udevd[346]: Using default interface naming scheme 'v260'.1397second # [ 8.103919] systemd[1]: Mounting /run/wrappers...1398test # [ 8.108250] systemd[1]: Mounted /run/wrappers.1399test # [ 8.110277] systemd[1]: Reached target Local File Systems.1400test # [ 8.116823] systemd[1]: Listening on Boot Loader Control Service Socket.1401test # [ 8.130741] systemd[1]: Starting register-nix-paths.service...1402test # [ 8.135057] systemd[1]: Starting Create SUID/SGID Wrappers...1403test # [ 8.135709] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1404test # [ 8.145423] systemd[1]: Starting Save Transient machine-id to Disk...1405test # [ 8.150486] systemd[1]: Starting Create System Files and Directories...1406second # [ 8.169712] systemd-resolved[332]: Using system hostname 'second'.1407second # [ 8.178043] systemd[1]: Mounted /run/wrappers.1408second # [ 8.180678] systemd[1]: Started Network Name Resolution.1409test # [ 8.175315] systemd-resolved[353]: Using system hostname 'test'.1410second # [ 8.185094] systemd[1]: Reached target Local File Systems.1411second # [ 8.189039] systemd[1]: Listening on Boot Loader Control Service Socket.1412second # [ 8.193246] systemd[1]: Starting register-nix-paths.service...1413test # [ 8.190046] systemd[1]: Started Network Name Resolution.1414second # [ 8.200186] systemd[1]: Starting Create SUID/SGID Wrappers...1415second # [ 8.200933] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1416second # [ 8.205313] systemd[1]: Starting Save Transient machine-id to Disk...1417second # [ 8.223069] systemd[1]: Starting Create System Files and Directories...1418test # [ 8.373875] systemd[1]: Finished Create System Files and Directories.1419second # [ 8.382566] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1420second # [ 8.389275] systemd[1]: Finished Save Transient machine-id to Disk.1421test # [ 8.386303] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1422test # [ 8.403480] systemd[1]: Starting Rebuild Journal Catalog...1423test # [ 8.416303] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1424test # [ 8.424689] systemd[1]: Started Rule-based Manager for Device Events and Files.1425second # [ 8.439236] systemd[1]: Finished Create System Files and Directories.1426test # [ 8.435334] systemd[1]: Finished Save Transient machine-id to Disk.1427second # [ 8.454693] systemd[1]: Starting Rebuild Journal Catalog...1428second # [ 8.467868] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1429second # [ 8.504573] systemd[1]: Started Rule-based Manager for Device Events and Files.1430test # [ 8.577606] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1431second # [ 8.614876] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1432test # [ 8.650687] systemd[1]: Finished Rebuild Journal Catalog.1433test # [ 8.669369] systemd[1]: Starting Update is Completed...1434second # [ 8.703619] systemd[1]: Finished Rebuild Journal Catalog.1435second # [ 8.711842] systemd[1]: Starting Update is Completed...1436test # [ 8.758582] systemd[1]: Finished Update is Completed.1437second # [ 8.798259] systemd[1]: Finished Update is Completed.1438test # [ 8.831952] systemd[1]: Finished Coldplug All udev Devices.1439second # [ 8.917076] systemd[1]: Finished Coldplug All udev Devices.1440test # [ 9.006514] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1441second # [ 9.065424] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1442test # [ 9.304612] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1443second # [ 9.350165] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1444test # [ 9.349502] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1445test # [ 9.351880] systemd[1]: Finished Create SUID/SGID Wrappers.1446test # [ 9.362340] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1447second # [ 9.397486] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1448second # [ 9.400270] systemd[1]: Finished Create SUID/SGID Wrappers.1449second # [ 9.421984] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1450second # [ 9.632618] systemd[1]: Finished Firewall.1451second # [ 9.633142] systemd[1]: Reached target Preparation for Network.1452second # [ 9.636638] systemd[1]: Starting Network Management...1453test # [ 9.657796] (udev-worker)[412]: Network interface NamePolicy= disabled on kernel command line.1454test # [ 9.672378] (udev-worker)[411]: Network interface NamePolicy= disabled on kernel command line.1455test # [ 9.683882] systemd[1]: Finished Firewall.1456test # [ 9.687351] systemd[1]: Reached target Preparation for Network.1457second # [ 9.697348] systemd[1]: Finished register-nix-paths.service.1458second # [ 9.698000] systemd[1]: Reached target System Initialization.1459second # [ 9.700945] systemd[1]: Started Discard unused filesystem blocks once a week.1460test # [ 9.693007] systemd[1]: Starting Network Management...1461second # [ 9.702060] systemd[1]: Started Daily Cleanup of Temporary Directories.1462test # [ 9.694051] systemd[1]: Finished register-nix-paths.service.1463test # [ 9.695822] systemd[1]: Reached target System Initialization.1464test # [ 9.698446] systemd[1]: Started Discard unused filesystem blocks once a week.1465second # [ 9.706934] systemd[1]: Reached target Timer Units.1466second # [ 9.707455] systemd[1]: Listening on D-Bus System Message Bus Socket.1467second # [ 9.707976] systemd[1]: Listening on Nix Daemon Socket.1468test # [ 9.699950] systemd[1]: Started Daily Cleanup of Temporary Directories.1469test # [ 9.704938] systemd[1]: Reached target Timer Units.1470test # [ 9.705414] systemd[1]: Listening on D-Bus System Message Bus Socket.1471test # [ 9.705959] systemd[1]: Listening on Nix Daemon Socket.1472second # [ 9.719024] systemd[1]: Listening on Authorization Manager Agent Helper.1473second # [ 9.719727] systemd[1]: Listening on Hostname Service Socket.1474second # [ 9.721738] systemd[1]: Reached target Socket Units.1475test # [ 9.716798] systemd[1]: Listening on Authorization Manager Agent Helper.1476second # [ 9.723542] systemd[1]: Starting D-Bus System Message Bus...1477test # [ 9.720552] systemd[1]: Listening on Hostname Service Socket.1478test # [ 9.721181] systemd[1]: Reached target Socket Units.1479test # [ 9.729353] systemd[1]: Starting D-Bus System Message Bus...1480second # [ 9.748762] (udev-worker)[399]: Network interface NamePolicy= disabled on kernel command line.1481second # [ 9.753129] (udev-worker)[403]: Network interface NamePolicy= disabled on kernel command line.1482second # [ 9.891708] cfg80211: Loading compiled-in X.509 certificates for regulatory database1483second # [ 9.919311] dbus-broker-launch[537]: Looking up NSS user entry for 'systemd-timesync'...1484test # [ 9.923006] mousedev: PS/2 mouse device common for all mice1485second # [ 9.933927] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1486second # [ 9.934439] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1487test # [ 9.940221] cfg80211: Loading compiled-in X.509 certificates for regulatory database1488second # [ 9.942033] dbus-broker-launch[537]: NSS returned no entry for 'systemd-timesync'1489second # [ 9.943074] dbus-broker-launch[537]: Invalid user-name in /nix/store/9cz1qgn4ivxnbvda5bdsmwsp7adkc73c-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"[ 9.952826] mousedev: PS/2 mouse device common for all mice1490second # 1491test # [ 9.945180] dbus-broker-launch[557]: Looking up NSS user entry for 'systemd-timesync'...1492test # [ 9.962244] dbus-broker-launch[557]: NSS returned no entry for 'systemd-timesync'1493test # [ 9.963674] dbus-broker-launch[557]: Invalid user-name in /nix/store/9cz1qgn4ivxnbvda5bdsmwsp7adkc73c-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1494test # [ 9.987432] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1495test # [ 9.987946] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1496second # [ 9.987456] systemd-networkd[534]: /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.1497second # [ 9.993182] systemd-networkd[534]: /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.1498second # [ 9.998460] systemd-networkd[534]: lo: Link UP1499second # [ 10.003263] systemd-networkd[534]: lo: Gained carrier1500second # [ 10.007162] systemd[1]: Started Network Management.1501second # [ 10.010785] dbus-broker-launch[537]: Ignoring duplicate name 'org.freedesktop.nm_dispatcher' in service file '/nix/store/nc2n2qi8lq7i3sr8wh2s74k57v8ivb7b-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_dispatcher.service'1502second # [ 10.020321] dbus-broker-launch[537]: Ignoring duplicate name 'org.freedesktop.nm_priv_helper' in service file '/nix/store/nc2n2qi8lq7i3sr8wh2s74k57v8ivb7b-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_priv_helper.service'1503second # [ 10.032135] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...1504second # [ 10.034142] systemd-networkd[534]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1505test # [ 10.027473] dbus-broker-launch[557]: Ignoring duplicate name 'org.freedesktop.nm_dispatcher' in service file '/nix/store/nc2n2qi8lq7i3sr8wh2s74k57v8ivb7b-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_dispatcher.service'1506second # [ 10.039176] systemd-networkd[534]: eth1: Configuring with /etc/systemd/network/40-eth1.network.1507test # [ 10.030832] dbus-broker-launch[557]: Ignoring duplicate name 'org.freedesktop.nm_priv_helper' in service file '/nix/store/nc2n2qi8lq7i3sr8wh2s74k57v8ivb7b-networkmanager-1.56.0/share/dbus-1/system-services/org.freedesktop.nm_priv_helper.service'1508second # [ 10.043998] dbus-broker-launch[537]: Ignoring duplicate name 'org.freedesktop.ModemManager1' in service file '/nix/store/had2hwcdifwqkpz3ji6sxkvg8yb164rc-modemmanager-1.24.2/share/dbus-1/system-services/org.freedesktop.ModemManager1.service'1509test # [ 10.037262] dbus-broker-launch[557]: Ignoring duplicate name 'org.freedesktop.ModemManager1' in service file '/nix/store/had2hwcdifwqkpz3ji6sxkvg8yb164rc-modemmanager-1.24.2/share/dbus-1/system-services/org.freedesktop.ModemManager1.service'1510second # [ 10.049048] systemd-networkd[534]: eth1: Link UP1511second # [ 10.050651] systemd-networkd[534]: eth1: Gained carrier1512test # [ 10.041404] dbus-broker-launch[557]: Ignoring duplicate name 'org.freedesktop.PolicyKit1' in service file '/nix/store/42037x5cj27f8dawijnxzb26db99wwxy-polkit-127/share/dbus-1/system-services/org.freedesktop.PolicyKit1.service'1513second # [ 10.052753] systemd-networkd[534]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1514test # [ 10.050376] systemd[1]: Started D-Bus System Message Bus.1515second # [ 10.057718] dbus-broker-launch[537]: Ignoring duplicate name 'org.freedesktop.PolicyKit1' in service file '/nix/store/42037x5cj27f8dawijnxzb26db99wwxy-polkit-127/share/dbus-1/system-services/org.freedesktop.PolicyKit1.service'1516test # [ 10.054009] systemd-networkd[556]: /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.1517second # [ 10.065138] systemd[1]: Started D-Bus System Message Bus.1518test # [ 10.059823] systemd-networkd[556]: /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.1519test # [ 10.067146] systemd-networkd[556]: lo: Link UP1520test # [ 10.070346] systemd-networkd[556]: lo: Gained carrier1521test # [ 10.074778] systemd-networkd[556]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1522test # [ 10.080826] systemd-networkd[556]: eth1: Configuring with /etc/systemd/network/40-eth1.network.1523test # [ 10.081765] systemd-networkd[556]: eth1: Link UP1524test # [ 10.085589] systemd-networkd[556]: eth1: Gained carrier1525test # [ 10.088737] systemd-networkd[556]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1526second # [ 10.098762] dbus-broker-launch[537]: Ready1527second # [ 10.102662] systemd[1]: Reached target Basic System.1528second # [ 10.109271] systemd[1]: Starting Network Manager Script Dispatcher Service...1529second # [ 10.115386] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1530second # [ 10.120770] systemd[1]: Starting Network Manager...1531test # [ 10.112916] dbus-broker-launch[557]: Ready1532test # [ 10.115748] systemd[1]: Started Network Management.1533test # [ 10.119241] systemd[1]: Reached target Basic System.1534second # [ 10.128585] systemd[1]: Started backdoor.service.1535test # [ 10.124076] systemd[1]: Starting Network Manager Script Dispatcher Service...1536test # [ 10.127736] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1537test # [ 10.140808] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1538second # [ 10.155707] systemd[1]: Starting Import lastlog data into lastlog2 database...1539test # [ 10.152969] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1540second # [ 10.170679] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1541test # [ 10.169218] systemd[1]: Starting Network Manager...1542second # [ 10.205343] systemd[1]: Starting Post-Boot Actions...1543test # [ 10.209484] systemd[1]: Started backdoor.service.1544test # [ 10.227700] systemd[1]: Starting Import lastlog data into lastlog2 database...1545second # [ 10.247525] systemd[1]: Started Reset console on configuration changes.1546second # [ 10.254797] rssf13kza7rj2jljq39fngbf0z7n3am5-wifi-secrets[549]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1547test # [ 10.263184] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1548test # [ 10.288722] rssf13kza7rj2jljq39fngbf0z7n3am5-wifi-secrets[566]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1549second # [ 10.308577] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.1550second # [ 10.321043] systemd[1]: NetworkManager-setup-secrets-wg-test-all.service: Deactivated successfully.1551test # [ 10.319253] systemd[1]: Starting Post-Boot Actions...1552second # [ 10.328783] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1553test # [ 10.327858] 8g1rx2i5wgny7771myl54j8za1ccscsg-wifi-secrets[567]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1554test # [ 10.344268] 1n5h5lsamc1iqqvp1xy6dcsj8mpn1yiw-wifi-secrets[568]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1555test # [ 10.355032] systemd[1]: Started Reset console on configuration changes.1556second # [ 10.383223] systemd[1]: Finished Post-Boot Actions.1557second # connecting to host...1558test # [ 10.390628] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...1559test # [ 10.400860] systemd[1]: NetworkManager-setup-secrets-wg-test-all.service: Deactivated successfully.1560second # [ 10.418941] nsncd[553]: Sep 02 15:08:29.249 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1561second # [ 10.424209] systemd[1]: Started Name Service Cache Daemon (nsncd).1562second # [ 10.429215] systemd[1]: Reached target Host and Network Name Lookups.1563second # [ 10.429801] systemd[1]: Reached target User and Group Name Lookups.1564second # [ 10.439012] systemd[1]: Starting User Login Management...1565test # [ 10.448752] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1566test # [ 10.451122] systemd[1]: NetworkManager-setup-secrets-wg-test-one.service: Deactivated successfully.1567test # [ 10.460623] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1568test # [ 10.461277] systemd[1]: NetworkManager-setup-secrets-wg-test-open.service: Deactivated successfully.1569test # [ 10.462142] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1570test # connecting to host...1571second # [ 10.481880] systemd[1]: Finished Import lastlog data into lastlog2 database.1572second # [ 10.494587] systemd[1]: Started Network Manager Script Dispatcher Service.1573test # [ 10.518137] nsncd[572]: Sep 02 15:08:29.334 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1574test # [ 10.527453] systemd[1]: Started Name Service Cache Daemon (nsncd).1575test: Guest shell says: b'Spawning backdoor root shell...\n'1576test: connected to guest root shell1577test: (connecting took 11.01 seconds)1578test: (finished: waiting for the VM to finish booting, in 11.01 seconds)1579test # [ 10.547769] systemd[1]: Finished Post-Boot Actions.1580second # [ 10.594665] systemd[1]: Starting Hostname Service...1581test # [ 10.583392] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.1582test # [ 10.586524] systemd[1]: Started Network Manager Script Dispatcher Service.1583test # [ 10.590096] systemd[1]: Reached target Host and Network Name Lookups.1584test # [ 10.592958] systemd[1]: Reached target User and Group Name Lookups.1585second # [ 10.609374] systemd-logind[582]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)1586second # [ 10.610284] systemd-logind[582]: Watching system buttons on /dev/input/event0 (gpio-keys)1587second # [ 10.610960] systemd-logind[582]: New seat seat0.1588test # [ 10.603255] systemd[1]: Starting User Login Management...1589second # [ 10.617367] systemd[1]: Started User Login Management.1590second # [ 10.624482] systemd[1]: Starting linger-users.service...1591test # [ 10.641364] systemd[1]: Finished Import lastlog data into lastlog2 database.1592second # [ 10.709840] systemd[1]: linger-users.service: Deactivated successfully.1593second # [ 10.710476] systemd[1]: Finished linger-users.service.1594test # [ 10.712484] systemd[1]: Starting Hostname Service...1595second # [ 10.731054] systemd[1]: Started Hostname Service.1596test # [ 10.775997] systemd-logind[616]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)1597test # [ 10.782506] systemd-logind[616]: Watching system buttons on /dev/input/event0 (gpio-keys)1598test # [ 10.783187] systemd-logind[616]: New seat seat0.1599test # [ 10.790493] systemd[1]: Started User Login Management.1600test # [ 10.795302] systemd[1]: Starting linger-users.service...1601second # [ 10.833834] systemd-networkd[534]: eth0: Link UP1602second # [ 10.834343] systemd-networkd[534]: eth0: Gained carrier1603second # [ 10.857480] systemd[1]: Started Network Manager.1604second # [ 10.859199] systemd[1]: Reached target Network.1605second # [ 10.864418] systemd[1]: Starting Ensure that NetworkManager declarative profiles are created...1606test # [ 10.861757] systemd[1]: linger-users.service: Deactivated successfully.1607second # [ 10.870376] systemd[1]: Starting Permit User Sessions...1608test # [ 10.865113] systemd[1]: Finished linger-users.service.1609test # [ 10.878469] systemd[1]: Started Hostname Service.1610test # [ 10.976046] systemd-networkd[556]: eth0: Link UP1611test # [ 10.976587] systemd-networkd[556]: eth0: Gained carrier1612test # [ 10.996615] systemd[1]: Started Network Manager.1613test # [ 10.997234] systemd[1]: Reached target Network.1614test # [ 11.002288] systemd[1]: Starting Ensure that NetworkManager declarative profiles are created...1615test # [ 11.007724] systemd[1]: Starting Permit User Sessions...1616second # [ 11.028779] systemd[1]: Finished Permit User Sessions.1617second # [ 11.041852] systemd[1]: Started Getty on tty1.1618second # [ 11.042365] systemd[1]: Reached target Login Prompts.1619second # [ 11.086371] systemd-resolved[332]: eth0: Bus client set default route setting: yes1620second # [ 11.087093] systemd-resolved[332]: eth0: Bus client set DNS server list to: 10.0.2.31621second # [ 11.159588] systemd[1]: NetworkManager-ensure-profiles.service: Deactivated successfully.1622second # [ 11.161463] systemd[1]: Finished Ensure that NetworkManager declarative profiles are created.1623test # [ 11.160295] systemd[1]: Finished Permit User Sessions.1624test # [ 11.180765] systemd[1]: Started Getty on tty1.1625test # [ 11.181471] systemd[1]: Reached target Login Prompts.1626test # [ 11.188294] systemd-resolved[353]: eth0: Bus client set default route setting: yes1627test # [ 11.196206] systemd-resolved[353]: eth0: Bus client set DNS server list to: 10.0.2.31628test # [ 11.229037] NetworkManager[569]: <warn> [1788361710.0431] keyfile: load: "/var/run/NetworkManager/system-connections/all.nmconnection": failed to load connection: invalid connection: connection.id: property is empty1629second # [ 11.304405] systemd[1]: Reached target Multi-User System.1630second # [ 11.308334] systemd[1]: Startup finished in 717ms (kernel) + 4.391s (initrd) + 6.197s (userspace) = 11.306s.1631test # [ 11.312104] systemd[1]: NetworkManager-ensure-profiles.service: Deactivated successfully.1632test # [ 11.312886] systemd[1]: Finished Ensure that NetworkManager declarative profiles are created.1633test # [ 11.499086] systemd[1]: Reached target Multi-User System.1634test # [ 11.502925] systemd[1]: Startup finished in 733ms (kernel) + 4.297s (initrd) + 6.470s (userspace) = 11.500s.1635second # [ 11.700636] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:08.0/virtio7/input/input31636test # [ 11.783271] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:08.0/virtio7/input/input31637second # [ 11.809786] systemd-networkd[534]: eth1: Gained IPv6LL1638test: (finished: waiting for unit NetworkManager.service, in 12.28 seconds)1639test: must succeed: cat /run/NetworkManager/system-connections/one.nmconnection1640test: (finished: must succeed: cat /run/NetworkManager/system-connections/one.nmconnection, in 0.05 seconds)1641test: must succeed: cat /run/secrets/NetworkManager/wifi-secrets1642second # [ 11.945460] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1643test: (finished: must succeed: cat /run/secrets/NetworkManager/wifi-secrets, in 0.04 seconds)1644test: must succeed: cat /run/NetworkManager/system-connections/open.nmconnection1645second # [ 11.992341] systemd[1]: Starting Virtual Console Setup...1646test: (finished: must succeed: cat /run/NetworkManager/system-connections/open.nmconnection, in 0.04 seconds)1647(finished: run the VM test script, in 12.96 seconds)1648second # [ 12.013806] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1649second # [ 12.017184] systemd[1]: Stopped Virtual Console Setup.1650second # [ 12.018274] systemd-logind[582]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1651second # [ 12.021844] systemd[1]: Starting Virtual Console Setup...1652test # [ 12.065188] systemd-networkd[556]: eth1: Gained IPv6LL1653test script finished in 13.03s1654cleanup1655kill QemuMachine (pid 15)1656second # qemu-system-aarch64: terminating on signal 15 from pid 6 (/nix/store/d6kq2phq0zy5invmkfgg8h35zxaf13s9-python3-3.13.15/bin/python3.13)1657test # [ 12.119170] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1658test # [ 12.161193] systemd[1]: Starting Virtual Console Setup...1659test # [ 12.185435] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1660test # [ 12.187847] systemd[1]: Stopped Virtual Console Setup.1661test # [ 12.190240] systemd-logind[616]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1662test # [ 12.193972] systemd[1]: Starting Virtual Console Setup...1663kill QemuMachine (pid 14)1664test # qemu-system-aarch64: terminating on signal 15 from pid 6 (/nix/store/d6kq2phq0zy5invmkfgg8h35zxaf13s9-python3-3.13.15/bin/python3.13)1665(finished: cleanup, in 0.25 seconds)