nixbot

builds

failed vm-test-run-wifi checks.x86_64-linux.wifi · build #106 · 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.0 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 vm13test # Disk image does not exist, creating the virtualisation disk image...14test # Formatting '/build/vm-state-test/tmp.eBAn3Hrl13', fmt=raw size=107374182415test # mke2fs 1.47.4 (6-Mar-2025)16test # Discarding device blocks: 0/262144 done17test # Creating filesystem with 262144 4k blocks and 65536 inodes18test # Filesystem UUID: b48e8f06-06f3-49de-801f-52fc5b6de68819test # Superblock backups stored on blocks:20test: QEMU running (pid 47)21test # 32768, 98304, 163840, 22937622test # 23test # Allocating group tables: 0/8 done24test # Writing inode tables: 0/8 done25test # Creating journal (8192 blocks): done26test # Writing superblocks and filesystem accounting information: 0/8 done27test # 28test # Virtualisation disk image created.29second: QEMU running (pid 48)30second # Disk image does not exist, creating the virtualisation disk image...31second # Formatting '/build/vm-state-second/tmp.s4Cp5G9xVy', fmt=raw size=107374182432second # mke2fs 1.47.4 (6-Mar-2025)33second # Discarding device blocks: 0/262144 done34second # Creating filesystem with 262144 4k blocks and 65536 inodes35second # Filesystem UUID: f4e24826-c264-41b9-bd36-12e9e06d3e1736second # Superblock backups stored on blocks:37second # 32768, 98304, 163840, 22937638second # 39second # Allocating group tables: 0/8 done40second # Writing inode tables: 0/8 done41second # Creating journal (8192 blocks): done42second # Writing superblocks and filesystem accounting information: 0/8 done43second # 44second # Virtualisation disk image created.45(finished: start all VMs, in 0.31 seconds)46test: waiting for unit NetworkManager.service47test: waiting for the VM to finish booting48test # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)49second # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)50test # 51test # 52second # 53second # 54test # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+3EFCC730+3EF2C730 CA0055second # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+3EFCC730+3EF2C730 CA0056test # Press Ctrl-B to configure iPXE (PCI 00:02.0)...57test # 58test # 59test # 60test # 61second # Press Ctrl-B to configure iPXE (PCI 00:02.0)...62second # 63second # 64second # 65second # 66test # iPXE (http://ipxe.org) 00:08.0 CB00 PCI2.10 PnP PMM 3EFCC730 3EF2C730 CB0067second # iPXE (http://ipxe.org) 00:08.0 CB00 PCI2.10 PnP PMM 3EFCC730 3EF2C730 CB0068test # Press Ctrl-B to configure iPXE (PCI 00:08.0)...69test # 70test # 71second # Press Ctrl-B to configure iPXE (PCI 00:08.0)...72second # 73second # 74test # Booting from ROM...75second # Booting from ROM...76test # Probing EDD (edd=off to disable)... ok[ 0.000000] Linux version 6.18.48 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Fri Aug 28 06:22:54 UTC 202677test # [ 0.000000] Command line: console=ttyS0 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/j959anz9hppwk4ffv4jw8hddxmv5acwh-nixos-system-test-test/init regInfo=/nix/store/q38zr40dp90fj3xmvak2cffhyq0bj5mf-closure-info/registration console=ttyS0,115200n8 console=tty078test # [ 0.000000] BIOS-provided physical RAM map:79test # [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable80test # [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved81test # [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved82test # [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000003ffd7fff] usable83test # [ 0.000000] BIOS-e820: [mem 0x000000003ffd8000-0x000000003fffffff] reserved84test # [ 0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved85test # [ 0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved86second # Probing EDD (edd=off to disable)... ok[ 0.000000] Linux version 6.18.48 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Fri Aug 28 06:22:54 UTC 202687test # [ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved88test # [ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved89test # [ 0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved90test # [ 0.000000] NX (Execute Disable) protection: active91test # [ 0.000000] APIC: Static calls initialized92second # [ 0.000000] Command line: console=ttyS0 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/9xmmxf7qfryq1r3fngz2qayqfwrghi8a-nixos-system-second-test/init regInfo=/nix/store/pqgbmhpgsjlwmhaam3knxcchvq851ib3-closure-info/registration console=ttyS0,115200n8 console=tty093test # [ 0.000000] SMBIOS 2.8 present.94second # [ 0.000000] BIOS-provided physical RAM map:95second # [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable96test # [ 0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/201497test # [ 0.000000] DMI: Memory slots populated: 1/198second # [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved99test # [ 0.000000] Hypervisor detected: KVM100second # [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved101test # [ 0.000000] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000102second # [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000003ffd7fff] usable103test # [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00104test # [ 0.000002] kvm-clock: using sched offset of 428085064 cycles105second # [ 0.000000] BIOS-e820: [mem 0x000000003ffd8000-0x000000003fffffff] reserved106second # [ 0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved107test # [ 0.000004] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns108second # [ 0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved109test # [ 0.000009] tsc: Detected 4192.100 MHz processor110second # [ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved111second # [ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved112test # [ 0.000695] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000113second # [ 0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved114second # [ 0.000000] NX (Execute Disable) protection: active115test # [ 0.000732] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs116second # [ 0.000000] APIC: Static calls initialized117second # [ 0.000000] SMBIOS 2.8 present.118test # [ 0.000736] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT119test # [ 0.002579] found SMP MP-table at [mem 0x000f5450-0x000f545f]120second # [ 0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/2014121second # [ 0.000000] DMI: Memory slots populated: 1/1122second # [ 0.000000] Hypervisor detected: KVM123second # [ 0.000000] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000124second # [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00125test # [ 0.002599] Using GB pages for direct mapping126test # [ 0.002684] RAMDISK: [mem 0x3e368000-0x3ffcffff]127test # [ 0.002695] ACPI: Early table checksum verification disabled128test # [ 0.002700] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )129second # [ 0.000000] kvm-clock: using sched offset of 432803327 cycles130test # [ 0.002706] ACPI: RSDT 0x000000003FFE2422 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)131test # [ 0.002713] ACPI: FACP 0x000000003FFE221A 0000F4 (v03 BOCHS BXPC 00000001 BXPC 00000001)132second # [ 0.000003] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns133second # [ 0.000007] tsc: Detected 4192.100 MHz processor134test # [ 0.002722] ACPI: DSDT 0x000000003FFE0040 0021DA (v01 BOCHS BXPC 00000001 BXPC 00000001)135second # [ 0.000670] last_pfn = 0x3ffd8 max_arch_pfn = 0x400000000136test # [ 0.002724] ACPI: FACS 0x000000003FFE0000 000040137second # [ 0.000711] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs138test # [ 0.002726] ACPI: APIC 0x000000003FFE230E 000078 (v03 BOCHS BXPC 00000001 BXPC 00000001)139second # [ 0.000715] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT140test # [ 0.002727] ACPI: HPET 0x000000003FFE2386 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)141second # [ 0.002539] found SMP MP-table at [mem 0x000f5450-0x000f545f]142second # [ 0.002579] Using GB pages for direct mapping143test # [ 0.002729] ACPI: MCFG 0x000000003FFE23BE 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001)144second # [ 0.002708] RAMDISK: [mem 0x3e369000-0x3ffcffff]145second # [ 0.002719] ACPI: Early table checksum verification disabled146test # [ 0.002730] ACPI: WAET 0x000000003FFE23FA 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001)147second # [ 0.002724] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )148test # [ 0.002731] ACPI: Reserving FACP table memory at [mem 0x3ffe221a-0x3ffe230d]149second # [ 0.002729] ACPI: RSDT 0x000000003FFE2422 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)150test # [ 0.002732] ACPI: Reserving DSDT table memory at [mem 0x3ffe0040-0x3ffe2219]151test # [ 0.002733] ACPI: Reserving FACS table memory at [mem 0x3ffe0000-0x3ffe003f]152second # [ 0.002735] ACPI: FACP 0x000000003FFE221A 0000F4 (v03 BOCHS BXPC 00000001 BXPC 00000001)153test # [ 0.002733] ACPI: Reserving APIC table memory at [mem 0x3ffe230e-0x3ffe2385]154second # [ 0.002745] ACPI: DSDT 0x000000003FFE0040 0021DA (v01 BOCHS BXPC 00000001 BXPC 00000001)155second # [ 0.002747] ACPI: FACS 0x000000003FFE0000 000040156test # [ 0.002733] ACPI: Reserving HPET table memory at [mem 0x3ffe2386-0x3ffe23bd]157test # [ 0.002734] ACPI: Reserving MCFG table memory at [mem 0x3ffe23be-0x3ffe23f9]158second # [ 0.002749] ACPI: APIC 0x000000003FFE230E 000078 (v03 BOCHS BXPC 00000001 BXPC 00000001)159test # [ 0.002734] ACPI: Reserving WAET table memory at [mem 0x3ffe23fa-0x3ffe2421]160second # [ 0.002751] ACPI: HPET 0x000000003FFE2386 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)161test # [ 0.003159] No NUMA configuration found162second # [ 0.002753] ACPI: MCFG 0x000000003FFE23BE 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001)163test # [ 0.003161] Faking a node at [mem 0x0000000000000000-0x000000003ffd7fff]164test # [ 0.003165] NODE_DATA(0) allocated [mem 0x3ffd2780-0x3ffd7cff]165second # [ 0.002755] ACPI: WAET 0x000000003FFE23FA 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001)166test # [ 0.003257] Zone ranges:167second # [ 0.002756] ACPI: Reserving FACP table memory at [mem 0x3ffe221a-0x3ffe230d]168test # [ 0.003258] DMA [mem 0x0000000000001000-0x0000000000ffffff]169second # [ 0.002758] ACPI: Reserving DSDT table memory at [mem 0x3ffe0040-0x3ffe2219]170test # [ 0.003259] DMA32 [mem 0x0000000001000000-0x000000003ffd7fff]171test # [ 0.003260] Normal empty172test # [ 0.003261] Device empty173second # [ 0.002758] ACPI: Reserving FACS table memory at [mem 0x3ffe0000-0x3ffe003f]174test # [ 0.003261] Movable zone start for each node175second # [ 0.002759] ACPI: Reserving APIC table memory at [mem 0x3ffe230e-0x3ffe2385]176test # [ 0.003262] Early memory node ranges177second # [ 0.002760] ACPI: Reserving HPET table memory at [mem 0x3ffe2386-0x3ffe23bd]178test # [ 0.003262] node 0: [mem 0x0000000000001000-0x000000000009efff]179second # [ 0.002761] ACPI: Reserving MCFG table memory at [mem 0x3ffe23be-0x3ffe23f9]180test # [ 0.003263] node 0: [mem 0x0000000000100000-0x000000003ffd7fff]181second # [ 0.002762] ACPI: Reserving WAET table memory at [mem 0x3ffe23fa-0x3ffe2421]182test # [ 0.003264] Initmem setup node 0 [mem 0x0000000000001000-0x000000003ffd7fff]183second # [ 0.003210] No NUMA configuration found184test # [ 0.003287] On node 0, zone DMA: 1 pages in unavailable ranges185second # [ 0.003211] Faking a node at [mem 0x0000000000000000-0x000000003ffd7fff]186test # [ 0.003531] On node 0, zone DMA: 97 pages in unavailable ranges187second # [ 0.003215] NODE_DATA(0) allocated [mem 0x3ffd2780-0x3ffd7cff]188second # [ 0.003320] Zone ranges:189test # [ 0.020611] On node 0, zone DMA32: 40 pages in unavailable ranges190test # [ 0.021486] ACPI: PM-Timer IO Port: 0x608191second # [ 0.003321] DMA [mem 0x0000000000001000-0x0000000000ffffff]192test # [ 0.021507] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])193second # [ 0.003322] DMA32 [mem 0x0000000001000000-0x000000003ffd7fff]194second # [ 0.003323] Normal empty195test # [ 0.021542] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23196second # [ 0.003324] Device empty197second # [ 0.003325] Movable zone start for each node198test # [ 0.021545] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)199second # [ 0.003326] Early memory node ranges200test # [ 0.021546] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)201second # [ 0.003326] node 0: [mem 0x0000000000001000-0x000000000009efff]202test # [ 0.021547] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)203second # [ 0.003328] node 0: [mem 0x0000000000100000-0x000000003ffd7fff]204test # [ 0.021549] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)205second # [ 0.003329] Initmem setup node 0 [mem 0x0000000000001000-0x000000003ffd7fff]206test # [ 0.021550] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)207second # [ 0.003355] On node 0, zone DMA: 1 pages in unavailable ranges208second # [ 0.003635] On node 0, zone DMA: 97 pages in unavailable ranges209test # [ 0.021553] ACPI: Using ACPI (MADT) for SMP configuration information210test # [ 0.021554] ACPI: HPET id: 0x8086a201 base: 0xfed00000211second # [ 0.022264] On node 0, zone DMA32: 40 pages in unavailable ranges212test # [ 0.021563] TSC deadline timer available213second # [ 0.023265] ACPI: PM-Timer IO Port: 0x608214test # [ 0.021589] CPU topo: Max. logical packages: 1215second # [ 0.023288] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])216test # [ 0.021590] CPU topo: Max. logical dies: 1217second # [ 0.023327] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23218test # [ 0.021590] CPU topo: Max. dies per package: 1219test # [ 0.021607] CPU topo: Max. threads per core: 1220second # [ 0.023331] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)221test # [ 0.021608] CPU topo: Num. cores per package: 1222second # [ 0.023333] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)223test # [ 0.021609] CPU topo: Num. threads per package: 1224second # [ 0.023335] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)225test # [ 0.021609] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs226second # [ 0.023337] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)227test # [ 0.021634] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()228second # [ 0.023337] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)229test # [ 0.021685] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]230second # [ 0.023340] ACPI: Using ACPI (MADT) for SMP configuration information231test # [ 0.021686] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]232second # [ 0.023342] ACPI: HPET id: 0x8086a201 base: 0xfed00000233second # [ 0.023354] TSC deadline timer available234test # [ 0.021689] [mem 0x40000000-0xafffffff] available for PCI devices235second # [ 0.023370] CPU topo: Max. logical packages: 1236test # [ 0.021691] Booting paravirtualized kernel on KVM237second # [ 0.023371] CPU topo: Max. logical dies: 1238second # [ 0.023371] CPU topo: Max. dies per package: 1239test # [ 0.021699] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns240second # [ 0.023385] CPU topo: Max. threads per core: 1241second # [ 0.023385] CPU topo: Num. cores per package: 1242test # [ 0.025775] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1243second # [ 0.023386] CPU topo: Num. threads per package: 1244test # [ 0.028036] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152245second # [ 0.023386] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs246test # [ 0.028101] kvm-guest: PV spinlocks disabled, single CPU247second # [ 0.023414] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()248second # [ 0.023473] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]249second # [ 0.023475] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]250second # [ 0.023477] [mem 0x40000000-0xafffffff] available for PCI devices251second # [ 0.023479] Booting paravirtualized kernel on KVM252test # [ 0.028104] Kernel command line: console=ttyS0 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/j959anz9hppwk4ffv4jw8hddxmv5acwh-nixos-system-test-test/init regInfo=/nix/store/q38zr40dp90fj3xmvak2cffhyq0bj5mf-closure-info/registration console=ttyS0,115200n8 console=tty0253second # [ 0.023485] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns254second # [ 0.027479] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1255test # [ 0.028215] Unknown kernel command line parameters "regInfo=/nix/store/q38zr40dp90fj3xmvak2cffhyq0bj5mf-closure-info/registration", will be passed to user space.256second # [ 0.030532] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152257test # [ 0.028410] random: crng init done258second # [ 0.030583] kvm-guest: PV spinlocks disabled, single CPU259test # [ 0.028411] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes260test # [ 0.029451] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)261test # [ 0.029512] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)262test # [ 0.029576] Fallback order for Node 0: 0263test # [ 0.029581] Built 1 zonelists, mobility grouping on. Total pages: 262006264test # [ 0.029582] Policy zone: DMA32265second # [ 0.030586] Kernel command line: console=ttyS0 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/9xmmxf7qfryq1r3fngz2qayqfwrghi8a-nixos-system-second-test/init regInfo=/nix/store/pqgbmhpgsjlwmhaam3knxcchvq851ib3-closure-info/registration console=ttyS0,115200n8 console=tty0266test # [ 0.032348] mem auto-init: stack:all(zero), heap alloc:on, heap free:off267test # [ 0.035826] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1268test # [ 0.037896] allocated 2097152 bytes of page_ext269second # [ 0.030690] Unknown kernel command line parameters "regInfo=/nix/store/pqgbmhpgsjlwmhaam3knxcchvq851ib3-closure-info/registration", will be passed to user space.270test # [ 0.052529] ftrace: allocating 48733 entries in 192 pages271second # [ 0.030894] random: crng init done272test # [ 0.052536] ftrace: allocated 192 pages with 2 groups273test # [ 0.053635] Dynamic Preempt: lazy274second # [ 0.030896] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes275test # [ 0.053829] rcu: Preemptible hierarchical RCU implementation.276test # [ 0.053830] rcu: RCU event tracing is enabled.277second # [ 0.032008] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)278test # [ 0.053831] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.279second # [ 0.032039] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)280test # [ 0.053834] Trampoline variant of Tasks RCU enabled.281second # [ 0.032084] Fallback order for Node 0: 0282test # [ 0.053835] Rude variant of Tasks RCU enabled.283test # [ 0.053835] Tracing variant of Tasks RCU enabled.284second # [ 0.032088] Built 1 zonelists, mobility grouping on. Total pages: 262006285second # [ 0.032090] Policy zone: DMA32286test # [ 0.053836] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.287second # [ 0.035529] mem auto-init: stack:all(zero), heap alloc:on, heap free:off288test # [ 0.053837] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1289second # [ 0.039016] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1290test # [ 0.053853] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.291second # [ 0.042451] allocated 2097152 bytes of page_ext292second # [ 0.056093] ftrace: allocating 48733 entries in 192 pages293test # [ 0.053855] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.294second # [ 0.056100] ftrace: allocated 192 pages with 2 groups295second # [ 0.057596] Dynamic Preempt: lazy296test # [ 0.053856] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.297second # [ 0.057790] rcu: Preemptible hierarchical RCU implementation.298test # [ 0.059098] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16299second # [ 0.057791] rcu: RCU event tracing is enabled.300test # [ 0.059450] rcu: srcu_init: Setting srcu_struct sizes based on contention.301second # [ 0.057792] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.302second # [ 0.057794] Trampoline variant of Tasks RCU enabled.303test # [ 0.059464] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns304second # [ 0.057795] Rude variant of Tasks RCU enabled.305second # [ 0.057795] Tracing variant of Tasks RCU enabled.306test # [ 0.059677] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)307test # [ 0.065897] Console: colour VGA+ 80x25308second # [ 0.057796] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.309test # [ 0.065904] printk: legacy console [tty0] enabled310second # [ 0.057797] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1311test # [ 0.105551] printk: legacy console [ttyS0] enabled312test # [ 0.253113] ACPI: Core revision 20250807313second # [ 0.057867] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.314second # [ 0.057868] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.315test # [ 0.254269] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns316second # [ 0.057870] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.317test # [ 0.256305] APIC: Switch to symmetric I/O mode setup318second # [ 0.063094] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16319test # [ 0.257560] x2apic enabled320second # [ 0.063422] rcu: srcu_init: Setting srcu_struct sizes based on contention.321test # [ 0.258441] APIC: Switched APIC routing to: physical x2apic322second # [ 0.063433] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns323test # [ 0.260504] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1324second # [ 0.063622] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)325second # [ 0.071378] Console: colour VGA+ 80x25326test # [ 0.261851] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x3c6d3a52f6d, max_idle_ns: 440795275709 ns327second # [ 0.071385] printk: legacy console [tty0] enabled328second # [ 0.115214] printk: legacy console [ttyS0] enabled329test # [ 0.264036] Calibrating delay loop (skipped) preset value.. 8384.20 BogoMIPS (lpj=4192100)330second # [ 0.259290] ACPI: Core revision 20250807331test # [ 0.266140] x86/cpu: User Mode Instruction Prevention (UMIP) activated332second # [ 0.260399] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns333test # [ 0.268137] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127334second # [ 0.262396] APIC: Switch to symmetric I/O mode setup335test # [ 0.269034] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0336second # [ 0.263965] x2apic enabled337second # [ 0.266102] APIC: Switched APIC routing to: physical x2apic338test # [ 0.270045] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto339second # [ 0.268132] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1340test # [ 0.272035] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl341test # [ 0.273035] Spectre V2 : Mitigation: Enhanced / Automatic IBRS342second # [ 0.269428] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x3c6d3a52f6d, max_idle_ns: 440795275709 ns343test # [ 0.275034] Speculative Return Stack Overflow: Mitigation: Safe RET344second # [ 0.271580] Calibrating delay loop (skipped) preset value.. 8384.20 BogoMIPS (lpj=4192100)345test # [ 0.276034] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization346second # [ 0.273595] x86/cpu: User Mode Instruction Prevention (UMIP) activated347second # [ 0.274698] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127348second # [ 0.275578] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0349test # [ 0.278043] Spectre V2 : Enabling IBPB for BPF350second # [ 0.276581] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto351test # [ 0.280036] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier352second # [ 0.277579] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl353test # [ 0.282037] active return thunk: srso_alias_return_thunk354second # [ 0.278578] Spectre V2 : Mitigation: Enhanced / Automatic IBRS355test # [ 0.283953] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'356second # [ 0.279579] Speculative Return Stack Overflow: Mitigation: Safe RET357test # [ 0.285034] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'358second # [ 0.280578] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization359test # [ 0.286033] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'360test # [ 0.288033] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'361test # [ 0.289033] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'362test # [ 0.290033] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'363second # [ 0.282585] Spectre V2 : Enabling IBPB for BPF364test # [ 0.292033] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'365second # [ 0.284579] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier366second # [ 0.285579] active return thunk: srso_alias_return_thunk367test # [ 0.293033] x86/fpu: Supporting XSAVE feature 0x800: 'Control-flow User registers'368second # [ 0.286601] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'369test # [ 0.295033] x86/fpu: Supporting XSAVE feature 0x1000: 'Control-flow Kernel registers (KVM only)'370second # [ 0.287578] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'371test # [ 0.296034] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256372second # [ 0.289578] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'373test # [ 0.297033] x86/fpu: xstate_offset[5]: 832, xstate_sizes[5]: 64374second # [ 0.290578] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'375test # [ 0.298034] x86/fpu: xstate_offset[6]: 896, xstate_sizes[6]: 512376second # [ 0.291578] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'377test # [ 0.299034] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024378second # [ 0.293578] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'379test # [ 0.301033] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]: 8380second # [ 0.294578] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'381test # [ 0.302035] x86/fpu: xstate_offset[11]: 2440, xstate_sizes[11]: 16382test # [ 0.303034] x86/fpu: xstate_offset[12]: 2456, xstate_sizes[12]: 24383second # [ 0.295578] x86/fpu: Supporting XSAVE feature 0x800: 'Control-flow User registers'384second # [ 0.296578] x86/fpu: Supporting XSAVE feature 0x1000: 'Control-flow Kernel registers (KVM only)'385test # [ 0.304034] x86/fpu: Enabled xstate features 0x1ae7, context size is 2480 bytes, using 'compacted' format.386second # [ 0.298579] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256387second # [ 0.299578] x86/fpu: xstate_offset[5]: 832, xstate_sizes[5]: 64388second # [ 0.301578] x86/fpu: xstate_offset[6]: 896, xstate_sizes[6]: 512389second # [ 0.302578] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024390second # [ 0.303578] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]: 8391second # [ 0.304578] x86/fpu: xstate_offset[11]: 2440, xstate_sizes[11]: 16392second # [ 0.305578] x86/fpu: xstate_offset[12]: 2456, xstate_sizes[12]: 24393second # [ 0.306578] x86/fpu: Enabled xstate features 0x1ae7, context size is 2480 bytes, using 'compacted' format.394test # [ 0.333286] Freeing SMP alternatives memory: 44K395test # [ 0.334038] pid_max: default: 32768 minimum: 301396test # [ 0.335111] LSM: initializing lsm=capability,landlock,yama,bpf,ima397test # [ 0.336140] landlock: Up and running.398test # [ 0.337034] Yama: becoming mindful.399test # [ 0.338157] LSM support for eBPF active400test # [ 0.339138] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)401test # [ 0.340055] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)402second # [ 0.337682] Freeing SMP alternatives memory: 44K403test # [ 0.343523] smpboot: CPU0: AMD Ryzen 9 7950X3D 16-Core Processor (family: 0x19, model: 0x61, stepping: 0x2)404second # [ 0.338582] pid_max: default: 32768 minimum: 301405second # [ 0.339645] LSM: initializing lsm=capability,landlock,yama,bpf,ima406test # [ 0.344510] Performance Events: Fam17h+ core perfctr, AMD PMU driver.407second # [ 0.340671] landlock: Up and running.408test # [ 0.345038] ... version: 2409second # [ 0.341578] Yama: becoming mindful.410test # [ 0.345968] ... bit width: 48411second # [ 0.342781] LSM support for eBPF active412test # [ 0.346772] ... generic counters: 6413test # [ 0.347089] ... generic bitmap: 000000000000003f414second # [ 0.343657] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)415test # [ 0.348035] ... fixed-purpose counters: 0416second # [ 0.344612] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)417test # [ 0.348967] ... fixed-purpose bitmap: 0000000000000000418test # [ 0.349985] ... value mask: 0000ffffffffffff419test # [ 0.350980] ... max period: 00007fffffffffff420second # [ 0.347998] smpboot: CPU0: AMD Ryzen 9 7950X3D 16-Core Processor (family: 0x19, model: 0x61, stepping: 0x2)421test # [ 0.352019] ... global_ctrl mask: 000000000000003f422second # [ 0.349039] Performance Events: Fam17h+ core perfctr, AMD PMU driver.423test # [ 0.353115] signal: max sigframe size: 3376424second # [ 0.349586] ... version: 2425test # [ 0.354125] rcu: Hierarchical SRCU implementation.426second # [ 0.350500] ... bit width: 48427second # [ 0.351319] ... generic counters: 6428test # [ 0.355042] rcu: Max phase no-delay instances is 400.429second # [ 0.351579] ... generic bitmap: 000000000000003f430second # [ 0.352579] ... fixed-purpose counters: 0431second # [ 0.353491] ... fixed-purpose bitmap: 0000000000000000432second # [ 0.354499] ... value mask: 0000ffffffffffff433test # [ 0.359413] smp: Bringing up secondary CPUs ...434test # [ 0.360060] smp: Brought up 1 node, 1 CPU435second # [ 0.355507] ... max period: 00007fffffffffff436second # [ 0.356505] ... global_ctrl mask: 000000000000003f437test # [ 0.360949] smpboot: Total of 1 processors activated (8384.20 BogoMIPS)438second # [ 0.357656] signal: max sigframe size: 3376439second # [ 0.358666] rcu: Hierarchical SRCU implementation.440test # [ 0.362220] Memory: 943004K/1048024K available (17215K kernel code, 2726K rwdata, 13580K rodata, 3644K init, 2988K bss, 97592K reserved, 0K cma-reserved)441second # [ 0.359600] rcu: Max phase no-delay instances is 400.442test # [ 0.363243] devtmpfs: initialized443test # [ 0.364178] x86/mm: Memory block size: 128MB444test # [ 0.365836] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)445second # [ 0.364132] smp: Bringing up secondary CPUs ...446second # [ 0.364601] smp: Brought up 1 node, 1 CPU447test # [ 0.367065] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).448second # [ 0.365574] smpboot: Total of 1 processors activated (8384.20 BogoMIPS)449test # [ 0.368183] pinctrl core: initialized pinctrl subsystem450test # [ 0.369286] PM: RTC time: 00:12:40, date: 2026-09-04451second # [ 0.366797] Memory: 943000K/1048024K available (17215K kernel code, 2726K rwdata, 13580K rodata, 3644K init, 2988K bss, 97588K reserved, 0K cma-reserved)452second # [ 0.367776] devtmpfs: initialized453test # [ 0.372304] NET: Registered PF_NETLINK/PF_ROUTE protocol family454second # [ 0.368704] x86/mm: Memory block size: 128MB455test # [ 0.373336] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations456test # [ 0.374163] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations457second # [ 0.370474] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)458second # [ 0.371606] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).459test # [ 0.375153] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations460second # [ 0.372644] pinctrl core: initialized pinctrl subsystem461test # [ 0.376045] audit: initializing netlink subsys (disabled)462second # [ 0.373954] PM: RTC time: 00:12:40, date: 2026-09-04463test # [ 0.377285] thermal_sys: Registered thermal governor 'fair_share'464test # [ 0.377286] thermal_sys: Registered thermal governor 'bang_bang'465test # [ 0.378038] audit: type=2000 audit(1788480761.422:1): state=initialized audit_enabled=0 res=1466second # [ 0.377002] NET: Registered PF_NETLINK/PF_ROUTE protocol family467test # [ 0.380038] thermal_sys: Registered thermal governor 'step_wise'468second # [ 0.378257] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations469test # [ 0.380039] thermal_sys: Registered thermal governor 'user_space'470test # [ 0.381035] thermal_sys: Registered thermal governor 'power_allocator'471second # [ 0.378601] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations472test # [ 0.382052] cpuidle: using governor menu473second # [ 0.379725] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations474test # [ 0.384975] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5475second # [ 0.380589] audit: initializing netlink subsys (disabled)476test # [ 0.386250] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]477second # [ 0.381854] thermal_sys: Registered thermal governor 'fair_share'478test # [ 0.387038] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry479second # [ 0.381857] thermal_sys: Registered thermal governor 'bang_bang'480test # [ 0.388047] PCI: Using configuration type 1 for base access481second # [ 0.382581] thermal_sys: Registered thermal governor 'step_wise'482test # [ 0.389404] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.483second # [ 0.383584] audit: type=2000 audit(1788480761.429:1): state=initialized audit_enabled=0 res=1484second # [ 0.385585] thermal_sys: Registered thermal governor 'user_space'485second # [ 0.385587] thermal_sys: Registered thermal governor 'power_allocator'486second # [ 0.386606] cpuidle: using governor menu487second # [ 0.389311] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5488second # [ 0.389826] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]489test # [ 0.397061] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages490second # [ 0.390582] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry491test # [ 0.398036] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page492second # [ 0.391592] PCI: Using configuration type 1 for base access493second # [ 0.392835] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.494test # [ 0.403036] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages495test # [ 0.404035] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page496second # [ 0.397670] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages497second # [ 0.398580] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page498test # [ 0.410052] ACPI: Added _OSI(Module Device)499test # [ 0.410958] ACPI: Added _OSI(Processor Device)500test # [ 0.411802] ACPI: Added _OSI(Processor Aggregator Device)501second # [ 0.403579] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages502second # [ 0.404580] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page503test # [ 0.422496] ACPI: 1 ACPI AML tables successfully acquired and loaded504second # [ 0.414355] ACPI: Added _OSI(Module Device)505second # [ 0.414580] ACPI: Added _OSI(Processor Device)506second # [ 0.415550] ACPI: Added _OSI(Processor Aggregator Device)507test # [ 0.426388] ACPI: Interpreter enabled508test # [ 0.427051] ACPI: PM: (supports S0 S3 S4 S5)509test # [ 0.427979] ACPI: Using IOAPIC for interrupt routing510second # [ 0.420424] ACPI: 1 ACPI AML tables successfully acquired and loaded511test # [ 0.429902] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug512test # [ 0.431035] PCI: Using E820 reservations for host bridge windows513test # [ 0.432155] ACPI: Enabled 2 GPEs in block 00 to 3F514second # [ 0.426906] ACPI: Interpreter enabled515second # [ 0.427595] ACPI: PM: (supports S0 S3 S4 S5)516second # [ 0.428515] ACPI: Using IOAPIC for interrupt routing517test # [ 0.436771] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])518test # [ 0.437041] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]519second # [ 0.431321] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug520test # [ 0.438101] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]521second # [ 0.432580] PCI: Using E820 reservations for host bridge windows522test # [ 0.439141] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]523second # [ 0.433828] ACPI: Enabled 2 GPEs in block 00 to 3F524test # [ 0.440467] PCI host bridge to bus 0000:00525test # [ 0.441042] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window]526test # [ 0.442037] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window]527second # [ 0.437866] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])528test # [ 0.443037] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]529second # [ 0.438585] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]530test # [ 0.444036] pci_bus 0000:00: root bus resource [mem 0x40000000-0xafffffff window]531second # [ 0.439640] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]532test # [ 0.445039] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]533second # [ 0.440677] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]534test # [ 0.446036] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]535second # [ 0.442199] PCI host bridge to bus 0000:00536test # [ 0.447037] pci_bus 0000:00: root bus resource [bus 00-ff]537second # [ 0.442584] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window]538test # [ 0.448179] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint539second # [ 0.443582] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window]540second # [ 0.444580] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]541test # [ 0.449744] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint542second # [ 0.445580] pci_bus 0000:00: root bus resource [mem 0x40000000-0xafffffff window]543second # [ 0.446580] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]544second # [ 0.447580] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]545test # [ 0.453093] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]546second # [ 0.448581] pci_bus 0000:00: root bus resource [bus 00-ff]547test # [ 0.454056] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]548second # [ 0.449835] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint549test # [ 0.455075] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]550second # [ 0.451237] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint551test # [ 0.456335] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]552test # [ 0.457809] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint553second # [ 0.453636] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]554test # [ 0.460054] pci 0000:00:02.0: BAR 0 [io 0xc140-0xc15f]555second # [ 0.454600] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]556test # [ 0.461047] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]557second # [ 0.455619] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]558test # [ 0.462081] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]559second # [ 0.456863] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]560test # [ 0.463046] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]561second # [ 0.458317] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint562test # [ 0.464976] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint563second # [ 0.460590] pci 0000:00:02.0: BAR 0 [io 0xc140-0xc15f]564test # [ 0.467046] pci 0000:00:03.0: BAR 0 [io 0xc160-0xc17f]565second # [ 0.461594] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]566test # [ 0.468047] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]567second # [ 0.462618] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]568test # [ 0.469076] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]569second # [ 0.463590] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]570test # [ 0.470968] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint571second # [ 0.465479] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint572second # [ 0.467602] pci 0000:00:03.0: BAR 0 [io 0xc160-0xc17f]573test # [ 0.474046] pci 0000:00:04.0: BAR 0 [io 0xc080-0xc0bf]574second # [ 0.468590] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]575test # [ 0.475047] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]576second # [ 0.469619] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]577test # [ 0.476075] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]578second # [ 0.471467] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint579test # [ 0.478035] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint580test # [ 0.480046] pci 0000:00:05.0: BAR 0 [io 0xc180-0xc19f]581second # [ 0.474803] pci 0000:00:04.0: BAR 0 [io 0xc080-0xc0bf]582second # [ 0.475592] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]583test # [ 0.481047] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]584second # [ 0.476621] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]585test # [ 0.482078] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]586test # [ 0.483977] pci 0000:00:06.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint587second # [ 0.478675] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint588test # [ 0.486048] pci 0000:00:06.0: BAR 0 [io 0xc1a0-0xc1bf]589second # [ 0.480590] pci 0000:00:05.0: BAR 0 [io 0xc180-0xc19f]590test # [ 0.487047] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]591second # [ 0.481592] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]592test # [ 0.488076] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]593second # [ 0.482621] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]594test # [ 0.489960] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint595second # [ 0.484518] pci 0000:00:06.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint596test # [ 0.492055] pci 0000:00:07.0: BAR 0 [io 0xc000-0xc07f]597second # [ 0.486590] pci 0000:00:06.0: BAR 0 [io 0xc1a0-0xc1bf]598test # [ 0.493057] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]599second # [ 0.487592] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]600test # [ 0.494075] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]601second # [ 0.488621] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]602test # [ 0.496013] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint603second # [ 0.490646] pci 0000:00:07.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint604test # [ 0.498046] pci 0000:00:08.0: BAR 0 [io 0xc1c0-0xc1df]605second # [ 0.493031] pci 0000:00:07.0: BAR 0 [io 0xc000-0xc07f]606test # [ 0.499047] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]607second # [ 0.493592] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]608test # [ 0.500075] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]609second # [ 0.494623] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]610test # [ 0.501047] pci 0000:00:08.0: ROM [mem 0xfeb80000-0xfebbffff pref]611second # [ 0.496646] pci 0000:00:08.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint612test # [ 0.502964] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint613second # [ 0.499247] pci 0000:00:08.0: BAR 0 [io 0xc1c0-0xc1df]614test # [ 0.505056] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]615second # [ 0.499592] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]616test # [ 0.506076] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]617second # [ 0.500623] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]618second # [ 0.501592] pci 0000:00:08.0: ROM [mem 0xfeb80000-0xfebbffff pref]619test # [ 0.507945] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint620test # [ 0.510046] pci 0000:00:0a.0: BAR 0 [io 0xc0c0-0xc0ff]621second # [ 0.503787] pci 0000:00:09.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint622test # [ 0.511048] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]623test # [ 0.512084] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]624second # [ 0.506078] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]625second # [ 0.506620] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]626test # [ 0.514253] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint627second # [ 0.508619] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint628test # [ 0.516046] pci 0000:00:0b.0: BAR 0 [io 0xc1e0-0xc1ff]629test # [ 0.517046] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]630second # [ 0.510591] pci 0000:00:0a.0: BAR 0 [io 0xc0c0-0xc0ff]631test # [ 0.518075] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]632second # [ 0.511591] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]633second # [ 0.513001] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]634second # [ 0.514557] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint635second # [ 0.516591] pci 0000:00:0b.0: BAR 0 [io 0xc1e0-0xc1ff]636second # [ 0.517594] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]637second # [ 0.518620] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]638test # [ 0.519976] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint639test # [ 0.521737] pci 0000:00:1d.0: BAR 4 [io 0xc200-0xc21f]640test # [ 0.522300] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint641test # [ 0.523657] pci 0000:00:1d.1: BAR 4 [io 0xc220-0xc23f]642test # [ 0.524311] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint643test # [ 0.525706] pci 0000:00:1d.2: BAR 4 [io 0xc240-0xc25f]644second # [ 0.520683] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint645test # [ 0.526615] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint646second # [ 0.523564] pci 0000:00:1d.0: BAR 4 [io 0xc200-0xc21f]647test # [ 0.527628] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]648second # [ 0.524731] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint649test # [ 0.528411] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint650second # [ 0.526478] pci 0000:00:1d.1: BAR 4 [io 0xc220-0xc23f]651second # [ 0.527720] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint652test # [ 0.529547] pci 0000:00:1f.0: quirk: [io 0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO653second # [ 0.529304] pci 0000:00:1d.2: BAR 4 [io 0xc240-0xc25f]654test # [ 0.530567] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint655second # [ 0.529913] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint656test # [ 0.532065] pci 0000:00:1f.2: BAR 4 [io 0xc260-0xc27f]657test # [ 0.533047] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]658second # [ 0.531312] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]659test # [ 0.534534] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint660second # [ 0.531890] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint661test # [ 0.535935] pci 0000:00:1f.3: BAR 4 [io 0x0700-0x073f]662second # [ 0.533085] pci 0000:00:1f.0: quirk: [io 0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO663second # [ 0.534091] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint664second # [ 0.536128] pci 0000:00:1f.2: BAR 4 [io 0xc260-0xc27f]665test # [ 0.541839] ACPI: PCI: Interrupt link LNKA configured for IRQ 10666second # [ 0.536593] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]667test # [ 0.543166] ACPI: PCI: Interrupt link LNKB configured for IRQ 10668second # [ 0.538137] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint669test # [ 0.544161] ACPI: PCI: Interrupt link LNKC configured for IRQ 11670test # [ 0.545163] ACPI: PCI: Interrupt link LNKD configured for IRQ 11671second # [ 0.539373] pci 0000:00:1f.3: BAR 4 [io 0x0700-0x073f]672test # [ 0.546165] ACPI: PCI: Interrupt link LNKE configured for IRQ 10673test # [ 0.547168] ACPI: PCI: Interrupt link LNKF configured for IRQ 10674test # [ 0.548168] ACPI: PCI: Interrupt link LNKG configured for IRQ 11675test # [ 0.549161] ACPI: PCI: Interrupt link LNKH configured for IRQ 11676second # [ 0.545788] ACPI: PCI: Interrupt link LNKA configured for IRQ 10677test # [ 0.550093] ACPI: PCI: Interrupt link GSIA configured for IRQ 16678test # [ 0.551049] ACPI: PCI: Interrupt link GSIB configured for IRQ 17679second # [ 0.546708] ACPI: PCI: Interrupt link LNKB configured for IRQ 10680test # [ 0.552055] ACPI: PCI: Interrupt link GSIC configured for IRQ 18681second # [ 0.547707] ACPI: PCI: Interrupt link LNKC configured for IRQ 11682test # [ 0.553054] ACPI: PCI: Interrupt link GSID configured for IRQ 19683second # [ 0.548698] ACPI: PCI: Interrupt link LNKD configured for IRQ 11684test # [ 0.554050] ACPI: PCI: Interrupt link GSIE configured for IRQ 20685second # [ 0.549761] ACPI: PCI: Interrupt link LNKE configured for IRQ 10686test # [ 0.555076] ACPI: PCI: Interrupt link GSIF configured for IRQ 21687second # [ 0.550709] ACPI: PCI: Interrupt link LNKF configured for IRQ 10688test # [ 0.556094] ACPI: PCI: Interrupt link GSIG configured for IRQ 22689second # [ 0.551706] ACPI: PCI: Interrupt link LNKG configured for IRQ 11690test # [ 0.557053] ACPI: PCI: Interrupt link GSIH configured for IRQ 23691second # [ 0.552701] ACPI: PCI: Interrupt link LNKH configured for IRQ 11692second # [ 0.553628] ACPI: PCI: Interrupt link GSIA configured for IRQ 16693test # [ 0.559248] iommu: Default domain type: Translated694second # [ 0.554621] ACPI: PCI: Interrupt link GSIB configured for IRQ 17695test # [ 0.560043] iommu: DMA domain TLB invalidation policy: lazy mode696second # [ 0.555640] ACPI: PCI: Interrupt link GSIC configured for IRQ 18697test # [ 0.561264] ACPI: bus type USB registered698second # [ 0.556593] ACPI: PCI: Interrupt link GSID configured for IRQ 19699test # [ 0.562103] usbcore: registered new interface driver usbfs700test # [ 0.563061] usbcore: registered new interface driver hub701second # [ 0.557596] ACPI: PCI: Interrupt link GSIE configured for IRQ 20702test # [ 0.564057] usbcore: registered new device driver usb703second # [ 0.558596] ACPI: PCI: Interrupt link GSIF configured for IRQ 21704second # [ 0.559593] ACPI: PCI: Interrupt link GSIG configured for IRQ 22705test # [ 0.565794] NetLabel: Initializing706test # [ 0.566041] NetLabel: domain hash size = 128707second # [ 0.560609] ACPI: PCI: Interrupt link GSIH configured for IRQ 23708test # [ 0.566992] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO709test # [ 0.568019] NetLabel: unlabeled traffic allowed by default710second # [ 0.563114] iommu: Default domain type: Translated711test # [ 0.568989] PCI: Using ACPI for IRQ routing712second # [ 0.563587] iommu: DMA domain TLB invalidation policy: lazy mode713second # [ 0.564827] ACPI: bus type USB registered714second # [ 0.565638] usbcore: registered new interface driver usbfs715second # [ 0.566598] usbcore: registered new interface driver hub716second # [ 0.567599] usbcore: registered new device driver usb717second # [ 0.569290] NetLabel: Initializing718second # [ 0.569585] NetLabel: domain hash size = 128719second # [ 0.570528] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO720second # [ 0.571607] NetLabel: unlabeled traffic allowed by default721second # [ 0.572591] PCI: Using ACPI for IRQ routing722test # [ 0.650151] pci 0000:00:01.0: vgaarb: setting as boot VGA device723test # [ 0.651031] pci 0000:00:01.0: vgaarb: bridge control possible724test # [ 0.651031] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none725test # [ 0.651039] vgaarb: loaded726test # [ 0.651890] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0727test # [ 0.652882] hpet0: 3 comparators, 64-bit 100.000000 MHz counter728test # [ 0.657114] clocksource: Switched to clocksource kvm-clock729second # [ 0.654573] pci 0000:00:01.0: vgaarb: setting as boot VGA device730second # [ 0.654576] pci 0000:00:01.0: vgaarb: bridge control possible731test # [ 0.660394] VFS: Disk quotas dquot_6.6.0732second # [ 0.654576] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none733test # [ 0.661316] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)734second # [ 0.654586] vgaarb: loaded735test # [ 0.662983] pnp: PnP ACPI init736second # [ 0.655462] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0737test # [ 0.663907] ACPI: IRQ 4 override to edge(!), high(!)738second # [ 0.656419] hpet0: 3 comparators, 64-bit 100.000000 MHz counter739test # [ 0.665108] system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved740test # [ 0.666994] pnp: PnP ACPI: found 6 devices741second # [ 0.661689] clocksource: Switched to clocksource kvm-clock742second # [ 0.664817] VFS: Disk quotas dquot_6.6.0743second # [ 0.665716] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)744test # [ 0.674255] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns745second # [ 0.667318] pnp: PnP ACPI init746test # [ 0.676082] clocksource: Switched to clocksource acpi_pm747second # [ 0.668251] ACPI: IRQ 4 override to edge(!), high(!)748test # [ 0.677323] NET: Registered PF_INET protocol family749second # [ 0.669433] system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved750test # [ 0.678657] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)751second # [ 0.671296] pnp: PnP ACPI: found 6 devices752second # [ 0.678560] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns753second # [ 0.680366] clocksource: Switched to clocksource acpi_pm754second # [ 0.681567] NET: Registered PF_INET protocol family755second # [ 0.682822] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)756test # [ 0.692372] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)757test # [ 0.694268] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)758test # [ 0.695949] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)759test # [ 0.697628] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)760test # [ 0.699174] TCP: Hash tables configured (established 8192 bind 8192)761test # [ 0.700616] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)762test # [ 0.702210] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)763test # [ 0.703635] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)764second # [ 0.696116] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)765test # [ 0.705155] NET: Registered PF_UNIX/PF_LOCAL protocol family766test # [ 0.706684] NET: Registered PF_XDP protocol family767second # [ 0.697962] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)768test # [ 0.707899] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window]769second # [ 0.699585] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)770test # [ 0.709313] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window]771second # [ 0.701202] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)772test # [ 0.710626] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]773second # [ 0.702708] TCP: Hash tables configured (established 8192 bind 8192)774test # [ 0.712126] pci_bus 0000:00: resource 7 [mem 0x40000000-0xafffffff window]775second # [ 0.704299] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)776test # [ 0.713600] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]777second # [ 0.706317] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)778test # [ 0.715063] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]779second # [ 0.708115] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)780test # [ 0.717209] ACPI: \_SB_.GSIA: Enabled at IRQ 16781second # [ 0.709939] NET: Registered PF_UNIX/PF_LOCAL protocol family782second # [ 0.711133] NET: Registered PF_XDP protocol family783test # [ 0.719507] ACPI: \_SB_.GSIB: Enabled at IRQ 17784second # [ 0.712231] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window]785test # [ 0.721672] ACPI: \_SB_.GSIC: Enabled at IRQ 18786second # [ 0.713573] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window]787second # [ 0.714820] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]788test # [ 0.723817] ACPI: \_SB_.GSID: Enabled at IRQ 19789second # [ 0.716217] pci_bus 0000:00: resource 7 [mem 0x40000000-0xafffffff window]790test # [ 0.725526] PCI: CLS 0 bytes, default 64791second # [ 0.717605] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]792test # [ 0.726682] Trying to unpack rootfs image as initramfs...793second # [ 0.719001] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]794second # [ 0.721029] ACPI: \_SB_.GSIA: Enabled at IRQ 16795second # [ 0.723089] ACPI: \_SB_.GSIB: Enabled at IRQ 17796test # [ 0.730779] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x3c6d3a52f6d, max_idle_ns: 440795275709 ns797second # [ 0.725054] ACPI: \_SB_.GSIC: Enabled at IRQ 18798second # [ 0.726996] ACPI: \_SB_.GSID: Enabled at IRQ 19799second # [ 0.728824] PCI: CLS 0 bytes, default 64800second # [ 0.729887] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x3c6d3a52f6d, max_idle_ns: 440795275709 ns801second # [ 0.732006] Trying to unpack rootfs image as initramfs...802test # [ 0.763188] Initialise system trusted keyrings803test # [ 0.766672] workingset: timestamp_bits=40 max_order=18 bucket_order=0804second # [ 0.769537] Initialise system trusted keyrings805second # [ 0.773452] workingset: timestamp_bits=40 max_order=18 bucket_order=0806test # [ 0.783417] Key type asymmetric registered807test # [ 0.788612] Asymmetric key parser 'x509' registered808test # [ 0.789725] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)809test # [ 0.793722] io scheduler mq-deadline registered810test # [ 0.795613] io scheduler kyber registered811second # [ 0.788833] Key type asymmetric registered812test # [ 0.801040] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled813second # [ 0.794191] Asymmetric key parser 'x509' registered814second # [ 0.795636] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)815test # [ 0.804797] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A816second # [ 0.799352] io scheduler mq-deadline registered817test # [ 0.810390] Linux agpgart interface v0.103818test # [ 0.811356] ACPI: bus type drm_connector registered819second # [ 0.803290] io scheduler kyber registered820second # [ 0.804914] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled821second # [ 0.806483] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A822test # [ 0.816710] usbcore: registered new interface driver usbserial_generic823test # [ 0.818071] usbserial: USB Serial support registered for generic824test # [ 0.819333] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.825test # [ 0.819333] Please enable it if your BIOS has the CPPC option.826second # [ 0.813804] Linux agpgart interface v0.103827second # [ 0.814776] ACPI: bus type drm_connector registered828test # [ 0.826604] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled829second # [ 0.819551] usbcore: registered new interface driver usbserial_generic830test # [ 0.828256] drop_monitor: Initializing network drop monitor service831second # [ 0.820913] usbserial: USB Serial support registered for generic832test # [ 0.832730] NET: Registered PF_INET6 protocol family833second # [ 0.825191] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.834second # [ 0.825191] Please enable it if your BIOS has the CPPC option.835test # [ 0.835843] Segment Routing with IPv6836second # [ 0.827963] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled837test # [ 0.838615] In-situ OAM (IOAM) with IPv6838second # [ 0.831306] drop_monitor: Initializing network drop monitor service839test # [ 0.840150] IPI shorthand broadcast: enabled840second # [ 0.832734] NET: Registered PF_INET6 protocol family841second # [ 0.836606] Segment Routing with IPv6842second # [ 0.840200] In-situ OAM (IOAM) with IPv6843test # [ 0.847969] sched_clock: Marking stable (648022571, 199569379)->(943721546, -96129596)844second # [ 0.841444] IPI shorthand broadcast: enabled845test # [ 0.851921] registered taskstats version 1846test # [ 0.853076] Loading compiled-in X.509 certificates847second # [ 0.850375] sched_clock: Marking stable (647027757, 203144491)->(948918739, -98746491)848second # [ 0.852213] registered taskstats version 1849second # [ 0.855329] Loading compiled-in X.509 certificates850test # [ 0.870606] Demotion targets for Node 0: null851test # [ 0.871732] Key type .fscrypt registered852test # [ 0.874604] Key type fscrypt-provisioning registered853test # [ 0.875760] ima: No TPM chip found, activating TPM-bypass!854second # [ 0.868282] Demotion targets for Node 0: null855test # [ 0.878613] ima: Allocated hash algorithm: sha1856second # [ 0.871223] Key type .fscrypt registered857test # [ 0.879637] ima: No architecture policies found858second # [ 0.872076] Key type fscrypt-provisioning registered859test # [ 0.882761] PM: Magic number: 10:482:202860second # [ 0.875283] ima: No TPM chip found, activating TPM-bypass!861second # [ 0.876438] ima: Allocated hash algorithm: sha1862test # [ 0.886632] RAS: Correctable Errors collector initialized.863second # [ 0.879224] ima: No architecture policies found864second # [ 0.882190] PM: Magic number: 10:482:202865second # [ 0.883898] RAS: Correctable Errors collector initialized.866test # [ 0.894728] clk: Disabling unused clocks867test # [ 0.895641] PM: genpd: Disabling unused power domains868second # [ 0.892008] clk: Disabling unused clocks869second # [ 0.894189] PM: genpd: Disabling unused power domains870test # [ 1.030870] Freeing initrd memory: 29088K871test # [ 1.033933] Freeing unused decrypted memory: 2028K872test # [ 1.036690] Freeing unused kernel image (initmem) memory: 3644K873test # [ 1.038062] Write protecting the kernel read-only data: 32768k874test # [ 1.040191] Freeing unused kernel image (text/rodata gap) memory: 1216K875test # [ 1.041993] Freeing unused kernel image (rodata/data gap) memory: 756K876second # [ 1.041843] Freeing initrd memory: 29084K877second # [ 1.044960] Freeing unused decrypted memory: 2028K878second # [ 1.047588] Freeing unused kernel image (initmem) memory: 3644K879second # [ 1.048952] Write protecting the kernel read-only data: 32768k880second # [ 1.050950] Freeing unused kernel image (text/rodata gap) memory: 1216K881second # [ 1.052710] Freeing unused kernel image (rodata/data gap) memory: 756K882test # [ 1.076610] x86/mm: Checked W+X mappings: passed, no W+X pages found.883test # [ 1.078044] Run /init as init process884test # [ 1.087388] systemd[1]: Inserted module 'autofs4'885second # [ 1.087068] x86/mm: Checked W+X mappings: passed, no W+X pages found.886second # [ 1.088485] Run /init as init process887test # [ 1.101197] fuse: init (API version 7.45)888second # [ 1.098102] systemd[1]: Inserted module 'autofs4'889test # [ 1.106506] ACPI: \_SB_.GSIG: Enabled at IRQ 22890test # [ 1.109345] ACPI: \_SB_.GSIH: Enabled at IRQ 23891test # [ 1.113080] ACPI: \_SB_.GSIE: Enabled at IRQ 20892test # [ 1.115713] ACPI: \_SB_.GSIF: Enabled at IRQ 21893second # [ 1.112071] fuse: init (API version 7.45)894second # [ 1.117431] ACPI: \_SB_.GSIG: Enabled at IRQ 22895second # [ 1.120127] ACPI: \_SB_.GSIH: Enabled at IRQ 23896second # [ 1.123583] ACPI: \_SB_.GSIE: Enabled at IRQ 20897second # [ 1.126737] ACPI: \_SB_.GSIF: Enabled at IRQ 21898test # [ 1.142347] systemd[1]: Successfully made /usr/ read-only.899second # [ 1.154636] systemd[1]: Successfully made /usr/ read-only.900test # [ 1.478666] systemd[1]: systemd 261.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)901test # [ 1.485026] systemd[1]: Detected virtualization kvm.902test # [ 1.486149] systemd[1]: Detected architecture x86-64.903test # [ 1.487256] systemd[1]: Running in initrd.904test # [ 1.488466] systemd[1]: Initializing machine ID from random generator.905test # [ 1.489930] systemd[1]: Hostname set to <test>.906second # [ 1.490611] systemd[1]: systemd 261.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)907second # [ 1.496799] systemd[1]: Detected virtualization kvm.908second # [ 1.497926] systemd[1]: Detected architecture x86-64.909second # [ 1.499054] systemd[1]: Running in initrd.910second # [ 1.500318] systemd[1]: Initializing machine ID from random generator.911second # [ 1.501774] systemd[1]: Hostname set to <second>.912test # [ 1.669630] systemd[1]: bpf-restrict-fs: LSM BPF program attached913second # [ 1.675337] systemd[1]: bpf-restrict-fs: LSM BPF program attached914test # [ 1.704314] systemd[1]: Queued start job for default target Initrd Default Target.915test # [ 1.708759] systemd[1]: Created slice Slice /system/modprobe.916test # [ 1.710244] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.917test # [ 1.711967] systemd[1]: Expecting device /dev/disk/by-label/nixos...918test # [ 1.713376] systemd[1]: Reached target Path Units.919test # [ 1.714502] systemd[1]: Reached target Slice Units.920second # [ 1.706506] systemd[1]: Queued start job for default target Initrd Default Target.921test # [ 1.715665] systemd[1]: Reached target Swaps.922test # [ 1.716705] systemd[1]: Reached target Timer Units.923test # [ 1.717932] systemd[1]: Listening on D-Bus System Message Bus Socket.924second # [ 1.710378] systemd[1]: Created slice Slice /system/modprobe.925test # [ 1.719455] systemd[1]: Listening on Journal Socket (/dev/log).926second # [ 1.711840] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.927test # [ 1.720949] systemd[1]: Listening on Journal Sockets.928second # [ 1.713651] systemd[1]: Expecting device /dev/disk/by-label/nixos...929test # [ 1.722202] systemd[1]: Listening on udev Control Socket.930second # [ 1.715186] systemd[1]: Reached target Path Units.931test # [ 1.723507] systemd[1]: Listening on udev Kernel Socket.932second # [ 1.716403] systemd[1]: Reached target Slice Units.933test # [ 1.724775] systemd[1]: Reached target Socket Units.934second # [ 1.717642] systemd[1]: Reached target Swaps.935second # [ 1.718778] systemd[1]: Reached target Timer Units.936second # [ 1.720188] systemd[1]: Listening on D-Bus System Message Bus Socket.937second # [ 1.721736] systemd[1]: Listening on Journal Socket (/dev/log).938second # [ 1.723342] systemd[1]: Listening on Journal Sockets.939second # [ 1.724648] systemd[1]: Listening on udev Control Socket.940second # [ 1.725948] systemd[1]: Listening on udev Kernel Socket.941test # [ 1.726630] systemd[1]: Starting Create List of Static Device Nodes...942second # [ 1.727213] systemd[1]: Reached target Socket Units.943test # [ 1.741763] systemd[1]: Starting Load Kernel Module 9pnet_virtio...944second # [ 1.729238] systemd[1]: Starting Create List of Static Device Nodes...945test # [ 1.750129] systemd[1]: Starting Load Kernel Module configfs...946second # [ 1.745422] systemd[1]: Starting Load Kernel Module 9pnet_virtio...947test # [ 1.759761] systemd[1]: Starting Journal Service...948second # [ 1.753248] systemd[1]: Starting Load Kernel Module configfs...949test # [ 1.769761] systemd[1]: Starting Load Kernel Modules...950second # [ 1.761629] systemd[1]: Starting Journal Service...951test # [ 1.775468] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os952test # [ 1.778331] netfs: FS-Cache loaded953second # [ 1.772034] systemd[1]: Starting Load Kernel Modules...954test # [ 1.783145] systemd[1]: Starting Coldplug All udev Devices...955second # [ 1.779259] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os956test # [ 1.792231] 9pnet: Installing 9P2000 support957second # [ 1.789932] systemd[1]: Starting Coldplug All udev Devices...958test # [ 1.799747] systemd[1]: Finished Create List of Static Device Nodes.959second # [ 1.798461] netfs: FS-Cache loaded960test # [ 1.812291] systemd[1]: modprobe@configfs.service: Deactivated successfully.961test # [ 1.817257] systemd-journald[67]: Collecting audit messages is disabled.962second # [ 1.809663] systemd[1]: Finished Create List of Static Device Nodes.963test # [ 1.822104] systemd[1]: Finished Load Kernel Module configfs.964second # [ 1.815124] systemd-journald[67]: Collecting audit messages is disabled.965second # [ 1.818537] 9pnet: Installing 9P2000 support966test # [ 1.825934] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.967second # [ 1.820313] systemd[1]: modprobe@configfs.service: Deactivated successfully.968test # [ 1.830049] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.969second # [ 1.827701] systemd[1]: Finished Load Kernel Module configfs.970test # [ 1.835614] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev971test # [ 1.838044] systemd[1]: Finished Load Kernel Module 9pnet_virtio.972second # [ 1.831302] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.973test # [ 1.844164] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config974second # [ 1.837754] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config975second # [ 1.846304] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev976test # [ 1.857266] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...977second # [ 1.849953] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...978test # [ 1.871995] systemd[1]: Finished Load Kernel Modules.979second # [ 1.867544] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully.980test # [ 1.880746] systemd[1]: Starting Apply Kernel Variables...981second # [ 1.877240] systemd[1]: Finished Load Kernel Module 9pnet_virtio.982second # [ 1.885623] systemd[1]: Finished Load Kernel Modules.983test # [ 1.893714] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.984second # [ 1.894360] systemd[1]: Starting Apply Kernel Variables...985test # [ 1.902530] systemd[1]: Starting Create Static Device Nodes in /dev...986test # [ 1.915665] systemd[1]: Finished Apply Kernel Variables.987second # [ 1.908303] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.988second # [ 1.919395] systemd[1]: Starting Create Static Device Nodes in /dev...989test # [ 1.928638] systemd[1]: Finished Create Static Device Nodes in /dev.990test # [ 1.933926] systemd[1]: Reached target Preparation for Local File Systems.991test # [ 1.939699] systemd[1]: Reached target Local File Systems.992second # [ 1.934325] systemd[1]: Finished Apply Kernel Variables.993test # [ 1.944745] systemd[1]: Starting Rule-based Manager for Device Events and Files...994second # [ 1.949258] systemd[1]: Finished Create Static Device Nodes in /dev.995test # [ 1.761261] systemd-modules-load[68]: Inserted module 'dm_mod'[ 1.962247] systemd[1]: Started Journal Service.996test # 997second # [ 1.954502] systemd[1]: Reached target Preparation for Local File Systems.998test # [ 1.764427] systemd-modules-load[68]: Inserted module 'virtio_balloon'999second # [ 1.959267] systemd[1]: Reached target Local File Systems.1000test # [ 1.768364] systemd-modules-load[68]: Inserted module 'virtio_gpu'1001second # [ 1.966386] systemd[1]: Starting Rule-based Manager for Device Events and Files...1002second # [ 1.766954] systemd-modules-load[68]: Inserted module 'dm_mod'1003second # [ 1.769288] systemd-modules-load[68]: Inserted module 'virtio_balloon'1004second # [ 1.771358] systemd-modules-load[68]: Inserted module 'virtio_gpu'1005second # [ 1.979407] systemd[1]: Started Journal Service.1006test # [ 1.789093] systemd[1]: Starting Create System Files and Directories...1007test # [ 1.807447] systemd-udevd[75]: Using default interface naming scheme 'v261'.1008second # [ 1.798120] systemd[1]: Starting Create System Files and Directories...1009test # [ 1.820173] systemd[1]: Finished Create System Files and Directories.1010second # [ 1.825157] systemd[1]: Finished Create System Files and Directories.1011test # [ 1.838345] systemd[1]: Started Rule-based Manager for Device Events and Files.1012second # [ 1.829254] systemd-udevd[74]: Using default interface naming scheme 'v261'.1013test # [ 1.856154] systemd[1]: Finished Coldplug All udev Devices.1014test # [ 1.857301] systemd[1]: Reached target System Initialization.1015test # [ 1.858370] systemd[1]: Reached target Basic System.1016second # [ 1.851407] systemd[1]: Started Rule-based Manager for Device Events and Files.1017second # [ 1.862178] systemd[1]: Finished Coldplug All udev Devices.1018second # [ 1.863305] systemd[1]: Reached target System Initialization.1019second # [ 1.865418] systemd[1]: Reached target Basic System.1020test # [ 2.262182] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,121021test # [ 2.278846] virtio_blk virtio5: 1/0/0 default/read/poll queues1022test # [ 2.282418] serio: i8042 KBD port at 0x60,0x64 irq 11023second # [ 2.283818] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,121024test # [ 2.295608] serio: i8042 AUX port at 0x60,0x64 irq 121025second # [ 2.290642] virtio_blk virtio5: 1/0/0 default/read/poll queues1026second # [ 2.300037] ehci-pci 0000:00:1d.7: EHCI Host Controller1027second # [ 2.300947] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 11028second # [ 2.304464] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb0001029test # [ 2.317774] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1030second # [ 2.313199] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.001031test # [ 2.323099] ehci-pci 0000:00:1d.7: EHCI Host Controller1032second # [ 2.315253] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.181033test # [ 2.324005] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 11034second # [ 2.316562] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=11035test # [ 2.326054] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb0001036second # [ 2.318387] serio: i8042 KBD port at 0x60,0x64 irq 11037second # [ 2.319330] serio: i8042 AUX port at 0x60,0x64 irq 121038second # [ 2.320892] usb usb1: Product: EHCI Host Controller1039second # [ 2.322847] usb usb1: Manufacturer: Linux 6.18.48 ehci_hcd1040test # [ 2.333618] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.001041second # [ 2.325123] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1042second # [ 2.326446] usb usb1: SerialNumber: 0000:00:1d.71043second # [ 2.327747] hub 1-0:1.0: USB hub found1044second # [ 2.328676] hub 1-0:1.0: 6 ports detected1045test # [ 2.336319] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.181046test # [ 2.339163] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=11047test # [ 2.342161] usb usb1: Product: EHCI Host Controller1048second # [ 2.334516] uhci_hcd 0000:00:1d.0: UHCI Host Controller1049test # [ 2.343951] usb usb1: Manufacturer: Linux 6.18.48 ehci_hcd1050test # [ 2.346716] usb usb1: SerialNumber: 0000:00:1d.71051test # [ 2.348295] hub 1-0:1.0: USB hub found1052test # [ 2.350117] hub 1-0:1.0: 6 ports detected1053test # [ 2.352978] uhci_hcd 0000:00:1d.0: UHCI Host Controller1054test # [ 2.353955] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 21055second # [ 2.346216] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 21056test # [ 2.356464] SCSI subsystem initialized1057second # [ 2.353739] uhci_hcd 0000:00:1d.0: detected 2 ports1058test # [ 2.366951] uhci_hcd 0000:00:1d.0: detected 2 ports1059second # [ 2.359530] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c2001060test # [ 2.368012] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c2001061second # [ 2.368875] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181062test # [ 2.386638] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181063second # [ 2.379694] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=11064test # [ 2.388147] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=11065second # [ 2.383082] SCSI subsystem initialized1066second # [ 2.389566] usb usb2: Product: UHCI Host Controller1067test # [ 2.202230] systemd[1]: Starting Virtual Console Setup...1068second # [ 2.394677] usb usb2: Manufacturer: Linux 6.18.48 uhci_hcd1069second # [ 2.395605] usb usb2: SerialNumber: 0000:00:1d.01070test # [ 2.208120] (udev-worker)[87]: Network interface NamePolicy= disabled on kernel command line.1071second # [ 2.205091] systemd[1]: Starting Virtual Console Setup...1072test # [ 2.218203] (udev-worker)[94]: Network interface NamePolicy= disabled on kernel command line.1073second # [ 2.207664] (udev-worker)[87]: Network interface NamePolicy= disabled on kernel command line.1074second # [ 2.420595] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input01075test # [ 2.429064] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input01076second # [ 2.220633] (udev-worker)[91]: Network interface NamePolicy= disabled on kernel command line.1077test # [ 2.433912] usb usb2: Product: UHCI Host Controller1078second # [ 2.428252] hub 2-0:1.0: USB hub found1079test # [ 2.241328] systemd-vconsole-setup[99]: Configuration of first virtual console was skipped, ignoring remaining ones.1080test # [ 2.245628] systemd[1]: Finished Virtual Console Setup.1081second # [ 2.438194] hub 2-0:1.0: 2 ports detected1082test # [ 2.448151] usb usb2: Manufacturer: Linux 6.18.48 uhci_hcd1083second # [ 2.236637] systemd-vconsole-setup[99]: Configuration of first virtual console was skipped, ignoring remaining ones.1084second # [ 2.241494] systemd[1]: Finished Virtual Console Setup.1085test # [ 2.458313] usb usb2: SerialNumber: 0000:00:1d.01086test # [ 2.468057] hub 2-0:1.0: USB hub found1087second # [ 2.461779] uhci_hcd 0000:00:1d.1: UHCI Host Controller1088second # [ 2.462688] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 31089test # [ 2.473060] hub 2-0:1.0: 2 ports detected1090second # [ 2.472673] uhci_hcd 0000:00:1d.1: detected 2 ports1091test # [ 2.481803] uhci_hcd 0000:00:1d.1: UHCI Host Controller1092test # [ 2.482802] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 31093second # [ 2.475340] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c2201094second # [ 2.480371] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181095test # [ 2.290872] systemd[1]: Found device /dev/disk/by-label/nixos.1096second # [ 2.280081] systemd[1]: Found device /dev/disk/by-label/nixos.1097second # [ 2.281268] systemd[1]: Reached target Initrd Root Device.1098test # [ 2.293337] systemd[1]: Reached target Initrd Root Device.1099second # [ 2.286077] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1100test # [ 2.296784] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...[ 2.498677] uhci_hcd 0000:00:1d.1: detected 2 ports1101test # 1102second # [ 2.490528] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=11103second # [ 2.493214] usb usb3: Product: UHCI Host Controller1104second # [ 2.493993] usb usb3: Manufacturer: Linux 6.18.48 uhci_hcd1105test # [ 2.505269] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c2201106second # [ 2.500106] usb usb3: SerialNumber: 0000:00:1d.11107second # [ 2.502373] hub 3-0:1.0: USB hub found1108test # [ 2.512472] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181109test # [ 2.515641] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=11110second # [ 2.508236] hub 3-0:1.0: 2 ports detected1111test # [ 2.518300] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode1112test # [ 2.520197] usb usb3: Product: UHCI Host Controller1113test # [ 2.521535] usb usb3: Manufacturer: Linux 6.18.48 uhci_hcd1114test # [ 2.523259] usb usb3: SerialNumber: 0000:00:1d.11115test # [ 2.524292] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)1116second # [ 2.312772] systemd-fsck[107]: nixos: clean, 12/65536 files, 13019/262144 blocks1117second # [ 2.518211] uhci_hcd 0000:00:1d.2: UHCI Host Controller1118second # [ 2.519069] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 41119test # [ 2.528614] hub 3-0:1.0: USB hub found1120test # [ 2.330699] systemd-fsck[108]: nixos: clean, 12/65536 files, 13019/262144 blocks1121second # [ 2.522820] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode1122test # [ 2.531842] ahci 0000:00:1f.2: flags: 64bit ncq only1123second # [ 2.524136] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)1124test # [ 2.532941] hub 3-0:1.0: 2 ports detected1125second # [ 2.525636] uhci_hcd 0000:00:1d.2: detected 2 ports1126second # [ 2.526831] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c2401127test # [ 2.536536] uhci_hcd 0000:00:1d.2: UHCI Host Controller1128second # [ 2.528264] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181129second # [ 2.529592] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=11130second # [ 2.531037] ahci 0000:00:1f.2: flags: 64bit ncq only1131test # [ 2.539666] scsi host0: ahci1132test # [ 2.540413] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 41133second # [ 2.533224] usb usb4: Product: UHCI Host Controller1134test # [ 2.541684] uhci_hcd 0000:00:1d.2: detected 2 ports1135second # [ 2.534030] usb usb4: Manufacturer: Linux 6.18.48 uhci_hcd1136test # [ 2.544206] scsi host1: ahci1137second # [ 2.537261] scsi host0: ahci1138test # [ 2.546016] scsi host2: ahci1139second # [ 2.538801] scsi host1: ahci1140test # [ 2.547875] scsi host3: ahci1141second # [ 2.540335] usb usb4: SerialNumber: 0000:00:1d.21142test # [ 2.549896] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c2401143second # [ 2.541912] hub 4-0:1.0: USB hub found1144test # [ 2.551059] scsi host4: ahci1145second # [ 2.543227] scsi host2: ahci1146second # [ 2.544928] hub 4-0:1.0: 2 ports detected1147test # [ 2.552634] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181148second # [ 2.545912] scsi host3: ahci1149test # [ 2.553959] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=11150test # [ 2.555498] scsi host5: ahci1151second # [ 2.547838] scsi host4: ahci1152test # [ 2.556204] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 44 lpm-pol 11153second # [ 2.550230] scsi host5: ahci1154test # [ 2.558903] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 44 lpm-pol 11155second # [ 2.550947] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 44 lpm-pol 11156test # [ 2.560308] usb usb4: Product: UHCI Host Controller1157test # [ 2.561259] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 44 lpm-pol 11158test # [ 2.562765] usb usb4: Manufacturer: Linux 6.18.48 uhci_hcd1159test # [ 2.563855] usb usb4: SerialNumber: 0000:00:1d.21160test # [ 2.564784] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 44 lpm-pol 11161test # [ 2.566474] hub 4-0:1.0: USB hub found1162test # [ 2.567603] hub 4-0:1.0: 2 ports detected1163test # [ 2.568328] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 44 lpm-pol 11164second # [ 2.561455] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 44 lpm-pol 11165second # [ 2.567756] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 44 lpm-pol 11166test # [ 2.577355] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 44 lpm-pol 11167second # [ 2.571187] usb 1-1: new high-speed USB device number 2 using ehci-pci1168second # [ 2.573934] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 44 lpm-pol 11169second # [ 2.575413] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 44 lpm-pol 11170second # [ 2.576830] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 44 lpm-pol 11171test # [ 2.588622] usb 1-1: new high-speed USB device number 2 using ehci-pci1172second # [ 2.702083] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.001173second # [ 2.703438] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=101174second # [ 2.704838] usb 1-1: Product: QEMU USB Tablet1175second # [ 2.705711] usb 1-1: Manufacturer: QEMU1176second # [ 2.706516] usb 1-1: SerialNumber: 28754-0000:00:1d.7-11177test # [ 2.718408] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.001178test # [ 2.719772] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=101179test # [ 2.721186] usb 1-1: Product: QEMU USB Tablet1180test # [ 2.722053] usb 1-1: Manufacturer: QEMU1181test # [ 2.722839] usb 1-1: SerialNumber: 28754-0000:00:1d.7-11182second # [ 2.719665] hid: raw HID events driver (C) Jiri Kosina1183test # [ 2.736068] hid: raw HID events driver (C) Jiri Kosina1184test # [ 2.602688] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1185second # [ 2.591068] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1186test # [ 2.609496] systemd[1]: Mounting /sysroot...1187second # [ 2.603142] systemd[1]: Mounting /sysroot...1188test # [ 2.898825] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)1189second # [ 2.890768] ata1: SATA link down (SStatus 0 SControl 300)1190test # [ 2.900061] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/1001191second # [ 2.891867] ata2: SATA link down (SStatus 0 SControl 300)1192test # [ 2.901356] ata3.00: applying bridge limits1193second # [ 2.893131] ata6: SATA link down (SStatus 0 SControl 300)1194test # [ 2.902272] ata3.00: configured for UDMA/1001195second # [ 2.894332] ata5: SATA link down (SStatus 0 SControl 300)1196test # [ 2.903254] ata1: SATA link down (SStatus 0 SControl 300)1197second # [ 2.895432] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)1198test # [ 2.904451] ata6: SATA link down (SStatus 0 SControl 300)1199second # [ 2.896703] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/1001200second # [ 2.897700] ata3.00: applying bridge limits1201test # [ 2.905914] ata2: SATA link down (SStatus 0 SControl 300)1202second # [ 2.898676] ata4: SATA link down (SStatus 0 SControl 300)1203test # [ 2.907260] ata5: SATA link down (SStatus 0 SControl 300)1204second # [ 2.899762] ata3.00: configured for UDMA/1001205test # [ 2.908687] ata4: SATA link down (SStatus 0 SControl 300)1206second # [ 2.900956] scsi 2:0:0:0: CD-ROM QEMU QEMU DVD-ROM 2.5+ PQ: 0 ANSI: 51207test # [ 2.910335] scsi 2:0:0:0: CD-ROM QEMU QEMU DVD-ROM 2.5+ PQ: 0 ANSI: 51208second # [ 2.950808] usbcore: registered new interface driver usbhid1209test # [ 2.960784] usbcore: registered new interface driver usbhid1210test # [ 2.961739] usbhid: USB HID core driver1211second # [ 2.955388] usbhid: USB HID core driver1212test # [ 2.974867] input: QEMU QEMU USB Tablet as /devices/pci0000:00/0000:00:1d.7/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input21213second # [ 2.968727] input: QEMU QEMU USB Tablet as /devices/pci0000:00/0000:00:1d.7/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input21214second # [ 2.971111] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input01215test # [ 2.979708] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input01216second # [ 2.974535] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray1217test # [ 2.984803] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray1218second # [ 2.980271] EXT4-fs (vda): mounted filesystem f4e24826-c264-41b9-bd36-12e9e06d3e17 r/w with ordered data mode. Quota mode: none.1219test # [ 2.991015] EXT4-fs (vda): mounted filesystem b48e8f06-06f3-49de-801f-52fc5b6de688 r/w with ordered data mode. Quota mode: none.1220second # [ 2.783673] systemd[1]: Mounted /sysroot.1221second # [ 2.987583] cdrom: Uniform CD-ROM driver Revision: 3.201222test # [ 2.797696] systemd[1]: Mounted /sysroot.1223second # [ 2.786254] systemd[1]: Reached target Initrd Root File System.1224test # [ 2.799630] systemd[1]: Reached target Initrd Root File System.1225test # [ 3.000295] cdrom: Uniform CD-ROM driver Revision: 3.201226second # [ 2.790088] systemd[1]: Starting Mountpoints Configured in the Real Root...1227test # [ 2.803076] systemd[1]: Starting Mountpoints Configured in the Real Root...1228second # [ 2.804209] systemd-sysroot-fstab-check[138]: /sysroot should be mounted in the initrd, will request daemon-reload.1229second # [ 2.807077] systemd[1]: Reload requested from client PID 138 ('systemd-sysroot') (unit initrd-parse-etc.service)...1230test # [ 2.820233] systemd-sysroot-fstab-check[140]: /sysroot should be mounted in the initrd, will request daemon-reload.1231second # [ 2.809927] systemd[1]: Reloading...1232test # [ 2.824988] systemd[1]: Reload requested from client PID 140 ('systemd-sysroot') (unit initrd-parse-etc.service)...1233test # [ 2.827153] systemd[1]: Reloading...1234second # [ 2.878441] systemd[1]: Reloading finished in 68 ms.1235test # [ 2.896153] systemd[1]: Reloading finished in 71 ms.1236second # [ 2.887621] systemd-sysroot-fstab-check[138]: Requesting initrd-fs.target/start/replace...1237second # [ 2.892203] systemd-sysroot-fstab-check[138]: Requesting swap.target/start/replace...1238test # [ 2.907099] systemd-sysroot-fstab-check[140]: Requesting initrd-fs.target/start/replace...1239second # [ 2.895205] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio1240test # [ 2.910325] systemd-sysroot-fstab-check[140]: Requesting swap.target/start/replace...1241second # [ 2.898729] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1242second # [ 2.900549] systemd[1]: Finished Mountpoints Configured in the Real Root.1243second # [ 2.901841] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1244test # [ 2.914915] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1245test # [ 2.917075] systemd[1]: Finished Mountpoints Configured in the Real Root.1246test # [ 2.918300] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1247test # [ 2.920922] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio1248test # [ 3.599410] systemd[1]: Mounting /sysroot/nix/.ro-store...1249test # [ 3.602717] systemd[1]: Mounting /sysroot/nix/.rw-store...1250test # [ 3.607735] systemd[1]: Mounting /sysroot/run...1251test # [ 3.610287] systemd[1]: Mounting /sysroot/tmp/shared...1252second # [ 3.603878] systemd[1]: Mounting /sysroot/nix/.ro-store...1253test # [ 3.617191] systemd[1]: Mounting /sysroot/tmp/xchg...1254second # [ 3.607154] systemd[1]: Mounting /sysroot/nix/.rw-store...1255second # [ 3.610140] systemd[1]: Mounting /sysroot/run...1256second # [ 3.615226] systemd[1]: Mounting /sysroot/tmp/shared...1257second # [ 3.618143] systemd[1]: Mounting /sysroot/tmp/xchg...1258test # [ 3.639487] systemd[1]: Mounted /sysroot/nix/.rw-store.1259test # [ 3.841519] 9p: Installing v9fs 9p2000 file system support1260test # [ 3.645926] systemd[1]: Mounted /sysroot/run.1261second # [ 3.844238] 9p: Installing v9fs 9p2000 file system support1262test # [ 3.654662] systemd[1]: Starting rw-sysroot-nix-store.service...1263second # [ 3.647367] systemd[1]: Mounted /sysroot/nix/.rw-store.1264test # [ 3.660165] systemd[1]: Mounted /sysroot/nix/.ro-store.1265test # [ 3.661389] systemd[1]: Mounted /sysroot/tmp/shared.1266test # [ 3.663252] systemd[1]: Mounted /sysroot/tmp/xchg.1267second # [ 3.653103] systemd[1]: Mounted /sysroot/nix/.ro-store.1268second # [ 3.654158] systemd[1]: Mounted /sysroot/run.1269second # [ 3.655243] systemd[1]: Mounted /sysroot/tmp/shared.1270second # [ 3.657243] systemd[1]: Mounted /sysroot/tmp/xchg.1271test # [ 3.671195] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1272second # [ 3.661170] systemd[1]: Starting rw-sysroot-nix-store.service...1273test # [ 3.673094] systemd[1]: Finished rw-sysroot-nix-store.service.1274test # [ 3.675539] systemd[1]: Mounting /sysroot/nix/store...1275second # [ 3.670270] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1276second # [ 3.671698] systemd[1]: Finished rw-sysroot-nix-store.service.1277test # [ 3.692395] systemd[1]: Mounted /sysroot/nix/store.1278test # [ 3.693730] systemd[1]: Reached target Initrd File Systems.1279test # [ 3.695633] systemd[1]: Starting Find NixOS closure...1280test # [ 3.698540] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1281test # [ 3.714990] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1282test # [ 3.722769] systemd[1]: Finished Find NixOS closure.1283test # [ 3.724352] systemd[1]: Reached target Initrd Default Target.1284test # [ 3.726504] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1285test # [ 3.740274] systemd[1]: Stopped target Initrd Default Target.1286test # [ 3.742179] systemd[1]: Stopped target Basic System.1287test # [ 3.743206] systemd[1]: Stopped target Initrd Root Device.1288test # [ 3.744330] systemd[1]: Stopped target Path Units.1289test # [ 3.745365] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1290test # [ 3.747179] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1291test # [ 3.749142] systemd[1]: Stopped target Slice Units.1292test # [ 3.750196] systemd[1]: Stopped target Socket Units.1293test # [ 3.751335] systemd[1]: Stopped target System Initialization.1294test # [ 3.753160] systemd[1]: Stopped target Swaps.1295test # [ 3.754118] systemd[1]: Stopped target Timer Units.1296test # [ 3.755096] systemd[1]: dbus.socket: Deactivated successfully.1297test # [ 3.756488] systemd[1]: Closed D-Bus System Message Bus Socket.1298test # [ 3.757767] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1299test # [ 3.759445] systemd[1]: Stopped Find NixOS closure.1300test # [ 3.761146] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio1301test # [ 3.763093] systemd[1]: Starting rw-sysroot-nix-store.service...1302test # [ 3.764222] systemd[1]: systemd-sysctl.service: Deactivated successfully.1303test # [ 3.765614] systemd[1]: Stopped Apply Kernel Variables.1304test # [ 3.766960] systemd[1]: systemd-modules-load.service: Deactivated successfully.1305test # [ 3.768681] systemd[1]: Stopped Load Kernel Modules.1306test # [ 3.770179] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1307test # [ 3.771760] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1308test # [ 3.774145] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1309test # [ 3.776124] systemd[1]: Stopped Create System Files and Directories.1310test # [ 3.777335] systemd[1]: Stopped target Local File Systems.1311test # [ 3.778491] systemd[1]: Stopped target Preparation for Local File Systems.1312test # [ 3.780076] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1313test # [ 3.781866] systemd[1]: Stopped Coldplug All udev Devices.1314test # [ 3.784608] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1315test # [ 3.787145] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1316test # [ 3.788462] systemd[1]: Stopped Virtual Console Setup.1317test # [ 3.794731] systemd[1]: initrd-cleanup.service: Deactivated successfully.1318test # [ 3.799782] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1319test # [ 3.806691] systemd[1]: systemd-udevd.service: Deactivated successfully.1320test # [ 3.809426] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1321test # [ 3.812819] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1322test # [ 3.814332] systemd[1]: Finished rw-sysroot-nix-store.service.1323test # [ 3.815889] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1324test # [ 3.817995] systemd[1]: Closed udev Control Socket.1325test # [ 3.819345] systemd[1]: Starting Cleanup udev Database...1326test # [ 3.821043] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1327test # [ 3.822513] systemd[1]: Stopped Create Static Device Nodes in /dev.1328test # [ 3.824199] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1329test # [ 3.825726] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1330test # [ 3.828167] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1331test # [ 3.829417] systemd[1]: Stopped Create List of Static Device Nodes.1332test # [ 3.841458] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1333test # [ 3.843648] systemd[1]: Finished Cleanup udev Database.1334test # [ 3.845416] systemd[1]: Reached target Switch Root.1335test # [ 3.847623] systemd[1]: Starting NixOS Activation...1336test # [ 3.931079] initrd-nixos-activation-start[194]: booting system configuration /nix/store/j959anz9hppwk4ffv4jw8hddxmv5acwh-nixos-system-test-test1337test # [ 3.963058] initrd-nixos-activation-start[194]: running activation script...1338test # [ 4.310409] initrd-nixos-activation-start[217]: setting up /etc...1339test # [ 4.448986] initrd-nixos-activation-start[217]: setting up age secrets...1340second # [ 4.604245] systemd[1]: Mounting /sysroot/nix/store...1341second # [ 4.621069] systemd[1]: Mounted /sysroot/nix/store.1342second # [ 4.622532] systemd[1]: Reached target Initrd File Systems.1343second # [ 4.624936] systemd[1]: Starting Find NixOS closure...1344second # [ 4.628152] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1345second # [ 4.647148] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1346second # [ 4.649871] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1347second # [ 4.656509] systemd[1]: Finished Find NixOS closure.1348second # [ 4.657975] systemd[1]: Reached target Initrd Default Target.1349second # [ 4.659983] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1350second # [ 4.672647] systemd[1]: Stopped target Initrd Default Target.1351second # [ 4.674003] systemd[1]: Stopped target Basic System.1352second # [ 4.675337] systemd[1]: Stopped target Initrd Root Device.1353second # [ 4.677147] systemd[1]: Stopped target Path Units.1354second # [ 4.678137] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1355second # [ 4.679590] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1356second # [ 4.681161] systemd[1]: Stopped target Slice Units.1357second # [ 4.682566] systemd[1]: Stopped target Socket Units.1358second # [ 4.684251] systemd[1]: Stopped target System Initialization.1359second # [ 4.686237] systemd[1]: Stopped target Swaps.1360second # [ 4.687159] systemd[1]: Stopped target Timer Units.1361second # [ 4.688152] systemd[1]: dbus.socket: Deactivated successfully.1362second # [ 4.689286] systemd[1]: Closed D-Bus System Message Bus Socket.1363second # [ 4.690664] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1364second # [ 4.693179] systemd[1]: Stopped Find NixOS closure.1365second # [ 4.694152] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio1366second # [ 4.696218] systemd[1]: Starting rw-sysroot-nix-store.service...1367second # [ 4.697365] systemd[1]: systemd-sysctl.service: Deactivated successfully.1368second # [ 4.699153] systemd[1]: Stopped Apply Kernel Variables.1369second # [ 4.700204] systemd[1]: systemd-modules-load.service: Deactivated successfully.1370second # [ 4.702192] systemd[1]: Stopped Load Kernel Modules.1371second # [ 4.703409] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1372second # [ 4.705250] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1373second # [ 4.706647] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1374second # [ 4.708210] systemd[1]: Stopped Create System Files and Directories.1375second # [ 4.710160] systemd[1]: Stopped target Local File Systems.1376second # [ 4.711428] systemd[1]: Stopped target Preparation for Local File Systems.1377second # [ 4.713102] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1378second # [ 4.714651] systemd[1]: Stopped Coldplug All udev Devices.1379second # [ 4.716320] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1380second # [ 4.718662] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1381second # [ 4.720191] systemd[1]: Stopped Virtual Console Setup.1382second # [ 4.730532] systemd[1]: initrd-cleanup.service: Deactivated successfully.1383test # [ 4.742522] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1384test # [ 4.744587] systemd[1]: Finished NixOS Activation.1385second # [ 4.734634] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1386test # [ 4.746951] systemd[1]: Starting Switch Root...1387second # [ 4.739478] systemd[1]: systemd-udevd.service: Deactivated successfully.1388second # [ 4.741419] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1389second # [ 4.743308] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1390second # [ 4.745153] systemd[1]: Finished rw-sysroot-nix-store.service.1391test # [ 4.759375] systemd[1]: Switching root.1392second # [ 4.748094] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1393second # [ 4.749441] systemd[1]: Closed udev Control Socket.1394second # [ 4.751102] systemd[1]: Starting Cleanup udev Database...1395second # [ 4.752152] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1396second # [ 4.754183] systemd[1]: Stopped Create Static Device Nodes in /dev.1397second # [ 4.755388] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1398second # [ 4.756833] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1399second # [ 4.758564] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1400second # [ 4.759817] systemd[1]: Stopped Create List of Static Device Nodes.1401second # [ 4.773428] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1402second # [ 4.776119] systemd[1]: Finished Cleanup udev Database.1403second # [ 4.777162] systemd[1]: Reached target Switch Root.1404second # [ 4.778844] systemd[1]: Starting NixOS Activation...1405second # [ 4.870579] initrd-nixos-activation-start[192]: booting system configuration /nix/store/9xmmxf7qfryq1r3fngz2qayqfwrghi8a-nixos-system-second-test1406test # [ 5.088538] systemd-journald[67]: Received SIGTERM from PID 1 (systemd).1407second # [ 4.906708] initrd-nixos-activation-start[192]: running activation script...1408test # [ 5.202423] NET: Registered PF_VSOCK protocol family1409second # [ 5.143569] initrd-nixos-activation-start[215]: setting up /etc...1410second # [ 5.273661] initrd-nixos-activation-start[215]: setting up age secrets...1411test # [ 5.564131] systemd[1]: systemd 261.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)1412test # [ 5.569016] systemd[1]: Detected virtualization kvm.1413test # [ 5.569938] systemd[1]: Detected architecture x86-64.1414test # [ 5.570904] systemd[1]: Detected first boot.1415test # [ 5.573311] systemd[1]: Initializing machine ID from random generator.1416second # [ 5.390782] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1417second # [ 5.393118] systemd[1]: Finished NixOS Activation.1418second # [ 5.395151] systemd[1]: Starting Switch Root...1419second # [ 5.406903] systemd[1]: Switching root.1420second # [ 5.735657] systemd-journald[67]: Received SIGTERM from PID 1 (systemd).1421second # [ 5.878244] NET: Registered PF_VSOCK protocol family1422test # [ 5.901475] systemd[1]: bpf-restrict-fs: LSM BPF program attached1423test # [ 5.980528] systemd[1]: Applying preset policy.1424second # [ 6.237350] systemd[1]: systemd 261.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)1425second # [ 6.241818] systemd[1]: Detected virtualization kvm.1426second # [ 6.242670] systemd[1]: Detected architecture x86-64.1427second # [ 6.243604] systemd[1]: Detected first boot.1428second # [ 6.245909] systemd[1]: Initializing machine ID from random generator.1429test # [ 6.257330] systemd[1]: Populated /etc with preset unit settings.1430second # [ 6.549399] systemd[1]: bpf-restrict-fs: LSM BPF program attached1431test # [ 6.621882] systemd[1]: initrd-switch-root.service: Deactivated successfully.1432test # [ 6.623511] systemd[1]: Stopped initrd-switch-root.service.1433test # [ 6.626197] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1434test # [ 6.628341] systemd[1]: Created slice Slice /system/getty.1435test # [ 6.629837] systemd[1]: Created slice User and Session Slice.1436test # [ 6.630923] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1437test # [ 6.632327] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1438second # [ 6.632998] systemd[1]: Applying preset policy.1439test # [ 6.633651] systemd[1]: Expecting device /dev/hvc0...1440test # [ 6.643179] systemd[1]: Expecting device /dev/ttyS0...1441test # [ 6.644113] systemd[1]: Reached target Local Encrypted Volumes.1442test # [ 6.645126] systemd[1]: Stopped target initrd-fs.target.1443test # [ 6.646052] systemd[1]: Stopped target initrd-root-fs.target.1444test # [ 6.647028] systemd[1]: Stopped target initrd-switch-root.target.1445test # [ 6.648077] systemd[1]: Reached target Virtual Machines and Containers.1446test # [ 6.649189] systemd[1]: Reached target Path Units.1447test # [ 6.650073] systemd[1]: Reached target Remote File Systems.1448test # [ 6.651042] systemd[1]: Reached target Slice Units.1449test # [ 6.651955] systemd[1]: Reached target Swaps.1450test # [ 6.654090] systemd[1]: Listening on Query the User Interactively for a Password.1451test # [ 6.656872] systemd[1]: Listening on Process Core Dump Socket.1452test # [ 6.659032] systemd[1]: Listening on Credential Encryption/Decryption.1453test # [ 6.661181] systemd[1]: Listening on Factory Reset Management.1454test # [ 6.662272] systemd[1]: Listening on Hostname Service Socket.1455test # [ 6.665039] systemd[1]: Starting Journal Log Access Socket...1456test # [ 6.666483] systemd[1]: Listening on Journal Audit Socket.1457test # [ 6.668937] systemd[1]: Listening on Console Output Muting Service Socket.1458test # [ 6.670200] systemd[1]: Listening on Network Management Metrics Varlink Socket.1459test # [ 6.671643] systemd[1]: Listening on Network Management Varlink Socket.1460test # [ 6.672852] systemd[1]: Listening on Network Management Netlink Socket.1461test # [ 6.674097] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1462test # [ 6.675523] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1463test # [ 6.677071] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1464test # [ 6.682524] systemd[1]: Listening on Disk Repartitioning Service Socket.1465test # [ 6.683772] systemd[1]: Listening on Resolve Monitor Varlink Socket.1466test # [ 6.684947] systemd[1]: Listening on Resolve Service Varlink Socket.1467test # [ 6.686113] systemd[1]: Listening on udev Control Socket.1468test # [ 6.687165] systemd[1]: Listening on udev Varlink Socket.1469test # [ 6.689994] systemd[1]: Mounting Huge Pages File System...1470test # [ 6.694459] systemd[1]: Mounting POSIX Message Queue File System...1471test # [ 6.700301] systemd[1]: Mounting Kernel Debug File System...1472test # [ 6.707936] systemd[1]: Mounting Kernel Trace File System...1473test # [ 6.714394] systemd[1]: Starting Create List of Static Device Nodes...1474test # [ 6.719731] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio1475test # [ 6.736510] systemd[1]: Starting Load Kernel Module configfs...1476test # [ 6.738374] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1477test # [ 6.745450] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1478test # [ 6.748046] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1479test # [ 6.754673] systemd[1]: Mounting FUSE Control File System...1480test # [ 6.756119] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671481test # [ 6.766281] systemd[1]: Starting Journal Service...1482test # [ 6.772890] systemd[1]: Starting Load Kernel Modules...1483test # [ 6.783125] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1484test # [ 6.796371] systemd[1]: Starting Remount Root and Kernel File Systems...1485test # [ 6.801176] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1486test # [ 6.806009] systemd-journald[342]: Collecting audit messages is enabled.1487test # [ 6.815805] systemd[1]: Starting Coldplug All udev Devices...1488test # [ 6.827729] loop: module loaded1489test # [ 6.836111] systemd[1]: Listening on Journal Log Access Socket.1490test # [ 6.843098] systemd[1]: Mounted Huge Pages File System.1491test # [ 6.847805] systemd[1]: Started Journal Service.1492test # [ 6.649663] systemd[1]: Queued start job for default target Multi-User System.[ 6.850847] EXT4-fs (vda): re-mounted b48e8f06-06f3-49de-801f-52fc5b6de688.1493test # 1494test # [ 6.654155] systemd[1]: systemd-journald.service: Deactivated successfully.1495test # [ 6.658721] systemd-modules-load[343]: Module 'ctr' is built in1496test # [ 6.661592] systemd-modules-load[343]: Inserted module 'loop'1497test # [ 6.664674] systemd[1]: Mounted POSIX Message Queue File System.1498test # [ 6.668432] systemd[1]: Mounted Kernel Debug File System.1499test # [ 6.673773] systemd[1]: Mounted Kernel Trace File System.1500test # [ 6.675142] systemd[1]: Finished Create List of Static Device Nodes.1501test # [ 6.678456] systemd[1]: modprobe@configfs.service: Deactivated successfully.1502test # [ 6.679966] systemd[1]: Finished Load Kernel Module configfs.1503test # [ 6.682907] systemd[1]: Mounted FUSE Control File System.1504test # [ 6.687300] systemd[1]: Finished Load Kernel Modules.1505test # [ 6.692138] systemd[1]: Finished Remount Root and Kernel File Systems.1506test # [ 6.707077] systemd[1]: Listening on Disk Image Download Service Socket.1507test # [ 6.711623] systemd[1]: Mounting Kernel Configuration File System...1508test # [ 6.715384] systemd[1]: Starting Firewall...1509test # [ 6.722346] systemd-oomd[345]: No swap; memory pressure usage will be degraded1510test # [ 6.729073] systemd[1]: Starting Flush Journal to Persistent Storage...1511test # [ 6.730312] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1512second # [ 6.926779] systemd[1]: Populated /etc with preset unit settings.1513test # [ 6.742193] systemd[1]: Starting Load/Save OS Random Seed...1514test # [ 6.752776] systemd[1]: Starting Apply Kernel Variables...1515test # [ 6.764361] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1516test # [ 6.765715] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1517test # [ 6.768787] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1518test # [ 6.986889] systemd-journald[342]: Received client request to flush runtime journal.1519test # [ 7.051037] systemd[1]: Mounted Kernel Configuration File System.1520test # [ 7.057073] systemd[1]: Finished Load/Save OS Random Seed.1521test # [ 7.058390] systemd[1]: Reached target First Boot Complete.1522second # [ 7.250702] systemd[1]: initrd-switch-root.service: Deactivated successfully.1523second # [ 7.252484] systemd[1]: Stopped initrd-switch-root.service.1524second # [ 7.255116] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1525test # [ 7.065159] systemd[1]: Finished Apply Kernel Variables.1526second # [ 7.257564] systemd[1]: Created slice Slice /system/getty.1527test # [ 7.066583] systemd[1]: Starting Network Name Resolution...1528second # [ 7.259508] systemd[1]: Created slice User and Session Slice.1529second # [ 7.260736] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1530test # [ 7.069710] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1531second # [ 7.262201] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1532test # [ 7.073107] systemd[1]: Starting Create Static Device Nodes in /dev...1533test # [ 7.076751] systemd[1]: Finished Create Static Device Nodes in /dev.1534second # [ 7.263483] systemd[1]: Expecting device /dev/hvc0...1535test # [ 7.080624] systemd[1]: Reached target Preparation for Local File Systems.1536second # [ 7.272682] systemd[1]: Expecting device /dev/ttyS0...1537second # [ 7.273620] systemd[1]: Reached target Local Encrypted Volumes.1538second # [ 7.274621] systemd[1]: Stopped target initrd-fs.target.1539second # [ 7.275552] systemd[1]: Stopped target initrd-root-fs.target.1540test # [ 7.084160] systemd[1]: Starting Rule-based Manager for Device Events and Files...1541second # [ 7.276528] systemd[1]: Stopped target initrd-switch-root.target.1542second # [ 7.277582] systemd[1]: Reached target Virtual Machines and Containers.1543test # [ 7.087270] systemd-resolved[371]: Positive Trust Anchors:1544second # [ 7.278719] systemd[1]: Reached target Path Units.1545second # [ 7.279599] systemd[1]: Reached target Remote File Systems.1546second # [ 7.280573] systemd[1]: Reached target Slice Units.1547second # [ 7.281472] systemd[1]: Reached target Swaps.1548test # [ 7.091158] systemd-resolved[371]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d1549second # [ 7.283495] systemd[1]: Listening on Query the User Interactively for a Password.1550test # [ 7.094305] systemd-resolved[371]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b161551second # [ 7.286943] systemd[1]: Listening on Process Core Dump Socket.1552second # [ 7.289343] systemd[1]: Listening on Credential Encryption/Decryption.1553second # [ 7.291634] systemd[1]: Listening on Factory Reset Management.1554second # [ 7.292734] systemd[1]: Listening on Hostname Service Socket.1555test # [ 7.097227] systemd-resolved[371]: 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 test1556second # [ 7.296644] systemd[1]: Starting Journal Log Access Socket...1557second # [ 7.298037] systemd[1]: Listening on Journal Audit Socket.1558second # [ 7.300824] systemd[1]: Listening on Console Output Muting Service Socket.1559second # [ 7.302511] systemd[1]: Listening on Network Management Metrics Varlink Socket.1560second # [ 7.304015] systemd[1]: Listening on Network Management Varlink Socket.1561second # [ 7.305325] systemd[1]: Listening on Network Management Netlink Socket.1562second # [ 7.306606] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1563second # [ 7.308090] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1564test # [ 7.118110] systemd[1]: Finished Flush Journal to Persistent Storage.1565second # [ 7.309706] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1566second # [ 7.315610] systemd[1]: Listening on Disk Repartitioning Service Socket.1567second # [ 7.316979] systemd[1]: Listening on Resolve Monitor Varlink Socket.1568second # [ 7.318369] systemd[1]: Listening on Resolve Service Varlink Socket.1569second # [ 7.319763] systemd[1]: Listening on udev Control Socket.1570second # [ 7.321014] systemd[1]: Listening on udev Varlink Socket.1571second # [ 7.324318] systemd[1]: Mounting Huge Pages File System...1572second # [ 7.328989] systemd[1]: Mounting POSIX Message Queue File System...1573test # [ 7.142368] systemd-udevd[383]: Using default interface naming scheme 'v261'.1574second # [ 7.335285] systemd[1]: Mounting Kernel Debug File System...1575second # [ 7.340699] systemd[1]: Mounting Kernel Trace File System...1576second # [ 7.346990] systemd[1]: Starting Create List of Static Device Nodes...1577second # [ 7.352314] systemd[1]: Load Kernel Module 9pnet_virtio skipped, unmet condition check ConditionKernelModuleLoaded=!9pnet_virtio1578second # [ 7.363856] systemd[1]: Starting Load Kernel Module configfs...1579test # [ 7.175374] systemd-resolved[371]: Using system hostname 'test'.1580test # [ 7.180460] systemd[1]: Finished Coldplug All udev Devices.1581second # [ 7.373881] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1582test # [ 7.184703] systemd[1]: Started Network Name Resolution.1583second # [ 7.383340] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1584second # [ 7.385371] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1585second # [ 7.396742] systemd[1]: Mounting FUSE Control File System...1586second # [ 7.401634] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671587second # [ 7.411662] systemd[1]: Starting Journal Service...1588second # [ 7.420415] systemd[1]: Starting Load Kernel Modules...1589second # [ 7.429857] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1590second # [ 7.440774] systemd[1]: Starting Remount Root and Kernel File Systems...1591test # [ 7.254338] systemd[1]: Started Rule-based Manager for Device Events and Files.1592second # [ 7.447211] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1593second # [ 7.460435] systemd-journald[319]: Collecting audit messages is enabled.1594second # [ 7.464498] systemd[1]: Starting Coldplug All udev Devices...1595second # [ 7.491810] systemd[1]: Listening on Journal Log Access Socket.1596second # [ 7.493675] loop: module loaded1597second # [ 7.497748] systemd[1]: Mounted Huge Pages File System.1598second # [ 7.505225] systemd[1]: Mounted POSIX Message Queue File System.1599second # [ 7.509224] EXT4-fs (vda): re-mounted f4e24826-c264-41b9-bd36-12e9e06d3e17.1600second # [ 7.511266] systemd[1]: Mounted Kernel Debug File System.1601second # [ 7.515787] systemd[1]: Mounted Kernel Trace File System.1602second # [ 7.319768] systemd[1]: Queued start job for default target Multi-User System.1603second # [ 7.524473] systemd[1]: Finished Create List of Static Device Nodes.1604second # [ 7.322874] systemd[1]: systemd-journald.service: Deactivated successfully.1605second # [ 7.325594] systemd-modules-load[320]: Module 'ctr' is built in1606second # [ 7.531962] systemd[1]: Started Journal Service.1607second # [ 7.330278] systemd-modules-load[320]: Inserted module 'loop'1608second # [ 7.336492] systemd[1]: modprobe@configfs.service: Deactivated successfully.1609second # [ 7.342347] systemd[1]: Finished Load Kernel Module configfs.1610second # [ 7.343540] systemd[1]: Mounted FUSE Control File System.1611second # [ 7.347843] systemd[1]: Finished Load Kernel Modules.1612second # [ 7.352119] systemd[1]: Finished Remount Root and Kernel File Systems.1613second # [ 7.362934] systemd-oomd[322]: No swap; memory pressure usage will be degraded1614second # [ 7.368103] systemd[1]: Listening on Disk Image Download Service Socket.1615second # [ 7.371750] systemd[1]: Mounting Kernel Configuration File System...1616second # [ 7.378910] systemd[1]: Starting Firewall...1617test # [ 7.393621] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1618second # [ 7.384083] systemd[1]: Starting Flush Journal to Persistent Storage...1619second # [ 7.385729] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1620second # [ 7.395962] systemd[1]: Starting Load/Save OS Random Seed...1621second # [ 7.413484] systemd[1]: Starting Apply Kernel Variables...1622test # [ 7.431427] systemd[1]: Mounting /run/wrappers...1623second # [ 7.431232] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1624second # [ 7.433511] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1625second # [ 7.437115] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1626test # [ 7.469428] systemd[1]: Mounted /run/wrappers.1627test # [ 7.471782] systemd[1]: Reached target Local File Systems.1628test # [ 7.475687] systemd[1]: Listening on Boot Loader Control Service Socket.1629test # [ 7.483206] systemd[1]: Starting register-nix-paths.service...1630second # [ 7.674799] systemd-journald[319]: Received client request to flush runtime journal.1631test # [ 7.486873] systemd[1]: Starting Create SUID/SGID Wrappers...1632test # [ 7.489098] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1633test # [ 7.500713] systemd[1]: Starting Save Transient machine-id to Disk...1634test # [ 7.520255] systemd[1]: Starting Create System Files and Directories...1635test # [ 7.547668] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1636test # [ 7.599126] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.1637test # [ 7.600491] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1638test # [ 7.609569] systemd[1]: Finished Save Transient machine-id to Disk.1639test # [ 7.652223] systemd[1]: Finished Create System Files and Directories.1640test # [ 7.662125] systemd[1]: Starting Rebuild Journal Catalog...1641test # [ 7.667940] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1642test # [ 7.685244] (udev-worker)[439]: Network interface NamePolicy= disabled on kernel command line.1643test # [ 7.700521] (udev-worker)[431]: Network interface NamePolicy= disabled on kernel command line.1644test # [ 7.762920] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1645second # [ 7.754376] systemd[1]: Finished Load/Save OS Random Seed.1646second # [ 7.759416] systemd[1]: Reached target First Boot Complete.1647second # [ 7.764205] systemd[1]: Mounted Kernel Configuration File System.1648second # [ 7.770442] systemd[1]: Finished Apply Kernel Variables.1649second # [ 7.773213] systemd[1]: Starting Network Name Resolution...1650second # [ 7.776600] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1651second # [ 7.781088] systemd[1]: Starting Create Static Device Nodes in /dev...1652second # [ 7.783226] systemd[1]: Finished Create Static Device Nodes in /dev.1653second # [ 7.784966] systemd[1]: Reached target Preparation for Local File Systems.1654second # [ 7.788383] systemd[1]: Starting Rule-based Manager for Device Events and Files...1655test # [ 7.801140] systemd[1]: Finished Rebuild Journal Catalog.1656second # [ 7.791804] systemd-resolved[348]: Positive Trust Anchors:1657second # [ 7.794590] systemd-resolved[348]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d1658second # [ 7.797835] systemd-resolved[348]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b161659test # [ 7.811132] systemd[1]: Starting Update is Completed...1660second # [ 7.801078] systemd-resolved[348]: 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 test1661second # [ 7.818713] systemd[1]: Finished Flush Journal to Persistent Storage.1662second # [ 7.821551] systemd[1]: Finished Coldplug All udev Devices.1663second # [ 7.826349] systemd-udevd[359]: Using default interface naming scheme 'v261'.1664test # [ 7.861134] systemd[1]: Finished Update is Completed.1665second # [ 7.856316] systemd-resolved[348]: Using system hostname 'second'.1666second # [ 7.863166] systemd[1]: Started Network Name Resolution.1667test # [ 7.930232] systemd[1]: Finished Firewall.1668test # [ 7.933232] systemd[1]: Reached target Preparation for Network.1669test # [ 7.934897] systemd[1]: Listening on Network Management Resolve Hook Socket.1670test # [ 7.942349] systemd[1]: Starting Network Management...1671second # [ 7.932691] systemd[1]: Started Rule-based Manager for Device Events and Files.1672test # [ 8.036311] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1673test # [ 8.040409] systemd[1]: Finished Create SUID/SGID Wrappers.1674second # [ 8.052573] systemd[1]: Mounting /run/wrappers...1675second # [ 8.095397] systemd[1]: Mounted /run/wrappers.1676second # [ 8.097540] systemd[1]: Reached target Local File Systems.1677second # [ 8.100282] systemd[1]: Listening on Boot Loader Control Service Socket.1678second # [ 8.106094] systemd[1]: Starting register-nix-paths.service...1679second # [ 8.109384] systemd[1]: Starting Create SUID/SGID Wrappers...1680second # [ 8.111352] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1681second # [ 8.129105] systemd[1]: Starting Save Transient machine-id to Disk...1682second # [ 8.142326] systemd[1]: Starting Create System Files and Directories...1683test # [ 8.362289] cfg80211: Loading compiled-in X.509 certificates for regulatory database1684second # [ 8.158184] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1685test # [ 8.379700] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console1686test # [ 8.382052] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1687test # [ 8.383080] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1688test # [ 8.389476] mousedev: PS/2 mouse device common for all mice1689test # [ 8.396495] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input31690test # [ 8.226132] systemd-networkd[553]: /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.1691test # [ 8.231563] systemd-networkd[553]: /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.1692test # [ 8.237270] systemd-networkd[553]: lo: Link UP1693test # [ 8.238858] systemd-networkd[553]: lo: Gained carrier1694test # [ 8.253508] systemd[1]: Started Network Management.1695test # [ 8.258083] systemd-networkd[553]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1696second # [ 8.248198] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1697test # [ 8.260696] systemd-networkd[553]: eth1: Configuring with /etc/systemd/network/40-eth1.network.1698test # [ 8.268086] systemd-networkd[553]: eth1: Link UP1699second # [ 8.257228] systemd[1]: Finished Save Transient machine-id to Disk.1700test # [ 8.270645] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...1701test # [ 8.273428] systemd-networkd[553]: eth1: Gained carrier1702test # [ 8.274490] systemd-networkd[553]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1703second # [ 8.308205] systemd[1]: Finished Create System Files and Directories.1704test # [ 8.328157] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.1705second # [ 8.320283] systemd[1]: Starting Rebuild Journal Catalog...1706second # [ 8.325523] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1707second # [ 8.344348] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1708test # [ 8.357127] systemd[1]: Finished register-nix-paths.service.1709test # [ 8.359336] systemd[1]: Reached target System Initialization.1710test # [ 8.361833] systemd[1]: Started Discard unused filesystem blocks once a week.1711test # [ 8.363511] systemd[1]: Started Daily Cleanup of Temporary Directories.1712test # [ 8.366201] systemd[1]: Reached target Timer Units.1713test # [ 8.367814] systemd[1]: Listening on D-Bus System Message Bus Socket.1714test # [ 8.369322] systemd[1]: Listening on Nix Daemon Socket.1715test # [ 8.374613] systemd[1]: Listening on Authorization Manager Agent Helper.1716test # [ 8.375865] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1717test # [ 8.377389] systemd[1]: Reached target Socket Units.1718test # [ 8.382145] systemd[1]: Starting D-Bus System Message Bus...1719test # [ 8.408049] systemd-resolved[371]: Clock change detected. Flushing caches.1720test # [ 8.434616] ACPI: button: Power Button [PWRF]1721test # [ 8.500781] NET: Registered PF_PACKET protocol family1722second # [ 8.417320] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1723test # [ 8.583757] rtc_cmos 00:04: RTC can wake from S41724test # [ 8.599496] rtc_cmos 00:04: registered as rtc01725test # [ 8.607085] rtc_cmos 00:04: setting system clock to 2026-09-04T00:12:49 UTC (1788480769)1726test # [ 8.607194] rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs1727test # [ 8.608862] systemd-journald[342]: Time jumped backwards, rotating.1728test # [ 8.611534] Console: switching to colour dummy device 80x251729second # [ 8.446567] systemd[1]: Finished Rebuild Journal Catalog.1730second # [ 8.456402] systemd[1]: Starting Update is Completed...1731test # [ 8.614605] parport_pc 00:02: reported by Plug and Play ACPI1732second # [ 8.457579] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.1733test # [ 8.614697] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]1734test # [ 8.631431] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:09.0/virtio7/input/input41735test # [ 8.473575] dbus-broker-launch[578]: Looking up NSS user entry for 'systemd-timesync'...1736test # [ 8.476834] dbus-broker-launch[578]: NSS returned no entry for 'systemd-timesync'1737test # [ 8.478457] dbus-broker-launch[578]: Invalid user-name in /nix/store/w10146x5br2zk655hnwq4nr9vn6nv24f-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1738test # [ 8.496979] dbus-broker-launch[578]: Ignoring duplicate name 'org.freedesktop.nm_dispatcher' in service file '/nix/store/6qz6q8j2r2cirh33f67mpdsxnqf8d680-networkmanager-1.58.0/share/dbus-1/system-services/org.freedesktop.nm_dispatcher.service'1739test # [ 8.500860] dbus-broker-launch[578]: Ignoring duplicate name 'org.freedesktop.nm_priv_helper' in service file '/nix/store/6qz6q8j2r2cirh33f67mpdsxnqf8d680-networkmanager-1.58.0/share/dbus-1/system-services/org.freedesktop.nm_priv_helper.service'1740test # [ 8.505732] dbus-broker-launch[578]: Ignoring duplicate name 'org.freedesktop.ModemManager1' in service file '/nix/store/nhsrpbakhmswx0ykmkxj8q0ykm2ifjlh-modemmanager-1.24.2/share/dbus-1/system-services/org.freedesktop.ModemManager1.service'1741test # [ 8.509535] dbus-broker-launch[578]: Ignoring duplicate name 'org.freedesktop.PolicyKit1' in service file '/nix/store/3pj4zjhsfxh3fbj02aqm1pxkyf2d1r7f-polkit-127/share/dbus-1/system-services/org.freedesktop.PolicyKit1.service'1742test # [ 8.515190] systemd[1]: Started D-Bus System Message Bus.1743test # [ 8.519077] systemd[1]: Reached target Basic System.1744test # [ 8.522215] systemd[1]: Starting Network Manager Script Dispatcher Service...1745second # [ 8.517243] systemd[1]: Finished Update is Completed.1746test # [ 8.533086] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1747test # [ 8.546938] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1748test # [ 8.553707] dbus-broker-launch[578]: Ready1749test # [ 8.657428] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized1750test # [ 8.756366] [drm] Found bochs VGA, ID 0xb0c5.1751test # [ 8.756368] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.1752second # [ 8.545352] (udev-worker)[409]: Network interface NamePolicy= disabled on kernel command line.1753test # [ 8.560764] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1754second # [ 8.551387] (udev-worker)[411]: Network interface NamePolicy= disabled on kernel command line.1755test # [ 8.576708] systemd[1]: Starting Network Manager...1756test # [ 8.785336] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic1757test # [ 8.786252] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 01758test # [ 8.589880] systemd[1]: Started backdoor.service.1759second # [ 8.585166] systemd[1]: Finished Firewall.1760second # [ 8.586489] systemd[1]: Reached target Preparation for Network.1761second # [ 8.590951] systemd[1]: Listening on Network Management Resolve Hook Socket.1762test # [ 8.606081] systemd[1]: Starting Import lastlog data into lastlog2 database...1763second # [ 8.600501] systemd[1]: Starting Network Management...1764test # [ 8.637397] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1765test # [ 8.643951] fwqmh4fc3j6in9rflv5cf5kgmc9k4ybb-wifi-secrets[583]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1766test # [ 8.648807] iif2wwqra6cyixya934jn1gzixwi7l6v-wifi-secrets[584]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1767test # [ 8.856007] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt1768test # [ 8.856873] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD1769test # [ 8.670250] systemd[1]: Starting Post-Boot Actions...1770test # [ 8.692935] d1nj6zvw29gdp15fx855q5n4s3rj0h43-wifi-secrets[585]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1771test # [ 8.702169] systemd[1]: Started Reset console on configuration changes.1772second # [ 8.714177] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1773second # [ 8.718564] systemd[1]: Finished Create SUID/SGID Wrappers.1774test # [ 8.737994] systemd[1]: NetworkManager-setup-secrets-wg-test-all.service: Deactivated successfully.1775test # connecting to host...1776test # [ 8.749093] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1777test # [ 8.752668] systemd[1]: NetworkManager-setup-secrets-wg-test-one.service: Deactivated successfully.1778test # [ 8.760490] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1779test # [ 8.764101] systemd[1]: NetworkManager-setup-secrets-wg-test-open.service: Deactivated successfully.1780test # [ 8.775267] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1781test: Guest shell says: b'Spawning backdoor root shell...\n'1782test: connected to guest root shell1783test: (connecting took 9.53 seconds)1784test: (finished: waiting for the VM to finish booting, in 9.53 seconds)1785test # [ 8.803249] nsncd[589]: Sep 04 00:12:49.893 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1786test # [ 8.818214] systemd[1]: Started Name Service Cache Daemon (nsncd).1787test # [ 8.834177] systemd[1]: Finished Post-Boot Actions.1788test # [ 8.855981] systemd[1]: Started Network Manager Script Dispatcher Service.1789test # [ 8.864432] systemd[1]: Finished Import lastlog data into lastlog2 database.1790second # [ 9.056745] cfg80211: Loading compiled-in X.509 certificates for regulatory database1791test # [ 8.878921] systemd[1]: Reached target Host and Network Name Lookups.1792test # [ 8.880167] systemd[1]: Reached target User and Group Name Lookups.1793test # [ 8.885197] systemd[1]: Starting User Login Management...1794second # [ 9.080247] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1795second # [ 9.082044] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1796second # [ 8.903811] systemd[1]: Finished register-nix-paths.service.1797second # [ 8.907134] systemd[1]: Reached target System Initialization.1798second # [ 8.909477] systemd[1]: Started Discard unused filesystem blocks once a week.1799second # [ 8.911502] systemd[1]: Started Daily Cleanup of Temporary Directories.1800second # [ 8.913958] systemd[1]: Reached target Timer Units.1801second # [ 8.916205] systemd[1]: Listening on D-Bus System Message Bus Socket.1802second # [ 8.918505] systemd[1]: Listening on Nix Daemon Socket.1803second # [ 8.921433] systemd-networkd[527]: /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.1804second # [ 8.926817] systemd[1]: Listening on Authorization Manager Agent Helper.1805second # [ 8.928127] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1806test # [ 8.941777] systemd[1]: Starting Hostname Service...1807second # [ 8.930341] systemd[1]: Reached target Socket Units.1808second # [ 8.933158] systemd-networkd[527]: /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.1809second # [ 8.936928] systemd-networkd[527]: lo: Link UP1810second # [ 8.939107] systemd-networkd[527]: lo: Gained carrier1811second # [ 8.943087] systemd[1]: Starting D-Bus System Message Bus...1812second # [ 8.949250] systemd[1]: Started Network Management.1813second # [ 8.954739] systemd-networkd[527]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1814second # [ 8.957690] systemd-networkd[527]: eth1: Configuring with /etc/systemd/network/40-eth1.network.1815second # [ 8.966004] systemd-networkd[527]: eth1: Link UP1816second # [ 8.966972] systemd-networkd[527]: eth1: Gained carrier1817second # [ 8.968059] systemd-networkd[527]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network1818second # [ 8.973638] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...1819second # [ 9.189764] NET: Registered PF_PACKET protocol family1820second # [ 9.024362] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.1821test # [ 9.095336] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input61822second # [ 9.241910] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console1823second # [ 9.244263] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input31824second # [ 9.249182] mousedev: PS/2 mouse device common for all mice1825test # [ 9.095673] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input51826second # [ 9.071999] dbus-broker-launch[551]: Looking up NSS user entry for 'systemd-timesync'...1827second # [ 9.078387] dbus-broker-launch[551]: NSS returned no entry for 'systemd-timesync'1828second # [ 9.080697] dbus-broker-launch[551]: Invalid user-name in /nix/store/w10146x5br2zk655hnwq4nr9vn6nv24f-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1829test # [ 9.239792] Console: switching to colour frame buffer device 160x501830test # [ 9.318732] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device1831test # [ 9.009058] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1832second # [ 9.109755] dbus-broker-launch[551]: Ignoring duplicate name 'org.freedesktop.nm_dispatcher' in service file '/nix/store/6qz6q8j2r2cirh33f67mpdsxnqf8d680-networkmanager-1.58.0/share/dbus-1/system-services/org.freedesktop.nm_dispatcher.service'1833test # [ 9.124702] systemd[1]: Starting Virtual Console Setup...1834second # [ 9.114430] dbus-broker-launch[551]: Ignoring duplicate name 'org.freedesktop.nm_priv_helper' in service file '/nix/store/6qz6q8j2r2cirh33f67mpdsxnqf8d680-networkmanager-1.58.0/share/dbus-1/system-services/org.freedesktop.nm_priv_helper.service'1835test # [ 9.131446] systemd[1]: Started Hostname Service.1836second # [ 9.118572] dbus-broker-launch[551]: Ignoring duplicate name 'org.freedesktop.ModemManager1' in service file '/nix/store/nhsrpbakhmswx0ykmkxj8q0ykm2ifjlh-modemmanager-1.24.2/share/dbus-1/system-services/org.freedesktop.ModemManager1.service'1837test # [ 9.137443] systemd-logind[638]: New seat seat0.1838second # [ 9.122781] dbus-broker-launch[551]: Ignoring duplicate name 'org.freedesktop.PolicyKit1' in service file '/nix/store/3pj4zjhsfxh3fbj02aqm1pxkyf2d1r7f-polkit-127/share/dbus-1/system-services/org.freedesktop.PolicyKit1.service'1839second # [ 9.128164] systemd[1]: Started D-Bus System Message Bus.1840second # [ 9.130119] systemd[1]: Reached target Basic System.1841test # [ 9.143551] systemd[1]: Started User Login Management.1842test # [ 9.144779] systemd-logind[638]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard)1843second # [ 9.136089] systemd[1]: Starting Network Manager Script Dispatcher Service...1844test # [ 9.151403] systemd-logind[638]: Watching system buttons on /dev/input/event2 (Power Button)1845test # [ 9.153217] systemd[1]: Starting linger-users.service...1846second # [ 9.142116] systemd[1]: Starting Generate Wi-Fi secrets for NetworkManager...1847second # [ 9.159103] systemd[1]: Starting Network Manager...1848test # [ 9.178534] systemd-networkd[553]: eth0: Link UP1849second # [ 9.167282] dbus-broker-launch[551]: Ready1850test # [ 9.181761] systemd-networkd[553]: eth0: Gained carrier1851second # [ 9.176797] systemd[1]: Started backdoor.service.1852test # [ 9.206672] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1853test # [ 9.214322] systemd[1]: Stopped Virtual Console Setup.1854second # [ 9.200943] systemd[1]: Starting Import lastlog data into lastlog2 database...1855second # [ 9.216221] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1856test # [ 9.238657] systemd[1]: Starting Virtual Console Setup...1857test # [ 9.244571] systemd[1]: Started Network Manager.1858test # [ 9.252599] systemd[1]: Reached target Network.1859second # [ 9.244984] systemd[1]: Starting Post-Boot Actions...1860test # [ 9.269411] systemd[1]: Starting Ensure that NetworkManager declarative profiles are created...1861second # [ 9.258734] fwqmh4fc3j6in9rflv5cf5kgmc9k4ybb-wifi-secrets[558]: Generating wifi secrets file: /run/secrets/NetworkManager/wifi-secrets1862second # [ 9.268506] systemd[1]: Started Reset console on configuration changes.1863test # [ 9.290628] systemd[1]: Starting Permit User Sessions...1864test # [ 9.502801] ppdev: user-space parallel port driver1865test # [ 9.325833] systemd[1]: linger-users.service: Deactivated successfully.1866second # [ 9.315348] systemd[1]: NetworkManager-setup-secrets-wg-test-all.service: Deactivated successfully.1867second # connecting to host...1868second # [ 9.333048] systemd[1]: Finished Generate Wi-Fi secrets for NetworkManager.1869test # [ 9.347544] systemd[1]: Finished linger-users.service.1870second # [ 9.283316] ACPI: button: Power Button [PWRF]1871second # [ 9.377777] systemd-resolved[348]: Clock change detected. Flushing caches.1872second # [ 9.486749] rtc_cmos 00:04: RTC can wake from S41873second # [ 9.542010] Console: switching to colour dummy device 80x251874test # [ 9.465683] systemd[1]: Finished Permit User Sessions.1875second # [ 9.579508] rtc_cmos 00:04: registered as rtc01876second # [ 9.579620] rtc_cmos 00:04: setting system clock to 2026-09-04T00:12:50 UTC (1788480770)1877second # [ 9.485587] nsncd[563]: Sep 04 00:12:50.588 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1878test # [ 9.500689] systemd[1]: Started Getty on tty1.1879second # [ 9.490459] systemd[1]: Finished Post-Boot Actions.1880test # [ 9.506104] systemd[1]: Reached target Login Prompts.1881second # [ 9.579742] rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs1882second # [ 9.582885] systemd-journald[319]: Time jumped backwards, rotating.1883second # [ 9.501840] systemd[1]: Started Name Service Cache Daemon (nsncd).1884second # [ 9.506870] systemd[1]: Started Network Manager Script Dispatcher Service.1885second # [ 9.509505] systemd[1]: Reached target Host and Network Name Lookups.1886second # [ 9.512518] systemd[1]: Reached target User and Group Name Lookups.1887second # [ 9.625493] parport_pc 00:02: reported by Plug and Play ACPI1888test # [ 9.733314] iTCO_wdt iTCO_wdt.1.auto: Found a ICH9 TCO device (Version=2, TCOBASE=0x0660)1889second # [ 9.625635] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]1890second # [ 9.524321] systemd[1]: Starting User Login Management...1891second # [ 9.528450] systemd[1]: Finished Import lastlog data into lastlog2 database.1892test # [ 9.541739] systemd-resolved[371]: eth0: Bus client set default route setting: yes1893test # [ 9.547300] systemd-resolved[371]: eth0: Bus client set DNS server list to: 10.0.2.31894second # [ 9.666566] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:09.0/virtio7/input/input41895second # [ 9.746062] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized1896second # [ 9.599097] systemd[1]: Starting Hostname Service...1897second # [ 9.805437] [drm] Found bochs VGA, ID 0xb0c5.1898test # [ 9.611416] systemd-logind[638]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1899second # [ 9.805439] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.1900second # [ 9.821754] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic1901second # [ 9.822848] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 01902test # [ 9.832492] iTCO_wdt iTCO_wdt.1.auto: initialized. heartbeat=30 sec (nowayout=0)1903test # [ 9.646189] NetworkManager[586]: <warn> [1788480770.7359] keyfile: load: "/var/run/NetworkManager/system-connections/one.nmconnection": failed to load connection: invalid connection: connection.id: property is empty1904test # [ 9.652116] NetworkManager[586]: <warn> [1788480770.7369] keyfile: load: "/var/run/NetworkManager/system-connections/all.nmconnection": failed to load connection: invalid connection: connection.id: property is empty1905second # [ 9.682705] systemd-logind[599]: New seat seat0.1906second # [ 9.687379] systemd[1]: Started User Login Management.1907second # [ 9.698863] systemd[1]: Starting linger-users.service...1908second # [ 9.935248] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt1909second # [ 9.936434] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD1910test # [ 9.756719] systemd[1]: NetworkManager-ensure-profiles.service: Deactivated successfully.1911test # [ 9.760251] systemd[1]: Finished Ensure that NetworkManager declarative profiles are created.1912second # [ 9.788064] systemd[1]: linger-users.service: Deactivated successfully.1913second # [ 9.789913] systemd[1]: Finished linger-users.service.1914test # [ 9.822253] systemd-networkd[553]: eth1: Gained IPv6LL1915second # [ 9.830416] systemd[1]: Started Hostname Service.1916test # [ 10.061464] kvm_amd: TSC scaling supported1917test # [ 10.062251] kvm_amd: Nested Virtualization enabled1918test # [ 10.063524] kvm_amd: Nested Paging enabled1919test # [ 10.064464] kvm_amd: LBR virtualization supported1920test # [ 10.065519] kvm_amd: Virtual GIF supported1921test # [ 10.066377] kvm_amd: Virtual NMI enabled1922test # [ 9.872087] systemd[1]: Reached target Multi-User System.1923test # [ 9.877678] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1924test # [ 9.881063] systemd[1]: Stopped Virtual Console Setup.1925test # [ 9.897407] systemd[1]: Starting Virtual Console Setup...1926second # [ 10.029327] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input61927second # [ 10.029667] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input51928second # [ 9.942793] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1929second # [ 10.074701] Console: switching to colour frame buffer device 160x501930test # [ 10.166493] EDAC MC: Ver: 3.0.01931second # [ 9.967671] systemd-networkd[527]: eth0: Link UP1932second # [ 9.969715] systemd-networkd[527]: eth0: Gained carrier1933second # [ 10.176554] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device1934test: (finished: waiting for unit NetworkManager.service, in 10.72 seconds)1935test: must succeed: cat /run/NetworkManager/system-connections/one.nmconnection1936second # [ 10.005428] systemd[1]: Started Network Manager.1937second # [ 10.011326] systemd[1]: Reached target Network.1938test: (finished: must succeed: cat /run/NetworkManager/system-connections/one.nmconnection, in 0.03 seconds)1939cleanup1940kill QemuMachine (pid 48)1941second # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/b5bpi6zfajzzrwwpgba2q6li3nnya4bs-python3-3.14.7/bin/python3.14)1942kill QemuMachine (pid 47)1943test # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/b5bpi6zfajzzrwwpgba2q6li3nnya4bs-python3-3.14.7/bin/python3.14)1944(finished: cleanup, in 0.25 seconds)1945Traceback (most recent call last):1946 File "/nix/store/pg9mx4grw834zhq8i5jz7c4pfk7sffad-nixos-test-driver-1.1/bin/.nixos-test-driver-wrapped", line 9, in <module>1947 sys.exit(main())1948 ~~~~^^1949 File "/nix/store/pg9mx4grw834zhq8i5jz7c4pfk7sffad-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/__init__.py", line 194, in main1950 driver.run_tests()1951 ~~~~~~~~~~~~~~~~^^1952 File "/nix/store/pg9mx4grw834zhq8i5jz7c4pfk7sffad-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/driver.py", line 437, in run_tests1953 self.test_script()1954 ~~~~~~~~~~~~~~~~^^1955 File "/nix/store/pg9mx4grw834zhq8i5jz7c4pfk7sffad-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/driver.py", line 395, in test_script1956 exec(self.tests, symbols, None)1957 ~~~~^^^^^^^^^^^^^^^^^^^^^^^^^^^1958 File "<string>", line 4, in <module>1959AssertionError: Expected mock password in connection file:1960[connection]1961autoconnect=true1962id=1963type=wifi19641965[wifi]1966mode=infrastructure1967ssid=19681969[wifi-security]1970key-mgmt=wpa-psk1971psk=1972