vm-test-run-nix-grpc-store-acme-substituter
checks.x86_64-linux.acme-vm
· build #500
· raw
1tribuchet: building on jamie2Machine state will be reset. To keep it, pass --keep-machine-state3start all VLans4(finished: start all VLans, in 0.00 seconds)5Test will time out and terminate in 600.0 seconds6run the VM test script7start all VMs8host1: starting vm9server: starting vm10server # Disk image does not exist, creating the virtualisation disk image...11server: QEMU running (pid 48)12server # Formatting '/build/vm-state-server/tmp.NeJboWAfM4', fmt=raw size=107374182413server # mke2fs 1.47.4 (6-Mar-2025)14server # Discarding device blocks: 0/262144 done15server # Creating filesystem with 262144 4k blocks and 65536 inodes16server # Filesystem UUID: 0397a20c-8409-48d9-9908-9a1787a4ee1917server # Superblock backups stored on blocks:18server # 32768, 98304, 163840, 22937619server # 20server # Allocating group tables: 0/8 done21server # Writing inode tables: 0/8 done22server # Creating journal (8192 blocks): done23server # Writing superblocks and filesystem accounting information: 0/8 done24server # 25server # Virtualisation disk image created.26server # Starting virtiofs daemons...27server # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)28server # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether29server # [2026-09-22T14:50:17Z INFO virtiofsd] Waiting for vhost-user socket connection...30server # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)31server # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether32server # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)33server # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether34server # [2026-09-22T14:50:17Z INFO virtiofsd] Waiting for vhost-user socket connection...35server # [2026-09-22T14:50:17Z INFO virtiofsd] Waiting for vhost-user socket connection...36server # [2026-09-22T14:50:17Z INFO virtiofsd] Client connected, servicing requests37server # [2026-09-22T14:50:17Z INFO virtiofsd] Client connected, servicing requests38server # [2026-09-22T14:50:17Z INFO virtiofsd] Client connected, servicing requests39host1 # Disk image does not exist, creating the virtualisation disk image...40host1: QEMU running (pid 47)41host1 # Formatting '/build/vm-state-host1/tmp.MK5gXkqnys', fmt=raw size=107374182442host1 # mke2fs 1.47.4 (6-Mar-2025)43host1 # Discarding device blocks: 0/262144 done44host1 # Creating filesystem with 262144 4k blocks and 65536 inodes45host1 # Filesystem UUID: ac1b9174-ddd3-4121-826f-5af554c97e1646host1 # Superblock backups stored on blocks:47(finished: start all VMs, in 0.28 seconds)48host1 # 32768, 98304, 163840, 22937649host1 # 50host1 # Allocating group tables: 0/8 done51host1 # Writing inode tables: 0/8 done52host1 # Creating journal (8192 blocks): done53host1 # Writing superblocks and filesystem accounting information: 0/8 done54host1 # 55host1 # Virtualisation disk image created.56host1 # Starting virtiofs daemons...57host1 # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)58host1 # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether59host1 # [2026-09-22T14:50:17Z INFO virtiofsd] Waiting for vhost-user socket connection...60host1 # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)61host1 # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether62host1 # [2026-09-22T14:50:17Z INFO virtiofsd] Waiting for vhost-user socket connection...63server: waiting for unit step-ca.service64host1 # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)65host1 # [2026-09-22T14:50:17Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether66host1 # [2026-09-22T14:50:17Z INFO virtiofsd] Waiting for vhost-user socket connection...67host1 # [2026-09-22T14:50:17Z INFO virtiofsd] Client connected, servicing requests68server: waiting for the VM to finish booting69host1 # [2026-09-22T14:50:17Z INFO virtiofsd] Client connected, servicing requests70host1 # [2026-09-22T14:50:17Z INFO virtiofsd] Client connected, servicing requests71server # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)72host1 # SeaBIOS (version rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org)73server # 74server # 75server # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+7EFCC730+7EF2C730 CA0076host1 # 77server # Press Ctrl-B to configure iPXE (PCI 00:02.0)...78host1 # 79server # 80server # 81server # 82server # 83host1 # iPXE (http://ipxe.org) 00:02.0 CA00 PCI2.10 PnP PMM+7EFCC730+7EF2C730 CA0084server # iPXE (http://ipxe.org) 00:05.0 CB00 PCI2.10 PnP PMM 7EFCC730 7EF2C730 CB0085host1 # Press Ctrl-B to configure iPXE (PCI 00:02.0)...86host1 # 87host1 # 88host1 # 89host1 # 90server # Press Ctrl-B to configure iPXE (PCI 00:05.0)...91server # 92server # 93host1 # iPXE (http://ipxe.org) 00:05.0 CB00 PCI2.10 PnP PMM 7EFCC730 7EF2C730 CB0094host1 # Press Ctrl-B to configure iPXE (PCI 00:05.0)...95host1 # 96host1 # 97server # Booting from ROM...98host1 # Booting from ROM...99server # Probing EDD (edd=off to disable)... ok[ 0.000000] Linux version 6.18.52 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Mon Sep 14 11:36:19 UTC 2026100server # [ 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/8l9v81b9z9smli644yzp9k6bkpl0cbhw-nixos-system-server-test/init regInfo=/nix/store/wkwgnkxvjyw6lv7fs8rw8i0374bqfhq8-closure-info/registration console=ttyS0,115200n8 console=tty0101server # [ 0.000000] BIOS-provided physical RAM map:102server # [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable103server # [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved104host1 # Probing EDD (edd=off to disable)... ok[ 0.000000] Linux version 6.18.52 (nixbld@localhost) (gcc (GCC) 15.3.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT_DYNAMIC Mon Sep 14 11:36:19 UTC 2026105server # [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved106server # [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000007ffd7fff] usable107server # [ 0.000000] BIOS-e820: [mem 0x000000007ffd8000-0x000000007fffffff] reserved108server # [ 0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved109host1 # [ 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/ld8qc26x68vrjd5il0wpal6dkq6ndgd7-nixos-system-host1-test/init regInfo=/nix/store/hri8kx47zf4dpjlfgs875kbiarj2hw1z-closure-info/registration console=ttyS0,115200n8 console=tty0110server # [ 0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved111host1 # [ 0.000000] BIOS-provided physical RAM map:112server # [ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved113host1 # [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable114server # [ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved115host1 # [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved116server # [ 0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved117host1 # [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved118server # [ 0.000000] NX (Execute Disable) protection: active119host1 # [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000007ffd7fff] usable120server # [ 0.000000] APIC: Static calls initialized121server # [ 0.000000] SMBIOS 2.8 present.122host1 # [ 0.000000] BIOS-e820: [mem 0x000000007ffd8000-0x000000007fffffff] reserved123host1 # [ 0.000000] BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved124server # [ 0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/2014125server # [ 0.000000] DMI: Memory slots populated: 1/1126host1 # [ 0.000000] BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved127server # [ 0.000000] Hypervisor detected: KVM128host1 # [ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved129server # [ 0.000000] last_pfn = 0x7ffd8 max_arch_pfn = 0x10000000000130server # [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00131host1 # [ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved132server # [ 0.000000] kvm-clock: using sched offset of 480671156 cycles133host1 # [ 0.000000] BIOS-e820: [mem 0x000000fd00000000-0x000000ffffffffff] reserved134host1 # [ 0.000000] NX (Execute Disable) protection: active135server # [ 0.000002] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns136host1 # [ 0.000000] APIC: Static calls initialized137host1 # [ 0.000000] SMBIOS 2.8 present.138server # [ 0.000005] tsc: Detected 2400.012 MHz processor139server # [ 0.000816] last_pfn = 0x7ffd8 max_arch_pfn = 0x10000000000140host1 # [ 0.000000] DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS rel-1.17.0-0-gb52ca86e094d-prebuilt.qemu.org 04/01/2014141server # [ 0.000843] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs142host1 # [ 0.000000] DMI: Memory slots populated: 1/1143host1 # [ 0.000000] Hypervisor detected: KVM144server # [ 0.000846] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT145host1 # [ 0.000000] last_pfn = 0x7ffd8 max_arch_pfn = 0x10000000000146server # [ 0.002736] found SMP MP-table at [mem 0x000f5450-0x000f545f]147host1 # [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00148server # [ 0.002748] Using GB pages for direct mapping149host1 # [ 0.000000] kvm-clock: using sched offset of 499608023 cycles150server # [ 0.002802] RAMDISK: [mem 0x7e36e000-0x7ffcffff]151server # [ 0.002811] ACPI: Early table checksum verification disabled152host1 # [ 0.000002] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns153server # [ 0.002814] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )154host1 # [ 0.000005] tsc: Detected 2400.012 MHz processor155host1 # [ 0.000813] last_pfn = 0x7ffd8 max_arch_pfn = 0x10000000000156server # [ 0.002818] ACPI: RSDT 0x000000007FFE2422 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)157host1 # [ 0.000840] MTRR map: 4 entries (3 fixed + 1 variable; max 19), built from 8 variable MTRRs158server # [ 0.002822] ACPI: FACP 0x000000007FFE221A 0000F4 (v03 BOCHS BXPC 00000001 BXPC 00000001)159host1 # [ 0.000842] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT160server # [ 0.002829] ACPI: DSDT 0x000000007FFE0040 0021DA (v01 BOCHS BXPC 00000001 BXPC 00000001)161host1 # [ 0.002731] found SMP MP-table at [mem 0x000f5450-0x000f545f]162server # [ 0.002831] ACPI: FACS 0x000000007FFE0000 000040163host1 # [ 0.002742] Using GB pages for direct mapping164host1 # [ 0.002798] RAMDISK: [mem 0x7e370000-0x7ffcffff]165server # [ 0.002833] ACPI: APIC 0x000000007FFE230E 000078 (v03 BOCHS BXPC 00000001 BXPC 00000001)166host1 # [ 0.002807] ACPI: Early table checksum verification disabled167server # [ 0.002834] ACPI: HPET 0x000000007FFE2386 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)168host1 # [ 0.002810] ACPI: RSDP 0x00000000000F5270 000014 (v00 BOCHS )169server # [ 0.002836] ACPI: MCFG 0x000000007FFE23BE 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001)170host1 # [ 0.002814] ACPI: RSDT 0x000000007FFE2422 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)171server # [ 0.002837] ACPI: WAET 0x000000007FFE23FA 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001)172host1 # [ 0.002818] ACPI: FACP 0x000000007FFE221A 0000F4 (v03 BOCHS BXPC 00000001 BXPC 00000001)173server # [ 0.002839] ACPI: Reserving FACP table memory at [mem 0x7ffe221a-0x7ffe230d]174host1 # [ 0.002824] ACPI: DSDT 0x000000007FFE0040 0021DA (v01 BOCHS BXPC 00000001 BXPC 00000001)175server # [ 0.002840] ACPI: Reserving DSDT table memory at [mem 0x7ffe0040-0x7ffe2219]176host1 # [ 0.002826] ACPI: FACS 0x000000007FFE0000 000040177server # [ 0.002840] ACPI: Reserving FACS table memory at [mem 0x7ffe0000-0x7ffe003f]178host1 # [ 0.002828] ACPI: APIC 0x000000007FFE230E 000078 (v03 BOCHS BXPC 00000001 BXPC 00000001)179server # [ 0.002841] ACPI: Reserving APIC table memory at [mem 0x7ffe230e-0x7ffe2385]180host1 # [ 0.002829] ACPI: HPET 0x000000007FFE2386 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001)181server # [ 0.002841] ACPI: Reserving HPET table memory at [mem 0x7ffe2386-0x7ffe23bd]182server # [ 0.002842] ACPI: Reserving MCFG table memory at [mem 0x7ffe23be-0x7ffe23f9]183host1 # [ 0.002831] ACPI: MCFG 0x000000007FFE23BE 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001)184server # [ 0.002842] ACPI: Reserving WAET table memory at [mem 0x7ffe23fa-0x7ffe2421]185host1 # [ 0.002832] ACPI: WAET 0x000000007FFE23FA 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001)186server # [ 0.003087] No NUMA configuration found187host1 # [ 0.002834] ACPI: Reserving FACP table memory at [mem 0x7ffe221a-0x7ffe230d]188server # [ 0.003088] Faking a node at [mem 0x0000000000000000-0x000000007ffd7fff]189host1 # [ 0.002835] ACPI: Reserving DSDT table memory at [mem 0x7ffe0040-0x7ffe2219]190server # [ 0.003090] NODE_DATA(0) allocated [mem 0x7ffd2780-0x7ffd7cff]191server # [ 0.005537] Zone ranges:192host1 # [ 0.002835] ACPI: Reserving FACS table memory at [mem 0x7ffe0000-0x7ffe003f]193server # [ 0.005537] DMA [mem 0x0000000000001000-0x0000000000ffffff]194host1 # [ 0.002836] ACPI: Reserving APIC table memory at [mem 0x7ffe230e-0x7ffe2385]195server # [ 0.005539] DMA32 [mem 0x0000000001000000-0x000000007ffd7fff]196server # [ 0.005540] Normal empty197server # [ 0.005541] Device empty198host1 # [ 0.002836] ACPI: Reserving HPET table memory at [mem 0x7ffe2386-0x7ffe23bd]199server # [ 0.005542] Movable zone start for each node200host1 # [ 0.002837] ACPI: Reserving MCFG table memory at [mem 0x7ffe23be-0x7ffe23f9]201server # [ 0.005542] Early memory node ranges202host1 # [ 0.002837] ACPI: Reserving WAET table memory at [mem 0x7ffe23fa-0x7ffe2421]203server # [ 0.005543] node 0: [mem 0x0000000000001000-0x000000000009efff]204host1 # [ 0.003068] No NUMA configuration found205server # [ 0.005544] node 0: [mem 0x0000000000100000-0x000000007ffd7fff]206host1 # [ 0.003068] Faking a node at [mem 0x0000000000000000-0x000000007ffd7fff]207server # [ 0.005545] Initmem setup node 0 [mem 0x0000000000001000-0x000000007ffd7fff]208host1 # [ 0.003071] NODE_DATA(0) allocated [mem 0x7ffd2780-0x7ffd7cff]209host1 # [ 0.005489] Zone ranges:210server # [ 0.005566] On node 0, zone DMA: 1 pages in unavailable ranges211host1 # [ 0.005490] DMA [mem 0x0000000000001000-0x0000000000ffffff]212server # [ 0.005842] On node 0, zone DMA: 97 pages in unavailable ranges213host1 # [ 0.005492] DMA32 [mem 0x0000000001000000-0x000000007ffd7fff]214server # [ 0.043667] On node 0, zone DMA32: 40 pages in unavailable ranges215host1 # [ 0.005493] Normal empty216server # [ 0.044147] ACPI: PM-Timer IO Port: 0x608217host1 # [ 0.005494] Device empty218server # [ 0.044160] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])219host1 # [ 0.005494] Movable zone start for each node220host1 # [ 0.005495] Early memory node ranges221server # [ 0.044192] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23222host1 # [ 0.005495] node 0: [mem 0x0000000000001000-0x000000000009efff]223server # [ 0.044195] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)224host1 # [ 0.005496] node 0: [mem 0x0000000000100000-0x000000007ffd7fff]225server # [ 0.044197] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)226host1 # [ 0.005497] Initmem setup node 0 [mem 0x0000000000001000-0x000000007ffd7fff]227server # [ 0.044198] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)228host1 # [ 0.005518] On node 0, zone DMA: 1 pages in unavailable ranges229server # [ 0.044199] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)230host1 # [ 0.005803] On node 0, zone DMA: 97 pages in unavailable ranges231server # [ 0.044200] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)232host1 # [ 0.043738] On node 0, zone DMA32: 40 pages in unavailable ranges233host1 # [ 0.044213] ACPI: PM-Timer IO Port: 0x608234server # [ 0.044202] ACPI: Using ACPI (MADT) for SMP configuration information235host1 # [ 0.044227] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])236server # [ 0.044203] ACPI: HPET id: 0x8086a201 base: 0xfed00000237server # [ 0.044208] TSC deadline timer available238host1 # [ 0.044260] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23239server # [ 0.044212] CPU topo: Max. logical packages: 1240host1 # [ 0.044262] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)241server # [ 0.044213] CPU topo: Max. logical dies: 1242server # [ 0.044213] CPU topo: Max. dies per package: 1243host1 # [ 0.044264] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)244server # [ 0.044216] CPU topo: Max. threads per core: 1245host1 # [ 0.044265] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)246server # [ 0.044217] CPU topo: Num. cores per package: 1247server # [ 0.044217] CPU topo: Num. threads per package: 1248host1 # [ 0.044266] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)249server # [ 0.044217] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs250host1 # [ 0.044267] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)251server # [ 0.044238] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()252host1 # [ 0.044270] ACPI: Using ACPI (MADT) for SMP configuration information253host1 # [ 0.044271] ACPI: HPET id: 0x8086a201 base: 0xfed00000254server # [ 0.044270] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]255host1 # [ 0.044275] TSC deadline timer available256host1 # [ 0.044279] CPU topo: Max. logical packages: 1257server # [ 0.044272] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]258host1 # [ 0.044280] CPU topo: Max. logical dies: 1259server # [ 0.044273] [mem 0xc0000000-0xfed1bfff] available for PCI devices260host1 # [ 0.044280] CPU topo: Max. dies per package: 1261server # [ 0.044275] Booting paravirtualized kernel on KVM262host1 # [ 0.044284] CPU topo: Max. threads per core: 1263host1 # [ 0.044284] CPU topo: Num. cores per package: 1264server # [ 0.044278] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns265host1 # [ 0.044285] CPU topo: Num. threads per package: 1266server # [ 0.048776] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1267host1 # [ 0.044285] CPU topo: Allowing 1 present CPUs plus 0 hotplug CPUs268server # [ 0.051073] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152269host1 # [ 0.044308] kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write()270server # [ 0.051125] kvm-guest: PV spinlocks disabled, single CPU271host1 # [ 0.044340] PM: hibernation: Registered nosave memory: [mem 0x00000000-0x00000fff]272host1 # [ 0.044342] PM: hibernation: Registered nosave memory: [mem 0x0009f000-0x000fffff]273host1 # [ 0.044344] [mem 0xc0000000-0xfed1bfff] available for PCI devices274host1 # [ 0.044346] Booting paravirtualized kernel on KVM275host1 # [ 0.044349] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns276server # [ 0.051126] 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/8l9v81b9z9smli644yzp9k6bkpl0cbhw-nixos-system-server-test/init regInfo=/nix/store/wkwgnkxvjyw6lv7fs8rw8i0374bqfhq8-closure-info/registration console=ttyS0,115200n8 console=tty0277host1 # [ 0.048845] setup_percpu: NR_CPUS:384 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1278host1 # [ 0.051416] percpu: Embedded 98 pages/cpu s278528 r8192 d114688 u2097152279server # [ 0.051223] Unknown kernel command line parameters "regInfo=/nix/store/wkwgnkxvjyw6lv7fs8rw8i0374bqfhq8-closure-info/registration", will be passed to user space.280server # [ 0.051235] random: crng init done281host1 # [ 0.051466] kvm-guest: PV spinlocks disabled, single CPU282server # [ 0.051236] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes283server # [ 0.053466] Dentry cache hash table entries: 262144 (order: 9, 2097152 bytes, linear)284server # [ 0.054865] Inode-cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)285server # [ 0.054897] Fallback order for Node 0: 0286host1 # [ 0.051468] 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/ld8qc26x68vrjd5il0wpal6dkq6ndgd7-nixos-system-host1-test/init regInfo=/nix/store/hri8kx47zf4dpjlfgs875kbiarj2hw1z-closure-info/registration console=ttyS0,115200n8 console=tty0287server # [ 0.054900] Built 1 zonelists, mobility grouping on. Total pages: 524150288server # [ 0.054901] Policy zone: DMA32289server # [ 0.057489] mem auto-init: stack:all(zero), heap alloc:on, heap free:off290host1 # [ 0.051567] Unknown kernel command line parameters "regInfo=/nix/store/hri8kx47zf4dpjlfgs875kbiarj2hw1z-closure-info/registration", will be passed to user space.291server # [ 0.061567] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1292host1 # [ 0.051579] random: crng init done293server # [ 0.066274] allocated 4194304 bytes of page_ext294host1 # [ 0.051579] printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes295server # [ 0.076890] ftrace: allocating 48787 entries in 192 pages296server # [ 0.076892] ftrace: allocated 192 pages with 2 groups297host1 # [ 0.053831] Dentry cache hash table entries: 262144 (order: 9, 2097152 bytes, linear)298server # [ 0.077830] Dynamic Preempt: lazy299server # [ 0.077982] rcu: Preemptible hierarchical RCU implementation.300host1 # [ 0.054955] Inode-cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)301host1 # [ 0.054989] Fallback order for Node 0: 0302server # [ 0.077983] rcu: RCU event tracing is enabled.303host1 # [ 0.054992] Built 1 zonelists, mobility grouping on. Total pages: 524150304server # [ 0.077984] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.305host1 # [ 0.054993] Policy zone: DMA32306server # [ 0.077985] Trampoline variant of Tasks RCU enabled.307host1 # [ 0.057556] mem auto-init: stack:all(zero), heap alloc:on, heap free:off308server # [ 0.077985] Rude variant of Tasks RCU enabled.309server # [ 0.077986] Tracing variant of Tasks RCU enabled.310host1 # [ 0.061689] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1311host1 # [ 0.066655] allocated 4194304 bytes of page_ext312server # [ 0.077986] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.313host1 # [ 0.076958] ftrace: allocating 48787 entries in 192 pages314server # [ 0.077987] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1315host1 # [ 0.076960] ftrace: allocated 192 pages with 2 groups316host1 # [ 0.077833] Dynamic Preempt: lazy317server # [ 0.078010] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.318host1 # [ 0.077970] rcu: Preemptible hierarchical RCU implementation.319host1 # [ 0.077970] rcu: RCU event tracing is enabled.320server # [ 0.078012] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.321host1 # [ 0.077971] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.322server # [ 0.078013] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.323host1 # [ 0.077973] Trampoline variant of Tasks RCU enabled.324host1 # [ 0.077973] Rude variant of Tasks RCU enabled.325server # [ 0.082471] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16326host1 # [ 0.077974] Tracing variant of Tasks RCU enabled.327server # [ 0.082758] rcu: srcu_init: Setting srcu_struct sizes based on contention.328host1 # [ 0.077974] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.329server # [ 0.082765] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns330host1 # [ 0.077975] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1331server # [ 0.082876] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)332host1 # [ 0.078027] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.333server # [ 0.086455] Console: colour VGA+ 80x25334server # [ 0.086458] printk: legacy console [tty0] enabled335host1 # [ 0.078029] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.336server # [ 0.116020] printk: legacy console [ttyS0] enabled337host1 # [ 0.078030] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.338server # [ 0.220166] ACPI: Core revision 20250807339host1 # [ 0.082547] NR_IRQS: 24832, nr_irqs: 256, preallocated irqs: 16340host1 # [ 0.082832] rcu: srcu_init: Setting srcu_struct sizes based on contention.341server # [ 0.221088] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns342host1 # [ 0.082840] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns343server # [ 0.222674] APIC: Switch to symmetric I/O mode setup344server # [ 0.223660] x2apic enabled345host1 # [ 0.082953] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)346host1 # [ 0.086506] Console: colour VGA+ 80x25347server # [ 0.224419] APIC: Switched APIC routing to: physical x2apic348host1 # [ 0.086508] printk: legacy console [tty0] enabled349host1 # [ 0.116101] printk: legacy console [ttyS0] enabled350host1 # [ 0.219602] ACPI: Core revision 20250807351server # [ 0.226253] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1352host1 # [ 0.220508] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns353server # [ 0.227230] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x229842dd0bd, max_idle_ns: 440795319571 ns354host1 # [ 0.222031] APIC: Switch to symmetric I/O mode setup355host1 # [ 0.222973] x2apic enabled356server # [ 0.228910] Calibrating delay loop (skipped) preset value.. 4800.02 BogoMIPS (lpj=2400012)357host1 # [ 0.223720] APIC: Switched APIC routing to: physical x2apic358server # [ 0.229996] x86/cpu: User Mode Instruction Prevention (UMIP) activated359server # [ 0.231034] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127360host1 # [ 0.225540] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1361server # [ 0.232650] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0362host1 # [ 0.226526] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x229842dd0bd, max_idle_ns: 440795319571 ns363server # [ 0.233714] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto364host1 # [ 0.228223] Calibrating delay loop (skipped) preset value.. 4800.02 BogoMIPS (lpj=2400012)365server # [ 0.234907] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl366host1 # [ 0.229313] x86/cpu: User Mode Instruction Prevention (UMIP) activated367server # [ 0.236907] Transient Scheduler Attacks: Vulnerable: No microcode368host1 # [ 0.230356] Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127369server # [ 0.237907] Spectre V2 : Mitigation: Enhanced / Automatic IBRS370host1 # [ 0.231911] Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0371server # [ 0.238907] Speculative Return Stack Overflow: Mitigation: Safe RET372host1 # [ 0.232984] mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto373host1 # [ 0.234220] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl374host1 # [ 0.235220] Transient Scheduler Attacks: Vulnerable: No microcode375server # [ 0.239906] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization376host1 # [ 0.236936] Spectre V2 : Mitigation: Enhanced / Automatic IBRS377server # [ 0.241914] Spectre V2 : Enabling IBPB for BPF378host1 # [ 0.237904] Speculative Return Stack Overflow: Mitigation: Safe RET379server # [ 0.243474] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier380server # [ 0.244907] active return thunk: srso_alias_return_thunk381server # [ 0.245928] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'382host1 # [ 0.238220] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization383server # [ 0.246911] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'384host1 # [ 0.240228] Spectre V2 : Enabling IBPB for BPF385server # [ 0.248702] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'386host1 # [ 0.241851] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier387server # [ 0.249729] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'388host1 # [ 0.243220] active return thunk: srso_alias_return_thunk389server # [ 0.250907] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'390host1 # [ 0.244241] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'391server # [ 0.251907] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'392host1 # [ 0.245220] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'393server # [ 0.252907] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'394host1 # [ 0.246219] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'395server # [ 0.253908] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256396host1 # [ 0.247220] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'397server # [ 0.254907] x86/fpu: xstate_offset[5]: 832, xstate_sizes[5]: 64398host1 # [ 0.248220] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'399server # [ 0.256683] x86/fpu: xstate_offset[6]: 896, xstate_sizes[6]: 512400host1 # [ 0.249219] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'401server # [ 0.257698] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024402server # [ 0.258690] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]: 8403host1 # [ 0.250219] x86/fpu: Supporting XSAVE feature 0x200: 'Protection Keys User registers'404host1 # [ 0.252220] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256405server # [ 0.259682] x86/fpu: Enabled xstate features 0x2e7, context size is 2440 bytes, using 'compacted' format.406host1 # [ 0.253220] x86/fpu: xstate_offset[5]: 832, xstate_sizes[5]: 64407host1 # [ 0.254219] x86/fpu: xstate_offset[6]: 896, xstate_sizes[6]: 512408host1 # [ 0.255219] x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024409host1 # [ 0.256219] x86/fpu: xstate_offset[9]: 2432, xstate_sizes[9]: 8410host1 # [ 0.257220] x86/fpu: Enabled xstate features 0x2e7, context size is 2440 bytes, using 'compacted' format.411server # [ 0.296403] Freeing SMP alternatives memory: 44K412server # [ 0.296912] pid_max: default: 32768 minimum: 301413server # [ 0.298012] LSM: initializing lsm=capability,landlock,yama,bpf,ima414server # [ 0.299040] landlock: Up and running.415server # [ 0.299908] Yama: becoming mindful.416server # [ 0.300720] LSM support for eBPF active417host1 # [ 0.294088] Freeing SMP alternatives memory: 44K418server # [ 0.301490] Mount-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)419host1 # [ 0.294794] pid_max: default: 32768 minimum: 301420server # [ 0.301948] Mountpoint-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)421host1 # [ 0.295330] LSM: initializing lsm=capability,landlock,yama,bpf,ima422host1 # [ 0.296331] landlock: Up and running.423host1 # [ 0.297220] Yama: becoming mindful.424server # [ 0.305251] smpboot: CPU0: AMD EPYC 9654 96-Core Processor (family: 0x19, model: 0x11, stepping: 0x1)425host1 # [ 0.298449] LSM support for eBPF active426host1 # [ 0.299339] Mount-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)427server # [ 0.306563] Performance Events: Fam17h+ core perfctr, AMD PMU driver.428server # [ 0.306919] ... version: 2429host1 # [ 0.300268] Mountpoint-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)430server # [ 0.307638] ... bit width: 48431server # [ 0.307909] ... generic counters: 6432server # [ 0.308595] ... generic bitmap: 000000000000003f433server # [ 0.308910] ... fixed-purpose counters: 0434host1 # [ 0.303412] smpboot: CPU0: AMD EPYC 9654 96-Core Processor (family: 0x19, model: 0x11, stepping: 0x1)435server # [ 0.309634] ... fixed-purpose bitmap: 0000000000000000436host1 # [ 0.304839] Performance Events: Fam17h+ core perfctr, AMD PMU driver.437server # [ 0.309909] ... value mask: 0000ffffffffffff438host1 # [ 0.305229] ... version: 2439server # [ 0.310843] ... max period: 00007fffffffffff440host1 # [ 0.305978] ... bit width: 48441server # [ 0.311667] ... global_ctrl mask: 000000000000003f442host1 # [ 0.306222] ... generic counters: 6443server # [ 0.312014] signal: max sigframe size: 3376444host1 # [ 0.306937] ... generic bitmap: 000000000000003f445server # [ 0.312839] rcu: Hierarchical SRCU implementation.446host1 # [ 0.307222] ... fixed-purpose counters: 0447server # [ 0.313505] rcu: Max phase no-delay instances is 400.448host1 # [ 0.307927] ... fixed-purpose bitmap: 0000000000000000449host1 # [ 0.308222] ... value mask: 0000ffffffffffff450host1 # [ 0.309079] ... max period: 00007fffffffffff451host1 # [ 0.309874] ... global_ctrl mask: 000000000000003f452host1 # [ 0.310344] signal: max sigframe size: 3376453host1 # [ 0.311131] rcu: Hierarchical SRCU implementation.454host1 # [ 0.311821] rcu: Max phase no-delay instances is 400.455server # [ 0.318875] smp: Bringing up secondary CPUs ...456server # [ 0.319533] smp: Brought up 1 node, 1 CPU457server # [ 0.319920] smpboot: Total of 1 processors activated (4800.02 BogoMIPS)458server # [ 0.321099] Memory: 1969656K/2096600K available (17247K kernel code, 2727K rwdata, 13616K rodata, 3652K init, 2976K bss, 117512K reserved, 0K cma-reserved)459host1 # [ 0.317089] smp: Bringing up secondary CPUs ...460server # [ 0.322251] devtmpfs: initialized461host1 # [ 0.317777] smp: Brought up 1 node, 1 CPU462server # [ 0.323117] x86/mm: Memory block size: 128MB463host1 # [ 0.318222] smpboot: Total of 1 processors activated (4800.02 BogoMIPS)464server # [ 0.325083] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)465host1 # [ 0.319445] Memory: 1969684K/2096600K available (17247K kernel code, 2727K rwdata, 13616K rodata, 3652K init, 2976K bss, 117504K reserved, 0K cma-reserved)466server # [ 0.325936] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).467host1 # [ 0.320572] devtmpfs: initialized468server # [ 0.327013] pinctrl core: initialized pinctrl subsystem469host1 # [ 0.321374] x86/mm: Memory block size: 128MB470server # [ 0.328090] PM: RTC time: 14:50:17, date: 2026-09-22471host1 # [ 0.323189] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)472host1 # [ 0.324107] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).473host1 # [ 0.325340] pinctrl core: initialized pinctrl subsystem474server # [ 0.332255] NET: Registered PF_NETLINK/PF_ROUTE protocol family475host1 # [ 0.326464] PM: RTC time: 14:50:17, date: 2026-09-22476server # [ 0.333464] DMA: preallocated 256 KiB GFP_KERNEL pool for atomic allocations477server # [ 0.333936] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations478server # [ 0.335222] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations479host1 # [ 0.330526] NET: Registered PF_NETLINK/PF_ROUTE protocol family480server # [ 0.335922] audit: initializing netlink subsys (disabled)481host1 # [ 0.331743] DMA: preallocated 256 KiB GFP_KERNEL pool for atomic allocations482server # [ 0.337106] thermal_sys: Registered thermal governor 'fair_share'483server # [ 0.337109] thermal_sys: Registered thermal governor 'bang_bang'484host1 # [ 0.332248] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations485server # [ 0.337911] thermal_sys: Registered thermal governor 'step_wise'486host1 # [ 0.333517] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations487server # [ 0.338844] thermal_sys: Registered thermal governor 'user_space'488host1 # [ 0.334233] audit: initializing netlink subsys (disabled)489server # [ 0.339635] audit: type=2000 audit(1790088618.333:1): state=initialized audit_enabled=0 res=1490host1 # [ 0.335383] thermal_sys: Registered thermal governor 'fair_share'491server # [ 0.340913] thermal_sys: Registered thermal governor 'power_allocator'492host1 # [ 0.335386] thermal_sys: Registered thermal governor 'bang_bang'493server # [ 0.340929] cpuidle: using governor menu494host1 # [ 0.336223] thermal_sys: Registered thermal governor 'step_wise'495server # [ 0.343134] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5496host1 # [ 0.337154] thermal_sys: Registered thermal governor 'user_space'497server # [ 0.344158] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]498host1 # [ 0.338043] audit: type=2000 audit(1790088618.338:1): state=initialized audit_enabled=0 res=1499server # [ 0.344913] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry500host1 # [ 0.340226] thermal_sys: Registered thermal governor 'power_allocator'501host1 # [ 0.340241] cpuidle: using governor menu502server # [ 0.345922] PCI: Using configuration type 1 for base access503host1 # [ 0.342446] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5504server # [ 0.347023] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.505host1 # [ 0.343463] PCI: ECAM [mem 0xb0000000-0xbfffffff] (base 0xb0000000) for domain 0000 [bus 00-ff]506host1 # [ 0.344226] PCI: ECAM [mem 0xb0000000-0xbfffffff] reserved as E820 entry507host1 # [ 0.345237] PCI: Using configuration type 1 for base access508host1 # [ 0.346351] kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.509server # [ 0.352162] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages510server # [ 0.352910] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page511host1 # [ 0.351311] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages512host1 # [ 0.352224] HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page513server # [ 0.357911] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages514server # [ 0.358910] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page515host1 # [ 0.357223] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages516host1 # [ 0.358222] HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page517server # [ 0.369380] ACPI: Added _OSI(Module Device)518server # [ 0.369911] ACPI: Added _OSI(Processor Device)519server # [ 0.370639] ACPI: Added _OSI(Processor Aggregator Device)520host1 # [ 0.368577] ACPI: Added _OSI(Module Device)521host1 # [ 0.369223] ACPI: Added _OSI(Processor Device)522host1 # [ 0.369948] ACPI: Added _OSI(Processor Aggregator Device)523server # [ 0.379547] ACPI: 1 ACPI AML tables successfully acquired and loaded524host1 # [ 0.378335] ACPI: 1 ACPI AML tables successfully acquired and loaded525server # [ 0.383372] ACPI: Interpreter enabled526server # [ 0.383936] ACPI: PM: (supports S0 S3 S4 S5)527server # [ 0.384644] ACPI: Using IOAPIC for interrupt routing528server # [ 0.384967] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug529host1 # [ 0.382640] ACPI: Interpreter enabled530server # [ 0.385910] PCI: Using E820 reservations for host bridge windows531host1 # [ 0.383239] ACPI: PM: (supports S0 S3 S4 S5)532host1 # [ 0.383949] ACPI: Using IOAPIC for interrupt routing533server # [ 0.389000] ACPI: Enabled 2 GPEs in block 00 to 3F534host1 # [ 0.386295] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug535host1 # [ 0.387223] PCI: Using E820 reservations for host bridge windows536host1 # [ 0.390310] ACPI: Enabled 2 GPEs in block 00 to 3F537server # [ 0.397832] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])538server # [ 0.398661] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]539server # [ 0.400762] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]540server # [ 0.401901] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]541host1 # [ 0.398041] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])542server # [ 0.403109] PCI host bridge to bus 0000:00543host1 # [ 0.398975] acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3]544server # [ 0.403813] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window]545host1 # [ 0.400302] acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR]546server # [ 0.404696] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window]547host1 # [ 0.401345] acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability]548server # [ 0.405706] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]549host1 # [ 0.402590] PCI host bridge to bus 0000:00550server # [ 0.406791] pci_bus 0000:00: root bus resource [mem 0x80000000-0xafffffff window]551host1 # [ 0.403227] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window]552server # [ 0.407814] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]553host1 # [ 0.404222] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window]554server # [ 0.408788] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]555host1 # [ 0.405222] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]556server # [ 0.409819] pci_bus 0000:00: root bus resource [bus 00-ff]557host1 # [ 0.406222] pci_bus 0000:00: root bus resource [mem 0x80000000-0xafffffff window]558server # [ 0.410670] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint559host1 # [ 0.407222] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window]560host1 # [ 0.408228] pci_bus 0000:00: root bus resource [mem 0x100000000-0x8ffffffff window]561server # [ 0.412342] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint562host1 # [ 0.409222] pci_bus 0000:00: root bus resource [bus 00-ff]563host1 # [ 0.410193] pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 conventional PCI endpoint564host1 # [ 0.411686] pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 conventional PCI endpoint565server # [ 0.414981] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]566server # [ 0.415922] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]567server # [ 0.416857] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]568server # [ 0.417846] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]569host1 # [ 0.414311] pci 0000:00:01.0: BAR 0 [mem 0xfd000000-0xfdffffff pref]570host1 # [ 0.415234] pci 0000:00:01.0: BAR 2 [mem 0xfebd0000-0xfebd0fff]571server # [ 0.419655] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint572host1 # [ 0.416157] pci 0000:00:01.0: ROM [mem 0xfebc0000-0xfebcffff pref]573host1 # [ 0.417141] pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]574server # [ 0.422928] pci 0000:00:02.0: BAR 0 [io 0xc100-0xc11f]575host1 # [ 0.418960] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint576server # [ 0.423773] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]577server # [ 0.424698] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]578server # [ 0.425741] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]579host1 # [ 0.422240] pci 0000:00:02.0: BAR 0 [io 0xc100-0xc11f]580host1 # [ 0.423068] pci 0000:00:02.0: BAR 1 [mem 0xfebd1000-0xfebd1fff]581server # [ 0.427246] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint582host1 # [ 0.423955] pci 0000:00:02.0: BAR 4 [mem 0xfe000000-0xfe003fff 64bit pref]583host1 # [ 0.424228] pci 0000:00:02.0: ROM [mem 0xfeb40000-0xfeb7ffff pref]584server # [ 0.429928] pci 0000:00:03.0: BAR 0 [io 0xc120-0xc13f]585host1 # [ 0.425777] pci 0000:00:03.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint586server # [ 0.430766] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]587server # [ 0.431636] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]588host1 # [ 0.427251] pci 0000:00:03.0: BAR 0 [io 0xc120-0xc13f]589server # [ 0.432478] pci 0000:00:04.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint590host1 # [ 0.428106] pci 0000:00:03.0: BAR 1 [mem 0xfebd2000-0xfebd2fff]591host1 # [ 0.428963] pci 0000:00:03.0: BAR 4 [mem 0xfe004000-0xfe007fff 64bit pref]592host1 # [ 0.429792] pci 0000:00:04.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint593server # [ 0.435911] pci 0000:00:04.0: BAR 0 [io 0xc000-0xc07f]594server # [ 0.436738] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]595server # [ 0.437638] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]596host1 # [ 0.432249] pci 0000:00:04.0: BAR 0 [io 0xc000-0xc07f]597host1 # [ 0.433095] pci 0000:00:04.0: BAR 1 [mem 0xfebd3000-0xfebd3fff]598server # [ 0.438499] pci 0000:00:05.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint599host1 # [ 0.433958] pci 0000:00:04.0: BAR 4 [mem 0xfe008000-0xfe00bfff 64bit pref]600host1 # [ 0.434819] pci 0000:00:05.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint601server # [ 0.440919] pci 0000:00:05.0: BAR 0 [io 0xc140-0xc15f]602server # [ 0.441772] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]603host1 # [ 0.437119] pci 0000:00:05.0: BAR 0 [io 0xc140-0xc15f]604host1 # [ 0.437850] pci 0000:00:05.0: BAR 1 [mem 0xfebd4000-0xfebd4fff]605server # [ 0.442672] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]606server # [ 0.443756] pci 0000:00:05.0: ROM [mem 0xfeb80000-0xfebbffff pref]607host1 # [ 0.438244] pci 0000:00:05.0: BAR 4 [mem 0xfe00c000-0xfe00ffff 64bit pref]608host1 # [ 0.439228] pci 0000:00:05.0: ROM [mem 0xfeb80000-0xfebbffff pref]609server # [ 0.445257] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint610host1 # [ 0.440736] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint611server # [ 0.446923] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]612server # [ 0.447888] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]613host1 # [ 0.442256] pci 0000:00:06.0: BAR 1 [mem 0xfebd5000-0xfebd5fff]614host1 # [ 0.443244] pci 0000:00:06.0: BAR 4 [mem 0xfe010000-0xfe013fff 64bit pref]615server # [ 0.449294] pci 0000:00:07.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint616host1 # [ 0.444758] pci 0000:00:07.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint617server # [ 0.451347] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]618host1 # [ 0.446253] pci 0000:00:07.0: BAR 1 [mem 0xfebd6000-0xfebd6fff]619server # [ 0.452677] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]620host1 # [ 0.447244] pci 0000:00:07.0: BAR 4 [mem 0xfe014000-0xfe017fff 64bit pref]621server # [ 0.453559] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint622host1 # [ 0.448828] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint623host1 # [ 0.450236] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]624server # [ 0.454926] pci 0000:00:08.0: BAR 1 [mem 0xfebd7000-0xfebd7fff]625host1 # [ 0.451196] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]626server # [ 0.455868] pci 0000:00:08.0: BAR 4 [mem 0xfe018000-0xfe01bfff 64bit pref]627host1 # [ 0.452617] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint628server # [ 0.457286] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint629host1 # [ 0.454248] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]630server # [ 0.459783] pci 0000:00:09.0: BAR 1 [mem 0xfebd8000-0xfebd8fff]631host1 # [ 0.455244] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]632server # [ 0.460622] pci 0000:00:09.0: BAR 4 [mem 0xfe01c000-0xfe01ffff 64bit pref]633host1 # [ 0.456793] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint634server # [ 0.461472] pci 0000:00:0a.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint635host1 # [ 0.458239] pci 0000:00:0a.0: BAR 0 [io 0xc080-0xc0bf]636host1 # [ 0.459113] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]637server # [ 0.463792] pci 0000:00:0a.0: BAR 0 [io 0xc080-0xc0bf]638server # [ 0.464545] pci 0000:00:0a.0: BAR 1 [mem 0xfebd9000-0xfebd9fff]639host1 # [ 0.459957] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]640server # [ 0.464932] pci 0000:00:0a.0: BAR 4 [mem 0xfe020000-0xfe023fff 64bit pref]641host1 # [ 0.460786] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint642server # [ 0.466477] pci 0000:00:0b.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint643host1 # [ 0.463229] pci 0000:00:0b.0: BAR 0 [io 0xc160-0xc17f]644host1 # [ 0.464078] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]645server # [ 0.468611] pci 0000:00:0b.0: BAR 0 [io 0xc160-0xc17f]646host1 # [ 0.464954] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]647server # [ 0.468918] pci 0000:00:0b.0: BAR 1 [mem 0xfebda000-0xfebdafff]648server # [ 0.469877] pci 0000:00:0b.0: BAR 4 [mem 0xfe024000-0xfe027fff 64bit pref]649host1 # [ 0.465807] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint650host1 # [ 0.466878] pci 0000:00:1d.0: BAR 4 [io 0xc180-0xc19f]651server # [ 0.471385] pci 0000:00:1d.0: [8086:2934] type 00 class 0x0c0300 conventional PCI endpoint652host1 # [ 0.467456] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint653server # [ 0.472800] pci 0000:00:1d.0: BAR 4 [io 0xc180-0xc19f]654host1 # [ 0.468847] pci 0000:00:1d.1: BAR 4 [io 0xc1a0-0xc1bf]655server # [ 0.473748] pci 0000:00:1d.1: [8086:2935] type 00 class 0x0c0300 conventional PCI endpoint656host1 # [ 0.469899] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint657server # [ 0.475797] pci 0000:00:1d.1: BAR 4 [io 0xc1a0-0xc1bf]658host1 # [ 0.471875] pci 0000:00:1d.2: BAR 4 [io 0xc1c0-0xc1df]659server # [ 0.476742] pci 0000:00:1d.2: [8086:2936] type 00 class 0x0c0300 conventional PCI endpoint660server # [ 0.478610] pci 0000:00:1d.2: BAR 4 [io 0xc1c0-0xc1df]661host1 # [ 0.472443] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint662host1 # [ 0.474848] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]663server # [ 0.479148] pci 0000:00:1d.7: [8086:293a] type 00 class 0x0c0320 conventional PCI endpoint664host1 # [ 0.475501] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint665host1 # [ 0.476513] pci 0000:00:1f.0: quirk: [io 0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO666server # [ 0.481725] pci 0000:00:1d.7: BAR 0 [mem 0xfebdb000-0xfebdbfff]667host1 # [ 0.477614] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint668server # [ 0.482927] pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 conventional PCI endpoint669server # [ 0.484200] pci 0000:00:1f.0: quirk: [io 0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO670host1 # [ 0.479251] pci 0000:00:1f.2: BAR 4 [io 0xc1e0-0xc1ff]671host1 # [ 0.480116] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]672server # [ 0.485179] pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 conventional PCI endpoint673host1 # [ 0.481276] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint674server # [ 0.486938] pci 0000:00:1f.2: BAR 4 [io 0xc1e0-0xc1ff]675host1 # [ 0.482959] pci 0000:00:1f.3: BAR 4 [io 0x0700-0x073f]676server # [ 0.487796] pci 0000:00:1f.2: BAR 5 [mem 0xfebdc000-0xfebdcfff]677server # [ 0.488989] pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 conventional PCI endpoint678server # [ 0.490752] pci 0000:00:1f.3: BAR 4 [io 0x0700-0x073f]679host1 # [ 0.486819] ACPI: PCI: Interrupt link LNKA configured for IRQ 10680host1 # [ 0.487331] ACPI: PCI: Interrupt link LNKB configured for IRQ 10681host1 # [ 0.488324] ACPI: PCI: Interrupt link LNKC configured for IRQ 11682host1 # [ 0.489319] ACPI: PCI: Interrupt link LNKD configured for IRQ 11683server # [ 0.494999] ACPI: PCI: Interrupt link LNKA configured for IRQ 10684host1 # [ 0.490319] ACPI: PCI: Interrupt link LNKE configured for IRQ 10685server # [ 0.496020] ACPI: PCI: Interrupt link LNKB configured for IRQ 10686host1 # [ 0.491324] ACPI: PCI: Interrupt link LNKF configured for IRQ 10687server # [ 0.497026] ACPI: PCI: Interrupt link LNKC configured for IRQ 11688host1 # [ 0.492323] ACPI: PCI: Interrupt link LNKG configured for IRQ 11689server # [ 0.498012] ACPI: PCI: Interrupt link LNKD configured for IRQ 11690host1 # [ 0.493320] ACPI: PCI: Interrupt link LNKH configured for IRQ 11691server # [ 0.499009] ACPI: PCI: Interrupt link LNKE configured for IRQ 10692host1 # [ 0.494260] ACPI: PCI: Interrupt link GSIA configured for IRQ 16693server # [ 0.500011] ACPI: PCI: Interrupt link LNKF configured for IRQ 10694host1 # [ 0.495227] ACPI: PCI: Interrupt link GSIB configured for IRQ 17695host1 # [ 0.496241] ACPI: PCI: Interrupt link GSIC configured for IRQ 18696server # [ 0.501018] ACPI: PCI: Interrupt link LNKG configured for IRQ 11697host1 # [ 0.497239] ACPI: PCI: Interrupt link GSID configured for IRQ 19698server # [ 0.502025] ACPI: PCI: Interrupt link LNKH configured for IRQ 11699host1 # [ 0.498200] ACPI: PCI: Interrupt link GSIE configured for IRQ 20700server # [ 0.502966] ACPI: PCI: Interrupt link GSIA configured for IRQ 16701host1 # [ 0.498949] ACPI: PCI: Interrupt link GSIF configured for IRQ 21702server # [ 0.503928] ACPI: PCI: Interrupt link GSIB configured for IRQ 17703server # [ 0.504872] ACPI: PCI: Interrupt link GSIC configured for IRQ 18704server # [ 0.505699] ACPI: PCI: Interrupt link GSID configured for IRQ 19705host1 # [ 0.499237] ACPI: PCI: Interrupt link GSIG configured for IRQ 22706server # [ 0.506610] ACPI: PCI: Interrupt link GSIE configured for IRQ 20707host1 # [ 0.501038] ACPI: PCI: Interrupt link GSIH configured for IRQ 23708host1 # [ 0.503131] iommu: Default domain type: Translated709server # [ 0.506924] ACPI: PCI: Interrupt link GSIF configured for IRQ 21710host1 # [ 0.503818] iommu: DMA domain TLB invalidation policy: lazy mode711server # [ 0.507930] ACPI: PCI: Interrupt link GSIG configured for IRQ 22712host1 # [ 0.504507] ACPI: bus type USB registered713server # [ 0.508928] ACPI: PCI: Interrupt link GSIH configured for IRQ 23714host1 # [ 0.505256] usbcore: registered new interface driver usbfs715host1 # [ 0.506139] usbcore: registered new interface driver hub716server # [ 0.511018] iommu: Default domain type: Translated717host1 # [ 0.506879] usbcore: registered new device driver usb718server # [ 0.511799] iommu: DMA domain TLB invalidation policy: lazy mode719host1 # [ 0.508114] NetLabel: Initializing720server # [ 0.512934] ACPI: bus type USB registered721host1 # [ 0.508642] NetLabel: domain hash size = 128722server # [ 0.513668] usbcore: registered new interface driver usbfs723host1 # [ 0.509222] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO724server # [ 0.514056] usbcore: registered new interface driver hub725host1 # [ 0.510183] NetLabel: unlabeled traffic allowed by default726server # [ 0.514885] usbcore: registered new device driver usb727host1 # [ 0.510909] PCI: Using ACPI for IRQ routing728server # [ 0.516403] NetLabel: Initializing729server # [ 0.516911] NetLabel: domain hash size = 128730server # [ 0.517609] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO731server # [ 0.517950] NetLabel: unlabeled traffic allowed by default732server # [ 0.518837] PCI: Using ACPI for IRQ routing733host1 # [ 0.554327] pci 0000:00:01.0: vgaarb: setting as boot VGA device734host1 # [ 0.555218] pci 0000:00:01.0: vgaarb: bridge control possible735host1 # [ 0.555218] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none736host1 # [ 0.555226] vgaarb: loaded737host1 # [ 0.555953] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0738server # [ 0.562514] pci 0000:00:01.0: vgaarb: setting as boot VGA device739host1 # [ 0.556223] hpet0: 3 comparators, 64-bit 100.000000 MHz counter740server # [ 0.562906] pci 0000:00:01.0: vgaarb: bridge control possible741server # [ 0.562906] pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none742server # [ 0.562915] vgaarb: loaded743server # [ 0.563679] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0744server # [ 0.563912] hpet0: 3 comparators, 64-bit 100.000000 MHz counter745host1 # [ 0.561312] clocksource: Switched to clocksource kvm-clock746server # [ 0.567005] clocksource: Switched to clocksource kvm-clock747host1 # [ 0.564949] VFS: Disk quotas dquot_6.6.0748host1 # [ 0.565662] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)749host1 # [ 0.566986] pnp: PnP ACPI init750server # [ 0.570665] VFS: Disk quotas dquot_6.6.0751host1 # [ 0.567808] ACPI: IRQ 4 override to edge(!), high(!)752server # [ 0.571378] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)753host1 # [ 0.568752] system 00:04: [mem 0xb0000000-0xbfffffff window] has been reserved754server # [ 0.572744] pnp: PnP ACPI init755host1 # [ 0.570254] pnp: PnP ACPI: found 5 devices756server # [ 0.573552] ACPI: IRQ 4 override to edge(!), high(!)757server # [ 0.574488] system 00:04: [mem 0xb0000000-0xbfffffff window] has been reserved758server # [ 0.576017] pnp: PnP ACPI: found 5 devices759host1 # [ 0.577853] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns760host1 # [ 0.579266] clocksource: Switched to clocksource acpi_pm761host1 # [ 0.580195] NET: Registered PF_INET protocol family762server # [ 0.583755] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns763host1 # [ 0.581353] IP idents hash table entries: 32768 (order: 6, 262144 bytes, linear)764server # [ 0.585166] clocksource: Switched to clocksource acpi_pm765server # [ 0.586083] NET: Registered PF_INET protocol family766server # [ 0.587606] IP idents hash table entries: 32768 (order: 6, 262144 bytes, linear)767host1 # [ 0.598581] tcp_listen_portaddr_hash hash table entries: 1024 (order: 2, 16384 bytes, linear)768host1 # [ 0.599994] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)769host1 # [ 0.601265] TCP established hash table entries: 16384 (order: 5, 131072 bytes, linear)770server # [ 0.604473] tcp_listen_portaddr_hash hash table entries: 1024 (order: 2, 16384 bytes, linear)771host1 # [ 0.602589] TCP bind hash table entries: 16384 (order: 7, 524288 bytes, linear)772server # [ 0.605987] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)773host1 # [ 0.603799] TCP: Hash tables configured (established 16384 bind 16384)774server # [ 0.607279] TCP established hash table entries: 16384 (order: 5, 131072 bytes, linear)775host1 # [ 0.604891] MPTCP token hash table entries: 2048 (order: 4, 49152 bytes, linear)776server # [ 0.608576] TCP bind hash table entries: 16384 (order: 7, 524288 bytes, linear)777host1 # [ 0.606107] UDP hash table entries: 1024 (order: 4, 65536 bytes, linear)778server # [ 0.609790] TCP: Hash tables configured (established 16384 bind 16384)779host1 # [ 0.607139] UDP-Lite hash table entries: 1024 (order: 4, 65536 bytes, linear)780server # [ 0.610875] MPTCP token hash table entries: 2048 (order: 4, 49152 bytes, linear)781host1 # [ 0.608329] NET: Registered PF_UNIX/PF_LOCAL protocol family782host1 # [ 0.609260] NET: Registered PF_XDP protocol family783server # [ 0.612110] UDP hash table entries: 1024 (order: 4, 65536 bytes, linear)784host1 # [ 0.610071] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window]785server # [ 0.613180] UDP-Lite hash table entries: 1024 (order: 4, 65536 bytes, linear)786host1 # [ 0.611024] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window]787server # [ 0.614361] NET: Registered PF_UNIX/PF_LOCAL protocol family788host1 # [ 0.611982] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]789server # [ 0.615314] NET: Registered PF_XDP protocol family790host1 # [ 0.613049] pci_bus 0000:00: resource 7 [mem 0x80000000-0xafffffff window]791server # [ 0.616112] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window]792host1 # [ 0.614095] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]793server # [ 0.617078] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window]794server # [ 0.618051] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]795host1 # [ 0.615142] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]796server # [ 0.619132] pci_bus 0000:00: resource 7 [mem 0x80000000-0xafffffff window]797host1 # [ 0.616873] ACPI: \_SB_.GSIA: Enabled at IRQ 16798server # [ 0.620478] pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window]799server # [ 0.621862] pci_bus 0000:00: resource 9 [mem 0x100000000-0x8ffffffff window]800host1 # [ 0.619649] ACPI: \_SB_.GSIB: Enabled at IRQ 17801server # [ 0.623939] ACPI: \_SB_.GSIA: Enabled at IRQ 16802host1 # [ 0.621598] ACPI: \_SB_.GSIC: Enabled at IRQ 18803host1 # [ 0.623594] ACPI: \_SB_.GSID: Enabled at IRQ 19804server # [ 0.626756] ACPI: \_SB_.GSIB: Enabled at IRQ 17805host1 # [ 0.625258] PCI: CLS 0 bytes, default 64806server # [ 0.628790] ACPI: \_SB_.GSIC: Enabled at IRQ 18807host1 # [ 0.626114] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x229842dd0bd, max_idle_ns: 440795319571 ns808host1 # [ 0.627776] Trying to unpack rootfs image as initramfs...809server # [ 0.630853] ACPI: \_SB_.GSID: Enabled at IRQ 19810server # [ 0.632531] PCI: CLS 0 bytes, default 64811server # [ 0.633529] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x229842dd0bd, max_idle_ns: 440795319571 ns812server # [ 0.635333] Trying to unpack rootfs image as initramfs...813host1 # [ 0.672468] Initialise system trusted keyrings814host1 # [ 0.675455] workingset: timestamp_bits=40 max_order=19 bucket_order=0815server # [ 0.683304] Initialise system trusted keyrings816server # [ 0.686365] workingset: timestamp_bits=40 max_order=19 bucket_order=0817host1 # [ 0.696745] Key type asymmetric registered818host1 # [ 0.699412] Asymmetric key parser 'x509' registered819host1 # [ 0.700264] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)820host1 # [ 0.703510] io scheduler mq-deadline registered821host1 # [ 0.704319] io scheduler kyber registered822server # [ 0.710428] Key type asymmetric registered823host1 # [ 0.708067] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled824server # [ 0.711233] Asymmetric key parser 'x509' registered825server # [ 0.712124] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 248)826host1 # [ 0.709323] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A827server # [ 0.715296] io scheduler mq-deadline registered828host1 # [ 0.713177] Linux agpgart interface v0.103829server # [ 0.716083] io scheduler kyber registered830host1 # [ 0.713957] ACPI: bus type drm_connector registered831server # [ 0.718946] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled832host1 # [ 0.716880] usbcore: registered new interface driver usbserial_generic833host1 # [ 0.717992] usbserial: USB Serial support registered for generic834server # [ 0.722459] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A835host1 # [ 0.720435] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.836host1 # [ 0.720435] Please enable it if your BIOS has the CPPC option.837host1 # [ 0.722713] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled838server # [ 0.728036] Linux agpgart interface v0.103839server # [ 0.728847] ACPI: bus type drm_connector registered840host1 # [ 0.728544] drop_monitor: Initializing network drop monitor service841server # [ 0.731725] usbcore: registered new interface driver usbserial_generic842host1 # [ 0.729738] NET: Registered PF_INET6 protocol family843server # [ 0.732878] usbserial: USB Serial support registered for generic844host1 # [ 0.732953] Segment Routing with IPv6845host1 # [ 0.733664] In-situ OAM (IOAM) with IPv6846server # [ 0.737181] amd_pstate: The CPPC feature is supported but currently disabled by the BIOS.847server # [ 0.737181] Please enable it if your BIOS has the CPPC option.848host1 # [ 0.736697] IPI shorthand broadcast: enabled849server # [ 0.739532] amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled850server # [ 0.742350] drop_monitor: Initializing network drop monitor service851server # [ 0.743616] NET: Registered PF_INET6 protocol family852host1 # [ 0.743981] sched_clock: Marking stable (602016444, 141378753)->(812229599, -68834402)853server # [ 0.748677] Segment Routing with IPv6854server # [ 0.749363] In-situ OAM (IOAM) with IPv6855host1 # [ 0.749594] registered taskstats version 1856server # [ 0.752479] IPI shorthand broadcast: enabled857host1 # [ 0.750554] Loading compiled-in X.509 certificates858server # [ 0.760789] sched_clock: Marking stable (618017304, 142140909)->(832567687, -72409474)859server # [ 0.764270] registered taskstats version 1860server # [ 0.765252] Loading compiled-in X.509 certificates861host1 # [ 0.769408] Demotion targets for Node 0: null862host1 # [ 0.770503] Key type .fscrypt registered863host1 # [ 0.771198] Key type fscrypt-provisioning registered864host1 # [ 0.774511] ima: No TPM chip found, activating TPM-bypass!865host1 # [ 0.775520] ima: Allocated hash algorithm: sha1866host1 # [ 0.776356] ima: No architecture policies found867host1 # [ 0.780598] PM: Magic number: 10:943:839868server # [ 0.784178] Demotion targets for Node 0: null869host1 # [ 0.782298] RAS: Correctable Errors collector initialized.870server # [ 0.787218] Key type .fscrypt registered871server # [ 0.787888] Key type fscrypt-provisioning registered872server # [ 0.788854] ima: No TPM chip found, activating TPM-bypass!873server # [ 0.791178] ima: Allocated hash algorithm: sha1874server # [ 0.791984] ima: No architecture policies found875host1 # [ 0.790150] clk: Disabling unused clocks876server # [ 0.794173] PM: Magic number: 10:943:839877server # [ 0.795923] RAS: Correctable Errors collector initialized.878host1 # [ 0.794430] PM: genpd: Disabling unused power domains879server # [ 0.806952] clk: Disabling unused clocks880server # [ 0.809189] PM: genpd: Disabling unused power domains881host1 # [ 0.982890] Freeing initrd memory: 29056K882host1 # [ 0.986362] Freeing unused decrypted memory: 2028K883host1 # [ 0.989334] Freeing unused kernel image (initmem) memory: 3652K884host1 # [ 0.990450] Write protecting the kernel read-only data: 32768k885host1 # [ 0.992424] Freeing unused kernel image (text/rodata gap) memory: 1184K886host1 # [ 0.993962] Freeing unused kernel image (rodata/data gap) memory: 720K887server # [ 1.002232] Freeing initrd memory: 29064K888server # [ 1.005510] Freeing unused decrypted memory: 2028K889server # [ 1.008432] Freeing unused kernel image (initmem) memory: 3652K890server # [ 1.009574] Write protecting the kernel read-only data: 32768k891server # [ 1.011576] Freeing unused kernel image (text/rodata gap) memory: 1184K892server # [ 1.013189] Freeing unused kernel image (rodata/data gap) memory: 720K893host1 # [ 1.045063] x86/mm: Checked W+X mappings: passed, no W+X pages found.894host1 # [ 1.046144] Run /init as init process895host1 # [ 1.058246] systemd[1]: Inserted module 'autofs4'896server # [ 1.064029] x86/mm: Checked W+X mappings: passed, no W+X pages found.897server # [ 1.065096] Run /init as init process898server # [ 1.076543] systemd[1]: Inserted module 'autofs4'899host1 # [ 1.078616] fuse: init (API version 7.45)900host1 # [ 1.086095] ACPI: \_SB_.GSIG: Enabled at IRQ 22901host1 # [ 1.088605] ACPI: \_SB_.GSIH: Enabled at IRQ 23902host1 # [ 1.091773] ACPI: \_SB_.GSIE: Enabled at IRQ 20903host1 # [ 1.093686] ACPI: \_SB_.GSIF: Enabled at IRQ 21904server # [ 1.096725] fuse: init (API version 7.45)905host1 # [ 1.099037] virtiofs virtio5: discovered new tag: nix-store906host1 # [ 1.100598] virtiofs virtio5: virtio_fs_setup_dax: No cache capability907server # [ 1.104257] ACPI: \_SB_.GSIG: Enabled at IRQ 22908server # [ 1.107365] ACPI: \_SB_.GSIH: Enabled at IRQ 23909host1 # [ 1.107649] virtiofs virtio6: discovered new tag: shared910server # [ 1.110742] ACPI: \_SB_.GSIE: Enabled at IRQ 20911host1 # [ 1.109348] virtiofs virtio6: virtio_fs_setup_dax: No cache capability912server # [ 1.112896] ACPI: \_SB_.GSIF: Enabled at IRQ 21913host1 # [ 1.112531] virtiofs virtio7: discovered new tag: xchg914host1 # [ 1.114050] virtiofs virtio7: virtio_fs_setup_dax: No cache capability915server # [ 1.119039] virtiofs virtio5: discovered new tag: nix-store916server # [ 1.120597] virtiofs virtio5: virtio_fs_setup_dax: No cache capability917server # [ 1.127815] virtiofs virtio6: discovered new tag: shared918server # [ 1.129366] virtiofs virtio6: virtio_fs_setup_dax: No cache capability919server # [ 1.132795] virtiofs virtio7: discovered new tag: xchg920server # [ 1.134357] virtiofs virtio7: virtio_fs_setup_dax: No cache capability921host1 # [ 1.134422] systemd[1]: Successfully made /usr/ read-only.922server # [ 1.157166] systemd[1]: Successfully made /usr/ read-only.923host1 # [ 1.471108] 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)924host1 # [ 1.483101] systemd[1]: Detected virtualization kvm.925host1 # [ 1.485288] systemd[1]: Detected architecture x86-64.926host1 # [ 1.487452] systemd[1]: Running in initrd.927host1 # [ 1.489968] systemd[1]: Initializing machine ID from random generator.928server # [ 1.492684] 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)929host1 # [ 1.492988] systemd[1]: Hostname set to <host1>.930server # [ 1.497453] systemd[1]: Detected virtualization kvm.931server # [ 1.498296] systemd[1]: Detected architecture x86-64.932server # [ 1.499102] systemd[1]: Running in initrd.933server # [ 1.500164] systemd[1]: Initializing machine ID from random generator.934server # [ 1.501334] systemd[1]: Hostname set to <server>.935server # [ 1.691634] systemd[1]: bpf-restrict-fs: LSM BPF program attached936host1 # [ 1.721495] systemd[1]: bpf-restrict-fs: LSM BPF program attached937server # [ 1.730011] systemd[1]: Queued start job for default target Initrd Default Target.938server # [ 1.734443] systemd[1]: Created slice Slice /system/modprobe.939server # [ 1.735657] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.940server # [ 1.737119] systemd[1]: Expecting device /dev/disk/by-label/nixos...941server # [ 1.738318] systemd[1]: Reached target Path Units.942server # [ 1.739224] systemd[1]: Reached target Slice Units.943server # [ 1.740161] systemd[1]: Reached target Swaps.944server # [ 1.740960] systemd[1]: Reached target Timer Units.945server # [ 1.741987] systemd[1]: Listening on D-Bus System Message Bus Socket.946server # [ 1.743279] systemd[1]: Listening on Journal Socket (/dev/log).947server # [ 1.744505] systemd[1]: Listening on Journal Sockets.948server # [ 1.745559] systemd[1]: Listening on udev Control Socket.949server # [ 1.746640] systemd[1]: Listening on udev Kernel Socket.950server # [ 1.747641] systemd[1]: Reached target Socket Units.951server # [ 1.749552] systemd[1]: Starting Create List of Static Device Nodes...952server # [ 1.754227] systemd[1]: Starting Load Kernel Module configfs...953server # [ 1.761275] systemd[1]: Starting Journal Service...954host1 # [ 1.776869] systemd[1]: Queued start job for default target Initrd Default Target.955host1 # [ 1.780785] systemd[1]: Created slice Slice /system/modprobe.956host1 # [ 1.781967] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.957server # [ 1.785410] systemd[1]: Starting Load Kernel Modules...958host1 # [ 1.783339] systemd[1]: Expecting device /dev/disk/by-label/nixos...959host1 # [ 1.784511] systemd[1]: Reached target Path Units.960host1 # [ 1.785406] systemd[1]: Reached target Slice Units.961host1 # [ 1.786224] systemd[1]: Reached target Swaps.962host1 # [ 1.787000] systemd[1]: Reached target Timer Units.963host1 # [ 1.787970] systemd[1]: Listening on D-Bus System Message Bus Socket.964host1 # [ 1.789153] systemd[1]: Listening on Journal Socket (/dev/log).965server # [ 1.792249] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os966host1 # [ 1.790293] systemd[1]: Listening on Journal Sockets.967host1 # [ 1.791248] systemd[1]: Listening on udev Control Socket.968host1 # [ 1.792224] systemd[1]: Listening on udev Kernel Socket.969host1 # [ 1.793136] systemd[1]: Reached target Socket Units.970server # [ 1.797221] systemd[1]: Starting Coldplug All udev Devices...971host1 # [ 1.794998] systemd[1]: Starting Create List of Static Device Nodes...972host1 # [ 1.799458] systemd[1]: Starting Load Kernel Module configfs...973server # [ 1.811513] systemd-journald[66]: Collecting audit messages is disabled.974server # [ 1.812770] systemd[1]: Finished Create List of Static Device Nodes.975server # [ 1.816784] systemd[1]: modprobe@configfs.service: Deactivated successfully.976host1 # [ 1.807468] systemd[1]: Starting Journal Service...977server # [ 1.825720] systemd[1]: Finished Load Kernel Module configfs.978server # [ 1.831600] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config979host1 # [ 1.833188] systemd[1]: Starting Load Kernel Modules...980host1 # [ 1.834169] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os981server # [ 1.843240] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...982host1 # [ 1.845597] systemd[1]: Starting Coldplug All udev Devices...983server # [ 1.852126] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.984host1 # [ 1.857181] systemd-journald[66]: Collecting audit messages is disabled.985server # [ 1.861315] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev986host1 # [ 1.859564] systemd[1]: Finished Create List of Static Device Nodes.987host1 # [ 1.867072] systemd[1]: modprobe@configfs.service: Deactivated successfully.988host1 # [ 1.872821] systemd[1]: Finished Load Kernel Module configfs.989host1 # [ 1.878844] systemd[1]: Kernel Configuration File System skipped, unmet condition check ConditionPathExists=/sys/kernel/config990server # [ 1.884724] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.991server # [ 1.894352] systemd[1]: Starting Create Static Device Nodes in /dev...992host1 # [ 1.891527] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...993server # [ 1.908275] systemd[1]: Finished Load Kernel Modules.994host1 # [ 1.905473] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.995host1 # [ 1.912508] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev996server # [ 1.916346] systemd[1]: Starting Apply Kernel Variables...997server # [ 1.935296] systemd[1]: Started Journal Service.998server # [ 1.794135] systemd-modules-load[67]: Inserted module 'dm_mod'999server # [ 1.797322] systemd-modules-load[67]: Inserted module 'virtio_balloon'1000server # [ 1.798407] systemd-modules-load[67]: Inserted module 'virtio_gpu'1001host1 # [ 1.941496] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1002server # [ 1.804954] systemd[1]: Finished Create Static Device Nodes in /dev.1003host1 # [ 1.950160] systemd[1]: Starting Create Static Device Nodes in /dev...1004server # [ 1.811732] systemd[1]: Finished Apply Kernel Variables.1005server # [ 1.814993] systemd[1]: Reached target Preparation for Local File Systems.1006server # [ 1.815938] systemd[1]: Reached target Local File Systems.1007server # [ 1.819131] systemd[1]: Starting Create System Files and Directories...1008host1 # [ 1.962001] systemd[1]: Finished Load Kernel Modules.1009server # [ 1.826346] systemd[1]: Starting Rule-based Manager for Device Events and Files...1010host1 # [ 1.974732] systemd[1]: Starting Apply Kernel Variables...1011host1 # [ 1.837331] systemd-modules-load[67]: Inserted module 'dm_mod'1012host1 # [ 1.839413] systemd-modules-load[67]: Inserted module 'virtio_balloon'1013host1 # [ 1.981925] systemd[1]: Started Journal Service.1014host1 # [ 1.843359] systemd-modules-load[67]: Inserted module 'virtio_gpu'1015server # [ 1.850550] systemd[1]: Finished Create System Files and Directories.1016host1 # [ 1.860706] systemd[1]: Finished Create Static Device Nodes in /dev.1017host1 # [ 1.862099] systemd[1]: Reached target Preparation for Local File Systems.1018host1 # [ 1.865880] systemd[1]: Reached target Local File Systems.1019host1 # [ 1.869111] systemd[1]: Starting Create System Files and Directories...1020server # [ 1.872354] systemd-udevd[81]: Using default interface naming scheme 'v261'.1021host1 # [ 1.874141] systemd[1]: Starting Rule-based Manager for Device Events and Files...1022host1 # [ 1.882190] systemd[1]: Finished Apply Kernel Variables.1023server # [ 1.896348] systemd[1]: Started Rule-based Manager for Device Events and Files.1024host1 # [ 1.906080] systemd[1]: Finished Create System Files and Directories.1025host1 # [ 1.929390] systemd-udevd[81]: Using default interface naming scheme 'v261'.1026server # [ 1.952710] systemd[1]: Finished Coldplug All udev Devices.1027server # [ 1.953659] systemd[1]: Reached target System Initialization.1028server # [ 1.955156] systemd[1]: Reached target Basic System.1029host1 # [ 1.954423] systemd[1]: Started Rule-based Manager for Device Events and Files.1030host1 # [ 2.007772] systemd[1]: Finished Coldplug All udev Devices.1031host1 # [ 2.008729] systemd[1]: Reached target System Initialization.1032host1 # [ 2.009576] systemd[1]: Reached target Basic System.1033server # [ 2.304945] virtio_blk virtio2: 1/0/0 default/read/poll queues1034server # [ 2.321839] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1035server # [ 2.346560] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,121036server # [ 2.350948] ehci-pci 0000:00:1d.7: EHCI Host Controller1037server # [ 2.351883] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 11038host1 # [ 2.349541] virtio_blk virtio2: 1/0/0 default/read/poll queues1039server # [ 2.353753] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb0001040server # [ 2.362181] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.001041server # [ 2.363041] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.181042server # [ 2.364126] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=11043server # [ 2.365585] usb usb1: Product: EHCI Host Controller1044server # [ 2.366855] usb usb1: Manufacturer: Linux 6.18.52 ehci_hcd1045server # [ 2.368847] serio: i8042 KBD port at 0x60,0x64 irq 11046server # [ 2.369737] usb usb1: SerialNumber: 0000:00:1d.71047host1 # [ 2.366711] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1048server # [ 2.370660] hub 1-0:1.0: USB hub found1049server # [ 2.371884] hub 1-0:1.0: 6 ports detected1050server # [ 2.377351] uhci_hcd 0000:00:1d.0: UHCI Host Controller1051server # [ 2.378065] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 21052host1 # [ 2.375869] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,121053host1 # [ 2.381533] ehci-pci 0000:00:1d.7: EHCI Host Controller1054host1 # [ 2.382437] ehci-pci 0000:00:1d.7: new USB bus registered, assigned bus number 11055host1 # [ 2.383676] ehci-pci 0000:00:1d.7: irq 19, io mem 0xfebdb0001056server # [ 2.247085] systemd[1]: Starting Virtual Console Setup...1057server # [ 2.391323] serio: i8042 AUX port at 0x60,0x64 irq 121058host1 # [ 2.390410] ehci-pci 0000:00:1d.7: USB 2.0 started, EHCI 1.001059host1 # [ 2.391309] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.181060server # [ 2.395305] uhci_hcd 0000:00:1d.0: detected 2 ports1061server # [ 2.396069] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c1801062host1 # [ 2.393400] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=11063host1 # [ 2.395765] usb usb1: Product: EHCI Host Controller1064host1 # [ 2.398617] usb usb1: Manufacturer: Linux 6.18.52 ehci_hcd1065host1 # [ 2.399526] usb usb1: SerialNumber: 0000:00:1d.71066host1 # [ 2.401441] hub 1-0:1.0: USB hub found1067host1 # [ 2.402691] hub 1-0:1.0: 6 ports detected1068host1 # [ 2.406311] serio: i8042 KBD port at 0x60,0x64 irq 11069host1 # [ 2.407062] serio: i8042 AUX port at 0x60,0x64 irq 121070server # [ 2.419612] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181071server # [ 2.280279] systemd-vconsole-setup[102]: Configuration of first virtual console was skipped, ignoring remaining ones.1072server # [ 2.286470] (udev-worker)[87]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1073server # [ 2.288959] (udev-worker)[87]: Network interface NamePolicy= disabled on kernel command line.1074server # [ 2.433166] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=11075server # [ 2.292619] (udev-worker)[84]: Network interface NamePolicy= disabled on kernel command line.1076host1 # [ 2.434498] uhci_hcd 0000:00:1d.0: UHCI Host Controller1077server # [ 2.295919] systemd[1]: Finished Virtual Console Setup.1078host1 # [ 2.435264] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 21079server # [ 2.447445] usb usb2: Product: UHCI Host Controller1080host1 # [ 2.447288] uhci_hcd 0000:00:1d.0: detected 2 ports1081server # [ 2.450559] SCSI subsystem initialized1082host1 # [ 2.448354] uhci_hcd 0000:00:1d.0: irq 16, io port 0x0000c1801083server # [ 2.454255] usb usb2: Manufacturer: Linux 6.18.52 uhci_hcd1084server # [ 2.454979] usb usb2: SerialNumber: 0000:00:1d.01085host1 # [ 2.312584] systemd[1]: Starting Virtual Console Setup...1086server # [ 2.460632] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input01087server # [ 2.464406] hub 2-0:1.0: USB hub found1088host1 # [ 2.461464] usb usb2: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181089host1 # [ 2.462812] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=11090server # [ 2.467165] hub 2-0:1.0: 2 ports detected1091host1 # [ 2.472522] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input01092server # [ 2.334058] systemd[1]: Found device /dev/disk/by-label/nixos.1093server # [ 2.335062] systemd[1]: Reached target Initrd Root Device.1094server # [ 2.336442] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1095server # [ 2.485162] uhci_hcd 0000:00:1d.1: UHCI Host Controller1096server # [ 2.485906] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 31097host1 # [ 2.344580] (udev-worker)[96]: Network interface NamePolicy= disabled on kernel command line.1098server # [ 2.489228] uhci_hcd 0000:00:1d.1: detected 2 ports1099server # [ 2.490109] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c1a01100host1 # [ 2.348742] systemd-vconsole-setup[103]: Configuration of first virtual console was skipped, ignoring remaining ones.1101host1 # [ 2.352470] systemd[1]: Finished Virtual Console Setup.1102server # [ 2.497273] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181103server # [ 2.498429] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=11104host1 # [ 2.353760] (udev-worker)[98]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1105host1 # [ 2.359362] (udev-worker)[98]: Network interface NamePolicy= disabled on kernel command line.1106server # [ 2.505197] usb usb3: Product: UHCI Host Controller1107server # [ 2.505944] usb usb3: Manufacturer: Linux 6.18.52 uhci_hcd1108host1 # [ 2.503423] usb usb2: Product: UHCI Host Controller1109host1 # [ 2.504141] usb usb2: Manufacturer: Linux 6.18.52 uhci_hcd1110server # [ 2.508181] usb usb3: SerialNumber: 0000:00:1d.11111server # [ 2.510816] hub 3-0:1.0: USB hub found1112server # [ 2.512199] hub 3-0:1.0: 2 ports detected1113host1 # [ 2.514170] usb usb2: SerialNumber: 0000:00:1d.01114server # [ 2.377861] systemd-fsck[109]: nixos: clean, 12/65536 files, 13019/262144 blocks1115server # [ 2.522201] uhci_hcd 0000:00:1d.2: UHCI Host Controller1116host1 # [ 2.520144] hub 2-0:1.0: USB hub found1117server # [ 2.523007] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 41118host1 # [ 2.523401] hub 2-0:1.0: 2 ports detected1119server # [ 2.385685] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1120host1 # [ 2.526188] SCSI subsystem initialized1121host1 # [ 2.386306] systemd[1]: Found device /dev/disk/by-label/nixos.1122server # [ 2.531213] uhci_hcd 0000:00:1d.2: detected 2 ports1123host1 # [ 2.387689] systemd[1]: Reached target Initrd Root Device.1124server # [ 2.532007] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c1c01125host1 # [ 2.390405] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1126server # [ 2.535428] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181127server # [ 2.538325] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=11128host1 # [ 2.536156] uhci_hcd 0000:00:1d.1: UHCI Host Controller1129host1 # [ 2.536905] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 31130server # [ 2.544124] usb usb4: Product: UHCI Host Controller1131server # [ 2.548320] usb usb4: Manufacturer: Linux 6.18.52 uhci_hcd1132host1 # [ 2.545784] uhci_hcd 0000:00:1d.1: detected 2 ports1133server # [ 2.549802] usb usb4: SerialNumber: 0000:00:1d.21134server # [ 2.552832] hub 4-0:1.0: USB hub found1135server # [ 2.554209] hub 4-0:1.0: 2 ports detected1136host1 # [ 2.552512] uhci_hcd 0000:00:1d.1: irq 17, io port 0x0000c1a01137host1 # [ 2.554719] usb usb3: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181138host1 # [ 2.557423] usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=11139host1 # [ 2.560432] usb usb3: Product: UHCI Host Controller1140host1 # [ 2.561187] usb usb3: Manufacturer: Linux 6.18.52 uhci_hcd1141host1 # [ 2.563423] usb usb3: SerialNumber: 0000:00:1d.11142server # [ 2.566661] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode1143host1 # [ 2.565830] hub 3-0:1.0: USB hub found1144host1 # [ 2.567678] hub 3-0:1.0: 2 ports detected1145host1 # [ 2.431837] systemd-fsck[110]: nixos: clean, 12/65536 files, 13019/262144 blocks1146host1 # [ 2.575902] uhci_hcd 0000:00:1d.2: UHCI Host Controller1147server # [ 2.580066] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)1148server # [ 2.580958] ahci 0000:00:1f.2: flags: 64bit ncq only1149host1 # [ 2.437356] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1150host1 # [ 2.582467] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 41151host1 # [ 2.585570] uhci_hcd 0000:00:1d.2: detected 2 ports1152server # [ 2.590250] scsi host0: ahci1153server # [ 2.591513] scsi host1: ahci1154host1 # [ 2.588612] uhci_hcd 0000:00:1d.2: irq 18, io port 0x0000c1c01155server # [ 2.594046] scsi host2: ahci1156host1 # [ 2.591652] usb usb4: New USB device found, idVendor=1d6b, idProduct=0001, bcdDevice= 6.181157server # [ 2.595797] scsi host3: ahci1158server # [ 2.597698] scsi host4: ahci1159host1 # [ 2.594430] usb usb4: New USB device strings: Mfr=3, Product=2, SerialNumber=11160server # [ 2.599480] scsi host5: ahci1161server # [ 2.601027] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 47 lpm-pol 11162host1 # [ 2.598896] usb usb4: Product: UHCI Host Controller1163server # [ 2.602448] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 47 lpm-pol 11164server # [ 2.603740] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 47 lpm-pol 11165server # [ 2.604933] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 47 lpm-pol 11166server # [ 2.606078] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 47 lpm-pol 11167server # [ 2.607226] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 47 lpm-pol 11168host1 # [ 2.604674] usb usb4: Manufacturer: Linux 6.18.52 uhci_hcd1169host1 # [ 2.605486] usb usb4: SerialNumber: 0000:00:1d.21170server # [ 2.609176] usb 1-1: new high-speed USB device number 2 using ehci-pci1171host1 # [ 2.607356] hub 4-0:1.0: USB hub found1172host1 # [ 2.609998] hub 4-0:1.0: 2 ports detected1173host1 # [ 2.634548] ahci 0000:00:1f.2: AHCI vers 0001.0000, 32 command slots, 1.5 Gbps, SATA mode1174host1 # [ 2.640419] usb 1-1: new high-speed USB device number 2 using ehci-pci1175host1 # [ 2.642448] ahci 0000:00:1f.2: 6/6 ports implemented (port mask 0x3f)1176host1 # [ 2.643297] ahci 0000:00:1f.2: flags: 64bit ncq only1177host1 # [ 2.647460] scsi host0: ahci1178host1 # [ 2.648930] scsi host1: ahci1179host1 # [ 2.651065] scsi host2: ahci1180host1 # [ 2.652831] scsi host3: ahci1181host1 # [ 2.654439] scsi host4: ahci1182host1 # [ 2.656000] scsi host5: ahci1183host1 # [ 2.657164] ata1: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc100 irq 47 lpm-pol 11184host1 # [ 2.659028] ata2: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc180 irq 47 lpm-pol 11185host1 # [ 2.660222] ata3: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc200 irq 47 lpm-pol 11186host1 # [ 2.661404] ata4: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc280 irq 47 lpm-pol 11187host1 # [ 2.662559] ata5: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc300 irq 47 lpm-pol 11188host1 # [ 2.663794] ata6: SATA max UDMA/133 abar m4096@0xfebdc000 port 0xfebdc380 irq 47 lpm-pol 11189server # [ 2.739185] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.001190server # [ 2.740367] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=101191server # [ 2.741683] usb 1-1: Product: QEMU USB Tablet1192server # [ 2.742393] usb 1-1: Manufacturer: QEMU1193server # [ 2.742935] usb 1-1: SerialNumber: 28754-0000:00:1d.7-11194server # [ 2.757066] hid: raw HID events driver (C) Jiri Kosina1195host1 # [ 2.770835] usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.001196host1 # [ 2.773650] usb 1-1: New USB device strings: Mfr=1, Product=3, SerialNumber=101197host1 # [ 2.776913] usb 1-1: Product: QEMU USB Tablet1198host1 # [ 2.778796] usb 1-1: Manufacturer: QEMU1199host1 # [ 2.780448] usb 1-1: SerialNumber: 28754-0000:00:1d.7-11200server # [ 2.665858] systemd[1]: Mounting /sysroot...1201host1 # [ 2.812124] hid: raw HID events driver (C) Jiri Kosina1202host1 # [ 2.714167] systemd[1]: Mounting /sysroot...1203server # [ 2.920569] ata5: SATA link down (SStatus 0 SControl 300)1204server # [ 2.921503] ata2: SATA link down (SStatus 0 SControl 300)1205server # [ 2.922580] ata4: SATA link down (SStatus 0 SControl 300)1206server # [ 2.923636] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)1207server # [ 2.924676] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/1001208server # [ 2.925525] ata3.00: applying bridge limits1209server # [ 2.926304] ata1: SATA link down (SStatus 0 SControl 300)1210server # [ 2.927171] ata6: SATA link down (SStatus 0 SControl 300)1211server # [ 2.928037] ata3.00: configured for UDMA/1001212server # [ 2.929022] scsi 2:0:0:0: CD-ROM QEMU QEMU DVD-ROM 2.5+ PQ: 0 ANSI: 51213host1 # [ 2.975251] ata5: SATA link down (SStatus 0 SControl 300)1214host1 # [ 2.977511] ata2: SATA link down (SStatus 0 SControl 300)1215host1 # [ 2.980060] ata6: SATA link down (SStatus 0 SControl 300)1216host1 # [ 2.982251] ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300)1217server # [ 2.987392] usbcore: registered new interface driver usbhid1218server # [ 2.988170] usbhid: USB HID core driver1219host1 # [ 2.984877] ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/1001220host1 # [ 2.986980] ata3.00: applying bridge limits1221host1 # [ 2.989071] ata4: SATA link down (SStatus 0 SControl 300)1222host1 # [ 2.991344] ata1: SATA link down (SStatus 0 SControl 300)1223host1 # [ 2.993696] ata3.00: configured for UDMA/1001224host1 # [ 2.996143] scsi 2:0:0:0: CD-ROM QEMU QEMU DVD-ROM 2.5+ PQ: 0 ANSI: 51225server # [ 3.008794] 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/input21226server # [ 3.010581] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input01227server # [ 3.017268] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray1228server # [ 3.034351] cdrom: Uniform CD-ROM driver Revision: 3.201229server # [ 3.047192] EXT4-fs (vda): mounted filesystem 0397a20c-8409-48d9-9908-9a1787a4ee19 r/w with ordered data mode. Quota mode: none.1230server # [ 2.909596] systemd[1]: Mounted /sysroot.1231server # [ 2.911170] systemd[1]: Reached target Initrd Root File System.1232server # [ 2.913107] systemd[1]: Starting Mountpoints Configured in the Real Root...1233host1 # [ 3.063623] usbcore: registered new interface driver usbhid1234host1 # [ 3.067140] usbhid: USB HID core driver1235server # [ 2.927400] systemd-sysroot-fstab-check[144]: /sysroot should be mounted in the initrd, will request daemon-reload.1236server # [ 2.933062] systemd[1]: Reload requested from client PID 144 ('systemd-sysroot') (unit initrd-parse-etc.service)...1237server # [ 2.934483] systemd[1]: Reloading...1238host1 # [ 3.077561] sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray1239host1 # [ 3.091599] 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/input21240host1 # [ 3.093484] cdrom: Uniform CD-ROM driver Revision: 3.201241host1 # [ 3.096451] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:1d.7-1/input01242host1 # [ 3.106464] EXT4-fs (vda): mounted filesystem ac1b9174-ddd3-4121-826f-5af554c97e16 r/w with ordered data mode. Quota mode: none.1243host1 # [ 2.970855] systemd[1]: Mounted /sysroot.1244host1 # [ 2.972747] systemd[1]: Reached target Initrd Root File System.1245host1 # [ 2.976476] systemd[1]: Starting Mountpoints Configured in the Real Root...1246host1 # [ 2.995958] systemd-sysroot-fstab-check[141]: /sysroot should be mounted in the initrd, will request daemon-reload.1247host1 # [ 3.002072] systemd[1]: Reload requested from client PID 141 ('systemd-sysroot') (unit initrd-parse-etc.service)...1248host1 # [ 3.003473] systemd[1]: Reloading...1249server # [ 3.015479] systemd[1]: Reloading finished in 82 ms.1250server # [ 3.024182] systemd-sysroot-fstab-check[144]: Requesting initrd-fs.target/start/replace...1251server # [ 3.028205] systemd-sysroot-fstab-check[144]: Requesting swap.target/start/replace...1252server # [ 3.031764] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1253server # [ 3.033157] systemd[1]: Finished Mountpoints Configured in the Real Root.1254server # [ 3.034175] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1255host1 # [ 3.081887] systemd[1]: Reloading finished in 80 ms.1256host1 # [ 3.089879] systemd-sysroot-fstab-check[141]: Requesting initrd-fs.target/start/replace...1257host1 # [ 3.094159] systemd-sysroot-fstab-check[141]: Requesting swap.target/start/replace...1258host1 # [ 3.098642] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1259host1 # [ 3.100056] systemd[1]: Finished Mountpoints Configured in the Real Root.1260host1 # [ 3.101089] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1261server # [ 3.668166] systemd[1]: Mounting /sysroot/nix/.ro-store...1262server # [ 3.674171] systemd[1]: Mounting /sysroot/nix/.rw-store...1263server # [ 3.681181] systemd[1]: Mounting /sysroot/run...1264server # [ 3.691313] systemd[1]: Mounting /sysroot/tmp/shared...1265server # [ 3.705143] systemd[1]: Mounting /sysroot/tmp/xchg...1266host1 # [ 3.716143] systemd[1]: Mounting /sysroot/nix/.ro-store...1267host1 # [ 3.719675] systemd[1]: Mounting /sysroot/nix/.rw-store...1268host1 # [ 3.727140] systemd[1]: Mounting /sysroot/run...1269host1 # [ 3.735252] systemd[1]: Mounting /sysroot/tmp/shared...1270server # [ 3.742580] systemd[1]: Mounted /sysroot/nix/.ro-store.1271server # [ 3.743733] systemd[1]: Mounted /sysroot/nix/.rw-store.1272server # [ 3.745789] systemd[1]: Mounted /sysroot/run.1273host1 # [ 3.745694] systemd[1]: Mounting /sysroot/tmp/xchg...1274server # [ 3.750343] systemd[1]: Mounted /sysroot/tmp/shared.1275server # [ 3.751309] systemd[1]: Mounted /sysroot/tmp/xchg.1276server # [ 3.755785] systemd[1]: Starting rw-sysroot-nix-store.service...1277server # [ 3.766247] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1278server # [ 3.767688] systemd[1]: Finished rw-sysroot-nix-store.service.1279host1 # [ 3.779714] systemd[1]: Mounted /sysroot/nix/.ro-store.1280host1 # [ 3.781276] systemd[1]: Mounted /sysroot/nix/.rw-store.1281host1 # [ 3.785746] systemd[1]: Mounted /sysroot/run.1282host1 # [ 3.787765] systemd[1]: Mounted /sysroot/tmp/shared.1283host1 # [ 3.788686] systemd[1]: Mounted /sysroot/tmp/xchg.1284host1 # [ 3.792892] systemd[1]: Starting rw-sysroot-nix-store.service...1285host1 # [ 3.803308] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1286host1 # [ 3.804761] systemd[1]: Finished rw-sysroot-nix-store.service.1287host1 # [ 3.806913] systemd[1]: Mounting /sysroot/nix/store...1288host1 # [ 3.828071] systemd[1]: Mounted /sysroot/nix/store.1289host1 # [ 3.828788] systemd[1]: Reached target Initrd File Systems.1290host1 # [ 3.830357] systemd[1]: Starting Find NixOS closure...1291host1 # [ 3.834135] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1292host1 # [ 3.850501] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1293host1 # [ 3.857988] systemd[1]: Finished Find NixOS closure.1294host1 # [ 3.859372] systemd[1]: Reached target Initrd Default Target.1295host1 # [ 3.861155] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1296host1 # [ 3.873983] systemd[1]: Stopped target Initrd Default Target.1297host1 # [ 3.875415] systemd[1]: Stopped target Basic System.1298host1 # [ 3.876377] systemd[1]: Stopped target Initrd Root Device.1299host1 # [ 3.878108] systemd[1]: Stopped target Path Units.1300host1 # [ 3.878780] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1301host1 # [ 3.879905] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1302host1 # [ 3.880906] systemd[1]: Stopped target Slice Units.1303host1 # [ 3.881607] systemd[1]: Stopped target Socket Units.1304host1 # [ 3.882499] systemd[1]: Stopped target System Initialization.1305host1 # [ 3.883658] systemd[1]: Stopped target Swaps.1306host1 # [ 3.884539] systemd[1]: Stopped target Timer Units.1307host1 # [ 3.885451] systemd[1]: dbus.socket: Deactivated successfully.1308host1 # [ 3.887082] systemd[1]: Closed D-Bus System Message Bus Socket.1309host1 # [ 3.887874] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1310host1 # [ 3.888840] systemd[1]: Stopped Find NixOS closure.1311host1 # [ 3.889961] systemd[1]: Starting rw-sysroot-nix-store.service...1312host1 # [ 3.891142] systemd[1]: systemd-sysctl.service: Deactivated successfully.1313host1 # [ 3.892200] systemd[1]: Stopped Apply Kernel Variables.1314host1 # [ 3.893969] systemd[1]: systemd-modules-load.service: Deactivated successfully.1315host1 # [ 3.894954] systemd[1]: Stopped Load Kernel Modules.1316host1 # [ 3.895830] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1317host1 # [ 3.897089] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1318host1 # [ 3.899050] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1319host1 # [ 3.900046] systemd[1]: Stopped Create System Files and Directories.1320host1 # [ 3.900859] systemd[1]: Stopped target Local File Systems.1321host1 # [ 3.903107] systemd[1]: Stopped target Preparation for Local File Systems.1322host1 # [ 3.904121] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1323host1 # [ 3.905901] systemd[1]: Stopped Coldplug All udev Devices.1324host1 # [ 3.908152] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1325host1 # [ 3.909280] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1326host1 # [ 3.910312] systemd[1]: Stopped Virtual Console Setup.1327host1 # [ 3.919558] systemd[1]: initrd-cleanup.service: Deactivated successfully.1328host1 # [ 3.922251] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1329host1 # [ 3.923677] systemd[1]: systemd-udevd.service: Deactivated successfully.1330host1 # [ 3.927067] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1331host1 # [ 3.931359] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1332host1 # [ 3.933186] systemd[1]: Finished rw-sysroot-nix-store.service.1333host1 # [ 3.934193] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1334host1 # [ 3.936081] systemd[1]: Closed udev Control Socket.1335host1 # [ 3.937066] systemd[1]: Starting Cleanup udev Database...1336host1 # [ 3.937841] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1337host1 # [ 3.939210] systemd[1]: Stopped Create Static Device Nodes in /dev.1338host1 # [ 3.941118] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1339host1 # [ 3.942175] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1340host1 # [ 3.943142] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1341host1 # [ 3.944066] systemd[1]: Stopped Create List of Static Device Nodes.1342host1 # [ 3.958732] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1343host1 # [ 3.960460] systemd[1]: Finished Cleanup udev Database.1344host1 # [ 3.961735] systemd[1]: Reached target Switch Root.1345host1 # [ 3.963564] systemd[1]: Starting NixOS Activation...1346host1 # [ 4.023375] initrd-nixos-activation-start[194]: booting system configuration /nix/store/ld8qc26x68vrjd5il0wpal6dkq6ndgd7-nixos-system-host1-test1347host1 # [ 4.048679] initrd-nixos-activation-start[194]: running activation script...1348host1 # [ 4.261870] initrd-nixos-activation-start[217]: setting up /etc...1349host1 # [ 4.374449] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1350host1 # [ 4.376155] systemd[1]: Finished NixOS Activation.1351host1 # [ 4.377627] systemd[1]: Starting Switch Root...1352host1 # [ 4.391102] systemd[1]: Switching root.1353host1 # [ 4.663834] systemd-journald[66]: Received SIGTERM from PID 1 (systemd).1354server # [ 4.668329] systemd[1]: Mounting /sysroot/nix/store...1355server # [ 4.715713] systemd[1]: Mounted /sysroot/nix/store.1356server # [ 4.719142] systemd[1]: Reached target Initrd File Systems.1357server # [ 4.721921] systemd[1]: Starting Find NixOS closure...1358server # [ 4.726246] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1359host1 # [ 4.885286] NET: Registered PF_VSOCK protocol family1360server # [ 4.750798] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1361server # [ 4.752904] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1362server # [ 4.760375] systemd[1]: Finished Find NixOS closure.1363server # [ 4.762160] systemd[1]: Reached target Initrd Default Target.1364server # [ 4.763551] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1365server # [ 4.777263] systemd[1]: Stopped target Initrd Default Target.1366server # [ 4.778563] systemd[1]: Stopped target Basic System.1367server # [ 4.779571] systemd[1]: Stopped target Initrd Root Device.1368server # [ 4.781213] systemd[1]: Stopped target Path Units.1369server # [ 4.781878] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1370server # [ 4.782883] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1371server # [ 4.783852] systemd[1]: Stopped target Slice Units.1372server # [ 4.784546] systemd[1]: Stopped target Socket Units.1373server # [ 4.785432] systemd[1]: Stopped target System Initialization.1374server # [ 4.786460] systemd[1]: Stopped target Swaps.1375server # [ 4.787464] systemd[1]: Stopped target Timer Units.1376server # [ 4.788330] systemd[1]: dbus.socket: Deactivated successfully.1377server # [ 4.789380] systemd[1]: Closed D-Bus System Message Bus Socket.1378server # [ 4.790882] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1379server # [ 4.791887] systemd[1]: Stopped Find NixOS closure.1380server # [ 4.792930] systemd[1]: Starting rw-sysroot-nix-store.service...1381server # [ 4.793846] systemd[1]: systemd-sysctl.service: Deactivated successfully.1382server # [ 4.795301] systemd[1]: Stopped Apply Kernel Variables.1383server # [ 4.796269] systemd[1]: systemd-modules-load.service: Deactivated successfully.1384server # [ 4.798234] systemd[1]: Stopped Load Kernel Modules.1385server # [ 4.799142] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1386server # [ 4.800893] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1387server # [ 4.801965] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1388server # [ 4.803100] systemd[1]: Stopped Create System Files and Directories.1389server # [ 4.804094] systemd[1]: Stopped target Local File Systems.1390server # [ 4.805351] systemd[1]: Stopped target Preparation for Local File Systems.1391server # [ 4.807521] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1392server # [ 4.808445] systemd[1]: Stopped Coldplug All udev Devices.1393server # [ 4.811652] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1394server # [ 4.812690] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1395server # [ 4.813696] systemd[1]: Stopped Virtual Console Setup.1396server # [ 4.820722] systemd[1]: initrd-cleanup.service: Deactivated successfully.1397server # [ 4.825109] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1398server # [ 4.829462] systemd[1]: systemd-udevd.service: Deactivated successfully.1399server # [ 4.832938] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1400server # [ 4.835062] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1401server # [ 4.836070] systemd[1]: Closed udev Control Socket.1402server # [ 4.838145] systemd[1]: Starting Cleanup udev Database...1403server # [ 4.839128] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1404server # [ 4.840936] systemd[1]: Stopped Create Static Device Nodes in /dev.1405server # [ 4.841816] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1406server # [ 4.842887] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1407server # [ 4.843905] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1408server # [ 4.844851] systemd[1]: Stopped Create List of Static Device Nodes.1409server # [ 4.847141] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1410server # [ 4.848653] systemd[1]: Finished rw-sysroot-nix-store.service.1411server # [ 4.861802] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1412server # [ 4.863450] systemd[1]: Finished Cleanup udev Database.1413server # [ 4.865122] systemd[1]: Reached target Switch Root.1414server # [ 4.866625] systemd[1]: Starting NixOS Activation...1415server # [ 4.923609] initrd-nixos-activation-start[196]: booting system configuration /nix/store/8l9v81b9z9smli644yzp9k6bkpl0cbhw-nixos-system-server-test1416server # [ 4.946994] initrd-nixos-activation-start[196]: running activation script...1417host1 # [ 5.246726] 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)1418host1 # [ 5.256631] systemd[1]: Detected virtualization kvm.1419host1 # [ 5.258448] systemd[1]: Detected architecture x86-64.1420host1 # [ 5.260293] systemd[1]: Detected first boot.1421host1 # [ 5.264177] systemd[1]: Initializing machine ID from random generator.1422server # [ 5.133851] initrd-nixos-activation-start[219]: setting up /etc...1423server # [ 5.240962] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1424server # [ 5.242589] systemd[1]: Finished NixOS Activation.1425server # [ 5.244508] systemd[1]: Starting Switch Root...1426server # [ 5.257344] systemd[1]: Switching root.1427host1 # [ 5.505436] systemd[1]: bpf-restrict-fs: LSM BPF program attached1428server # [ 5.525519] systemd-journald[66]: Received SIGTERM from PID 1 (systemd).1429host1 # [ 5.592762] systemd[1]: Applying preset policy.1430server # [ 5.626704] NET: Registered PF_VSOCK protocol family1431host1 # [ 5.755882] systemd[1]: Populated /etc with preset unit settings.1432host1 # [ 5.951976] systemd[1]: initrd-switch-root.service: Deactivated successfully.1433host1 # [ 5.953431] systemd[1]: Stopped initrd-switch-root.service.1434host1 # [ 5.955809] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1435host1 # [ 5.957891] systemd[1]: Created slice Slice /system/getty.1436host1 # [ 5.959265] systemd[1]: Created slice User and Session Slice.1437host1 # [ 5.960201] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1438host1 # [ 5.961476] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1439host1 # [ 5.962589] systemd[1]: Expecting device /dev/hvc0...1440host1 # [ 5.963311] systemd[1]: Expecting device /dev/ttyS0...1441host1 # [ 5.964078] systemd[1]: Reached target Local Encrypted Volumes.1442host1 # [ 5.964910] systemd[1]: Stopped target initrd-fs.target.1443host1 # [ 5.965697] systemd[1]: Stopped target initrd-root-fs.target.1444host1 # [ 5.966534] systemd[1]: Stopped target initrd-switch-root.target.1445host1 # [ 5.967414] systemd[1]: Reached target Virtual Machines and Containers.1446host1 # [ 5.968331] systemd[1]: Reached target Path Units.1447host1 # [ 5.969055] systemd[1]: Reached target Remote File Systems.1448host1 # [ 5.969906] systemd[1]: Reached target Slice Units.1449host1 # [ 5.970745] systemd[1]: Reached target Swaps.1450host1 # [ 5.972644] systemd[1]: Listening on Query the User Interactively for a Password.1451host1 # [ 5.975151] systemd[1]: Listening on Process Core Dump Socket.1452host1 # [ 5.976850] systemd[1]: Listening on Credential Encryption/Decryption.1453server # [ 5.985062] 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)1454server # [ 5.988871] systemd[1]: Detected virtualization kvm.1455server # [ 5.989558] systemd[1]: Detected architecture x86-64.1456server # [ 5.990325] systemd[1]: Detected first boot.1457server # [ 5.992883] systemd[1]: Initializing machine ID from random generator.1458host1 # [ 5.978873] systemd[1]: Listening on Factory Reset Management.1459host1 # [ 5.991519] systemd[1]: Listening on Hostname Service Socket.1460host1 # [ 5.994648] systemd[1]: Starting Journal Log Access Socket...1461host1 # [ 5.995924] systemd[1]: Listening on Journal Audit Socket.1462host1 # [ 5.998684] systemd[1]: Listening on Console Output Muting Service Socket.1463host1 # [ 5.999856] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1464host1 # [ 6.001085] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1465host1 # [ 6.002415] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1466host1 # [ 6.006135] systemd[1]: Listening on Disk Repartitioning Service Socket.1467host1 # [ 6.007193] systemd[1]: Listening on udev Control Socket.1468host1 # [ 6.008097] systemd[1]: Listening on udev Varlink Socket.1469host1 # [ 6.010281] systemd[1]: Mounting Huge Pages File System...1470host1 # [ 6.012692] systemd[1]: Mounting POSIX Message Queue File System...1471host1 # [ 6.020062] systemd[1]: Mounting Kernel Debug File System...1472host1 # [ 6.029670] systemd[1]: Mounting Kernel Trace File System...1473host1 # [ 6.041663] systemd[1]: Starting Create List of Static Device Nodes...1474host1 # [ 6.057246] systemd[1]: Starting Load Kernel Module configfs...1475host1 # [ 6.062046] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1476host1 # [ 6.072870] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1477host1 # [ 6.083009] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1478host1 # [ 6.097840] systemd[1]: Mounting FUSE Control File System...1479host1 # [ 6.099466] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671480host1 # [ 6.110830] systemd[1]: Starting Journal Service...1481server # [ 6.120215] systemd[1]: bpf-restrict-fs: LSM BPF program attached1482host1 # [ 6.119537] systemd[1]: Starting Load Kernel Modules...1483host1 # [ 6.132792] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1484host1 # [ 6.142699] systemd[1]: Starting Remount Root and Kernel File Systems...1485host1 # [ 6.148659] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1486host1 # [ 6.162238] systemd-journald[287]: Collecting audit messages is enabled.1487host1 # [ 6.167600] systemd[1]: Starting Coldplug All udev Devices...1488server # [ 6.189386] systemd[1]: Applying preset policy.1489host1 # [ 6.187478] systemd[1]: Listening on Journal Log Access Socket.1490host1 # [ 6.191634] systemd[1]: Mounted Huge Pages File System.1491host1 # [ 6.197589] systemd[1]: Mounted POSIX Message Queue File System.1492host1 # [ 6.058576] systemd[1]: Queued start job for default target Multi-User System.1493host1 # [ 6.060418] systemd[1]: systemd-journald.service: Deactivated successfully.1494host1 # [ 6.206524] systemd[1]: Started Journal Service.1495host1 # [ 6.073471] systemd[1]: Mounted Kernel Debug File System.1496host1 # [ 6.078468] systemd[1]: Mounted Kernel Trace File System.1497host1 # [ 6.082072] systemd[1]: Finished Create List of Static Device Nodes.1498host1 # [ 6.082989] systemd[1]: modprobe@configfs.service: Deactivated successfully.1499host1 # [ 6.084069] systemd[1]: Finished Load Kernel Module configfs.1500host1 # [ 6.234919] EXT4-fs (vda): re-mounted ac1b9174-ddd3-4121-826f-5af554c97e16.1501host1 # [ 6.236439] loop: module loaded1502host1 # [ 6.098395] systemd-modules-load[288]: Inserted module 'loop'1503host1 # [ 6.113067] systemd[1]: Mounting Kernel Configuration File System...1504host1 # [ 6.117723] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1505host1 # [ 6.121069] systemd[1]: Mounted FUSE Control File System.1506host1 # [ 6.132808] systemd[1]: Finished Load Kernel Modules.1507host1 # [ 6.138272] systemd[1]: Finished Remount Root and Kernel File Systems.1508host1 # [ 6.143103] systemd[1]: Listening on Disk Image Download Service Socket.1509host1 # [ 6.150100] systemd[1]: Starting Firewall...1510host1 # [ 6.151864] systemd-oomd[290]: No swap; memory pressure usage will be degraded1511host1 # [ 6.160083] systemd[1]: Starting Flush Journal to Persistent Storage...1512host1 # [ 6.161090] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1513host1 # [ 6.167154] systemd[1]: Starting Load/Save OS Random Seed...1514host1 # [ 6.180082] systemd[1]: Starting Apply Kernel Variables...1515host1 # [ 6.180952] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1516host1 # [ 6.189973] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1517server # [ 6.355858] systemd[1]: Populated /etc with preset unit settings.1518host1 # [ 6.394247] systemd-journald[287]: Received client request to flush runtime journal.1519host1 # [ 6.366612] systemd[1]: Mounted Kernel Configuration File System.1520host1 # [ 6.369345] systemd[1]: Finished Load/Save OS Random Seed.1521host1 # [ 6.370975] systemd[1]: Reached target First Boot Complete.1522host1 # [ 6.372879] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1523host1 # [ 6.375115] systemd[1]: Starting Create Static Device Nodes in /dev...1524host1 # [ 6.376101] systemd[1]: Finished Apply Kernel Variables.1525host1 # [ 6.377307] systemd[1]: Finished Flush Journal to Persistent Storage.1526server # [ 6.548428] systemd[1]: initrd-switch-root.service: Deactivated successfully.1527server # [ 6.549848] systemd[1]: Stopped initrd-switch-root.service.1528server # [ 6.552022] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1529server # [ 6.554367] systemd[1]: Created slice Slice /system/getty.1530server # [ 6.555677] systemd[1]: Created slice User and Session Slice.1531server # [ 6.556638] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1532server # [ 6.557889] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1533server # [ 6.558947] systemd[1]: Expecting device /dev/hvc0...1534server # [ 6.559686] systemd[1]: Expecting device /dev/ttyS0...1535server # [ 6.560438] systemd[1]: Reached target Local Encrypted Volumes.1536server # [ 6.561264] systemd[1]: Stopped target initrd-fs.target.1537server # [ 6.561968] systemd[1]: Stopped target initrd-root-fs.target.1538server # [ 6.562765] systemd[1]: Stopped target initrd-switch-root.target.1539server # [ 6.563648] systemd[1]: Reached target Virtual Machines and Containers.1540server # [ 6.564563] systemd[1]: Reached target Path Units.1541server # [ 6.565258] systemd[1]: Reached target Remote File Systems.1542server # [ 6.566009] systemd[1]: Reached target Slice Units.1543server # [ 6.566740] systemd[1]: Reached target Swaps.1544server # [ 6.568471] systemd[1]: Listening on Query the User Interactively for a Password.1545server # [ 6.571641] systemd[1]: Listening on Process Core Dump Socket.1546server # [ 6.574076] systemd[1]: Listening on Credential Encryption/Decryption.1547server # [ 6.576282] systemd[1]: Listening on Factory Reset Management.1548server # [ 6.589493] systemd[1]: Listening on Hostname Service Socket.1549server # [ 6.592505] systemd[1]: Starting Journal Log Access Socket...1550server # [ 6.593758] systemd[1]: Listening on Journal Audit Socket.1551server # [ 6.596489] systemd[1]: Listening on Console Output Muting Service Socket.1552server # [ 6.597744] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1553server # [ 6.599007] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1554server # [ 6.600494] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1555server # [ 6.604177] systemd[1]: Listening on Disk Repartitioning Service Socket.1556server # [ 6.605338] systemd[1]: Listening on udev Control Socket.1557server # [ 6.606598] systemd[1]: Listening on udev Varlink Socket.1558server # [ 6.608824] systemd[1]: Mounting Huge Pages File System...1559server # [ 6.612479] systemd[1]: Mounting POSIX Message Queue File System...1560host1 # [ 6.471293] systemd[1]: Finished Create Static Device Nodes in /dev.1561host1 # [ 6.474117] systemd[1]: Reached target Preparation for Local File Systems.1562server # [ 6.619261] systemd[1]: Mounting Kernel Debug File System...1563host1 # [ 6.478394] systemd[1]: Starting Rule-based Manager for Device Events and Files...1564server # [ 6.626810] systemd[1]: Mounting Kernel Trace File System...1565server # [ 6.635768] systemd[1]: Starting Create List of Static Device Nodes...1566host1 # [ 6.500137] systemd[1]: Finished Coldplug All udev Devices.1567server # [ 6.644975] systemd[1]: Starting Load Kernel Module configfs...1568server # [ 6.647598] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1569server # [ 6.653241] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1570server # [ 6.662338] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1571server # [ 6.677882] systemd[1]: Mounting FUSE Control File System...1572host1 # [ 6.535809] systemd-udevd[324]: Using default interface naming scheme 'v261'.1573server # [ 6.682632] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671574server # [ 6.698663] systemd[1]: Starting Journal Service...1575server # [ 6.707591] systemd[1]: Starting Load Kernel Modules...1576server # [ 6.714804] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1577server # [ 6.719419] systemd[1]: Starting Remount Root and Kernel File Systems...1578server # [ 6.722049] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1579server # [ 6.726912] systemd[1]: Starting Coldplug All udev Devices...1580host1 # [ 6.585240] systemd[1]: Started Rule-based Manager for Device Events and Files.1581server # [ 6.731814] systemd[1]: Listening on Journal Log Access Socket.1582server # [ 6.734693] systemd[1]: Mounted Huge Pages File System.1583server # [ 6.737328] systemd[1]: Mounted POSIX Message Queue File System.1584server # [ 6.739580] systemd[1]: Mounted Kernel Debug File System.1585server # [ 6.741822] systemd[1]: Mounted Kernel Trace File System.1586server # [ 6.745705] systemd[1]: Finished Create List of Static Device Nodes.1587server # [ 6.746993] systemd[1]: Mounted FUSE Control File System.1588server # [ 6.753592] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1589server # [ 6.767259] systemd[1]: modprobe@configfs.service: Deactivated successfully.1590server # [ 6.768917] systemd[1]: Finished Load Kernel Module configfs.1591server # [ 6.775789] systemd[1]: Mounting Kernel Configuration File System...1592server # [ 6.800636] systemd[1]: Mounted Kernel Configuration File System.1593server # [ 6.828583] EXT4-fs (vda): re-mounted 0397a20c-8409-48d9-9908-9a1787a4ee19.1594server # [ 6.831319] systemd-journald[289]: Collecting audit messages is enabled.1595server # [ 6.836660] loop: module loaded1596server # [ 6.841942] systemd[1]: Finished Remount Root and Kernel File Systems.1597server # [ 6.843427] systemd[1]: Listening on Disk Image Download Service Socket.1598server # [ 6.846231] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1599host1 # [ 6.705952] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1600server # [ 6.855632] systemd[1]: Starting Load/Save OS Random Seed...1601server # [ 6.857414] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1602server # [ 6.861750] systemd[1]: Finished Load Kernel Modules.1603server # [ 6.866614] systemd[1]: Starting Firewall...1604server # [ 6.873421] systemd[1]: Starting Apply Kernel Variables...1605server # [ 6.894091] systemd[1]: Started Journal Service.1606server # [ 6.759755] systemd[1]: Queued start job for default target Multi-User System.1607server # [ 6.762389] systemd[1]: systemd-journald.service: Deactivated successfully.1608server # [ 6.769391] systemd-modules-load[290]: Inserted module 'loop'1609server # [ 6.773699] systemd[1]: Starting Flush Journal to Persistent Storage...1610server # [ 6.782329] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1611server # [ 6.788802] systemd[1]: Starting Create Static Device Nodes in /dev...1612host1 # [ 6.792975] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1613host1 # [ 6.816544] systemd[1]: Mounting /run/wrappers...1614host1 # [ 6.826322] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.1615server # [ 6.990555] systemd-journald[289]: Received client request to flush runtime journal.1616host1 # [ 6.856659] systemd[1]: Mounted /run/wrappers.1617host1 # [ 6.857477] systemd[1]: Reached target Local File Systems.1618host1 # [ 6.860585] systemd[1]: Listening on Boot Loader Control Service Socket.1619host1 # [ 6.865161] systemd[1]: Starting register-nix-paths.service...1620host1 # [ 6.868677] systemd[1]: Starting Create SUID/SGID Wrappers...1621host1 # [ 6.870515] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1622host1 # [ 6.875406] systemd[1]: Starting Save Transient machine-id to Disk...1623host1 # [ 6.889228] systemd[1]: Starting Create System Files and Directories...1624host1 # [ 6.901123] (udev-worker)[356]: Network interface NamePolicy= disabled on kernel command line.1625host1 # [ 6.914560] (udev-worker)[359]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1626host1 # [ 6.923582] (udev-worker)[359]: Network interface NamePolicy= disabled on kernel command line.1627host1 # [ 6.993636] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1628host1 # [ 7.000911] systemd[1]: Finished Save Transient machine-id to Disk.1629host1 # [ 7.058456] systemd[1]: Finished Create System Files and Directories.1630host1 # [ 7.070209] systemd[1]: Starting Rebuild Journal Catalog...1631host1 # [ 7.078325] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1632server # [ 7.101537] systemd-oomd[291]: No swap; memory pressure usage will be degraded1633server # [ 7.107231] systemd[1]: Finished Apply Kernel Variables.1634server # [ 7.108311] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1635server # [ 7.110653] systemd[1]: Finished Create Static Device Nodes in /dev.1636server # [ 7.111779] systemd[1]: Reached target Preparation for Local File Systems.1637server # [ 7.113886] systemd[1]: Starting Rule-based Manager for Device Events and Files...1638server # [ 7.115446] systemd[1]: Finished Load/Save OS Random Seed.1639server # [ 7.117395] systemd[1]: Reached target First Boot Complete.1640server # [ 7.118516] systemd-udevd[321]: Using default interface naming scheme 'v261'.1641server # [ 7.120878] systemd[1]: Finished Flush Journal to Persistent Storage.1642server # [ 7.147106] systemd[1]: Finished Coldplug All udev Devices.1643server # [ 7.156335] systemd[1]: Started Rule-based Manager for Device Events and Files.1644host1 # [ 7.178486] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1645host1 # [ 7.226068] systemd[1]: Finished Rebuild Journal Catalog.1646host1 # [ 7.233621] systemd[1]: Starting Update is Completed...1647server # [ 7.300936] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1648host1 # [ 7.320093] systemd[1]: Finished Update is Completed.1649host1 # [ 7.494805] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console1650host1 # [ 7.507057] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input31651server # [ 7.381756] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1652host1 # [ 7.395149] systemd[1]: Condition check resulted in Virtio network device being skipped.1653host1 # [ 7.396600] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1654host1 # [ 7.399230] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1655host1 # [ 7.401213] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671656host1 # [ 7.404120] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1657host1 # [ 7.405719] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1658host1 # [ 7.406934] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1659server # [ 7.410752] systemd[1]: Mounting /run/wrappers...1660server # [ 7.420546] systemd[1]: Condition check resulted in /dev/ttyS0 being skipped.1661server # [ 7.446126] systemd[1]: Mounted /run/wrappers.1662server # [ 7.447982] systemd[1]: Reached target Local File Systems.1663server # [ 7.449829] systemd[1]: Listening on Boot Loader Control Service Socket.1664server # [ 7.453143] systemd[1]: Starting register-nix-paths.service...1665server # [ 7.455083] systemd[1]: Starting Create SUID/SGID Wrappers...1666server # [ 7.457941] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1667server # [ 7.459727] systemd[1]: Starting Save Transient machine-id to Disk...1668server # [ 7.465238] systemd[1]: Starting Create System Files and Directories...1669server # [ 7.526368] (udev-worker)[366]: Network interface NamePolicy= disabled on kernel command line.1670server # [ 7.542538] (udev-worker)[359]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1671server # [ 7.547462] (udev-worker)[359]: Network interface NamePolicy= disabled on kernel command line.1672server # [ 7.617294] systemd[1]: Finished Create System Files and Directories.1673server # [ 7.620959] systemd[1]: Starting Rebuild Journal Catalog...1674server # [ 7.623375] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1675host1 # [ 7.606634] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:06.0/virtio4/input/input41676server # [ 7.660699] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1677server # [ 7.664736] systemd[1]: Finished Save Transient machine-id to Disk.1678host1 # [ 7.690517] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1679host1 # [ 7.692839] systemd[1]: Finished Create SUID/SGID Wrappers.1680server # [ 7.708395] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1681host1 # [ 7.618740] ACPI: button: Power Button [PWRF]1682host1 # [ 7.670258] rtc_cmos PNP0B00:00: RTC can wake from S41683host1 # [ 7.676531] mousedev: PS/2 mouse device common for all mice1684host1 # [ 7.726276] rtc_cmos PNP0B00:00: registered as rtc01685host1 # [ 7.727251] rtc_cmos PNP0B00:00: setting system clock to 2026-09-22T14:50:25 UTC (1790088625)1686host1 # [ 7.727605] systemd-journald[287]: Time jumped backwards, rotating.1687host1 # [ 7.754707] systemd[1]: Finished Firewall.1688server # [ 7.762133] systemd[1]: Finished Rebuild Journal Catalog.1689server # [ 7.766189] systemd[1]: Starting Update is Completed...1690host1 # [ 7.728259] rtc_cmos PNP0B00:00: alarms up to one day, y3k, 242 bytes nvram, hpet irqs1691host1 # [ 7.769762] Console: switching to colour dummy device 80x251692host1 # [ 7.783816] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized1693host1 # [ 7.787449] parport_pc 00:02: reported by Plug and Play ACPI1694host1 # [ 7.787547] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]1695host1 # [ 7.917949] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt1696host1 # [ 7.918083] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD1697server # [ 7.858679] systemd[1]: Finished Update is Completed.1698host1 # [ 8.016471] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input61699host1 # [ 8.016741] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input51700host1 # [ 8.056645] [drm] Found bochs VGA, ID 0xb0c5.1701host1 # [ 8.056647] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.1702host1 # [ 8.063639] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic1703host1 # [ 7.953069] systemd[1]: Starting Virtual Console Setup...1704server # [ 7.957695] systemd[1]: Condition check resulted in Virtio network device being skipped.1705server # [ 7.959866] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1706server # [ 7.963224] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1707host1 # [ 8.104477] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 01708server # [ 7.966401] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671709server # [ 7.968534] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1710server # [ 7.970633] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1711server # [ 7.973633] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1712server # [ 8.128032] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input31713host1 # [ 8.181489] ppdev: user-space parallel port driver1714host1 # [ 8.043715] systemd[1]: Finished register-nix-paths.service.1715server # [ 8.200067] bochs-drm 0000:00:01.0: vgaarb: deactivate vga console1716host1 # [ 8.211733] iTCO_wdt iTCO_wdt.1.auto: Found a ICH9 TCO device (Version=2, TCOBASE=0x0660)1717server # [ 8.101668] systemd[1]: Finished Firewall.1718host1 # [ 8.218760] iTCO_wdt iTCO_wdt.1.auto: initialized. heartbeat=30 sec (nowayout=0)1719host1 # [ 8.238655] Console: switching to colour frame buffer device 160x501720host1 # [ 8.245854] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device1721host1 # [ 8.107737] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1722host1 # [ 8.110070] systemd[1]: Stopped Virtual Console Setup.1723host1 # [ 8.115897] systemd[1]: Starting Virtual Console Setup...1724server # [ 8.142382] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1725server # [ 8.144114] systemd[1]: Finished Create SUID/SGID Wrappers.1726host1 # [ 8.343073] kvm_amd: TSC scaling supported1727host1 # [ 8.343796] kvm_amd: Nested Virtualization enabled1728host1 # [ 8.344291] kvm_amd: Nested Paging enabled1729host1 # [ 8.346804] kvm_amd: LBR virtualization supported1730host1 # [ 8.347275] kvm_amd: Virtual VMLOAD VMSAVE supported1731host1 # [ 8.347968] kvm_amd: Virtual GIF supported1732host1 # [ 8.348668] kvm_amd: Virtual NMI enabled1733host1 # [ 8.385127] EDAC MC: Ver: 3.0.01734server # [ 8.245975] ACPI: button: Power Button [PWRF]1735server # [ 8.323439] rtc_cmos PNP0B00:00: RTC can wake from S41736host1 # [ 8.307116] systemd-vconsole-setup[526]: Configuration of first virtual console was skipped, ignoring remaining ones.1737host1 # [ 8.310828] systemd[1]: Finished Virtual Console Setup.1738host1 # [ 8.312542] systemd[1]: Reached target System Initialization.1739host1 # [ 8.313921] systemd[1]: Started Renew ACME Certificate for host1.1740host1 # [ 8.315137] systemd[1]: Started Discard unused filesystem blocks once a week.1741host1 # [ 8.316151] systemd[1]: Started Daily Cleanup of Temporary Directories.1742server # [ 8.331265] rtc_cmos PNP0B00:00: registered as rtc01743host1 # [ 8.318058] systemd[1]: Reached target Timer Units.1744server # [ 8.331332] rtc_cmos PNP0B00:00: setting system clock to 2026-09-22T14:50:25 UTC (1790088625)1745host1 # [ 8.318775] systemd[1]: Listening on D-Bus System Message Bus Socket.1746host1 # [ 8.319763] systemd[1]: Listening on Nix Daemon Socket.1747host1 # [ 8.321171] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1748host1 # [ 8.322354] systemd[1]: Reached target Socket Units.1749host1 # [ 8.323141] systemd[1]: Reached target Basic System.1750host1 # [ 8.325667] systemd[1]: Starting Set up the ACME certificate renewal infrastructure...1751host1 # [ 8.328180] systemd[1]: Started backdoor.service.1752host1 # [ 8.333069] systemd[1]: Starting Import lastlog data into lastlog2 database...1753host1 # [ 8.340706] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1754server # [ 8.331404] rtc_cmos PNP0B00:00: alarms up to one day, y3k, 242 bytes nvram, hpet irqs1755host1 # [ 8.352176] systemd[1]: Starting Post-Boot Actions...1756server # [ 8.333406] systemd-journald[289]: Time jumped backwards, rotating.1757server # [ 8.378734] parport_pc 00:02: reported by Plug and Play ACPI1758server # [ 8.378838] parport0: PC-style at 0x378, irq 7 [PCSPP(,...)]1759host1 # [ 8.361602] systemd[1]: Started Reset console on configuration changes.1760server # [ 8.383068] mousedev: PS/2 mouse device common for all mice1761server # [ 8.403676] input: QEMU Virtio Keyboard as /devices/pci0000:00/0000:00:06.0/virtio4/input/input41762host1 # [ 8.375038] systemd[1]: Starting resolvconf update...1763server # [ 8.424255] lpc_ich 0000:00:1f.0: I/O space for GPIO uninitialized1764server # [ 8.430195] Console: switching to colour dummy device 80x251765server # [ 8.520722] i801_smbus 0000:00:1f.3: SMBus using PCI interrupt1766host1 # connecting to host...1767server # [ 8.520848] i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD1768server # [ 8.555569] [drm] Found bochs VGA, ID 0xb0c5.1769server # [ 8.555571] [drm] Framebuffer size 16384 kB @ 0xfd000000, mmio @ 0xfebd0000.1770host1 # [ 8.412274] acme-setup-privileged[530]: + set -euo pipefail1771host1 # [ 8.413185] acme-setup-privileged[530]: + cd /var/lib/acme1772host1 # [ 8.415067] acme-setup-privileged[530]: + chmod -R u=rwX,g=,o= .lego/accounts1773host1 # [ 8.420253] systemd[1]: Starting D-Bus System Message Bus...1774host1 # [ 8.428957] acme-setup-privileged[530]: + chown -R acme .lego/accounts1775server # [ 8.575227] bochs-drm 0000:00:01.0: [drm] Registered 1 planes with drm panic1776server # [ 8.575875] [drm] Initialized bochs-drm 1.0.0 for 0000:00:01.0 on minor 01777host1 # [ 8.444163] systemd[1]: Finished Post-Boot Actions.1778server # [ 8.592894] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input61779server # [ 8.593997] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input51780host1 # [ 8.452937] acme-setup-privileged[530]: + for fixpath in host1 .lego/host11781host1 # [ 8.453845] acme-setup-privileged[530]: + '[' -d host1 ']'1782host1 # [ 8.454681] acme-setup-privileged[530]: + for fixpath in host1 .lego/host11783host1 # [ 8.457075] acme-setup-privileged[530]: + '[' -d .lego/host1 ']'1784host1 # [ 8.461246] nsncd[533]: Sep 22 14:50:26.370 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1785host1 # [ 8.463198] systemd[1]: Started Name Service Cache Daemon (nsncd).1786host1 # [ 8.472206] systemd[1]: Reached target Host and Network Name Lookups.1787host1 # [ 8.475338] systemd[1]: Reached target User and Group Name Lookups.1788server # [ 8.477452] systemd[1]: Finished register-nix-paths.service.1789server # [ 8.480487] systemd[1]: Reached target System Initialization.1790server # [ 8.481549] systemd[1]: Started Renew ACME Certificate for server.1791server # [ 8.482644] systemd[1]: Started Discard unused filesystem blocks once a week.1792server # [ 8.484218] systemd[1]: Started Daily Cleanup of Temporary Directories.1793server # [ 8.487153] systemd[1]: Reached target Timer Units.1794server # [ 8.487878] systemd[1]: Listening on D-Bus System Message Bus Socket.1795server # [ 8.489137] systemd[1]: Listening on Nix Daemon Socket.1796server # [ 8.490556] systemd[1]: Listening on Nix worker-protocol over gRPC.1797server # [ 8.491590] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1798server # [ 8.492995] systemd[1]: Reached target Socket Units.1799server # [ 8.495239] systemd[1]: Reached target Basic System.1800host1 # [ 8.494351] systemd[1]: Starting User Login Management...1801server # [ 8.497174] systemd[1]: Starting Set up the ACME certificate renewal infrastructure...1802host1 # [ 8.496796] systemd[1]: Finished Import lastlog data into lastlog2 database.1803server # [ 8.500155] systemd[1]: Started backdoor.service.1804server # [ 8.504446] systemd[1]: Starting Import lastlog data into lastlog2 database...1805server # [ 8.508053] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1806server # [ 8.515067] systemd[1]: Starting Post-Boot Actions...1807server # [ 8.518327] systemd[1]: Started Reset console on configuration changes.1808server # [ 8.524717] systemd[1]: Starting resolvconf update...1809server # [ 8.528992] systemd[1]: Starting step-ca-pki.service...1810server # [ 8.539288] systemd[1]: Starting D-Bus System Message Bus...1811host1 # [ 8.588829] dbus-broker-launch[547]: Looking up NSS user entry for 'systemd-timesync'...1812host1 # [ 8.591582] dbus-broker-launch[547]: NSS returned no entry for 'systemd-timesync'1813host1 # [ 8.593431] dbus-broker-launch[547]: Invalid user-name in /nix/store/qip1v2bp3gxd2mgy76zm58p8c4nw43qv-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1814host1 # [ 8.603433] acme-setup-start[564]: + set -euo pipefail1815host1 # [ 8.605338] acme-setup-start[564]: + test -e ca/key.pem1816host1 # [ 8.606489] acme-setup-start[564]: + minica --ca-key ca/key.pem --ca-cert ca/cert.pem --domains selfsigned.local1817host1 # [ 8.609450] systemd-logind[567]: New seat seat0.1818host1 # [ 8.616270] systemd-logind[567]: Watching system buttons on /dev/input/event2 (Power Button)1819host1 # [ 8.617561] systemd-logind[567]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1820host1 # [ 8.620088] systemd-logind[567]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard)1821host1 # [ 8.622322] systemd[1]: Started User Login Management.1822host1 # [ 8.629313] systemd[1]: Starting linger-users.service...1823server # [ 8.638052] systemd[1]: Finished Post-Boot Actions.1824host1 # [ 8.642586] systemd[1]: Started D-Bus System Message Bus.1825server # [ 8.662412] acme-setup-privileged[526]: + set -euo pipefail1826server # [ 8.663713] acme-setup-privileged[526]: + cd /var/lib/acme1827server # [ 8.666083] acme-setup-privileged[526]: + chmod -R u=rwX,g=,o= .lego/accounts1828host1 # [ 8.665539] systemd[1]: Stopped target Host and Network Name Lookups.1829host1 # [ 8.666478] systemd[1]: Stopping Host and Network Name Lookups...1830host1 # [ 8.667497] systemd[1]: Stopped target User and Group Name Lookups.1831host1 # [ 8.669111] systemd[1]: Stopping User and Group Name Lookups...1832server # connecting to host...1833host1 # [ 8.672069] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...1834host1 # [ 8.677521] systemd[1]: nscd.service: Deactivated successfully.1835server # [ 8.680877] systemd[1]: Started Name Service Cache Daemon (nsncd).1836server # [ 8.683516] systemd[1]: Reached target Host and Network Name Lookups.1837host1 # [ 8.682234] systemd[1]: Stopped Name Service Cache Daemon (nsncd).1838server # [ 8.687345] nsncd[529]: Sep 22 14:50:25.992 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1839host1 # [ 8.687362] dbus-broker-launch[547]: Ready1840server # [ 8.690939] systemd[1]: Reached target User and Group Name Lookups.1841server # [ 8.695727] systemd[1]: Starting User Login Management...1842server # [ 8.698334] acme-setup-privileged[526]: + chown -R acme .lego/accounts1843server # [ 8.699967] systemd[1]: Starting Virtual Console Setup...1844host1 # [ 8.699701] systemd[1]: Finished Set up the ACME certificate renewal infrastructure.1845host1 # [ 8.712354] systemd[1]: Starting Ensure certificate for host1...1846host1 # [ 8.716333] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1847host1 # [ 8.717259] systemd[1]: linger-users.service: Deactivated successfully.1848server # [ 8.723522] acme-setup-privileged[526]: + for fixpath in server .lego/server1849host1 # [ 8.722175] systemd[1]: Finished linger-users.service.1850server # [ 8.726533] acme-setup-privileged[526]: + '[' -d server ']'1851server # [ 8.727343] acme-setup-privileged[526]: + for fixpath in server .lego/server1852server # [ 8.729089] acme-setup-privileged[526]: + '[' -d .lego/server ']'1853server # [ 8.738637] systemd[1]: Finished Import lastlog data into lastlog2 database.1854server: Guest shell says: b'Spawning backdoor root shell...\n'1855host1 # [ 8.756764] systemd[1]: Finished resolvconf update.1856host1 # [ 8.760128] systemd[1]: Reached target Preparation for Network.1857host1 # [ 8.767028] systemd[1]: Starting DHCP Client...1858host1 # [ 8.770207] systemd[1]: Starting Address configuration of eth1...1859server: connected to guest root shell1860server # [ 8.763934] dbus-broker-launch[534]: Looking up NSS user entry for 'systemd-timesync'...1861server: (connecting took 9.44 seconds)1862server: (finished: waiting for the VM to finish booting, in 9.44 seconds)1863host1 # [ 8.773796] systemd[1]: Starting Extra networking commands....1864host1 # [ 8.779216] nsncd[633]: Sep 22 14:50:26.692 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1865host1 # [ 8.782698] systemd[1]: Started Name Service Cache Daemon (nsncd).1866server # [ 8.786993] dbus-broker-launch[534]: NSS returned no entry for 'systemd-timesync'1867host1 # [ 8.786875] systemd[1]: Reached target Host and Network Name Lookups.1868server # [ 8.788143] dbus-broker-launch[534]: Invalid user-name in /nix/store/nx73hf0ijh2g1n5nk090ic4yjxwlw34d-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1869host1 # [ 8.787774] systemd[1]: Reached target User and Group Name Lookups.1870host1 # [ 8.815958] acme-host1-start[631]: Waiting to acquire lock in /run/acme/1871host1 # [ 8.830612] acme-host1-start[631]: + '[' -e out/acme-success ']'1872host1 # [ 8.832144] acme-host1-start[631]: + minica --ca-cert=ca/cert.pem --ca-key=ca/key.pem --domains=host1 --ip-addresses=1873host1 # [ 8.859473] acme-host1-start[669]: + cd host11874host1 # [ 8.860541] acme-host1-start[669]: + cp -vp cert.pem ../out/cert.pem1875host1 # [ 8.867328] acme-host1-start[670]: 'cert.pem' -> '../out/cert.pem'1876host1 # [ 8.869821] acme-host1-start[669]: + cp -vp key.pem ../out/key.pem1877host1 # [ 8.877095] acme-host1-start[669]: 'key.pem' -> '../out/key.pem'1878host1 # [ 8.879169] acme-host1-start[631]: + cat out/cert.pem ca/cert.pem1879host1 # [ 8.890342] acme-host1-start[631]: + cp ca/cert.pem out/chain.pem1880host1 # [ 8.899307] network-addresses-eth1-start[644]: adding address 192.168.1.1/24... done1881host1 # [ 8.901276] acme-host1-start[631]: + cat out/key.pem out/fullchain.pem1882host1 # [ 8.908667] acme-host1-start[631]: + for fixpath in out certificates1883host1 # [ 8.909957] acme-host1-start[631]: + '[' -d out ']'1884host1 # [ 8.911087] acme-host1-start[631]: + chmod -R u=rwX,g=rX,o= out1885host1 # [ 8.918649] network-addresses-eth1-start[644]: adding address 2001:db8:1::1/64... done1886host1 # [ 8.923221] acme-host1-start[631]: + chown -R acme:acme out1887host1 # [ 8.936895] acme-host1-start[631]: + for fixpath in out certificates1888host1 # [ 8.938625] acme-host1-start[631]: + '[' -d certificates ']'1889host1 # [ 8.943080] systemd[1]: Finished Ensure certificate for host1.1890host1 # [ 8.948841] systemd[1]: Finished Address configuration of eth1.1891host1 # [ 8.985488] dhcpcd[671]: dhcpcd-10.3.2 starting1892host1 # [ 8.991052] dhcpcd[727]: dev: loaded udev1893host1 # [ 9.143548] 8021q: 802.1Q VLAN Support v1.81894host1 # [ 9.144033] 8021q: adding VLAN 0 to HW filter on device eth11895host1 # [ 9.007889] systemd[1]: Finished Extra networking commands..1896host1 # [ 9.010490] systemd[1]: Reached target Network.1897host1 # [ 9.013527] systemd[1]: Starting Permit User Sessions...1898host1 # [ 9.039151] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1899host1 # [ 9.231324] cfg80211: Loading compiled-in X.509 certificates for regulatory database1900host1 # [ 9.098065] systemd[1]: Finished Permit User Sessions.1901host1 # [ 9.101909] systemd[1]: Started Getty on tty1.1902host1 # [ 9.103645] systemd[1]: Reached target Login Prompts.1903host1 # [ 9.253751] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1904host1 # [ 9.254485] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1905host1 # [ 9.256578] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -21906host1 # [ 9.257536] cfg80211: failed to load regulatory.db1907host1 # [ 9.282787] 8021q: adding VLAN 0 to HW filter on device eth01908host1 # [ 9.142751] dhcpcd[727]: eth0: waiting for carrier1909host1 # [ 9.143716] dhcpcd[727]: eth0: carrier acquired1910host1 # [ 9.148349] dhcpcd[727]: DUID 00:01:00:01:32:45:52:33:52:54:00:12:34:561911host1 # [ 9.149496] dhcpcd[727]: eth0: IAID 00:12:34:561912host1 # [ 9.150268] dhcpcd[727]: eth0: adding address fe80::5054:ff:fe12:34561913server # [ 9.214355] ppdev: user-space parallel port driver1914server # [ 9.260670] Console: switching to colour frame buffer device 160x501915server # [ 9.436355] bochs-drm 0000:00:01.0: [drm] fb0: bochs-drmdrmfb frame buffer device1916server # [ 8.819416] systemd[1]: Started D-Bus System Message Bus.1917server # [ 9.309233] dbus-broker-launch[534]: Ready1918server # [ 9.315324] step-ca-pki-start[550]: Your certificate has been saved in root_ca.crt.1919server # [ 9.318143] step-ca-pki-start[550]: Your private key has been saved in root_ca.key.1920server # [ 9.319170] acme-setup-start[568]: + set -euo pipefail1921server # [ 9.319819] acme-setup-start[568]: + test -e ca/key.pem1922server # [ 9.326102] acme-setup-start[568]: + minica --ca-key ca/key.pem --ca-cert ca/cert.pem --domains selfsigned.local1923server # [ 9.332209] systemd[1]: Stopped target Host and Network Name Lookups.1924server # [ 9.337200] nsncd[631]: Sep 22 14:50:26.390 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1925server # [ 9.344538] systemd[1]: Stopping Host and Network Name Lookups...1926server # [ 9.345965] network-addresses-eth1-start[665]: adding address 192.168.1.2/24... done1927server # [ 9.353868] network-addresses-eth1-start[665]: adding address 2001:db8:1::2/64... done1928server # [ 9.356809] acme-server-start[661]: Waiting to acquire lock in /run/acme/1929server # [ 9.358774] systemd[1]: Stopped target User and Group Name Lookups.1930server # [ 9.363962] acme-server-start[661]: + '[' -e out/acme-success ']'1931server # [ 9.365509] acme-server-start[661]: + minica --ca-cert=ca/cert.pem --ca-key=ca/key.pem --domains=server --ip-addresses=1932server # [ 9.368162] systemd[1]: Stopping User and Group Name Lookups...1933server # [ 9.373432] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...1934server # [ 9.376149] systemd[1]: nscd.service: Deactivated successfully.1935server # [ 9.379065] systemd[1]: Stopped Name Service Cache Daemon (nsncd).1936server # [ 9.379981] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1937server # [ 9.385771] systemd[1]: Started Name Service Cache Daemon (nsncd).1938server # [ 9.386628] systemd[1]: Reached target Host and Network Name Lookups.1939server # [ 9.387546] systemd[1]: Reached target User and Group Name Lookups.1940server # [ 9.390100] systemd[1]: Finished Set up the ACME certificate renewal infrastructure.1941server # [ 9.393532] systemd[1]: Starting Ensure certificate for server...1942server # [ 9.394372] systemd[1]: Finished resolvconf update.1943server # [ 9.395025] systemd[1]: Reached target Preparation for Network.1944server # [ 9.395811] systemd[1]: Starting DHCP Client...1945server # [ 9.399294] systemd[1]: Starting Address configuration of eth1...1946server # [ 9.406700] systemd[1]: Starting Extra networking commands....1947server # [ 9.407723] step-ca-pki-start[673]: Your certificate has been saved in intermediate_ca.crt.1948server # [ 9.408756] step-ca-pki-start[673]: Your private key has been saved in intermediate_ca.key.1949server # [ 9.409810] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1950server # [ 9.415304] systemd[1]: Stopped Virtual Console Setup.1951server # [ 9.416190] systemd-logind[558]: New seat seat0.1952server # [ 9.416858] systemd[1]: Starting Virtual Console Setup...1953server # [ 9.417593] systemd-logind[558]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard)1954server # [ 9.422134] systemd-logind[558]: Watching system buttons on /dev/input/event2 (Power Button)1955server # [ 9.423305] systemd[1]: Started User Login Management.1956server # [ 9.423981] systemd[1]: Starting linger-users.service...1957server # [ 9.424734] systemd-logind[558]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1958server # [ 9.425832] systemd[1]: Finished Address configuration of eth1.1959server # [ 9.437478] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1960server # [ 9.443072] systemd[1]: Stopped Virtual Console Setup.1961server # [ 9.449885] systemd[1]: Starting Virtual Console Setup...1962server # [ 9.596379] iTCO_wdt iTCO_wdt.1.auto: Found a ICH9 TCO device (Version=2, TCOBASE=0x0660)1963server # [ 9.471172] acme-server-start[730]: + cd server1964server # [ 9.471790] acme-server-start[730]: + cp -vp cert.pem ../out/cert.pem1965server # [ 9.475717] systemd[1]: linger-users.service: Deactivated successfully.1966server # [ 9.479855] systemd[1]: Finished linger-users.service.1967server # [ 9.484354] systemd[1]: Finished step-ca-pki.service.1968server # [ 9.491795] acme-server-start[733]: 'cert.pem' -> '../out/cert.pem'1969server # [ 9.492662] acme-server-start[730]: + cp -vp key.pem ../out/key.pem1970server # [ 9.498697] acme-server-start[730]: 'key.pem' -> '../out/key.pem'1971server # [ 9.502159] acme-server-start[661]: + cat out/cert.pem ca/cert.pem1972server # [ 9.514697] acme-server-start[661]: + cp ca/cert.pem out/chain.pem1973server # [ 9.529812] acme-server-start[661]: + cat out/key.pem out/fullchain.pem1974server # [ 9.677195] iTCO_wdt iTCO_wdt.1.auto: initialized. heartbeat=30 sec (nowayout=0)1975server # [ 9.541198] acme-server-start[661]: + for fixpath in out certificates1976server # [ 9.542529] acme-server-start[661]: + '[' -d out ']'1977server # [ 9.543244] acme-server-start[661]: + chmod -R u=rwX,g=rX,o= out1978server # [ 9.552558] acme-server-start[661]: + chown -R acme:nix-grpc-daemon out1979server # [ 9.568870] acme-server-start[661]: + for fixpath in out certificates1980server # [ 9.569761] acme-server-start[661]: + '[' -d certificates ']'1981server # [ 9.574746] systemd[1]: Finished Ensure certificate for server.1982server # [ 9.576975] dhcpcd[680]: dhcpcd-10.3.2 starting1983server # [ 9.585531] dhcpcd[760]: dev: loaded udev1984server # [ 9.594579] systemd[1]: Finished Extra networking commands..1985server # [ 9.596683] systemd[1]: Reached target Network.1986server # [ 9.599718] systemd[1]: Starting Permit User Sessions...1987server # [ 9.750430] 8021q: 802.1Q VLAN Support v1.81988server # [ 9.750867] 8021q: adding VLAN 0 to HW filter on device eth11989server # [ 9.675101] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1990server # [ 9.723078] systemd[1]: Finished Permit User Sessions.1991server # [ 9.747181] systemd[1]: Started Getty on tty1.1992server # [ 9.748842] systemd[1]: Reached target Login Prompts.1993server # [ 9.906741] cfg80211: Loading compiled-in X.509 certificates for regulatory database1994server # [ 9.930545] kvm_amd: TSC scaling supported1995server # [ 9.931013] kvm_amd: Nested Virtualization enabled1996server # [ 9.931768] kvm_amd: Nested Paging enabled1997server # [ 9.932394] kvm_amd: LBR virtualization supported1998server # [ 9.932844] kvm_amd: Virtual VMLOAD VMSAVE supported1999server # [ 9.933594] kvm_amd: Virtual GIF supported2000server # [ 9.933969] kvm_amd: Virtual NMI enabled2001server # [ 9.951257] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'2002server # [ 9.951891] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'2003server # [ 9.954135] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -22004server # [ 9.954967] cfg80211: failed to load regulatory.db2005server # [ 9.977412] EDAC MC: Ver: 3.0.02006server # [ 9.998383] 8021q: adding VLAN 0 to HW filter on device eth02007server # [ 9.857438] dhcpcd[760]: eth0: waiting for carrier2008server # [ 9.858390] dhcpcd[760]: eth0: carrier acquired2009server # [ 9.864419] dhcpcd[760]: DUID 00:01:00:01:32:45:52:33:52:54:00:12:34:562010server # [ 9.865706] dhcpcd[760]: eth0: IAID 00:12:34:562011server # [ 9.866558] dhcpcd[760]: eth0: adding address fe80::5054:ff:fe12:34562012server # [ 9.897058] systemd-vconsole-setup[725]: Configuration of first virtual console was skipped, ignoring remaining ones.2013server # [ 9.900292] systemd[1]: Finished Virtual Console Setup.2014host1 # [ 10.054147] dhcpcd[727]: eth0: soliciting a DHCP lease2015host1 # [ 10.204903] NET: Registered PF_PACKET protocol family2016host1 # [ 10.067592] dhcpcd[727]: eth0: offered 10.0.2.15 from 10.0.2.22017host1 # [ 10.070162] dhcpcd[727]: eth0: probing address 10.0.2.15/242018server # [ 10.635789] dhcpcd[760]: eth0: soliciting a DHCP lease2019server # [ 10.795521] NET: Registered PF_PACKET protocol family2020server # [ 10.660843] dhcpcd[760]: eth0: offered 10.0.2.15 from 10.0.2.22021server # [ 10.663351] dhcpcd[760]: eth0: probing address 10.0.2.15/242022host1 # [ 11.156817] dhcpcd[727]: eth0: soliciting an IPv6 router2023host1 # [ 11.158160] dhcpcd[727]: eth0: Router Advertisement from fe80::22024host1 # [ 11.158961] dhcpcd[727]: eth0: adding address fec0::5054:ff:fe12:3456/642025host1 # [ 11.159847] dhcpcd[727]: eth0: adding route to fec0::/642026host1 # [ 11.160582] dhcpcd[727]: eth0: adding default route via fe80::22027server # [ 12.108583] dhcpcd[760]: eth0: soliciting an IPv6 router2028server # [ 12.109990] dhcpcd[760]: eth0: Router Advertisement from fe80::22029server # [ 12.111419] dhcpcd[760]: eth0: adding address fec0::5054:ff:fe12:3456/642030server # [ 12.112301] dhcpcd[760]: eth0: adding route to fec0::/642031server # [ 12.113047] dhcpcd[760]: eth0: adding default route via fe80::22032host1 # [ 14.774632] dhcpcd[727]: eth0: leased 10.0.2.15 for 86400 seconds2033host1 # [ 14.776463] dhcpcd[727]: eth0: adding route to 10.0.2.0/242034host1 # [ 14.779253] dhcpcd[727]: eth0: adding default route via 10.0.2.22035host1 # [ 14.853772] systemd[1]: Started DHCP Client.2036host1 # [ 14.856063] systemd[1]: Reached target Network is Online.2037host1 # [ 14.858880] systemd[1]: Starting fetch-ca-root.service...2038host1 # [ 14.892392] fetch-ca-root-start[813]: curl: (7) Failed to connect to server:8443 after 5 ms: Could not connect to server2039server # [ 15.362194] dhcpcd[760]: eth0: leased 10.0.2.15 for 86400 seconds2040server # [ 15.363186] dhcpcd[760]: eth0: adding route to 10.0.2.0/242041server # [ 15.363952] dhcpcd[760]: eth0: adding default route via 10.0.2.22042server # [ 15.426183] systemd[1]: Started DHCP Client.2043server # [ 15.428404] systemd[1]: Reached target Network is Online.2044server # [ 15.431635] systemd[1]: Starting step-ca service...2045server # [ 15.617789] step-ca[897]: badger 2026/09/22 14:50:32 INFO: All 0 tables opened in 0s2046server # [ 15.641551] step-ca[897]: 2026/09/22 14:50:32 Building new tls configuration using step-ca x509 Signer Interface2047server # [ 15.667095] step-ca[897]: 2026/09/22 14:50:32 Starting Smallstep CA/0.30.2 (linux/amd64)2048server # [ 15.668102] step-ca[897]: 2026/09/22 14:50:32 Documentation: https://u.step.sm/docs/ca2049server # [ 15.669033] step-ca[897]: 2026/09/22 14:50:32 Community Discord: https://u.step.sm/discord2050server # [ 15.669996] step-ca[897]: 2026/09/22 14:50:32 Config file: /etc/smallstep/ca.json2051server # [ 15.670936] step-ca[897]: 2026/09/22 14:50:32 The primary server URL is https://server:84432052server # [ 15.671957] step-ca[897]: 2026/09/22 14:50:32 Root certificates are available at https://server:8443/roots.pem2053server # [ 15.673124] step-ca[897]: 2026/09/22 14:50:32 X.509 Root Fingerprint: ec624fdfb7d090f743fa62c5dda3eeeb5fc6c408f82c28723f634148dd4696642054server # [ 15.675508] systemd[1]: Started step-ca service.2055server # [ 15.678556] systemd[1]: Reached target Multi-User System.2056server # [ 15.681938] systemd[1]: Starting Order (and renew) ACME certificate for server...2057server # [ 15.684336] step-ca[897]: 2026/09/22 14:50:32 Serving HTTPS on 0.0.0.0:8443 ...2058server # [ 15.726047] acme-order-renew-server-start[904]: Waiting to acquire lock in /run/acme/2059server # [ 15.731058] acme-order-renew-server-start[904]: + set -euo pipefail2060server # [ 15.732091] acme-order-renew-server-start[904]: + exec2061server # [ 15.732788] acme-order-renew-server-start[904]: + /nix/store/m9ik4hd36632x3n2ibrxl2vyi0w4y094-flock-0.4.0/bin/flock 112062server # [ 15.735658] acme-order-renew-server-start[913]: ++ find accounts -path '*/keys/*.key' -print -quit2063server # [ 15.742062] acme-order-renew-server-start[904]: + '[' -n '' ']'2064server # [ 15.742827] acme-order-renew-server-start[904]: + exec2065server # [ 15.743634] acme-order-renew-server-start[904]: + '[' -e certificates/server.key ']'2066server # [ 15.744595] acme-order-renew-server-start[904]: + lego run --accept-tos --path . --email root@example.org --http --http.address :80 --server https://server:8443/acme/acme/directory --key-type ec256 -d server --no-random-sleep --renew-force --ari-disable --force-cert-domains2067server # [ 15.908445] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.218578477Z INFO Private key saved. filepath=accounts/server_8443/root@example.org/root@example.org.key2068host1 # [ 15.924680] systemd[1]: Finished fetch-ca-root.service.2069server # [ 15.931264] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.241982569Z INFO Registering the account. email=root@example.org2070host1 # [ 15.929226] systemd[1]: Reached target Multi-User System.2071host1 # [ 15.936912] systemd[1]: Starting Order (and renew) ACME certificate for host1...2072server # [ 15.946695] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.257228361Z WARN !!!! HEADS UP !!!!2073server # [ 15.948148] acme-order-renew-server-start[914]: Your account credentials have been saved in your2074server # [ 15.949192] acme-order-renew-server-start[914]: configuration directory at "accounts".2075server # [ 15.950118] acme-order-renew-server-start[914]: You should make a secure backup of this folder now. This2076server # [ 15.951249] acme-order-renew-server-start[914]: configuration directory will also contain private keys2077server # [ 15.952318] acme-order-renew-server-start[914]: generated by lego and certificates obtained from the ACME2078server # [ 15.953397] acme-order-renew-server-start[914]: server. Making regular backups of this folder is ideal.2079server # [ 15.954841] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.265532769Z INFO Obtaining bundled SAN certificate. domains=server2080host1 # [ 15.991857] acme-order-renew-host1-start[818]: Waiting to acquire lock in /run/acme/2081host1 # [ 15.996882] acme-order-renew-host1-start[818]: + set -euo pipefail2082host1 # [ 15.997987] acme-order-renew-host1-start[818]: + exec2083host1 # [ 15.998679] acme-order-renew-host1-start[818]: + /nix/store/m9ik4hd36632x3n2ibrxl2vyi0w4y094-flock-0.4.0/bin/flock 112084host1 # [ 16.001461] acme-order-renew-host1-start[826]: ++ find accounts -path '*/keys/*.key' -print -quit2085host1 # [ 16.007064] acme-order-renew-host1-start[818]: + '[' -n '' ']'2086host1 # [ 16.007830] acme-order-renew-host1-start[818]: + exec2087host1 # [ 16.008628] acme-order-renew-host1-start[818]: + '[' -e certificates/host1.key ']'2088host1 # [ 16.009579] acme-order-renew-host1-start[818]: + lego run --accept-tos --path . --email root@example.org --http --http.address :80 --server https://server:8443/acme/acme/directory --key-type ec256 -d host1 --no-random-sleep --renew-force --ari-disable --force-cert-domains2089server # [ 16.053565] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.362659359Z INFO Use solver. domain=server type=http-012090server # [ 16.056917] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.362722495Z INFO http01: Trying to solve HTTP-01. domain=server2091server # [ 16.077183] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.387526765Z INFO The server validated our request. domain=server2092server # [ 16.079969] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.387631248Z INFO Validations succeeded; requesting certificates. domains=server2093server # [ 16.112902] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.422920090Z INFO Server responded with a certificate. domains=server2094server # [ 16.114783] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.423018427Z INFO Writing file. filepath=certificates/server.crt2095server # [ 16.116176] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.423174313Z INFO Writing file. filepath=certificates/server.issuer.crt2096server # [ 16.117581] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.423285221Z INFO Writing file. filepath=certificates/server.key2097server # [ 16.118961] acme-order-renew-server-start[914]: 2026-09-22T14:50:33.423426579Z INFO Writing file. filepath=certificates/server.json2098server # [ 16.122651] acme-order-renew-server-start[904]: + touch out/acme-success2099server # [ 16.126256] acme-order-renew-server-start[904]: + cmp -s certificates/server.crt out/fullchain.pem2100server # [ 16.129551] acme-order-renew-server-start[904]: + touch out/renewed2101host1 # [ 16.128462] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.042023356Z INFO Private key saved. filepath=accounts/server_8443/root@example.org/root@example.org.key2102server # [ 16.132427] acme-order-renew-server-start[904]: + echo Installing new certificate2103server # [ 16.133452] acme-order-renew-server-start[904]: Installing new certificate2104server # [ 16.134613] acme-order-renew-server-start[904]: + cp -vp certificates/server.crt out/fullchain.pem2105server # [ 16.137774] acme-order-renew-server-start[922]: 'certificates/server.crt' -> 'out/fullchain.pem'2106server # [ 16.139285] acme-order-renew-server-start[904]: + cp -vp certificates/server.key out/key.pem2107server # [ 16.142596] acme-order-renew-server-start[923]: 'certificates/server.key' -> 'out/key.pem'2108server # [ 16.144405] acme-order-renew-server-start[904]: + cp -vp certificates/server.issuer.crt out/chain.pem2109server # [ 16.148189] acme-order-renew-server-start[924]: 'certificates/server.issuer.crt' -> 'out/chain.pem'2110server # [ 16.149791] acme-order-renew-server-start[904]: + ln -sf fullchain.pem out/cert.pem2111host1 # [ 16.147784] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.061813581Z INFO Registering the account. email=root@example.org2112server # [ 16.153593] acme-order-renew-server-start[904]: + cat out/key.pem out/fullchain.pem2113server # [ 16.157813] acme-order-renew-server-start[904]: + for fixpath in out certificates2114server # [ 16.158947] acme-order-renew-server-start[904]: + '[' -d out ']'2115server # [ 16.159893] acme-order-renew-server-start[904]: + chmod -R u=rwX,g=rX,o= out2116server # [ 16.164238] acme-order-renew-server-start[904]: + chown -R acme:nix-grpc-daemon out2117server # [ 16.169683] acme-order-renew-server-start[904]: + for fixpath in out certificates2118server # [ 16.171120] acme-order-renew-server-start[904]: + '[' -d certificates ']'2119host1 # [ 16.169410] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.083412136Z WARN !!!! HEADS UP !!!!2120server # [ 16.171960] acme-order-renew-server-start[904]: + chmod -R u=rwX,g=rX,o= certificates2121host1 # [ 16.170618] acme-order-renew-host1-start[827]: Your account credentials have been saved in your2122host1 # [ 16.171655] acme-order-renew-host1-start[827]: configuration directory at "accounts".2123server # [ 16.174747] acme-order-renew-server-start[904]: + chown -R acme:nix-grpc-daemon certificates2124host1 # [ 16.172631] acme-order-renew-host1-start[827]: You should make a secure backup of this folder now. This2125host1 # [ 16.173743] acme-order-renew-host1-start[827]: configuration directory will also contain private keys2126host1 # [ 16.174826] acme-order-renew-host1-start[827]: generated by lego and certificates obtained from the ACME2127host1 # [ 16.176645] acme-order-renew-host1-start[827]: server. Making regular backups of this folder is ideal.2128server # [ 16.180081] acme-order-renew-server-start[904]: + chmod -R u=rwX,g=,o= accounts/.2129host1 # [ 16.177805] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.090164391Z INFO Obtaining bundled SAN certificate. domains=host12130server # [ 16.235064] systemd[1]: acme-order-renew-server.service: Deactivated successfully.2131server # [ 16.236989] systemd[1]: Finished Order (and renew) ACME certificate for server.2132server # [ 16.241254] systemd[1]: Startup finished in 926ms (kernel) + 4.535s (initrd) + 10.778s (userspace) = 16.240s.2133server # [ 16.242462] systemd[1]: acme-order-renew-server.service: Consumed 173ms CPU time over 554ms wall clock time, 46.6M memory peak, 4K written to disk, 10.3K incoming IP traffic, 8.1K outgoing IP traffic.2134host1 # [ 16.267597] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.180226675Z INFO Use solver. domain=host1 type=http-012135host1 # [ 16.271068] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.180284504Z INFO http01: Trying to solve HTTP-01. domain=host12136host1 # [ 16.283202] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.195911630Z INFO The server validated our request. domain=host12137host1 # [ 16.286678] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.196039020Z INFO Validations succeeded; requesting certificates. domains=host12138server: (finished: waiting for unit step-ca.service, in 16.98 seconds)2139server: waiting for unit nix-grpc-daemon.socket2140host1 # [ 16.309146] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.222352979Z INFO Server responded with a certificate. domains=host12141host1 # [ 16.312593] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.222521995Z INFO Writing file. filepath=certificates/host1.crt2142host1 # [ 16.315833] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.222709728Z INFO Writing file. filepath=certificates/host1.issuer.crt2143host1 # [ 16.319293] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.222808624Z INFO Writing file. filepath=certificates/host1.key2144host1 # [ 16.322749] acme-order-renew-host1-start[827]: 2026-09-22T14:50:34.222989932Z INFO Writing file. filepath=certificates/host1.json2145server: (finished: waiting for unit nix-grpc-daemon.socket, in 0.02 seconds)2146server: waiting for TCP port 50051 on localhost2147host1 # [ 16.330893] acme-order-renew-host1-start[818]: + touch out/acme-success2148host1 # [ 16.339286] acme-order-renew-host1-start[818]: + cmp -s certificates/host1.crt out/fullchain.pem2149host1 # [ 16.345652] acme-order-renew-host1-start[818]: + touch out/renewed2150host1 # [ 16.351492] acme-order-renew-host1-start[818]: + echo Installing new certificate2151server # Connection to localhost (127.0.0.1) 50051 port [tcp/*] succeeded!2152host1 # [ 16.353560] acme-order-renew-host1-start[818]: Installing new certificate2153server # [ 16.357370] systemd[1]: Starting Order (and renew) ACME certificate for server...2154host1 # [ 16.355539] acme-order-renew-host1-start[818]: + cp -vp certificates/host1.crt out/fullchain.pem2155server: (finished: waiting for TCP port 50051 on localhost, in 0.03 seconds)2156subtest: host1 obtains a certificate via ACME2157host1: waiting for success: /nix/store/44gxi8li8y8wrxrb93sya9hljkpigsqw-openssl-3.6.4-bin/bin/openssl x509 -in /var/lib/acme/host1/cert.pem -noout -subject -issuer | grep -q 'Test Intermediate CA'2158host1: waiting for the VM to finish booting2159host1: Guest shell says: b'Spawning backdoor root shell...\n'2160host1: connected to guest root shell2161host1: (connecting took 0.00 seconds)2162host1: (finished: waiting for the VM to finish booting, in 0.00 seconds)2163host1 # [ 16.360327] acme-order-renew-host1-start[834]: 'certificates/host1.crt' -> 'out/fullchain.pem'2164host1 # [ 16.362969] acme-order-renew-host1-start[818]: + cp -vp certificates/host1.key out/key.pem2165host1 # [ 16.367876] acme-order-renew-host1-start[837]: 'certificates/host1.key' -> 'out/key.pem'2166host1 # [ 16.369608] acme-order-renew-host1-start[818]: + cp -vp certificates/host1.issuer.crt out/chain.pem2167host1 # [ 16.374243] acme-order-renew-host1-start[839]: 'certificates/host1.issuer.crt' -> 'out/chain.pem'2168host1 # [ 16.376518] acme-order-renew-host1-start[818]: + ln -sf fullchain.pem out/cert.pem2169host1 # [ 16.381657] acme-order-renew-host1-start[818]: + cat out/key.pem out/fullchain.pem2170host1 # [ 16.387300] acme-order-renew-host1-start[818]: + for fixpath in out certificates2171host1 # [ 16.388634] acme-order-renew-host1-start[818]: + '[' -d out ']'2172host1 # [ 16.389432] acme-order-renew-host1-start[818]: + chmod -R u=rwX,g=rX,o= out2173server # [ 16.396234] acme-order-renew-server-start[955]: Waiting to acquire lock in /run/acme/2174host1 # [ 16.396188] acme-order-renew-host1-start[818]: + chown -R acme:acme out2175server # [ 16.400897] acme-order-renew-server-start[955]: + set -euo pipefail2176server # [ 16.401773] acme-order-renew-server-start[955]: + exec2177server # [ 16.402542] acme-order-renew-server-start[955]: + /nix/store/m9ik4hd36632x3n2ibrxl2vyi0w4y094-flock-0.4.0/bin/flock 112178server # [ 16.405374] acme-order-renew-server-start[963]: ++ find accounts -path '*/keys/*.key' -print -quit2179host1 # [ 16.406405] acme-order-renew-host1-start[818]: + for fixpath in out certificates2180server # [ 16.409404] acme-order-renew-server-start[955]: + '[' -n '' ']'2181host1 # [ 16.407387] acme-order-renew-host1-start[818]: + '[' -d certificates ']'2182server # [ 16.410226] acme-order-renew-server-start[955]: + exec2183server # [ 16.410874] acme-order-renew-server-start[955]: + '[' -e certificates/server.key ']'2184host1 # [ 16.409056] acme-order-renew-host1-start[818]: + chmod -R u=rwX,g=rX,o= certificates2185server # [ 16.411892] acme-order-renew-server-start[955]: + '[' -e certificates/server.crt ']'2186server # [ 16.413288] acme-order-renew-server-start[964]: ++ find accounts -name root@example.org.key2187server # [ 16.416969] acme-order-renew-server-start[955]: + '[' -n accounts/server_8443/root@example.org/root@example.org.key ']'2188host1 # [ 16.415405] acme-order-renew-host1-start[818]: + chown -R acme:acme certificates2189server # [ 16.418513] acme-order-renew-server-start[955]: + lego run --accept-tos --path . --email root@example.org --http --http.address :80 --server https://server:8443/acme/acme/directory --key-type ec256 -d server --no-random-sleep --force-cert-domains2190host1 # [ 16.424456] acme-order-renew-host1-start[818]: + chmod -R u=rwX,g=,o= accounts/.2191server # [ 16.438301] acme-order-renew-server-start[965]: 2026-09-22T14:50:33.748253617Z INFO Renewing certificate cert-name=server2192host1: (finished: waiting for success: /nix/store/44gxi8li8y8wrxrb93sya9hljkpigsqw-openssl-3.6.4-bin/bin/openssl x509 -in /var/lib/acme/host1/cert.pem -noout -subject -issuer | grep -q 'Test Intermediate CA', in 0.08 seconds)2193host1: must succeed: /nix/store/44gxi8li8y8wrxrb93sya9hljkpigsqw-openssl-3.6.4-bin/bin/openssl x509 -in /var/lib/acme/host1/cert.pem -noout -subject | grep -q 'CN *= *host1'2194server # [ 16.443741] acme-order-renew-server-start[965]: 2026-09-22T14:50:33.754467256Z WARN The server does not advertise a renewal info endpoint. cert-name=server error="renewalInfo[get/post]: server does not advertise a renewal info endpoint"2195server # [ 16.446183] acme-order-renew-server-start[965]: 2026-09-22T14:50:33.756820628Z INFO Skip renewal: The certificate expires at 2026-09-23T14:50:33Z, the renewal can be performed in 11h59m29s243194737ns. cert-name=server2196server # [ 16.450485] acme-order-renew-server-start[955]: + touch out/acme-success2197server # [ 16.454121] acme-order-renew-server-start[955]: + cmp -s certificates/server.crt out/fullchain.pem2198server # [ 16.456818] acme-order-renew-server-start[955]: + for fixpath in out certificates2199server # [ 16.457807] acme-order-renew-server-start[955]: + '[' -d out ']'2200server # [ 16.458640] acme-order-renew-server-start[955]: + chmod -R u=rwX,g=rX,o= out2201server # [ 16.462078] acme-order-renew-server-start[955]: + chown -R acme:nix-grpc-daemon out2202server # [ 16.466991] acme-order-renew-server-start[955]: + for fixpath in out certificates2203server # [ 16.468036] acme-order-renew-server-start[955]: + '[' -d certificates ']'2204server # [ 16.468927] acme-order-renew-server-start[955]: + chmod -R u=rwX,g=rX,o= certificates2205server # [ 16.472254] acme-order-renew-server-start[955]: + chown -R acme:nix-grpc-daemon certificates2206server # [ 16.476818] acme-order-renew-server-start[955]: + chmod -R u=rwX,g=,o= accounts/.2207host1: (finished: must succeed: /nix/store/44gxi8li8y8wrxrb93sya9hljkpigsqw-openssl-3.6.4-bin/bin/openssl x509 -in /var/lib/acme/host1/cert.pem -noout -subject | grep -q 'CN *= *host1', in 0.05 seconds)2208(finished: subtest: host1 obtains a certificate via ACME, in 0.13 seconds)2209subtest: server builds and signs a path2210server: must succeed: nix build --impure -f /etc/hello.nix --no-link --print-out-paths2211host1 # [ 16.488082] systemd[1]: acme-order-renew-host1.service: Deactivated successfully.2212host1 # [ 16.489709] systemd[1]: Finished Order (and renew) ACME certificate for host1.2213host1 # [ 16.494151] systemd[1]: Startup finished in 908ms (kernel) + 3.807s (initrd) + 11.776s (userspace) = 16.493s.2214host1 # [ 16.495438] systemd[1]: acme-order-renew-host1.service: Consumed 183ms CPU time over 552ms wall clock time, 46.5M memory peak, 4K written to disk, 10.3K incoming IP traffic, 8.3K outgoing IP traffic.2215server # [ 16.512675] systemd[1]: acme-order-renew-server.service: Deactivated successfully.2216server # [ 16.514755] systemd[1]: Finished Order (and renew) ACME certificate for server.2217server # [ 16.516520] systemd[1]: acme-order-renew-server.service: Consumed 83ms CPU time over 156ms wall clock time, 7M memory peak, 3.3K incoming IP traffic, 2.2K outgoing IP traffic.2218server # [ 16.526206] systemd[1]: Starting Nix worker-protocol over gRPC...2219server # [ 16.625704] nix-grpc-daemon[988]: ts=2026-09-22T14:50:33Z level=info event=roles builder=1 scheduler=1 scheduler_addr="" advertise=0.0.0.0:50051 niks3="" max_jobs=12220server # [ 16.640260] nix-grpc-daemon[988]: WARNING: All log messages before absl::InitializeLog() is called are written to STDERR2221server # [ 16.642753] nix-grpc-daemon[988]: E0000 00:00:1790088633.950634 988 tls_security_connector.cc:771] TlsServerCertificateWatcher getting identity_cert_error: UNKNOWN:Unable to get latest identity certificates.2222server # [ 16.648427] nix-grpc-daemon[988]: E0000 00:00:1790088633.958833 988 tls_security_connector.cc:767] TlsServerCertificateWatcher getting root_cert_error: UNKNOWN:Unable to get latest root certificates.2223server # [ 16.651165] nix-grpc-daemon[988]: ts=2026-09-22T14:50:33Z level=info event=startup listen=systemd proxy_socket=/nix/var/nix/daemon-socket/socket2224server # [ 16.654083] nix-grpc-daemon[988]: ts=2026-09-22T14:50:33Z level=info event=worker_hello addr=0.0.0.0:50051 systems=x86_64-linux,i686-linux,x86_64-v1-linux,x86_64-v2-linux,x86_64-v3-linux,x86_64-v4-linux max_jobs=1 running=02225server # [ 16.658033] nix-grpc-daemon[988]: ts=2026-09-22T14:50:33Z level=info event=unhealthy reason=min_free2226server # [ 16.659343] systemd[1]: Started Nix worker-protocol over gRPC.2227server # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 40 ms (attempt 1/5)2228server # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 116 ms (attempt 2/5)2229server # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 71 ms (attempt 3/5)2230server # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 489 ms (attempt 4/5)2231server # disabling binary cache 'https://cache.nixos.org' for 60 seconds2232server # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org2233server # this derivation will be built:2234server # /nix/store/avig127vzdbg0267m1wbz6jgaaa80332-hello-grpc.drv2235server # building '/nix/store/avig127vzdbg0267m1wbz6jgaaa80332-hello-grpc.drv'...2236server: (finished: must succeed: nix build --impure -f /etc/hello.nix --no-link --print-out-paths, in 1.22 seconds)2237server: must succeed: nix store sign -k /etc/cache-key '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc'2238server # added 1 signatures2239server: (finished: must succeed: nix store sign -k /etc/cache-key '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc', in 0.14 seconds)2240(finished: subtest: server builds and signs a path, in 1.36 seconds)2241subtest: host1 substitutes the signed path over gRPC (read-only cert)2242host1: must fail: test -e '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc'2243host1: (finished: must fail: test -e '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc', in 0.02 seconds)2244host1: must succeed: nix-store -r '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc'2245host1 # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 56 ms (attempt 1/5)2246host1 # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 81 ms (attempt 2/5)2247host1 # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 166 ms (attempt 3/5)2248host1 # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org; retrying in 34 ms (attempt 4/5)2249host1 # disabling binary cache 'https://cache.nixos.org' for 60 seconds2250host1 # warning: unable to download 'https://cache.nixos.org/nix-cache-info': Could not resolve hostname (6) Could not resolve host: cache.nixos.org2251server # [ 18.354519] systemd[1]: Started Nix Daemon.2252server # [ 18.462586] nix-daemon[1019]: accepted connection from pid 988, user nix-grpc-daemon (trusted)2253host1 # this path will be fetched (0.0 KiB download, 0.1 KiB unpacked):2254host1 # /nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc2255host1 # copying path '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc' from 'grpc://server:50051'...2256server # [ 18.487454] nix-grpc-daemon[988]: ts=2026-09-22T14:50:35Z level=info event=rpc method=FetchNars cn=host1 peer=ipv4:192.168.1.1:57398 duration_s=0 paths=1 nar_bytes_out=1282257host1 # warning: you did not specify '--add-root'; the result might be removed by the garbage collector2258host1: (finished: must succeed: nix-store -r '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc', in 0.71 seconds)2259host1: must succeed: grep -q hello-over-grpc '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc'2260host1: (finished: must succeed: grep -q hello-over-grpc '/nix/store/804av042nqqqnz51z8xx4r3cp6vg2x4b-hello-grpc', in 0.02 seconds)2261(finished: subtest: host1 substitutes the signed path over gRPC (read-only cert), in 0.75 seconds)2262subtest: read-only host1 cannot write2263host1: must succeed: echo deny > /root/denyfile2264host1: (finished: must succeed: echo deny > /root/denyfile, in 0.01 seconds)2265host1: must fail: nix store add --store 'grpc://server:50051?ca-cert=/run/root_ca.crt&client-cert=/var/lib/acme/host1/cert.pem&client-key=/var/lib/acme/host1/key.pem' /root/denyfile2266server # [ 18.707929] nix-grpc-daemon[988]: ts=2026-09-22T14:50:36Z level=info event=denied method=Connect cn=host1 role=read-only2267host1 # error: gRPC Connect on 'server:50051' failed: role 'read-only' may not call Connect2268host1 # error: cannot open connection to remote store 'grpc://server:50051': error: Nix daemon disconnected unexpectedly (maybe it crashed?)2269host1: (finished: must fail: nix store add --store 'grpc://server:50051?ca-cert=/run/root_ca.crt&client-cert=/var/lib/acme/host1/cert.pem&client-key=/var/lib/acme/host1/key.pem' /root/denyfile, in 0.14 seconds)2270server: must succeed: journalctl -u nix-grpc-daemon.service | grep -q 'event=denied .*cn=host1 role=read-only'2271server: (finished: must succeed: journalctl -u nix-grpc-daemon.service | grep -q 'event=denied .*cn=host1 role=read-only', in 0.05 seconds)2272(finished: subtest: read-only host1 cannot write, in 0.20 seconds)2273(finished: run the VM test script, in 19.74 seconds)2274test script finished in 19.93s2275cleanup2276kill QemuMachine (pid 47)2277host1 # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/d64q19q1xjdwfhqx6czvrjgrhq0n3lcc-python3-3.14.7/bin/python3.14)2278host1 # [2026-09-22T14:50:37Z INFO virtiofsd] Client disconnected, shutting down2279host1 # [2026-09-22T14:50:37Z INFO virtiofsd] Client disconnected, shutting down2280host1 # [2026-09-22T14:50:37Z INFO virtiofsd] Client disconnected, shutting down2281kill QemuMachine (pid 48)2282server # qemu-system-x86_64: terminating on signal 15 from pid 39 (/nix/store/d64q19q1xjdwfhqx6czvrjgrhq0n3lcc-python3-3.14.7/bin/python3.14)2283server # [2026-09-22T14:50:37Z INFO virtiofsd] Client disconnected, shutting down2284server # [2026-09-22T14:50:37Z INFO virtiofsd] Client disconnected, shutting down2285server # [2026-09-22T14:50:37Z INFO virtiofsd] Client disconnected, shutting down2286(finished: cleanup, in 0.44 seconds)2287additionally exposed symbols:2288 host1, server,2289 vlan1,2290 start_all, test_script, machines, machines_qemu, machines_nspawn, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, BaseMachine, QemuMachine, NspawnMachine, t, debug, dump_machine_ssh