vm-test-run-nix-grpc-store-acme-substituter
checks.aarch64-linux.acme-vm
· build #687
· raw
1tribuchet: building on eliza2Machine state will be reset. To keep it, pass --keep-machine-state3start all VLans4(finished: start all VLans, in 0.08 seconds)5start vhost-device-vsock6(finished: start vhost-device-vsock, in 0.00 seconds)7Test will time out and terminate in 600.0 seconds8run the VM test script9start all VMs10host1: starting vm11server: starting vm12host1 # Disk image does not exist, creating the virtualisation disk image...13host1 # Formatting '/build/vm-state-host1/tmp.nwdwSePurq', fmt=raw size=107374182414host1 # mke2fs 1.47.4 (6-Mar-2025)15host1 # Discarding device blocks: 0/262144 done16host1: QEMU running (pid 54)17host1 # Creating filesystem with 262144 4k blocks and 65536 inodes18host1 # Filesystem UUID: 91628846-5785-432a-97ed-98fff0fef2dc19host1 # Superblock backups stored on blocks:20host1 # 32768, 98304, 163840, 22937621host1 # 22host1 # Allocating group tables: 0/8 done23host1 # Writing inode tables: 0/8 done24host1 # Creating journal (8192 blocks): done25host1 # Writing superblocks and filesystem accounting information: 0/8 done26host1 # 27host1 # Virtualisation disk image created.28host1 # Starting virtiofs daemons...29host1 # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)30host1 # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)31host1 # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether32host1 # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether33host1 # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)34host1 # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether35host1 # [2026-10-25T21:41:07Z INFO virtiofsd] Waiting for vhost-user socket connection...36host1 # [2026-10-25T21:41:07Z INFO virtiofsd] Waiting for vhost-user socket connection...37host1 # [2026-10-25T21:41:07Z INFO virtiofsd] Waiting for vhost-user socket connection...38host1 # [2026-10-25T21:41:07Z INFO virtiofsd] Client connected, servicing requests39host1 # [2026-10-25T21:41:07Z INFO virtiofsd] Client connected, servicing requests40host1 # [2026-10-25T21:41:07Z INFO virtiofsd] Client connected, servicing requests41host1 # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]42host1 # [ 0.000000] Linux version 6.18.56 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT @179172517243host1 # [ 0.000000] KASLR enabled44host1 # [ 0.000000] random: crng init done45host1 # [ 0.000000] Machine model: linux,dummy-virt46host1 # [ 0.000000] efi: UEFI not found.47host1 # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT48host1 # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x00000000bfffffff]49host1 # [ 0.000000] NODE_DATA(0) allocated [mem 0xbfdec700-0xbfdefe7f]50host1 # [ 0.000000] Zone ranges:51host1 # [ 0.000000] DMA [mem 0x0000000040000000-0x00000000bfffffff]52host1 # [ 0.000000] DMA32 empty53host1 # [ 0.000000] Normal empty54host1 # [ 0.000000] Device empty55host1 # [ 0.000000] Movable zone start for each node56host1 # [ 0.000000] Early memory node ranges57host1 # [ 0.000000] node 0: [mem 0x0000000040000000-0x00000000bfffffff]58host1 # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x00000000bfffffff]59host1 # [ 0.000000] cma: Reserved 32 MiB at 0x00000000bbc0000060host1 # [ 0.000000] psci: probing for conduit method from DT.61host1 # [ 0.000000] psci: PSCIv1.3 detected in firmware.62host1 # [ 0.000000] psci: Using standard PSCI v0.2 function IDs63host1 # [ 0.000000] psci: Trusted OS migration not required64host1 # [ 0.000000] psci: SMC Calling Convention v1.165host1 # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)66host1 # [ 0.000000] percpu: Embedded 76 pages/cpu s186904 r8192 d116200 u31129667host1 # [ 0.000000] Detected PIPT I-cache on CPU068host1 # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)69host1 # [ 0.000000] CPU features: detected: GICv3 CPU interface70host1 # [ 0.000000] CPU features: detected: Spectre-v471host1 # [ 0.000000] CPU features: detected: Spectre-BHB72host1 # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_3873host1 # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_2374host1 # [ 0.000000] alternatives: applying boot alternatives75host1 # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/frr5dlaxxxyqjg525jrsyzri40f00pzv-nixos-system-host1-test/init regInfo=/nix/.ro-store/85v55dmmbfzvmzkfqsjf5qa95xpm7myq-closure-info/registration console=ttyAMA0,115200n8 console=tty076host1 # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/85v55dmmbfzvmzkfqsjf5qa95xpm7myq-closure-info/registration", will be passed to user space.77host1 # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes78host1 # [ 0.000000] Dentry cache hash table entries: 262144 (order: 9, 2097152 bytes, linear)79host1 # [ 0.000000] Inode-cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)80host1 # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 2MB81host1 # [ 0.000000] software IO TLB: area num 1.82host1 # [ 0.000000] software IO TLB: mapped [mem 0x00000000bb800000-0x00000000bba00000] (2MB)83host1 # [ 0.000000] Fallback order for Node 0: 084host1 # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 52428885host1 # [ 0.000000] Policy zone: DMA86host1 # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off87host1 # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=188host1 # [ 0.000000] allocated 4194304 bytes of page_ext89host1 # [ 0.000000] ftrace: allocating 75049 entries in 294 pages90host1 # [ 0.000000] ftrace: allocated 294 pages with 4 groups91host1 # [ 0.000000] rcu: Hierarchical RCU implementation.92host1 # [ 0.000000] rcu: RCU event tracing is enabled.93host1 # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=1.94host1 # [ 0.000000] Trampoline variant of Tasks RCU enabled.95host1 # [ 0.000000] Rude variant of Tasks RCU enabled.96host1 # [ 0.000000] Tracing variant of Tasks RCU enabled.97host1 # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.98host1 # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=199host1 # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.100host1 # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.101host1 # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.102host1 # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0103host1 # [ 0.000000] GICv3: 256 SPIs implemented104host1 # [ 0.000000] GICv3: 0 Extended SPIs implemented105host1 # [ 0.000000] Root IRQ handler: gic_handle_irq106host1 # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI107host1 # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0108host1 # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000109host1 # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]110host1 # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44af0000 (indirect, esz 8, psz 64K, shr 1)111host1 # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44b00000 (flat, esz 8, psz 64K, shr 1)112host1 # [ 0.000000] GICv3: using LPI property table @0x0000000044b10000113host1 # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044b20000114host1 # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.115host1 # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns116host1 # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).117host1 # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns118host1 # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns119host1 # [ 0.000046] arm-pv: using stolen time PV120host1 # [ 0.000871] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)121host1 # [ 0.001086] Console: colour dummy device 80x25122host1 # [ 0.001095] printk: legacy console [tty0] enabled123host1 # [ 0.001315] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)124host1 # [ 0.001323] pid_max: default: 32768 minimum: 301125host1 # [ 0.001426] LSM: initializing lsm=capability,landlock,yama,bpf,ima126host1 # [ 0.001764] landlock: Up and running.127host1 # [ 0.001769] Yama: becoming mindful.128host1 # [ 0.002694] LSM support for eBPF active129host1 # [ 0.002930] Mount-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)130host1 # [ 0.002968] Mountpoint-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)131host1 # [ 0.006279] rcu: Hierarchical SRCU implementation.132host1 # [ 0.006561] rcu: Max phase no-delay instances is 1000.133host1 # [ 0.009022] fsl-mc MSI: its@8080000 domain created134host1 # [ 0.009210] EFI services will not be available.135host1 # [ 0.009329] smp: Bringing up secondary CPUs ...136host1 # [ 0.009347] smp: Brought up 1 node, 1 CPU137host1 # [ 0.009351] SMP: Total of 1 processors activated.138host1 # [ 0.009354] CPU: All CPU(s) started at EL1139host1 # [ 0.009373] CPU features: detected: Branch Target Identification140host1 # [ 0.009378] CPU features: detected: ARMv8.4 Translation Table Level141host1 # [ 0.009382] CPU features: detected: Instruction cache invalidation not required for I/D coherence142host1 # [ 0.009385] CPU features: detected: Data cache clean to the PoU not required for I/D coherence143host1 # [ 0.009392] CPU features: detected: Common not Private translations144host1 # [ 0.009395] CPU features: detected: CRC32 instructions145host1 # [ 0.009398] CPU features: detected: Data cache clean to Point of Deep Persistence146host1 # [ 0.009402] CPU features: detected: Data cache clean to Point of Persistence147host1 # [ 0.009405] CPU features: detected: Data independent timing control (DIT)148host1 # [ 0.009408] CPU features: detected: E0PD149host1 # [ 0.009410] CPU features: detected: Enhanced Counter Virtualization150host1 # [ 0.009414] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)151host1 # [ 0.009417] CPU features: detected: Enhanced Virtualization Traps152host1 # [ 0.009420] CPU features: detected: Fine Grained Traps153host1 # [ 0.009423] CPU features: detected: Generic authentication (architected QARMA5 algorithm)154host1 # [ 0.009431] CPU features: detected: RCpc load-acquire (LDAPR)155host1 # [ 0.009441] CPU features: detected: LSE atomic instructions156host1 # [ 0.009452] CPU features: detected: Privileged Access Never157host1 # [ 0.009464] CPU features: detected: PMUv3158host1 # [ 0.009473] CPU features: detected: RAS Extension Support159host1 # [ 0.009476] CPU features: detected: RASv1p1 Extension Support160host1 # [ 0.009479] CPU features: detected: Random Number Generator161host1 # [ 0.009484] CPU features: detected: Speculation barrier (SB)162host1 # [ 0.009487] CPU features: detected: Stage-2 Force Write-Back163host1 # [ 0.009490] CPU features: detected: TLB range maintenance instructions164host1 # [ 0.009495] CPU features: detected: Speculative Store Bypassing Safe (SSBS)165host1 # [ 0.009554] alternatives: applying system-wide alternatives166host1 # [ 0.015453] CPU features: detected: BBM Level 2 without TLB conflict abort167host1 # [ 0.015845] Memory: 1920376K/2097152K available (24512K kernel code, 7102K rwdata, 26572K rodata, 4736K init, 1184K bss, 133164K reserved, 32768K cma-reserved)168host1 # [ 0.019964] devtmpfs: initialized169host1 # [ 0.022886] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)170host1 # [ 0.022913] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).171host1 # [ 0.023385] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL172host1 # [ 0.023391] 0 pages in range for non-PLT usage173host1 # [ 0.023392] 508192 pages in range for PLT usage174host1 # [ 0.023550] pinctrl core: initialized pinctrl subsystem175host1 # [ 0.024839] DMI not present or invalid.176host1 # [ 0.029461] NET: Registered PF_NETLINK/PF_ROUTE protocol family177host1 # [ 0.033483] DMA: preallocated 256 KiB GFP_KERNEL pool for atomic allocations178host1 # [ 0.033720] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations179host1 # [ 0.033977] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations180host1 # [ 0.034044] audit: initializing netlink subsys (disabled)181host1 # [ 0.035249] thermal_sys: Registered thermal governor 'fair_share'182host1 # [ 0.035254] thermal_sys: Registered thermal governor 'bang_bang'183host1 # [ 0.035266] thermal_sys: Registered thermal governor 'step_wise'184host1 # [ 0.035279] thermal_sys: Registered thermal governor 'user_space'185host1 # [ 0.035289] thermal_sys: Registered thermal governor 'power_allocator'186host1 # [ 0.035438] audit: type=2000 audit(0.028:1): state=initialized audit_enabled=0 res=1187host1 # [ 0.035452] cpuidle: using governor ladder188host1 # [ 0.035459] cpuidle: using governor menu189host1 # [ 0.035893] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.190host1 # [ 0.035934] ASID allocator initialised with 65536 entries191host1 # [ 0.037578] Serial: AMBA PL011 UART driver192host1 # [ 0.047832] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1193host1 # [ 0.047997] printk: console [ttyAMA0] enabled194host1 # [ 0.177474] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages195host1 # [ 0.177496] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page196host1 # [ 0.177500] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages197host1 # [ 0.177503] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page198host1 # [ 0.177506] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages199host1 # [ 0.177508] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page200host1 # [ 0.177512] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages201host1 # [ 0.177522] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page202host1 # [ 0.189111] fbcon: Taking over console203host1 # [ 0.189145] ACPI: Interpreter disabled.204host1 # [ 0.202146] iommu: Default domain type: Translated205host1 # [ 0.202209] iommu: DMA domain TLB invalidation policy: strict mode206host1 # [ 0.203228] SCSI subsystem initialized207host1 # [ 0.207872] usbcore: registered new interface driver usbfs208host1 # [ 0.207946] usbcore: registered new interface driver hub209host1 # [ 0.207967] usbcore: registered new device driver usb210host1 # [ 0.208446] pps_core: LinuxPPS API ver. 1 registered211host1 # [ 0.208451] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>212host1 # [ 0.208460] PTP clock support registered213host1 # [ 0.208526] EDAC MC: Ver: 3.0.0214host1 # [ 0.214466] scmi_core: SCMI protocol bus registered215host1 # [ 0.214928] FPGA manager framework216host1 # [ 0.216686] vgaarb: loaded217host1 # [ 0.217130] clocksource: Switched to clocksource arch_sys_counter218host1 # [ 0.222949] VFS: Disk quotas dquot_6.6.0219host1 # [ 0.223004] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)220host1 # [ 0.223323] netfs: FS-Cache loaded221host1 # [ 0.223489] pnp: PnP ACPI: disabled222host1 # [ 0.229825] NET: Registered PF_INET protocol family223host1 # [ 0.230126] IP idents hash table entries: 32768 (order: 6, 262144 bytes, linear)224host1 # [ 0.262400] tcp_listen_portaddr_hash hash table entries: 1024 (order: 2, 16384 bytes, linear)225host1 # [ 0.262450] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)226host1 # [ 0.262492] TCP established hash table entries: 16384 (order: 5, 131072 bytes, linear)227host1 # [ 0.262583] TCP bind hash table entries: 16384 (order: 7, 524288 bytes, linear)228host1 # [ 0.262725] TCP: Hash tables configured (established 16384 bind 16384)229host1 # [ 0.262842] MPTCP token hash table entries: 2048 (order: 4, 49152 bytes, linear)230host1 # [ 0.262890] UDP hash table entries: 1024 (order: 4, 65536 bytes, linear)231host1 # [ 0.262935] UDP-Lite hash table entries: 1024 (order: 4, 65536 bytes, linear)232host1 # [ 0.263056] NET: Registered PF_UNIX/PF_LOCAL protocol family233host1 # [ 0.263129] NET: Registered PF_XDP protocol family234host1 # [ 0.263150] PCI: CLS 0 bytes, default 64235host1 # [ 0.263503] Trying to unpack rootfs image as initramfs...236host1 # [ 0.281177] kvm [1]: HYP mode not available237host1 # [ 0.393918] Initialise system trusted keyrings238host1 # [ 0.394111] workingset: timestamp_bits=42 max_order=19 bucket_order=0239host1 # [ 0.394595] squashfs: version 4.0 (2009/01/31) Phillip Lougher240host1 # [ 0.394688] 9p: Installing v9fs 9p2000 file system support241host1 # [ 0.423195] Key type asymmetric registered242host1 # [ 0.423215] Asymmetric key parser 'x509' registered243host1 # [ 0.423318] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)244host1 # [ 0.423504] io scheduler mq-deadline registered245host1 # [ 0.423510] io scheduler kyber registered246host1 # [ 0.441410] pl061_gpio 9030000.pl061: PL061 GPIO chip registered247host1 # [ 0.442228] ledtrig-cpu: registered to indicate activity on CPUs248host1 # [ 0.442714] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:249host1 # [ 0.442736] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000250host1 # [ 0.442750] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000251host1 # [ 0.442756] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000252host1 # [ 0.442787] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits253host1 # [ 0.442832] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]254host1 # [ 0.442926] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00255host1 # [ 0.442936] pci_bus 0000:00: root bus resource [bus 00-ff]256host1 # [ 0.442940] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]257host1 # [ 0.442944] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]258host1 # [ 0.442947] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]259host1 # [ 0.443058] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint260host1 # [ 0.443584] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint261host1 # [ 0.443797] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]262host1 # [ 0.443810] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]263host1 # [ 0.443839] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]264host1 # [ 0.443851] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]265host1 # [ 0.444362] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint266host1 # [ 0.444558] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]267host1 # [ 0.444570] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]268host1 # [ 0.444597] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]269host1 # [ 0.445085] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint270host1 # [ 0.476698] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]271host1 # [ 0.476722] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]272host1 # [ 0.476751] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]273host1 # [ 0.477487] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint274host1 # [ 0.477690] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]275host1 # [ 0.477701] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]276host1 # [ 0.477728] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]277host1 # [ 0.477741] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]278host1 # [ 0.478410] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint279host1 # [ 0.478621] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]280host1 # [ 0.478657] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]281host1 # [ 0.479430] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint282host1 # [ 0.479693] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]283host1 # [ 0.479722] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]284host1 # [ 0.480160] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint285host1 # [ 0.480360] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]286host1 # [ 0.480790] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint287host1 # [ 0.480991] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]288host1 # [ 0.481027] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]289host1 # [ 0.481572] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint290host1 # [ 0.481769] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]291host1 # [ 0.481797] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]292host1 # [ 0.482297] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint293host1 # [ 0.482494] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]294host1 # [ 0.482521] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]295host1 # [ 0.483031] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint296host1 # [ 0.483319] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]297host1 # [ 0.483332] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]298host1 # [ 0.483359] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]299host1 # [ 0.484386] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint300host1 # [ 0.484586] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]301host1 # [ 0.484598] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]302host1 # [ 0.484625] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]303host1 # [ 0.485125] pci 0000:00:0d.0: [1af4:1053] type 00 class 0x078000 conventional PCI endpoint304host1 # [ 0.521400] pci 0000:00:0d.0: BAR 1 [mem 0x00000000-0x00000fff]305host1 # [ 0.521500] pci 0000:00:0d.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]306host1 # [ 0.522673] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned307host1 # [ 0.522684] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned308host1 # [ 0.522688] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned309host1 # [ 0.522740] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned310host1 # [ 0.522787] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned311host1 # [ 0.522836] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned312host1 # [ 0.522883] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned313host1 # [ 0.522933] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned314host1 # [ 0.522990] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned315host1 # [ 0.523037] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned316host1 # [ 0.523084] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned317host1 # [ 0.523137] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned318host1 # [ 0.523249] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned319host1 # [ 0.523297] pci 0000:00:0d.0: BAR 4 [mem 0x800002c000-0x800002ffff 64bit pref]: assigned320host1 # [ 0.523341] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned321host1 # [ 0.523360] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned322host1 # [ 0.523379] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned323host1 # [ 0.523397] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned324host1 # [ 0.523415] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned325host1 # [ 0.523434] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned326host1 # [ 0.523452] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned327host1 # [ 0.523472] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned328host1 # [ 0.523491] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned329host1 # [ 0.523509] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned330host1 # [ 0.523529] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned331host1 # [ 0.523554] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned332host1 # [ 0.523573] pci 0000:00:0d.0: BAR 1 [mem 0x1008c000-0x1008cfff]: assigned333host1 # [ 0.523603] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned334host1 # [ 0.523622] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned335host1 # [ 0.523641] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned336host1 # [ 0.523659] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned337host1 # [ 0.523677] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned338host1 # [ 0.523695] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned339host1 # [ 0.523720] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]340host1 # [ 0.523726] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]341host1 # [ 0.523729] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]342host1 # [ 0.524677] pci 0000:00:07.0: enabling device (0000 -> 0002)343host1 # [ 0.643850] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)344server: QEMU running (pid 55)345server # Disk image does not exist, creating the virtualisation disk image...346server # Formatting '/build/vm-state-server/tmp.gyK6goEmTJ', fmt=raw size=1073741824347server # mke2fs 1.47.4 (6-Mar-2025)348server # Discarding device blocks: 0/262144 done349server # Creating filesystem with 262144 4k blocks and 65536 inodes350(finished: start all VMs, in 6.11 seconds)351server # Filesystem UUID: e57bca6b-4dc1-4090-beb6-7d8ca67729a7352server: waiting for unit step-ca.service353server # Superblock backups stored on blocks:354server: waiting for the VM to finish booting355server # 32768, 98304, 163840, 229376356server # 357server # Allocating group tables: 0/8 done358server # Writing inode tables: 0/8 done359server # Creating journal (8192 blocks): done360server # Writing superblocks and filesystem accounting information: 0/8 done361server # 362server # Virtualisation disk image created.363server # Starting virtiofs daemons...364server # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)365server # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether366server # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)367server # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)368server # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether369server # [2026-10-25T21:41:07Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether370server # [2026-10-25T21:41:07Z INFO virtiofsd] Waiting for vhost-user socket connection...371server # [2026-10-25T21:41:07Z INFO virtiofsd] Waiting for vhost-user socket connection...372server # [2026-10-25T21:41:07Z INFO virtiofsd] Waiting for vhost-user socket connection...373server # [2026-10-25T21:41:07Z INFO virtiofsd] Client connected, servicing requests374server # [2026-10-25T21:41:07Z INFO virtiofsd] Client connected, servicing requests375server # [2026-10-25T21:41:07Z INFO virtiofsd] Client connected, servicing requests376host1 # [ 0.895285] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)377server # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0xc00fac40]378server # [ 0.000000] Linux version 6.18.56 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT @1791725172379server # [ 0.000000] KASLR enabled380server # [ 0.000000] random: crng init done381server # [ 0.000000] Machine model: linux,dummy-virt382server # [ 0.000000] efi: UEFI not found.383server # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT384server # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x00000000bfffffff]385server # [ 0.000000] NODE_DATA(0) allocated [mem 0xbfdec700-0xbfdefe7f]386server # [ 0.000000] Zone ranges:387server # [ 0.000000] DMA [mem 0x0000000040000000-0x00000000bfffffff]388server # [ 0.000000] DMA32 empty389server # [ 0.000000] Normal empty390server # [ 0.000000] Device empty391server # [ 0.000000] Movable zone start for each node392server # [ 0.000000] Early memory node ranges393server # [ 0.000000] node 0: [mem 0x0000000040000000-0x00000000bfffffff]394server # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x00000000bfffffff]395server # [ 0.000000] cma: Reserved 32 MiB at 0x00000000bbc00000396server # [ 0.000000] psci: probing for conduit method from DT.397server # [ 0.000000] psci: PSCIv1.3 detected in firmware.398server # [ 0.000000] psci: Using standard PSCI v0.2 function IDs399server # [ 0.000000] psci: Trusted OS migration not required400server # [ 0.000000] psci: SMC Calling Convention v1.1401server # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)402server # [ 0.000000] percpu: Embedded 76 pages/cpu s186904 r8192 d116200 u311296403server # [ 0.000000] Detected PIPT I-cache on CPU0404server # [ 0.000000] CPU features: detected: Address authentication (architected QARMA5 algorithm)405server # [ 0.000000] CPU features: detected: GICv3 CPU interface406server # [ 0.000000] CPU features: detected: Spectre-v4407server # [ 0.000000] CPU features: detected: Spectre-BHB408server # [ 0.000000] CPU features: detected: AmpereOne erratum AC03_CPU_38409server # [ 0.000000] CPU features: detected: AmpereOne erratum AC04_CPU_23410server # [ 0.000000] alternatives: applying boot alternatives411server # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/v56dhs75sxw81lpa16lrvcngwdyqblan-nixos-system-server-test/init regInfo=/nix/.ro-store/mq3cs30cl8vvvb7dkxvvkfpma4w43mxy-closure-info/registration console=ttyAMA0,115200n8 console=tty0412server # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/mq3cs30cl8vvvb7dkxvvkfpma4w43mxy-closure-info/registration", will be passed to user space.413server # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes414server # [ 0.000000] Dentry cache hash table entries: 262144 (order: 9, 2097152 bytes, linear)415server # [ 0.000000] Inode-cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)416server # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 2MB417server # [ 0.000000] software IO TLB: area num 1.418server # [ 0.000000] software IO TLB: mapped [mem 0x00000000bb800000-0x00000000bba00000] (2MB)419server # [ 0.000000] Fallback order for Node 0: 0420server # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 524288421server # [ 0.000000] Policy zone: DMA422server # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off423server # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1424server # [ 0.000000] allocated 4194304 bytes of page_ext425server # [ 0.000000] ftrace: allocating 75049 entries in 294 pages426server # [ 0.000000] ftrace: allocated 294 pages with 4 groups427server # [ 0.000000] rcu: Hierarchical RCU implementation.428server # [ 0.000000] rcu: RCU event tracing is enabled.429server # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=1.430server # [ 0.000000] Trampoline variant of Tasks RCU enabled.431server # [ 0.000000] Rude variant of Tasks RCU enabled.432server # [ 0.000000] Tracing variant of Tasks RCU enabled.433server # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.434server # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1435server # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.436server # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.437server # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.438server # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0439server # [ 0.000000] GICv3: 256 SPIs implemented440server # [ 0.000000] GICv3: 0 Extended SPIs implemented441server # [ 0.000000] Root IRQ handler: gic_handle_irq442server # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI443server # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0444server # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000445server # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]446server # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44af0000 (indirect, esz 8, psz 64K, shr 1)447server # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44b00000 (flat, esz 8, psz 64K, shr 1)448server # [ 0.000000] GICv3: using LPI property table @0x0000000044b10000449server # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044b20000450server # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.451server # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns452server # [ 0.000000] arch_timer: cp15 timer running at 1000.00MHz (virt).453server # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns454server # [ 0.000000] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns455server # [ 0.000068] arm-pv: using stolen time PV456server # [ 0.000844] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)457server # [ 0.001307] Console: colour dummy device 80x25458server # [ 0.001316] printk: legacy console [tty0] enabled459server # [ 0.001563] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)460server # [ 0.001572] pid_max: default: 32768 minimum: 301461server # [ 0.001728] LSM: initializing lsm=capability,landlock,yama,bpf,ima462server # [ 0.002043] landlock: Up and running.463server # [ 0.002048] Yama: becoming mindful.464server # [ 0.002891] LSM support for eBPF active465server # [ 0.003103] Mount-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)466server # [ 0.003228] Mountpoint-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)467server # [ 0.006318] rcu: Hierarchical SRCU implementation.468server # [ 0.006327] rcu: Max phase no-delay instances is 1000.469server # [ 0.008106] fsl-mc MSI: its@8080000 domain created470server # [ 0.008254] EFI services will not be available.471server # [ 0.008387] smp: Bringing up secondary CPUs ...472server # [ 0.008398] smp: Brought up 1 node, 1 CPU473server # [ 0.008402] SMP: Total of 1 processors activated.474server # [ 0.008405] CPU: All CPU(s) started at EL1475server # [ 0.008430] CPU features: detected: Branch Target Identification476server # [ 0.008439] CPU features: detected: ARMv8.4 Translation Table Level477server # [ 0.008442] CPU features: detected: Instruction cache invalidation not required for I/D coherence478server # [ 0.008446] CPU features: detected: Data cache clean to the PoU not required for I/D coherence479server # [ 0.008457] CPU features: detected: Common not Private translations480server # [ 0.008465] CPU features: detected: CRC32 instructions481server # [ 0.008468] CPU features: detected: Data cache clean to Point of Deep Persistence482server # [ 0.008472] CPU features: detected: Data cache clean to Point of Persistence483server # [ 0.008475] CPU features: detected: Data independent timing control (DIT)484server # [ 0.008477] CPU features: detected: E0PD485server # [ 0.008480] CPU features: detected: Enhanced Counter Virtualization486server # [ 0.008490] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)487server # [ 0.008495] CPU features: detected: Enhanced Virtualization Traps488server # [ 0.008498] CPU features: detected: Fine Grained Traps489server # [ 0.008508] CPU features: detected: Generic authentication (architected QARMA5 algorithm)490server # [ 0.008520] CPU features: detected: RCpc load-acquire (LDAPR)491server # [ 0.008523] CPU features: detected: LSE atomic instructions492server # [ 0.008526] CPU features: detected: Privileged Access Never493server # [ 0.008528] CPU features: detected: PMUv3494server # [ 0.008531] CPU features: detected: RAS Extension Support495server # [ 0.008534] CPU features: detected: RASv1p1 Extension Support496server # [ 0.008537] CPU features: detected: Random Number Generator497server # [ 0.008543] CPU features: detected: Speculation barrier (SB)498server # [ 0.008546] CPU features: detected: Stage-2 Force Write-Back499server # [ 0.008553] CPU features: detected: TLB range maintenance instructions500server # [ 0.008558] CPU features: detected: Speculative Store Bypassing Safe (SSBS)501server # [ 0.008649] alternatives: applying system-wide alternatives502server # [ 0.013774] CPU features: detected: BBM Level 2 without TLB conflict abort503server # [ 0.014016] Memory: 1920356K/2097152K available (24512K kernel code, 7102K rwdata, 26572K rodata, 4736K init, 1184K bss, 133196K reserved, 32768K cma-reserved)504server # [ 0.021103] devtmpfs: initialized505server # [ 0.024235] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)506server # [ 0.024304] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).507server # [ 0.024749] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL508server # [ 0.024760] 0 pages in range for non-PLT usage509server # [ 0.024766] 508192 pages in range for PLT usage510server # [ 0.024965] pinctrl core: initialized pinctrl subsystem511server # [ 0.026638] DMI not present or invalid.512server # [ 0.031493] NET: Registered PF_NETLINK/PF_ROUTE protocol family513server # [ 0.034068] DMA: preallocated 256 KiB GFP_KERNEL pool for atomic allocations514server # [ 0.034260] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations515server # [ 0.034491] DMA: preallocated 256 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations516server # [ 0.034554] audit: initializing netlink subsys (disabled)517server # [ 0.036066] thermal_sys: Registered thermal governor 'fair_share'518server # [ 0.036073] thermal_sys: Registered thermal governor 'bang_bang'519server # [ 0.036082] thermal_sys: Registered thermal governor 'step_wise'520server # [ 0.036094] thermal_sys: Registered thermal governor 'user_space'521server # [ 0.036107] thermal_sys: Registered thermal governor 'power_allocator'522server # [ 0.036155] audit: type=2000 audit(0.032:1): state=initialized audit_enabled=0 res=1523server # [ 0.036167] cpuidle: using governor ladder524server # [ 0.036173] cpuidle: using governor menu525server # [ 0.036796] hw-breakpoint: found 16 breakpoint and 4 watchpoint registers.526server # [ 0.036828] ASID allocator initialised with 65536 entries527server # [ 0.039081] Serial: AMBA PL011 UART driver528server # [ 0.047586] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1529server # [ 0.047786] printk: console [ttyAMA0] enabled530server # [ 0.196760] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages531server # [ 0.196786] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page532server # [ 0.196790] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages533server # [ 0.196795] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page534server # [ 0.196802] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages535server # [ 0.196805] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page536server # [ 0.196808] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages537server # [ 0.196810] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page538server # [ 0.209726] fbcon: Taking over console539server # [ 0.209752] ACPI: Interpreter disabled.540server # [ 0.214141] iommu: Default domain type: Translated541server # [ 0.214168] iommu: DMA domain TLB invalidation policy: strict mode542server # [ 0.214836] SCSI subsystem initialized543server # [ 0.226389] usbcore: registered new interface driver usbfs544server # [ 0.226454] usbcore: registered new interface driver hub545server # [ 0.226505] usbcore: registered new device driver usb546server # [ 0.227077] pps_core: LinuxPPS API ver. 1 registered547server # [ 0.227088] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>548server # [ 0.227111] PTP clock support registered549server # [ 0.227225] EDAC MC: Ver: 3.0.0550server # [ 0.228189] scmi_core: SCMI protocol bus registered551server # [ 0.236358] FPGA manager framework552server # [ 0.237308] vgaarb: loaded553server # [ 0.240134] clocksource: Switched to clocksource arch_sys_counter554server # [ 0.241451] VFS: Disk quotas dquot_6.6.0555server # [ 0.241494] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)556server # [ 0.246453] netfs: FS-Cache loaded557server # [ 0.246683] pnp: PnP ACPI: disabled558server # [ 0.257735] NET: Registered PF_INET protocol family559server # [ 0.258055] IP idents hash table entries: 32768 (order: 6, 262144 bytes, linear)560server # [ 0.299474] tcp_listen_portaddr_hash hash table entries: 1024 (order: 2, 16384 bytes, linear)561server # [ 0.299528] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)562server # [ 0.299560] TCP established hash table entries: 16384 (order: 5, 131072 bytes, linear)563server # [ 0.299648] TCP bind hash table entries: 16384 (order: 7, 524288 bytes, linear)564server # [ 0.299789] TCP: Hash tables configured (established 16384 bind 16384)565server # [ 0.299911] MPTCP token hash table entries: 2048 (order: 4, 49152 bytes, linear)566server # [ 0.299945] UDP hash table entries: 1024 (order: 4, 65536 bytes, linear)567server # [ 0.299981] UDP-Lite hash table entries: 1024 (order: 4, 65536 bytes, linear)568server # [ 0.300072] NET: Registered PF_UNIX/PF_LOCAL protocol family569server # [ 0.309389] NET: Registered PF_XDP protocol family570server # [ 0.309411] PCI: CLS 0 bytes, default 64571server # [ 0.309731] Trying to unpack rootfs image as initramfs...572server # [ 0.320163] kvm [1]: HYP mode not available573host1 # [ 1.358127] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)574host1 # [ 1.360446] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)575host1 # [ 2.055176] Freeing initrd memory: 26964K576host1 # [ 2.059878] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)577host1 # [ 2.063025] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)578host1 # [ 2.064974] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)579server # [ 0.437129] Initialise system trusted keyrings580server # [ 0.437393] workingset: timestamp_bits=42 max_order=19 bucket_order=0581server # [ 0.437963] squashfs: version 4.0 (2009/01/31) Phillip Lougher582server # [ 0.440276] 9p: Installing v9fs 9p2000 file system support583server # [ 0.469246] Key type asymmetric registered584server # [ 0.469273] Asymmetric key parser 'x509' registered585server # [ 0.469370] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)586server # [ 0.469591] io scheduler mq-deadline registered587server # [ 0.469599] io scheduler kyber registered588server # [ 0.488353] pl061_gpio 9030000.pl061: PL061 GPIO chip registered589server # [ 0.489139] ledtrig-cpu: registered to indicate activity on CPUs590server # [ 0.489673] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:591server # [ 0.489694] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000592server # [ 0.489704] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000593server # [ 0.489710] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000594server # [ 0.489733] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits595server # [ 0.489765] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]596server # [ 0.489869] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00597server # [ 0.489881] pci_bus 0000:00: root bus resource [bus 00-ff]598server # [ 0.489885] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]599server # [ 0.489888] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]600server # [ 0.489891] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]601server # [ 0.490000] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint602server # [ 0.490551] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint603server # [ 0.490749] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]604server # [ 0.490765] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]605server # [ 0.490797] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]606server # [ 0.490810] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]607server # [ 0.491310] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint608server # [ 0.491502] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]609server # [ 0.491520] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]610server # [ 0.491553] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]611server # [ 0.492065] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint612server # [ 0.514551] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]613server # [ 0.514565] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]614server # [ 0.514591] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]615server # [ 0.515106] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint616server # [ 0.515299] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]617server # [ 0.515310] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]618server # [ 0.515338] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]619server # [ 0.515350] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]620server # [ 0.515826] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint621server # [ 0.516081] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]622server # [ 0.516109] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]623server # [ 0.532785] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint624server # [ 0.533000] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]625server # [ 0.533029] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]626server # [ 0.533533] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint627server # [ 0.533722] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]628server # [ 0.534055] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint629server # [ 0.534251] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]630server # [ 0.534279] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]631server # [ 0.534778] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint632server # [ 0.534971] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]633server # [ 0.534998] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]634server # [ 0.535485] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint635server # [ 0.535681] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]636server # [ 0.535709] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]637server # [ 0.549285] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint638server # [ 0.549553] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]639server # [ 0.549566] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]640server # [ 0.549593] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]641server # [ 0.550111] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint642server # [ 0.550305] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]643server # [ 0.550324] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]644server # [ 0.550350] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]645server # [ 0.550835] pci 0000:00:0d.0: [1af4:1053] type 00 class 0x078000 conventional PCI endpoint646server # [ 0.551033] pci 0000:00:0d.0: BAR 1 [mem 0x00000000-0x00000fff]647server # [ 0.551062] pci 0000:00:0d.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]648server # [ 0.551734] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned649server # [ 0.551741] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned650server # [ 0.551744] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned651server # [ 0.551794] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned652server # [ 0.551840] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned653server # [ 0.551899] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned654server # [ 0.551947] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned655server # [ 0.552002] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned656server # [ 0.552051] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned657server # [ 0.552099] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned658server # [ 0.580304] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned659server # [ 0.580374] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned660server # [ 0.580496] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned661server # [ 0.580545] pci 0000:00:0d.0: BAR 4 [mem 0x800002c000-0x800002ffff 64bit pref]: assigned662server # [ 0.580591] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned663server # [ 0.580611] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned664server # [ 0.580630] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned665server # [ 0.580650] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned666server # [ 0.580670] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned667server # [ 0.580690] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned668server # [ 0.580709] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned669server # [ 0.580730] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned670server # [ 0.580750] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned671server # [ 0.580768] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned672server # [ 0.580786] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned673server # [ 0.580806] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned674server # [ 0.580826] pci 0000:00:0d.0: BAR 1 [mem 0x1008c000-0x1008cfff]: assigned675server # [ 0.580844] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned676server # [ 0.580862] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned677server # [ 0.580880] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned678server # [ 0.580903] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned679server # [ 0.580922] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned680server # [ 0.580940] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned681server # [ 0.580985] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]682server # [ 0.580993] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]683server # [ 0.581004] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]684server # [ 0.581963] pci 0000:00:07.0: enabling device (0000 -> 0002)685host1 # [ 2.566671] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)686host1 # [ 2.570910] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)687host1 # [ 2.572973] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)688host1 # [ 2.579424] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)689host1 # [ 2.585190] virtio-pci 0000:00:0d.0: enabling device (0000 -> 0002)690host1 # [ 2.591830] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled691host1 # [ 2.594960] msm_serial: driver initialized692host1 # [ 2.595176] SuperH (H)SCI(F) driver initialized693host1 # [ 2.595247] STM32 USART driver initialized694host1 # [ 2.616044] loop: module loaded695host1 # [ 2.616238] virtio_blk virtio2: 1/0/0 default/read/poll queues696host1 # [ 2.617085] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)697host1 # [ 2.622386] megasas: 07.734.00.00-rc1698host1 # [ 2.623338] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]699host1 # [ 2.627157] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000700host1 # [ 2.627183] Intel/Sharp Extended Query Table at 0x0031701host1 # [ 2.632261] Using buffer write method702host1 # [ 2.632308] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]703host1 # [ 2.637116] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000704host1 # [ 2.638361] Intel/Sharp Extended Query Table at 0x0031705host1 # [ 2.640058] Using buffer write method706host1 # [ 2.640085] Concatenating MTD devices:707host1 # [ 2.640088] (0): "0.flash"708host1 # [ 2.640090] (1): "0.flash"709host1 # [ 2.640092] into device "0.flash"710host1 # [ 2.650087] tun: Universal TUN/TAP device driver, 1.6711server # [ 0.629623] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)712host1 # [ 2.655173] thunder_xcv, ver 1.0713host1 # [ 2.655207] thunder_bgx, ver 1.0714host1 # [ 2.655230] nicpf, ver 1.0715host1 # [ 2.655997] e1000: Intel(R) PRO/1000 Network Driver716host1 # [ 2.656001] e1000: Copyright (c) 1999-2006 Intel Corporation.717host1 # [ 2.656034] e1000e: Intel(R) PRO/1000 Network Driver718host1 # [ 2.656040] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.719host1 # [ 2.656082] igb: Intel(R) Gigabit Ethernet Network Driver720host1 # [ 2.656090] igb: Copyright (c) 2007-2014 Intel Corporation.721host1 # [ 2.656125] igbvf: Intel(R) Gigabit Virtual Function Network Driver722host1 # [ 2.656132] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.723host1 # [ 2.656299] sky2: driver version 1.30724host1 # [ 2.665754] usbcore: registered new interface driver usb-storage725host1 # [ 2.666259] usbcore: registered new interface driver usbserial_generic726host1 # [ 2.666278] usbserial: USB Serial support registered for generic727host1 # [ 2.666966] hv_vmbus: registering driver hyperv_keyboard728host1 # [ 2.668516] ehci-pci 0000:00:07.0: EHCI Host Controller729host1 # [ 2.668547] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 1730host1 # [ 2.668786] ehci-pci 0000:00:07.0: irq 16, io mem 0x10086000731host1 # [ 2.669127] rtc-pl031 9010000.pl031: registered as rtc0732host1 # [ 2.675765] rtc-pl031 9010000.pl031: setting system clock to 2026-10-25T21:41:14 UTC (1792964474)733host1 # [ 2.676205] i2c_dev: i2c /dev entries driver734host1 # [ 2.679815] sdhci: Secure Digital Host Controller Interface driver735host1 # [ 2.679821] sdhci: Copyright(c) Pierre Ossman736host1 # [ 2.680140] Synopsys Designware Multimedia Card Interface Driver737host1 # [ 2.680567] sdhci-pltfm: SDHCI platform and OF driver helper738host1 # [ 2.681186] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.00739host1 # [ 2.681598] hub 1-0:1.0: USB hub found740host1 # [ 2.681621] hub 1-0:1.0: 6 ports detected741host1 # [ 2.690887] hid: raw HID events driver (C) Jiri Kosina742host1 # [ 2.691182] usbcore: registered new interface driver usbhid743host1 # [ 2.691186] usbhid: USB HID core driver744host1 # [ 2.692625] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available745host1 # [ 2.697620] drop_monitor: Initializing network drop monitor service746host1 # [ 2.698278] NET: Registered PF_INET6 protocol family747host1 # [ 2.698997] Segment Routing with IPv6748host1 # [ 2.699009] In-situ OAM (IOAM) with IPv6749host1 # [ 2.699047] NET: Registered PF_PACKET protocol family750host1 # [ 2.699125] 9pnet: Installing 9P2000 support751host1 # [ 2.699191] Key type dns_resolver registered752host1 # [ 2.710978] registered taskstats version 1753host1 # [ 2.711251] Loading compiled-in X.509 certificates754host1 # [ 2.721268] Demotion targets for Node 0: null755host1 # [ 2.721410] Key type .fscrypt registered756host1 # [ 2.721413] Key type fscrypt-provisioning registered757host1 # [ 2.721566] ima: No TPM chip found, activating TPM-bypass!758host1 # [ 2.721600] ima: Allocated hash algorithm: sha1759host1 # [ 2.721636] ima: No architecture policies found760host1 # [ 2.722382] input: gpio-keys as /devices/platform/gpio-keys/input/input0761host1 # [ 2.747818] clk: Disabling unused clocks762host1 # [ 2.747840] PM: genpd: Disabling unused power domains763host1 # [ 2.754583] Freeing unused kernel memory: 4736K764host1 # [ 2.754881] Run /init as init process765host1 # [ 2.776449] systemd[1]: Successfully made /usr/ read-only.766host1 # [ 2.929223] usb 1-1: new high-speed USB device number 2 using ehci-pci767host1 # [ 3.081155] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1768host1 # [ 3.110718] systemd[1]: systemd 261.3 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)769host1 # [ 3.110746] systemd[1]: Detected virtualization qemu.770host1 # [ 3.110828] systemd[1]: Detected architecture arm64.771host1 # [ 3.110839] systemd[1]: Running in initrd.772host1 # [ 3.111763] systemd[1]: Initializing machine ID from random generator.773host1 # [ 3.112004] systemd[1]: Hostname set to <host1>.774host1 # [ 3.177530] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input0775host1 # [ 3.276663] systemd[1]: bpf-restrict-fs: LSM BPF program attached776host1 # [ 3.301246] usb 1-2: new high-speed USB device number 3 using ehci-pci777host1 # [ 3.343726] systemd[1]: Queued start job for default target Initrd Default Target.778host1 # [ 3.348668] systemd[1]: Created slice Slice /system/modprobe.779host1 # [ 3.348912] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.780host1 # [ 3.348948] systemd[1]: Expecting device /dev/disk/by-label/nixos...781host1 # [ 3.348971] systemd[1]: Reached target Path Units.782host1 # [ 3.348984] systemd[1]: Reached target Slice Units.783host1 # [ 3.348998] systemd[1]: Reached target Swaps.784host1 # [ 3.349011] systemd[1]: Reached target Timer Units.785host1 # [ 3.354465] systemd[1]: Listening on D-Bus System Message Bus Socket.786host1 # [ 3.354687] systemd[1]: Listening on Journal Socket (/dev/log).787host1 # [ 3.354831] systemd[1]: Listening on Journal Sockets.788host1 # [ 3.354961] systemd[1]: Listening on udev Control Socket.789host1 # [ 3.355071] systemd[1]: Listening on udev Kernel Socket.790host1 # [ 3.355088] systemd[1]: Reached target Socket Units.791host1 # [ 3.356736] systemd[1]: Starting Create List of Static Device Nodes...792host1 # [ 3.356814] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs793host1 # [ 3.372241] systemd[1]: Mounting Kernel Configuration File System...794host1 # [ 3.397368] systemd[1]: Starting Journal Service...795host1 # [ 3.405476] systemd[1]: Starting Load Kernel Modules...796host1 # [ 3.405609] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os797host1 # [ 3.412916] systemd[1]: Starting Coldplug All udev Devices...798host1 # [ 3.435772] systemd[1]: Finished Create List of Static Device Nodes.799host1 # [ 3.436761] systemd[1]: Mounted Kernel Configuration File System.800host1 # [ 3.448758] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2801host1 # [ 3.448920] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input0802host1 # [ 3.458442] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...803host1 # [ 3.505818] systemd-journald[70]: Collecting audit messages is disabled.804host1 # [ 3.534508] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.805host1 # [ 3.546024] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.806host1 # [ 3.553751] systemd[1]: Starting Create Static Device Nodes in /dev...807host1 # [ 3.557244] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev808host1 # [ 3.575872] [drm] pci: virtio-gpu-pci detected at 0000:00:05.0809host1 # [ 3.576123] [drm] features: -virgl +edid -resource_blob -host_visible810host1 # [ 3.576127] [drm] features: -context_init811host1 # [ 3.576910] [drm] number of scanouts: 1812host1 # [ 3.576921] [drm] number of cap sets: 0813host1 # [ 3.601741] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic814host1 # [ 3.601756] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 0815host1 # [ 3.635794] Console: switching to colour frame buffer device 160x50816host1 # [ 3.647020] systemd[1]: Finished Create Static Device Nodes in /dev.817host1 # [ 3.647479] systemd[1]: Reached target Preparation for Local File Systems.818host1 # [ 3.647499] systemd[1]: Reached target Local File Systems.819host1 # [ 3.657791] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device820host1 # [ 3.659667] systemd[1]: Starting Rule-based Manager for Device Events and Files...821host1 # [ 3.689302] NET: Registered PF_VSOCK protocol family822host1 # [ 3.733418] systemd[1]: Started Journal Service.823host1 # [ 3.717312] systemd-modules-load[71]: Inserted module 'dm_mod'824host1 # [ 3.720362] systemd-modules-load[71]: Module 'virtio_balloon' is built in825host1 # [ 3.725752] systemd-modules-load[71]: Module 'virtio_console' is built in826host1 # [ 3.732542] systemd-modules-load[71]: Inserted module 'virtio_gpu'827host1 # [ 3.740350] systemd-modules-load[71]: Module 'virtio_rng' is built in828host1 # [ 3.744410] systemd-modules-load[71]: Inserted module 'vmw_vsock_virtio_transport'829host1 # [ 3.748453] systemd[1]: Finished Load Kernel Modules.830host1 # [ 3.752288] systemd[1]: Starting Apply Kernel Variables...831host1 # [ 3.760179] systemd[1]: Starting Create System Files and Directories...832host1 # [ 3.767514] systemd-udevd[77]: Using default interface naming scheme 'v261'.833server # [ 1.178547] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)834server # [ 2.135390] Freeing initrd memory: 26996K835server # [ 2.138863] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)836host1 # [ 3.804929] systemd[1]: Finished Create System Files and Directories.837host1 # [ 3.812750] systemd[1]: Finished Apply Kernel Variables.838host1 # [ 3.826861] systemd[1]: Started Rule-based Manager for Device Events and Files.839host1 # [ 3.900909] systemd[1]: Starting Virtual Console Setup...840host1 # [ 3.988638] systemd-vconsole-setup[105]: Configuration of first virtual console was skipped, ignoring remaining ones.841host1 # [ 3.997525] systemd[1]: Finished Virtual Console Setup.842server # [ 2.142369] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)843server # [ 2.480876] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)844server # [ 2.483767] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)845server # [ 2.487451] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)846server # [ 2.494856] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)847server # [ 2.498102] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)848server # [ 2.500083] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)849server # [ 2.504600] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)850server # [ 2.515678] virtio-pci 0000:00:0d.0: enabling device (0000 -> 0002)851server # [ 2.522476] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled852server # [ 2.525896] msm_serial: driver initialized853server # [ 2.526060] SuperH (H)SCI(F) driver initialized854server # [ 2.526130] STM32 USART driver initialized855server # [ 2.545155] loop: module loaded856server # [ 2.545328] virtio_blk virtio2: 1/0/0 default/read/poll queues857server # [ 2.546446] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)858server # [ 2.551757] megasas: 07.734.00.00-rc1859server # [ 2.553067] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]860server # [ 2.556017] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000861server # [ 2.556040] Intel/Sharp Extended Query Table at 0x0031862server # [ 2.561541] Using buffer write method863server # [ 2.561582] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]864server # [ 2.563562] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000865server # [ 2.563619] Intel/Sharp Extended Query Table at 0x0031866server # [ 2.570329] Using buffer write method867server # [ 2.570349] Concatenating MTD devices:868server # [ 2.570351] (0): "0.flash"869server # [ 2.570354] (1): "0.flash"870server # [ 2.570356] into device "0.flash"871server # [ 2.579367] tun: Universal TUN/TAP device driver, 1.6872server # [ 2.584486] thunder_xcv, ver 1.0873server # [ 2.584521] thunder_bgx, ver 1.0874server # [ 2.584542] nicpf, ver 1.0875server # [ 2.585134] e1000: Intel(R) PRO/1000 Network Driver876server # [ 2.585139] e1000: Copyright (c) 1999-2006 Intel Corporation.877server # [ 2.585168] e1000e: Intel(R) PRO/1000 Network Driver878server # [ 2.585174] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.879server # [ 2.585204] igb: Intel(R) Gigabit Ethernet Network Driver880server # [ 2.585211] igb: Copyright (c) 2007-2014 Intel Corporation.881server # [ 2.585233] igbvf: Intel(R) Gigabit Virtual Function Network Driver882server # [ 2.585237] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.883server # [ 2.585377] sky2: driver version 1.30884server # [ 2.587072] usbcore: registered new interface driver usb-storage885server # [ 2.587347] usbcore: registered new interface driver usbserial_generic886server # [ 2.587367] usbserial: USB Serial support registered for generic887server # [ 2.588052] hv_vmbus: registering driver hyperv_keyboard888server # [ 2.588822] ehci-pci 0000:00:07.0: EHCI Host Controller889server # [ 2.588857] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 1890server # [ 2.589079] ehci-pci 0000:00:07.0: irq 16, io mem 0x10086000891server # [ 2.602398] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.00892server # [ 2.603108] hub 1-0:1.0: USB hub found893server # [ 2.603146] hub 1-0:1.0: 6 ports detected894server # [ 2.606408] rtc-pl031 9010000.pl031: registered as rtc0895server # [ 2.606433] rtc-pl031 9010000.pl031: setting system clock to 2026-10-25T21:41:16 UTC (1792964476)896server # [ 2.606756] i2c_dev: i2c /dev entries driver897server # [ 2.613682] sdhci: Secure Digital Host Controller Interface driver898server # [ 2.613687] sdhci: Copyright(c) Pierre Ossman899server # [ 2.613980] Synopsys Designware Multimedia Card Interface Driver900server # [ 2.614372] sdhci-pltfm: SDHCI platform and OF driver helper901server # [ 2.615996] hid: raw HID events driver (C) Jiri Kosina902server # [ 2.619762] usbcore: registered new interface driver usbhid903server # [ 2.619767] usbhid: USB HID core driver904server # [ 2.622279] hw perfevents: enabled with armv8_pmuv3 PMU driver, 11 (0,800003ff) counters available905server # [ 2.623999] drop_monitor: Initializing network drop monitor service906server # [ 2.626544] NET: Registered PF_INET6 protocol family907server # [ 2.627171] Segment Routing with IPv6908server # [ 2.627186] In-situ OAM (IOAM) with IPv6909server # [ 2.627217] NET: Registered PF_PACKET protocol family910server # [ 2.627281] 9pnet: Installing 9P2000 support911server # [ 2.627333] Key type dns_resolver registered912server # [ 2.638330] registered taskstats version 1913server # [ 2.638578] Loading compiled-in X.509 certificates914server # [ 2.647978] Demotion targets for Node 0: null915server # [ 2.648100] Key type .fscrypt registered916server # [ 2.648105] Key type fscrypt-provisioning registered917server # [ 2.649991] ima: No TPM chip found, activating TPM-bypass!918server # [ 2.650015] ima: Allocated hash algorithm: sha1919server # [ 2.650047] ima: No architecture policies found920server # [ 2.650750] input: gpio-keys as /devices/platform/gpio-keys/input/input0921server # [ 2.673130] clk: Disabling unused clocks922server # [ 2.673154] PM: genpd: Disabling unused power domains923server # [ 2.679645] Freeing unused kernel memory: 4736K924server # [ 2.679950] Run /init as init process925server # [ 2.699448] systemd[1]: Successfully made /usr/ read-only.926server # [ 2.848191] usb 1-1: new high-speed USB device number 2 using ehci-pci927server # [ 2.997917] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1928server # [ 3.033632] systemd[1]: systemd 261.3 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)929server # [ 3.033659] systemd[1]: Detected virtualization qemu.930server # [ 3.033722] systemd[1]: Detected architecture arm64.931server # [ 3.033731] systemd[1]: Running in initrd.932server # [ 3.034391] systemd[1]: Initializing machine ID from random generator.933server # [ 3.034592] systemd[1]: Hostname set to <server>.934host1 # [ 4.710542] systemd[1]: Finished Coldplug All udev Devices.935host1 # [ 4.711540] systemd[1]: Reached target System Initialization.936host1 # [ 4.712478] systemd[1]: Reached target Basic System.937server # [ 3.092448] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input0938server # [ 3.183572] systemd[1]: bpf-restrict-fs: LSM BPF program attached939server # [ 3.212239] usb 1-2: new high-speed USB device number 3 using ehci-pci940server # [ 3.252110] systemd[1]: Queued start job for default target Initrd Default Target.941host1 # [ 4.911985] (udev-worker)[95]: Network interface NamePolicy= disabled on kernel command line.942server # [ 3.262945] systemd[1]: Created slice Slice /system/modprobe.943server # [ 3.263153] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.944server # [ 3.263186] systemd[1]: Expecting device /dev/disk/by-label/nixos...945server # [ 3.263214] systemd[1]: Reached target Path Units.946server # [ 3.263228] systemd[1]: Reached target Slice Units.947server # [ 3.263243] systemd[1]: Reached target Swaps.948server # [ 3.263257] systemd[1]: Reached target Timer Units.949server # [ 3.263403] systemd[1]: Listening on D-Bus System Message Bus Socket.950server # [ 3.263547] systemd[1]: Listening on Journal Socket (/dev/log).951server # [ 3.263659] systemd[1]: Listening on Journal Sockets.952server # [ 3.263769] systemd[1]: Listening on udev Control Socket.953server # [ 3.263970] systemd[1]: Listening on udev Kernel Socket.954server # [ 3.263987] systemd[1]: Reached target Socket Units.955host1 # [ 4.922351] (udev-worker)[93]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.956server # [ 3.275189] systemd[1]: Starting Create List of Static Device Nodes...957server # [ 3.275255] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs958host1 # [ 4.928318] (udev-worker)[93]: Network interface NamePolicy= disabled on kernel command line.959server # [ 3.280737] systemd[1]: Mounting Kernel Configuration File System...960server # [ 3.294502] systemd[1]: Starting Journal Service...961server # [ 3.302796] systemd[1]: Starting Load Kernel Modules...962server # [ 3.302895] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os963server # [ 3.343535] systemd-journald[70]: Collecting audit messages is disabled.964server # [ 3.345274] systemd[1]: Starting Coldplug All udev Devices...965server # [ 3.349383] systemd[1]: Finished Create List of Static Device Nodes.966server # [ 3.357060] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...967server # [ 3.379563] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2968server # [ 3.379712] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input0969server # [ 3.386278] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.970server # [ 3.400588] systemd[1]: Mounted Kernel Configuration File System.971server # [ 3.412249] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev972server # [ 3.426347] [drm] pci: virtio-gpu-pci detected at 0000:00:05.0973server # [ 3.426582] [drm] features: -virgl +edid -resource_blob -host_visible974server # [ 3.426585] [drm] features: -context_init975server # [ 3.427316] [drm] number of scanouts: 1976server # [ 3.427327] [drm] number of cap sets: 0977host1 # [ 5.085398] systemd[1]: Found device /dev/disk/by-label/nixos.978host1 # [ 5.088835] systemd[1]: Reached target Initrd Root Device.979host1 # [ 5.092822] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...980server # [ 3.448892] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.981server # [ 3.453968] systemd[1]: Starting Create Static Device Nodes in /dev...982server # [ 3.457498] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic983server # [ 3.457507] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 0984host1 # [ 5.144125] systemd-fsck[114]: nixos: clean, 12/65536 files, 13019/262144 blocks985server # [ 3.492654] Console: switching to colour frame buffer device 160x50986host1 # [ 5.152089] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.987host1 # [ 5.155532] systemd[1]: Mounting /sysroot...988server # [ 3.520812] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device989server # [ 3.525929] systemd[1]: Finished Create Static Device Nodes in /dev.990server # [ 3.526175] systemd[1]: Reached target Preparation for Local File Systems.991server # [ 3.526207] systemd[1]: Reached target Local File Systems.992server # [ 3.528051] systemd[1]: Starting Rule-based Manager for Device Events and Files...993server # [ 3.552330] NET: Registered PF_VSOCK protocol family994host1 # [ 5.226369] EXT4-fs (vda): mounted filesystem 91628846-5785-432a-97ed-98fff0fef2dc r/w with ordered data mode. Quota mode: none.995host1 # [ 5.211170] systemd[1]: Mounted /sysroot.996host1 # [ 5.213236] systemd[1]: Reached target Initrd Root File System.997server # [ 3.562755] systemd[1]: Started Journal Service.998host1 # [ 5.219565] systemd[1]: Starting Mountpoints Configured in the Real Root...999server # [ 3.545275] systemd-modules-load[71]: Inserted module 'dm_mod'1000server # [ 3.546683] systemd-modules-load[71]: Module 'virtio_balloon' is built in1001server # [ 3.547897] systemd-modules-load[71]: Module 'virtio_console' is built in1002server # [ 3.560525] systemd-modules-load[71]: Inserted module 'virtio_gpu'1003server # [ 3.561739] systemd-modules-load[71]: Module 'virtio_rng' is built in1004server # [ 3.562898] systemd[1]: Starting Create System Files and Directories...1005host1 # [ 5.251677] systemd-sysroot-fstab-check[122]: /sysroot should be mounted in the initrd, will request daemon-reload.1006server # [ 3.577863] systemd-modules-load[71]: Inserted module 'vmw_vsock_virtio_transport'1007host1 # [ 5.257962] systemd[1]: Reload requested from client PID 122 ('systemd-sysroot') (unit initrd-parse-etc.service)...1008host1 # [ 5.263331] systemd[1]: Reloading...1009server # [ 3.584348] systemd[1]: Finished Load Kernel Modules.1010server # [ 3.609154] systemd[1]: Starting Apply Kernel Variables...1011server # [ 3.637349] systemd[1]: Finished Create System Files and Directories.1012server # [ 3.644522] systemd-udevd[77]: Using default interface naming scheme 'v261'.1013server # [ 3.662130] systemd[1]: Finished Apply Kernel Variables.1014server # [ 3.685597] systemd[1]: Started Rule-based Manager for Device Events and Files.1015server # [ 3.756114] systemd[1]: Starting Virtual Console Setup...1016server # [ 3.851299] systemd-vconsole-setup[103]: Configuration of first virtual console was skipped, ignoring remaining ones.1017host1 # [ 5.536114] systemd[1]: Reloading finished in 274 ms.1018server # [ 3.862484] systemd[1]: Finished Virtual Console Setup.1019host1 # [ 5.569559] systemd-sysroot-fstab-check[122]: Requesting initrd-fs.target/start/replace...1020host1 # [ 5.575171] systemd-sysroot-fstab-check[122]: Requesting swap.target/start/replace...1021host1 # [ 5.584117] systemd[1]: Mounting /sysroot/nix/.ro-store...1022host1 # [ 5.590988] systemd[1]: Mounting /sysroot/nix/.rw-store...1023host1 # [ 5.610674] systemd[1]: Mounting /sysroot/run...1024host1 # [ 5.630051] systemd[1]: Mounting /sysroot/tmp/shared...1025host1 # [ 5.680925] systemd[1]: Mounting /sysroot/tmp/xchg...1026host1 # [ 5.689467] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1027host1 # [ 5.703405] systemd[1]: Finished Mountpoints Configured in the Real Root.1028host1 # [ 5.704627] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1029host1 # [ 5.732919] fuse: init (API version 7.45)1030host1 # [ 5.752676] virtiofs virtio6: discovered new tag: nix-store1031host1 # [ 5.762274] virtiofs virtio6: virtio_fs_setup_dax: No cache capability1032host1 # [ 5.755760] systemd[1]: Mounted /sysroot/run.1033host1 # [ 5.780629] virtiofs virtio7: discovered new tag: shared1034host1 # [ 5.790543] virtiofs virtio7: virtio_fs_setup_dax: No cache capability1035host1 # [ 5.804042] virtiofs virtio8: discovered new tag: xchg1036host1 # [ 5.804919] virtiofs virtio8: virtio_fs_setup_dax: No cache capability1037host1 # [ 5.792849] systemd[1]: Mounted /sysroot/nix/.rw-store.1038host1 # [ 5.806257] systemd[1]: Mounted /sysroot/tmp/shared.1039host1 # [ 5.815226] systemd[1]: Mounted /sysroot/nix/.ro-store.1040host1 # [ 5.821939] systemd[1]: Mounted /sysroot/tmp/xchg.1041host1 # [ 5.831742] systemd[1]: Starting rw-sysroot-nix-store.service...1042host1 # [ 5.864613] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1043host1 # [ 5.866572] systemd[1]: Finished rw-sysroot-nix-store.service.1044server # [ 4.588648] systemd[1]: Finished Coldplug All udev Devices.1045server # [ 4.589711] systemd[1]: Reached target System Initialization.1046server # [ 4.590585] systemd[1]: Reached target Basic System.1047server # [ 4.792523] (udev-worker)[99]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1048server # [ 4.845492] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.1049server # [ 4.851909] (udev-worker)[92]: Network interface NamePolicy= disabled on kernel command line.1050host1 # [ 6.579281] systemd[1]: Mounting /sysroot/nix/store...1051host1 # [ 6.622754] (udev-worker)[102]: mtd0ro: Failed to find and pin callout binary "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/udev/mtd_probe": No such file or directory1052server # [ 4.948719] systemd[1]: Found device /dev/disk/by-label/nixos.1053host1 # [ 6.629764] (udev-worker)[102]: mtd0ro: /etc/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory1054server # [ 4.954372] systemd[1]: Reached target Initrd Root Device.1055server # [ 4.958380] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1056host1 # [ 6.649349] systemd[1]: Mounted /sysroot/nix/store.1057host1 # [ 6.651874] systemd[1]: Reached target Initrd File Systems.1058host1 # [ 6.653078] systemd[1]: Starting Find NixOS closure...1059host1 # [ 6.661737] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1060server # [ 5.021731] systemd-fsck[114]: nixos: clean, 12/65536 files, 13019/262144 blocks1061server # [ 5.029555] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1062server # [ 5.033117] systemd[1]: Mounting /sysroot...1063host1 # [ 6.723271] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1064host1 # [ 6.731694] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1065host1 # [ 6.744176] systemd[1]: Finished Find NixOS closure.1066host1 # [ 6.762722] systemd[1]: Reached target Initrd Default Target.1067host1 # [ 6.767633] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1068server # [ 5.091668] systemd[1]: Mounted /sysroot.[ 5.116514] EXT4-fs (vda): mounted filesystem e57bca6b-4dc1-4090-beb6-7d8ca67729a7 r/w with ordered data mode. Quota mode: none.1069server # 1070host1 # [ 6.772240] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1071host1 # [ 6.775343] systemd[1]: Stopped Virtual Console Setup.1072host1 # [ 6.777328] systemd[1]: Stopping Virtual Console Setup...1073server # [ 5.098892] systemd[1]: Reached target Initrd Root File System.1074host1 # [ 6.782151] systemd[1]: Starting Virtual Console Setup...1075server # [ 5.104211] systemd[1]: Starting Mountpoints Configured in the Real Root...1076server # [ 5.139587] systemd-sysroot-fstab-check[122]: /sysroot should be mounted in the initrd, will request daemon-reload.1077server # [ 5.144479] systemd[1]: Reload requested from client PID 122 ('systemd-sysroot') (unit initrd-parse-etc.service)...1078server # [ 5.149201] systemd[1]: Reloading...1079host1 # [ 6.836153] systemd[1]: Stopped target Initrd Default Target.1080host1 # [ 6.837161] systemd[1]: Stopped target Basic System.1081host1 # [ 6.840125] systemd[1]: Stopped target Initrd Root Device.1082host1 # [ 6.841465] systemd[1]: Stopped target Path Units.1083host1 # [ 6.844144] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1084host1 # [ 6.848118] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1085host1 # [ 6.850599] systemd[1]: Stopped target Slice Units.1086host1 # [ 6.852554] systemd[1]: Stopped target Socket Units.1087host1 # [ 6.855308] systemd[1]: Stopped target System Initialization.1088host1 # [ 6.862861] systemd[1]: Stopped target Swaps.1089host1 # [ 6.863612] systemd[1]: Stopped target Timer Units.1090host1 # [ 6.864468] systemd[1]: dbus.socket: Deactivated successfully.1091host1 # [ 6.868229] systemd[1]: Closed D-Bus System Message Bus Socket.1092host1 # [ 6.869265] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1093host1 # [ 6.873766] systemd[1]: Stopped Find NixOS closure.1094host1 # [ 6.874758] systemd[1]: Starting rw-sysroot-nix-store.service...1095host1 # [ 6.877361] systemd[1]: systemd-sysctl.service: Deactivated successfully.1096host1 # [ 6.880352] systemd[1]: Stopped Apply Kernel Variables.1097host1 # [ 6.882189] systemd[1]: systemd-modules-load.service: Deactivated successfully.1098host1 # [ 6.884253] systemd[1]: Stopped Load Kernel Modules.1099host1 # [ 6.886895] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1100host1 # [ 6.888789] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1101host1 # [ 6.889914] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1102host1 # [ 6.891036] systemd[1]: Stopped Create System Files and Directories.1103host1 # [ 6.891948] systemd[1]: Stopped target Local File Systems.1104host1 # [ 6.893201] systemd[1]: Stopped target Preparation for Local File Systems.1105host1 # [ 6.894184] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1106host1 # [ 6.895415] systemd-vconsole-setup[169]: Configuration of first virtual console was skipped, ignoring remaining ones.1107host1 # [ 6.907718] systemd[1]: Stopped Coldplug All udev Devices.1108host1 # [ 6.910217] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1109host1 # [ 6.912512] systemd[1]: Stopped Virtual Console Setup.1110host1 # [ 6.916284] systemd[1]: systemd-udevd.service: Deactivated successfully.1111host1 # [ 6.917338] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1112host1 # [ 6.919609] systemd[1]: systemd-udevd.service: Consumed 1.769s CPU time over 3.243s wall clock time, 26.7M memory peak.1113host1 # [ 6.922173] systemd[1]: initrd-cleanup.service: Deactivated successfully.1114host1 # [ 6.925802] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1115host1 # [ 6.926978] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1116host1 # [ 6.928445] systemd[1]: Closed udev Control Socket.1117host1 # [ 6.929219] systemd[1]: Starting Cleanup udev Database...1118host1 # [ 6.930017] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1119host1 # [ 6.931208] systemd[1]: Stopped Create Static Device Nodes in /dev.1120host1 # [ 6.940462] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1121host1 # [ 6.941733] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1122host1 # [ 6.943109] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1123host1 # [ 6.948291] systemd[1]: Stopped Create List of Static Device Nodes.1124host1 # [ 6.949240] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1125host1 # [ 6.950276] systemd[1]: Finished rw-sysroot-nix-store.service.1126host1 # [ 6.987399] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1127host1 # [ 6.992679] systemd[1]: Finished Cleanup udev Database.1128host1 # [ 6.993604] systemd[1]: Reached target Switch Root.1129host1 # [ 6.994331] systemd[1]: Starting NixOS Activation...1130server # [ 5.396265] systemd[1]: Reloading finished in 249 ms.1131host1 # [ 7.077172] initrd-nixos-activation-start[181]: booting system configuration /nix/store/frr5dlaxxxyqjg525jrsyzri40f00pzv-nixos-system-host1-test1132server # [ 5.424784] systemd-sysroot-fstab-check[122]: Requesting initrd-fs.target/start/replace...1133server # [ 5.429666] systemd-sysroot-fstab-check[122]: Requesting swap.target/start/replace...1134host1 # [ 7.110787] initrd-nixos-activation-start[181]: running activation script...1135server # [ 5.437832] systemd[1]: Mounting /sysroot/nix/.ro-store...1136server # [ 5.456137] systemd[1]: Mounting /sysroot/nix/.rw-store...1137server # [ 5.469756] systemd[1]: Mounting /sysroot/run...1138server # [ 5.490558] systemd[1]: Mounting /sysroot/tmp/shared...1139server # [ 5.516788] systemd[1]: Mounting /sysroot/tmp/xchg...1140server # [ 5.530417] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1141server # [ 5.553182] systemd[1]: Finished Mountpoints Configured in the Real Root.1142server # [ 5.554468] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1143server # [ 5.561721] systemd[1]: Mounted /sysroot/nix/.rw-store.1144server # [ 5.583305] systemd[1]: Mounted /sysroot/run.1145server # [ 5.636586] fuse: init (API version 7.45)1146server # [ 5.644018] virtiofs virtio6: discovered new tag: nix-store1147server # [ 5.653786] virtiofs virtio6: virtio_fs_setup_dax: No cache capability1148server # [ 5.632169] systemd[1]: Starting rw-sysroot-nix-store.service...1149server # [ 5.670112] virtiofs virtio7: discovered new tag: shared1150server # [ 5.671020] virtiofs virtio7: virtio_fs_setup_dax: No cache capability1151server # [ 5.678408] virtiofs virtio8: discovered new tag: xchg1152server # [ 5.679287] virtiofs virtio8: virtio_fs_setup_dax: No cache capability1153server # [ 5.682011] systemd[1]: Mounted /sysroot/nix/.ro-store.1154server # [ 5.685239] systemd[1]: Mounted /sysroot/tmp/shared.1155server # [ 5.687343] systemd[1]: Mounted /sysroot/tmp/xchg.1156server # [ 5.690011] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1157server # [ 5.694245] systemd[1]: Finished rw-sysroot-nix-store.service.1158server # [ 5.706353] systemd[1]: Mounting /sysroot/nix/store...1159host1 # [ 7.387151] initrd-nixos-activation-start[204]: setting up /etc...1160server # [ 5.762223] systemd[1]: Mounted /sysroot/nix/store.1161server # [ 5.764187] systemd[1]: Reached target Initrd File Systems.1162server # [ 5.767176] systemd[1]: Starting Find NixOS closure...1163server # [ 5.783566] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1164server # [ 5.817649] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1165server # [ 5.838047] systemd[1]: Finished Find NixOS closure.1166server # [ 5.840818] systemd[1]: Reached target Initrd Default Target.1167server # [ 5.846578] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1168host1 # [ 7.529070] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1169host1 # [ 7.532176] systemd[1]: Finished NixOS Activation.1170host1 # [ 7.533526] systemd[1]: Starting Switch Root...1171host1 # [ 7.557034] systemd[1]: Switching root.1172server # [ 5.891690] systemd[1]: Stopped target Initrd Default Target.1173server # [ 5.896093] systemd[1]: Stopped target Basic System.1174server # [ 5.898702] systemd[1]: Stopped target Initrd Root Device.1175server # [ 5.899606] systemd[1]: Stopped target Path Units.1176server # [ 5.904208] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1177server # [ 5.906583] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1178server # [ 5.912343] systemd[1]: Stopped target Slice Units.1179server # [ 5.915801] systemd[1]: Stopped target Socket Units.1180server # [ 5.920867] systemd[1]: Stopped target System Initialization.1181server # [ 5.922906] systemd[1]: Stopped target Swaps.1182server # [ 5.924654] systemd[1]: Stopped target Timer Units.1183server # [ 5.928616] systemd[1]: dbus.socket: Deactivated successfully.1184server # [ 5.930546] systemd[1]: Closed D-Bus System Message Bus Socket.1185server # [ 5.932116] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1186server # [ 5.936410] systemd[1]: Stopped Find NixOS closure.1187server # [ 5.940267] systemd[1]: Starting rw-sysroot-nix-store.service...1188server # [ 5.942104] systemd[1]: systemd-sysctl.service: Deactivated successfully.1189server # [ 5.950421] systemd[1]: Stopped Apply Kernel Variables.1190server # [ 5.951998] systemd[1]: systemd-modules-load.service: Deactivated successfully.1191server # [ 5.954470] systemd[1]: Stopped Load Kernel Modules.1192server # [ 5.956907] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1193server # [ 5.962892] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1194server # [ 5.968385] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1195server # [ 5.969465] systemd[1]: Stopped Create System Files and Directories.1196server # [ 5.970365] systemd[1]: Stopped target Local File Systems.1197server # [ 5.971157] systemd[1]: Stopped target Preparation for Local File Systems.1198server # [ 5.975647] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1199server # [ 5.979110] systemd[1]: Stopped Coldplug All udev Devices.1200server # [ 5.980178] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1201server # [ 5.984215] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1202server # [ 5.985354] systemd[1]: Stopped Virtual Console Setup.1203server # [ 5.986122] systemd[1]: initrd-cleanup.service: Deactivated successfully.1204server # [ 5.987367] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1205server # [ 5.988494] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1206server # [ 5.989491] systemd[1]: Finished rw-sysroot-nix-store.service.1207server # [ 5.995250] systemd[1]: systemd-udevd.service: Deactivated successfully.1208server # [ 5.997141] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1209server # [ 5.999860] systemd[1]: systemd-udevd.service: Consumed 1.052s CPU time over 2.494s wall clock time, 18.3M memory peak.1210server # [ 6.002452] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1211server # [ 6.007826] systemd[1]: Closed udev Control Socket.1212server # [ 6.008910] systemd[1]: Starting Cleanup udev Database...1213server # [ 6.009797] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1214server # [ 6.010909] systemd[1]: Stopped Create Static Device Nodes in /dev.1215server # [ 6.011905] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1216server # [ 6.013263] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1217server # [ 6.014275] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1218server # [ 6.015261] systemd[1]: Stopped Create List of Static Device Nodes.1219server # [ 6.040784] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1220server # [ 6.042443] systemd[1]: Finished Cleanup udev Database.1221server # [ 6.045864] systemd[1]: Reached target Switch Root.1222server # [ 6.047064] systemd[1]: Starting NixOS Activation...1223host1 # [ 7.746736] systemd-journald[70]: Received SIGTERM from PID 1 (systemd).1224server # [ 6.132657] initrd-nixos-activation-start[174]: booting system configuration /nix/store/v56dhs75sxw81lpa16lrvcngwdyqblan-nixos-system-server-test1225server # [ 6.166446] initrd-nixos-activation-start[174]: running activation script...1226server # [ 6.435507] initrd-nixos-activation-start[197]: setting up /etc...1227server # [ 6.555022] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1228server # [ 6.558179] systemd[1]: Finished NixOS Activation.1229server # [ 6.559387] systemd[1]: Starting Switch Root...1230host1 # [ 8.263226] systemd[1]: systemd 261.3 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)1231host1 # [ 8.263289] systemd[1]: Detected virtualization qemu.1232host1 # [ 8.263375] systemd[1]: Detected architecture arm64.1233host1 # [ 8.263504] systemd[1]: Detected first boot.1234host1 # [ 8.274796] systemd[1]: Initializing machine ID from random generator.1235server # [ 6.583847] systemd[1]: Switching root.1236host1 # [ 8.408540] systemd[1]: bpf-restrict-fs: LSM BPF program attached1237server # [ 6.786273] systemd-journald[70]: Received SIGTERM from PID 1 (systemd).1238host1 # [ 8.559648] systemd[1]: Applying preset policy.1239host1 # [ 8.790746] systemd[1]: Populated /etc with preset unit settings.1240server # [ 7.290064] systemd[1]: systemd 261.3 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)1241server # [ 7.290127] systemd[1]: Detected virtualization qemu.1242server # [ 7.290200] systemd[1]: Detected architecture arm64.1243server # [ 7.290320] systemd[1]: Detected first boot.1244server # [ 7.301899] systemd[1]: Initializing machine ID from random generator.1245host1 # [ 9.019427] systemd[1]: initrd-switch-root.service: Deactivated successfully.1246host1 # [ 9.020313] systemd[1]: Stopped initrd-switch-root.service.1247host1 # [ 9.026216] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1248host1 # [ 9.027824] systemd[1]: Created slice Slice /system/getty.1249host1 # [ 9.029089] systemd[1]: Created slice User and Session Slice.1250host1 # [ 9.033103] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1251host1 # [ 9.035394] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1252host1 # [ 9.035816] systemd[1]: Expecting device /dev/hvc0...1253host1 # [ 9.036336] systemd[1]: Expecting device /dev/ttyAMA0...1254host1 # [ 9.036803] systemd[1]: Reached target Local Encrypted Volumes.1255host1 # [ 9.040765] systemd[1]: Stopped target initrd-fs.target.1256host1 # [ 9.041129] systemd[1]: Stopped target initrd-root-fs.target.1257host1 # [ 9.043333] systemd[1]: Stopped target initrd-switch-root.target.1258host1 # [ 9.043822] systemd[1]: Reached target Virtual Machines and Containers.1259host1 # [ 9.044256] systemd[1]: Reached target Path Units.1260host1 # [ 9.044669] systemd[1]: Reached target Remote File Systems.1261host1 # [ 9.045076] systemd[1]: Reached target Slice Units.1262host1 # [ 9.049083] systemd[1]: Reached target Swaps.1263host1 # [ 9.052088] systemd[1]: Listening on Query the User Interactively for a Password.1264host1 # [ 9.055110] systemd[1]: Listening on Process Core Dump Socket.1265host1 # [ 9.056550] systemd[1]: Listening on Credential Encryption/Decryption.1266host1 # [ 9.059959] systemd[1]: Listening on Factory Reset Management.1267host1 # [ 9.060453] systemd[1]: Listening on Hostname Service Socket.1268host1 # [ 9.066309] systemd[1]: Starting Journal Log Access Socket...1269host1 # [ 9.068274] systemd[1]: Listening on Journal Audit Socket.1270host1 # [ 9.072751] systemd[1]: Listening on Console Output Muting Service Socket.1271host1 # [ 9.074974] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1272host1 # [ 9.076238] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1273host1 # [ 9.079846] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1274host1 # [ 9.085359] systemd[1]: Listening on Disk Repartitioning Service Socket.1275host1 # [ 9.085882] systemd[1]: Listening on udev Control Socket.1276host1 # [ 9.086481] systemd[1]: Listening on udev Varlink Socket.1277host1 # [ 9.091841] systemd[1]: Mounting Huge Pages File System...1278host1 # [ 9.097737] systemd[1]: Mounting POSIX Message Queue File System...1279server # [ 7.435684] systemd[1]: bpf-restrict-fs: LSM BPF program attached1280host1 # [ 9.113278] systemd[1]: Mounting Kernel Debug File System...1281host1 # [ 9.121446] systemd[1]: Mounting Kernel Trace File System...1282host1 # [ 9.138145] systemd[1]: Starting Create List of Static Device Nodes...1283host1 # [ 9.139910] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1284host1 # [ 9.157888] systemd[1]: Mounting Kernel Configuration File System...1285host1 # [ 9.158428] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1286host1 # [ 9.166689] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1287host1 # [ 9.167184] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1288host1 # [ 9.197395] systemd[1]: Mounting FUSE Control File System...1289host1 # [ 9.197965] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671290host1 # [ 9.227920] systemd[1]: Starting Journal Service...1291host1 # [ 9.253705] systemd[1]: Starting Load Kernel Modules...1292host1 # [ 9.288786] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1293host1 # [ 9.304739] systemd[1]: Starting Remount Root and Kernel File Systems...1294host1 # [ 9.305129] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1295server # [ 7.633949] systemd[1]: Applying preset policy.1296host1 # [ 9.329772] systemd[1]: Starting Coldplug All udev Devices...1297host1 # [ 9.332515] systemd[1]: Listening on Journal Log Access Socket.1298host1 # [ 9.332919] systemd[1]: Mounted Huge Pages File System.1299host1 # [ 9.341921] systemd-journald[274]: Collecting audit messages is enabled.1300host1 # [ 9.362450] systemd[1]: Mounted POSIX Message Queue File System.1301host1 # [ 9.362951] systemd[1]: Mounted Kernel Debug File System.1302host1 # [ 9.363336] systemd[1]: Mounted Kernel Trace File System.1303host1 # [ 9.364716] systemd[1]: Finished Create List of Static Device Nodes.1304host1 # [ 9.357764] systemd[1]: Queued start job for default target Multi-User System.1305host1 # [ 9.365182] systemd[1]: systemd-journald.service: Deactivated successfully.1306host1 # [ 9.366736] systemd-modules-load[275]: Module 'atkbd' is built in1307host1 # [ 9.377276] systemd-modules-load[275]: Module 'loop' is built in1308host1 # [ 9.405532] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1309host1 # [ 9.406065] systemd[1]: Started Journal Service.1310host1 # [ 9.398566] systemd[1]: Finished Load Kernel Modules.1311host1 # [ 9.417544] systemd-oomd[276]: No swap; memory pressure usage will be degraded1312host1 # [ 9.433305] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1313host1 # [ 9.453302] EXT4-fs (vda): re-mounted 91628846-5785-432a-97ed-98fff0fef2dc.1314host1 # [ 9.454273] systemd[1]: Finished Remount Root and Kernel File Systems.1315host1 # [ 9.462126] systemd[1]: Mounted Kernel Configuration File System.1316host1 # [ 9.476125] systemd[1]: Listening on Disk Image Download Service Socket.1317host1 # [ 9.481664] systemd[1]: Starting Firewall...1318host1 # [ 9.486632] systemd[1]: Starting Flush Journal to Persistent Storage...1319host1 # [ 9.487687] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1320server # [ 7.842162] systemd[1]: Populated /etc with preset unit settings.1321host1 # [ 9.497378] systemd[1]: Starting Load/Save OS Random Seed...1322host1 # [ 9.498250] systemd[1]: Starting Apply Kernel Variables...1323host1 # [ 9.499169] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1324host1 # [ 9.514301] systemd[1]: Mounted FUSE Control File System.1325host1 # [ 9.634381] systemd-journald[274]: Received client request to flush runtime journal.1326host1 # [ 9.715545] systemd[1]: Finished Load/Save OS Random Seed.1327host1 # [ 9.724943] systemd[1]: Reached target First Boot Complete.1328host1 # [ 9.728282] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1329host1 # [ 9.729459] systemd[1]: Starting Create Static Device Nodes in /dev...1330server # [ 8.079795] systemd[1]: initrd-switch-root.service: Deactivated successfully.1331server # [ 8.081718] systemd[1]: Stopped initrd-switch-root.service.1332host1 # [ 9.737449] systemd[1]: Finished Flush Journal to Persistent Storage.1333host1 # [ 9.738564] systemd[1]: Finished Apply Kernel Variables.1334server # [ 8.085799] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1335server # [ 8.087535] systemd[1]: Created slice Slice /system/getty.1336server # [ 8.091422] systemd[1]: Created slice User and Session Slice.1337server # [ 8.091991] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1338server # [ 8.095016] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1339server # [ 8.095437] systemd[1]: Expecting device /dev/hvc0...1340server # [ 8.098446] systemd[1]: Expecting device /dev/ttyAMA0...1341server # [ 8.098843] systemd[1]: Reached target Local Encrypted Volumes.1342server # [ 8.099482] systemd[1]: Stopped target initrd-fs.target.1343server # [ 8.100080] systemd[1]: Stopped target initrd-root-fs.target.1344server # [ 8.104208] systemd[1]: Stopped target initrd-switch-root.target.1345server # [ 8.104606] systemd[1]: Reached target Virtual Machines and Containers.1346server # [ 8.105247] systemd[1]: Reached target Path Units.1347server # [ 8.105848] systemd[1]: Reached target Remote File Systems.1348server # [ 8.106435] systemd[1]: Reached target Slice Units.1349server # [ 8.107049] systemd[1]: Reached target Swaps.1350server # [ 8.113603] systemd[1]: Listening on Query the User Interactively for a Password.1351server # [ 8.115659] systemd[1]: Listening on Process Core Dump Socket.1352server # [ 8.119435] systemd[1]: Listening on Credential Encryption/Decryption.1353server # [ 8.122261] systemd[1]: Listening on Factory Reset Management.1354server # [ 8.122743] systemd[1]: Listening on Hostname Service Socket.1355server # [ 8.127612] systemd[1]: Starting Journal Log Access Socket...1356server # [ 8.130573] systemd[1]: Listening on Journal Audit Socket.1357server # [ 8.133572] systemd[1]: Listening on Console Output Muting Service Socket.1358server # [ 8.134216] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1359server # [ 8.134744] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1360server # [ 8.135341] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1361server # [ 8.145738] systemd[1]: Listening on Disk Repartitioning Service Socket.1362server # [ 8.146312] systemd[1]: Listening on udev Control Socket.1363server # [ 8.147066] systemd[1]: Listening on udev Varlink Socket.1364server # [ 8.152948] systemd[1]: Mounting Huge Pages File System...1365server # [ 8.160299] systemd[1]: Mounting POSIX Message Queue File System...1366server # [ 8.171673] systemd[1]: Mounting Kernel Debug File System...1367host1 # [ 9.837625] systemd[1]: Finished Create Static Device Nodes in /dev.1368server # [ 8.189041] systemd[1]: Mounting Kernel Trace File System...1369host1 # [ 9.844141] systemd[1]: Reached target Preparation for Local File Systems.1370host1 # [ 9.847265] systemd[1]: Starting Rule-based Manager for Device Events and Files...1371server # [ 8.197639] systemd[1]: Starting Create List of Static Device Nodes...1372server # [ 8.198023] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1373server # [ 8.216442] systemd[1]: Mounting Kernel Configuration File System...1374server # [ 8.216843] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1375server # [ 8.217114] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1376server # [ 8.217379] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1377server # [ 8.244112] systemd[1]: Mounting FUSE Control File System...1378server # [ 8.244579] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671379server # [ 8.276746] systemd[1]: Starting Journal Service...1380server # [ 8.301152] systemd[1]: Starting Load Kernel Modules...1381host1 # [ 9.965128] systemd-udevd[311]: Using default interface naming scheme 'v261'.1382server # [ 8.313569] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1383server # [ 8.325033] systemd[1]: Starting Remount Root and Kernel File Systems...1384server # [ 8.325416] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1385server # [ 8.335783] systemd[1]: Starting Coldplug All udev Devices...1386server # [ 8.343230] systemd[1]: Listening on Journal Log Access Socket.1387server # [ 8.343863] systemd[1]: Mounted Huge Pages File System.1388server # [ 8.347285] systemd[1]: Mounted POSIX Message Queue File System.1389server # [ 8.349550] systemd[1]: Mounted Kernel Debug File System.1390server # [ 8.350827] systemd[1]: Mounted Kernel Trace File System.1391host1 # [ 10.005986] systemd[1]: Mounting /run/wrappers...1392server # [ 8.353824] systemd[1]: Mounted Kernel Configuration File System.1393server # [ 8.355101] systemd[1]: Mounted FUSE Control File System.1394server # [ 8.402413] systemd[1]: Finished Create List of Static Device Nodes.1395server # [ 8.408962] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1396host1 # [ 10.077501] systemd[1]: Mounted /run/wrappers.1397host1 # [ 10.078451] systemd[1]: Reached target Local File Systems.1398host1 # [ 10.088192] systemd[1]: Listening on Boot Loader Control Service Socket.1399host1 # [ 10.093620] systemd[1]: Starting register-nix-paths.service...1400host1 # [ 10.100222] systemd[1]: Starting Create SUID/SGID Wrappers...1401host1 # [ 10.101255] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1402server # [ 8.464241] systemd[1]: Finished Load Kernel Modules.1403server # [ 8.465610] EXT4-fs (vda): re-mounted e57bca6b-4dc1-4090-beb6-7d8ca67729a7.1404host1 # [ 10.120253] systemd[1]: Starting Save Transient machine-id to Disk...1405host1 # [ 10.127294] systemd[1]: Starting Create System Files and Directories...1406server # [ 8.476810] systemd[1]: Starting Firewall...1407server # [ 8.489023] systemd[1]: Starting Apply Kernel Variables...1408server # [ 8.496542] systemd[1]: Finished Remount Root and Kernel File Systems.1409server # [ 8.497437] systemd[1]: Listening on Disk Image Download Service Socket.1410server # [ 8.497975] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1411host1 # [ 10.154225] systemd[1]: Started Rule-based Manager for Device Events and Files.1412server # [ 8.504099] systemd-journald[268]: Collecting audit messages is enabled.1413server # [ 8.517603] systemd[1]: Starting Load/Save OS Random Seed...1414server # [ 8.518856] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1415server # [ 8.576095] systemd[1]: Started Journal Service.1416server # [ 8.564300] systemd[1]: Queued start job for default target Multi-User System.1417server # [ 8.565555] systemd[1]: systemd-journald.service: Deactivated successfully.1418server # [ 8.581941] systemd-modules-load[269]: Module 'atkbd' is built in1419server # [ 8.593217] systemd-modules-load[269]: Module 'loop' is built in1420host1 # [ 10.272309] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1421host1 # [ 10.280377] systemd[1]: Finished Save Transient machine-id to Disk.1422server # [ 8.602781] systemd[1]: Starting Flush Journal to Persistent Storage...1423server # [ 8.622778] systemd-oomd[270]: No swap; memory pressure usage will be degraded1424server # [ 8.660263] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1425server # [ 8.661457] systemd[1]: Finished Load/Save OS Random Seed.1426server # [ 8.662264] systemd[1]: Reached target First Boot Complete.1427server # [ 8.673147] systemd[1]: Finished Apply Kernel Variables.1428host1 # [ 10.369217] systemd[1]: Finished Create System Files and Directories.1429host1 # [ 10.380498] systemd[1]: Starting Rebuild Journal Catalog...1430host1 # [ 10.386528] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1431server # [ 8.747388] systemd-journald[268]: Received client request to flush runtime journal.1432server # [ 8.801400] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1433server # [ 8.808326] systemd[1]: Starting Create Static Device Nodes in /dev...1434server # [ 8.816407] systemd[1]: Finished Flush Journal to Persistent Storage.1435host1 # [ 10.532298] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1436server # [ 8.891864] systemd[1]: Finished Create Static Device Nodes in /dev.1437server # [ 8.895154] systemd[1]: Reached target Preparation for Local File Systems.1438server # [ 8.906021] systemd[1]: Starting Rule-based Manager for Device Events and Files...1439host1 # [ 10.586240] systemd[1]: Finished Rebuild Journal Catalog.1440host1 # [ 10.595727] systemd[1]: Starting Update is Completed...1441host1 # [ 10.676472] systemd[1]: Finished Update is Completed.1442server # [ 9.061858] systemd[1]: Mounting /run/wrappers...1443server # [ 9.167475] systemd[1]: Mounted /run/wrappers.1444server # [ 9.168529] systemd[1]: Reached target Local File Systems.1445server # [ 9.169412] systemd[1]: Listening on Boot Loader Control Service Socket.1446server # [ 9.180341] systemd[1]: Starting register-nix-paths.service...1447server # [ 9.187131] systemd[1]: Starting Create SUID/SGID Wrappers...1448server # [ 9.205132] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.1449server # [ 9.220562] systemd[1]: Starting Save Transient machine-id to Disk...1450server # [ 9.224460] systemd[1]: Starting Create System Files and Directories...1451server # [ 9.341550] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.1452server # [ 9.352581] systemd[1]: Finished Save Transient machine-id to Disk.1453server # [ 9.489166] systemd[1]: Finished Create System Files and Directories.1454server # [ 9.496647] systemd[1]: Starting Rebuild Journal Catalog...1455server # [ 9.508236] systemd[1]: Starting Record System Boot/Shutdown in UTMP...1456server # [ 9.629438] systemd-udevd[312]: Using default interface naming scheme 'v261'.1457server # [ 9.666561] systemd[1]: Finished Record System Boot/Shutdown in UTMP.1458host1 # [ 11.413793] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1459host1 # [ 11.416711] systemd[1]: Finished Create SUID/SGID Wrappers.1460server # [ 9.782383] systemd[1]: Finished Rebuild Journal Catalog.1461server # [ 9.794207] systemd[1]: Starting Update is Completed...1462host1 # [ 11.613276] systemd[1]: Finished Coldplug All udev Devices.1463server # [ 9.941570] systemd[1]: Finished Update is Completed.1464server # [ 9.949257] systemd[1]: Started Rule-based Manager for Device Events and Files.1465host1 # [ 11.737129] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1466host1 # [ 11.794202] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1467host1 # [ 12.054460] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1468host1 # [ 12.151793] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1469server # [ 10.545472] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.1470server # [ 10.553755] systemd[1]: Finished Create SUID/SGID Wrappers.1471host1 # [ 12.329550] systemd[1]: Finished register-nix-paths.service.1472host1 # [ 12.333087] systemd[1]: Reached target System Initialization.1473host1 # [ 12.334049] systemd[1]: Started Renew ACME Certificate for host1.1474host1 # [ 12.334968] systemd[1]: Started Discard unused filesystem blocks once a week.1475host1 # [ 12.336007] systemd[1]: Started Daily Cleanup of Temporary Directories.1476host1 # [ 12.343756] systemd[1]: Reached target Timer Units.1477host1 # [ 12.349793] systemd[1]: Listening on D-Bus System Message Bus Socket.1478host1 # [ 12.350843] systemd[1]: Listening on Nix Daemon Socket.1479host1 # [ 12.351653] systemd[1]: Listening on OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local).1480host1 # [ 12.364154] systemd[1]: Starting OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK)...1481host1 # [ 12.365391] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1482host1 # [ 12.388620] systemd[1]: Starting D-Bus System Message Bus...1483host1 # [ 12.412490] systemd[1]: Finished Firewall.1484host1 # [ 12.446146] systemd-ssh-issue[493]: Options --make-vsock/--rm-vsock have been replaced by make-vsock/rm-vsock verbs.1485host1 # [ 12.451962] systemd[1]: Listening on OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK).1486host1 # [ 12.455516] systemd[1]: Reached target Socket Units.1487host1 # [ 12.466760] (udev-worker)[337]: Network interface NamePolicy= disabled on kernel command line.1488host1 # [ 12.475515] (udev-worker)[426]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1489host1 # [ 12.481037] (udev-worker)[426]: Network interface NamePolicy= disabled on kernel command line.1490host1 # [ 12.535843] dbus-broker-launch[494]: Looking up NSS user entry for 'systemd-timesync'...1491host1 # [ 12.542588] dbus-broker-launch[494]: NSS returned no entry for 'systemd-timesync'1492host1 # [ 12.546303] dbus-broker-launch[494]: Invalid user-name in /nix/store/x22q42php31hda5209nhwlyhgg3zcjz4-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1493host1 # [ 12.583560] systemd[1]: Started D-Bus System Message Bus.1494host1 # [ 12.588656] systemd[1]: Reached target Basic System.1495host1 # [ 12.596237] systemd[1]: Starting Set up the ACME certificate renewal infrastructure...1496host1 # [ 12.606795] systemd[1]: Started backdoor.service.1497host1 # [ 12.612179] systemd[1]: Starting Import lastlog data into lastlog2 database...1498host1 # [ 12.640327] dbus-broker-launch[494]: Ready1499host1 # [ 12.644520] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1500host1 # [ 12.679285] systemd[1]: Starting Post-Boot Actions...1501server # [ 11.012344] systemd[1]: Finished Firewall.1502host1 # [ 12.708190] systemd[1]: Started Reset console on configuration changes.1503host1 # [ 12.751794] systemd[1]: Starting resolvconf update...1504host1 # [ 12.825861] acme-setup-privileged[502]: + set -euo pipefail1505host1 # [ 12.826922] acme-setup-privileged[502]: + cd /var/lib/acme1506host1 # [ 12.827738] acme-setup-privileged[502]: + chmod -R u=rwX,g=,o= .lego/accounts1507host1 # [ 12.852906] systemd[1]: Starting SSH Host Keys Generation...1508host1 # [ 12.866095] acme-setup-privileged[502]: + chown -R acme .lego/accounts1509host1 # connecting to host...1510host1 # [ 12.890536] acme-setup-privileged[502]: + for fixpath in host1 .lego/host11511host1 # [ 12.891641] acme-setup-privileged[502]: + '[' -d host1 ']'1512host1 # [ 12.898038] acme-setup-privileged[502]: + for fixpath in host1 .lego/host11513host1 # [ 12.899126] acme-setup-privileged[502]: + '[' -d .lego/host1 ']'1514host1 # [ 12.913486] nsncd[505]: Oct 25 21:41:24.743 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1515host1 # [ 12.915756] systemd[1]: Finished Post-Boot Actions.1516host1 # [ 12.939649] systemd[1]: Started Name Service Cache Daemon (nsncd).1517server # [ 11.329252] systemd[1]: Finished Coldplug All udev Devices.1518host1 # [ 13.018574] systemd[1]: Finished Import lastlog data into lastlog2 database.1519host1 # [ 13.037102] systemd[1]: Reached target Host and Network Name Lookups.1520host1 # [ 13.038174] systemd[1]: Reached target User and Group Name Lookups.1521host1 # [ 13.058295] systemd[1]: Starting User Login Management...1522host1 # [ 13.104355] systemd[1]: Condition check resulted in Virtio network device being skipped.1523server # [ 11.468187] systemd[1]: Finished register-nix-paths.service.1524server # [ 11.469684] systemd[1]: Reached target System Initialization.1525server # [ 11.472309] systemd[1]: Started Renew ACME Certificate for server.1526server # [ 11.474976] systemd[1]: Started Discard unused filesystem blocks once a week.1527server # [ 11.479316] systemd[1]: Started Daily Cleanup of Temporary Directories.1528server # [ 11.482073] systemd[1]: Reached target Timer Units.1529server # [ 11.482862] systemd[1]: Listening on D-Bus System Message Bus Socket.1530server # [ 11.483894] systemd[1]: Listening on Nix Daemon Socket.1531server # [ 11.488892] systemd[1]: Listening on Nix worker-protocol over gRPC.1532server # [ 11.489845] systemd[1]: Listening on OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local).1533server # [ 11.500248] systemd[1]: Starting OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK)...1534server # [ 11.505901] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.1535server # [ 11.516285] systemd[1]: Starting D-Bus System Message Bus...1536server # [ 11.553086] systemd-ssh-issue[495]: Options --make-vsock/--rm-vsock have been replaced by make-vsock/rm-vsock verbs.1537server # [ 11.566062] systemd[1]: Listening on OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK).1538server # [ 11.569856] systemd[1]: Reached target Socket Units.1539host1 # [ 13.250463] acme-setup-start[534]: + set -euo pipefail1540host1 # [ 13.251359] acme-setup-start[534]: + test -e ca/key.pem1541host1 # [ 13.260231] acme-setup-start[534]: + minica --ca-key ca/key.pem --ca-cert ca/cert.pem --domains selfsigned.local1542host1 # [ 13.274014] systemd[1]: Stopped target Host and Network Name Lookups.1543host1 # [ 13.275095] systemd[1]: Stopping Host and Network Name Lookups...1544host1 # [ 13.275950] systemd[1]: Stopped target User and Group Name Lookups.1545server # [ 11.597432] dbus-broker-launch[496]: Looking up NSS user entry for 'systemd-timesync'...1546server # [ 11.602082] dbus-broker-launch[496]: NSS returned no entry for 'systemd-timesync'1547server # [ 11.605305] dbus-broker-launch[496]: Invalid user-name in /nix/store/5rbqnlcwa36b5kh8szwyp1z2glsjs0km-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"1548host1 # [ 13.286405] systemd[1]: Stopping User and Group Name Lookups...1549host1 # [ 13.292829] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...1550host1 # [ 13.293857] systemd[1]: nscd.service: Deactivated successfully.1551server # [ 11.620781] systemd[1]: Started D-Bus System Message Bus.1552host1 # [ 13.302775] systemd[1]: Stopped Name Service Cache Daemon (nsncd).1553server # [ 11.625343] systemd[1]: Reached target Basic System.1554server # [ 11.633552] systemd[1]: Starting Set up the ACME certificate renewal infrastructure...1555host1 # [ 13.308532] systemd-logind[548]: Watching system buttons on /dev/input/event0 (gpio-keys)1556server # [ 11.648856] systemd[1]: Starting Import lastlog data into lastlog2 database...1557host1 # [ 13.332623] systemd-logind[548]: New seat seat0.1558host1 # [ 13.336186] systemd[1]: Started User Login Management.1559server # [ 11.664437] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1560host1 # [ 13.356508] systemd[1]: Starting linger-users.service...1561server # [ 11.679300] systemd[1]: Starting Post-Boot Actions...1562server # [ 11.686399] systemd[1]: Started Reset console on configuration changes.1563host1 # [ 13.367714] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1564server # [ 11.699545] systemd[1]: Starting resolvconf update...1565server # [ 11.710742] systemd[1]: Starting SSH Host Keys Generation...1566server # [ 11.720465] systemd[1]: Starting step-ca-pki.service...1567host1 # [ 13.432662] systemd[1]: Finished Set up the ACME certificate renewal infrastructure.1568server # [ 11.764746] dbus-broker-launch[496]: Ready1569host1 # [ 13.457715] systemd[1]: Starting Ensure certificate for host1...1570host1 # [ 13.519798] systemd[1]: linger-users.service: Deactivated successfully.1571host1 # [ 13.524392] systemd[1]: Finished linger-users.service.1572host1 # [ 13.530075] systemd[1]: Started Name Service Cache Daemon (nsncd).1573server # [ 11.854459] systemd[1]: Finished Post-Boot Actions.1574host1 # [ 13.542000] nsncd[609]: Oct 25 21:41:25.384 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1575host1 # [ 13.553697] systemd[1]: Reached target Host and Network Name Lookups.1576host1 # [ 13.554798] systemd[1]: Reached target User and Group Name Lookups.1577server # [ 11.895540] acme-setup-privileged[499]: + set -euo pipefail1578server # [ 11.910307] acme-setup-privileged[499]: + cd /var/lib/acme1579server # [ 11.924705] acme-setup-privileged[499]: + chmod -R u=rwX,g=,o= .lego/accounts1580server # [ 11.936302] acme-setup-privileged[499]: + chown -R acme .lego/accounts1581server # [ 11.940715] systemd[1]: Started Name Service Cache Daemon (nsncd).1582server # [ 11.947538] systemd[1]: Reached target Host and Network Name Lookups.1583server # [ 11.958638] systemd[1]: Reached target User and Group Name Lookups.1584server # [ 11.965347] acme-setup-privileged[499]: + for fixpath in server .lego/server1585host1 # [ 13.657089] systemd[1]: Finished resolvconf update.1586host1 # [ 13.660503] systemd[1]: Reached target Preparation for Network.1587server # [ 11.975511] acme-setup-privileged[499]: + '[' -d server ']'1588server # [ 11.984344] acme-setup-privileged[499]: + for fixpath in server .lego/server1589host1 # [ 13.672252] systemd[1]: Starting DHCP Client...1590server # [ 11.994942] acme-setup-privileged[499]: + '[' -d .lego/server ']'1591host1 # [ 13.678838] systemd[1]: Starting Address configuration of eth1...1592server # [ 12.000843] nsncd[501]: Oct 25 21:41:25.870 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1593host1 # [ 13.688545] systemd[1]: Starting Extra networking commands....1594server # [ 12.015738] systemd[1]: Starting User Login Management...1595server # [ 12.023885] systemd[1]: Finished Import lastlog data into lastlog2 database.1596host1 # [ 13.733015] acme-host1-start[625]: Waiting to acquire lock in /run/acme/1597host1 # [ 13.775692] acme-host1-start[625]: + '[' -e out/acme-success ']'1598host1 # [ 13.783774] acme-host1-start[625]: + minica --ca-cert=ca/cert.pem --ca-key=ca/key.pem --domains=host1 --ip-addresses=1599host1 # [ 13.921097] acme-host1-start[665]: + cd host11600host1 # [ 13.921841] acme-host1-start[665]: + cp -vp cert.pem ../out/cert.pem1601host1 # [ 13.938898] acme-host1-start[666]: 'cert.pem' -> '../out/cert.pem'1602host1 # [ 13.947696] acme-host1-start[665]: + cp -vp key.pem ../out/key.pem1603server # [ 12.264133] systemd-logind[523]: New seat seat0.1604server # [ 12.281329] systemd[1]: Started User Login Management.1605host1 # [ 13.963070] acme-host1-start[665]: 'key.pem' -> '../out/key.pem'1606host1 # [ 13.966864] acme-host1-start[625]: + cat out/cert.pem ca/cert.pem1607server # [ 12.292315] systemd[1]: Starting linger-users.service...1608host1 # [ 13.999003] acme-host1-start[625]: + cp ca/cert.pem out/chain.pem[ 14.019019] mousedev: PS/2 mouse device common for all mice1609server # [ 12.329552] acme-setup-start[537]: + set -euo pipefail1610host1 # 1611host1 # [ 14.012794] network-addresses-eth1-start[648]: adding address 192.168.1.1/24... done1612server # [ 12.336613] acme-setup-start[537]: + test -e ca/key.pem1613server # [ 12.341640] acme-setup-start[537]: + minica --ca-key ca/key.pem --ca-cert ca/cert.pem --domains selfsigned.local1614host1 # [ 14.038977] network-addresses-eth1-start[648]: adding address 2001:db8:1::1/64... done1615host1 # [ 14.044145] acme-host1-start[625]: + cat out/key.pem out/fullchain.pem1616host1 # [ 14.073696] acme-host1-start[625]: + for fixpath in out certificates1617host1 # [ 14.074801] acme-host1-start[625]: + '[' -d out ']'1618host1 # [ 14.075507] acme-host1-start[625]: + chmod -R u=rwX,g=rX,o= out1619server # [ 12.400672] systemd[1]: Stopped target Host and Network Name Lookups.1620host1 # [ 14.093719] systemd[1]: Finished Address configuration of eth1.1621server # [ 12.417554] systemd[1]: Stopping Host and Network Name Lookups...1622host1 # [ 14.106250] acme-host1-start[625]: + chown -R acme:acme out1623server # [ 12.427826] systemd[1]: Stopped target User and Group Name Lookups.1624server # [ 12.444000] systemd[1]: Stopping User and Group Name Lookups...1625server # [ 12.459269] systemd[1]: Stopping Name Service Cache Daemon (nsncd)...1626host1 # [ 14.142799] acme-host1-start[625]: + for fixpath in out certificates1627host1 # [ 14.143829] acme-host1-start[625]: + '[' -d certificates ']'1628server # [ 12.465263] systemd[1]: nscd.service: Deactivated successfully.1629server # [ 12.473101] systemd[1]: Stopped Name Service Cache Daemon (nsncd).1630host1 # [ 14.157100] systemd[1]: Finished Ensure certificate for host1.1631server # [ 12.480876] systemd[1]: Starting Name Service Cache Daemon (nsncd)...1632server # [ 12.488565] systemd[1]: linger-users.service: Deactivated successfully.1633server # [ 12.496131] systemd[1]: Finished linger-users.service.1634host1 # [ 14.182377] dhcpcd[663]: dhcpcd-10.3.2 starting1635server # [ 12.517806] systemd[1]: Finished Set up the ACME certificate renewal infrastructure.1636server # [ 12.525599] systemd[1]: Starting Ensure certificate for server...1637host1 # [ 14.207446] dhcpcd[710]: dev: loaded udev1638server # [ 12.597479] systemd[1]: Started Name Service Cache Daemon (nsncd).1639server # [ 12.606017] systemd[1]: Reached target Host and Network Name Lookups.1640host1 # [ 14.307401] 8021q: 802.1Q VLAN Support v1.81641host1 # [ 14.307810] 8021q: adding VLAN 0 to HW filter on device eth11642host1 # [ 14.289502] systemd-logind[548]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)1643server # [ 12.616736] nsncd[599]: Oct 25 21:41:26.521 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"1644server # [ 12.630019] systemd[1]: Reached target User and Group Name Lookups.1645host1 # [ 14.318522] systemd[1]: Finished Extra networking commands..1646host1 # [ 14.319498] systemd[1]: Reached target Network.1647host1 # [ 14.326928] systemd[1]: Starting Permit User Sessions...1648server # [ 12.661446] systemd[1]: Finished resolvconf update.1649server # [ 12.664209] systemd[1]: Reached target Preparation for Network.1650server # [ 12.680200] systemd[1]: Starting DHCP Client...1651server # [ 12.683516] systemd[1]: Starting Extra networking commands....1652server # [ 12.765439] step-ca-pki-start[520]: Your certificate has been saved in root_ca.crt.1653server # [ 12.771177] step-ca-pki-start[520]: Your private key has been saved in root_ca.key.1654host1 # [ 14.506041] cfg80211: Loading compiled-in X.509 certificates for regulatory database1655server # [ 12.816860] acme-server-start[610]: Waiting to acquire lock in /run/acme/1656host1 # [ 14.511119] systemd[1]: Finished Permit User Sessions.1657host1 # [ 14.521421] systemd[1]: Started Getty on tty1.1658host1 # [ 14.523519] systemd[1]: Reached target Login Prompts.1659server # [ 12.857086] acme-server-start[610]: + '[' -e out/acme-success ']'1660server # [ 12.864256] acme-server-start[610]: + minica --ca-cert=ca/cert.pem --ca-key=ca/key.pem --domains=server --ip-addresses=1661server # [ 12.933502] acme-server-start[657]: + cd server1662host1 # [ 14.616496] sshd-keygen-start[566]: Generating public/private rsa key pair.1663host1 # [ 14.617592] sshd-keygen-start[566]: Your identification has been saved in /etc/ssh/ssh_host_rsa_key1664host1 # [ 14.618900] sshd-keygen-start[566]: Your public key has been saved in /etc/ssh/ssh_host_rsa_key.pub1665server # [ 12.941285] acme-server-start[657]: + cp -vp cert.pem ../out/cert.pem1666host1 # [ 14.625534] sshd-keygen-start[566]: The key fingerprint is:1667host1 # [ 14.626456] sshd-keygen-start[566]: SHA256:vtsVf8LfCtY8PnCKr87+2lCChjQbipi9iCTYWRZQZfk root@host11668host1 # [ 14.627635] sshd-keygen-start[566]: The key's randomart image is:1669host1 # [ 14.633067] sshd-keygen-start[566]: +---[RSA 4096]----+1670host1 # [ 14.633853] sshd-keygen-start[566]: | .oo.o. |1671server # [ 12.955172] acme-server-start[659]: 'cert.pem' -> '../out/cert.pem'1672host1 # [ 14.634662] sshd-keygen-start[566]: | o. |1673host1 # [ 14.635377] sshd-keygen-start[566]: | o +. |1674server # [ 12.962111] acme-server-start[657]: + cp -vp key.pem ../out/key.pem1675host1 # [ 14.641671] sshd-keygen-start[566]: |.= = o =E. |1676host1 # [ 14.642583] sshd-keygen-start[566]: |=.= . o S . o |1677host1 # [ 14.643334] sshd-keygen-start[566]: |+. . o o.*. |1678host1 # [ 14.648568] sshd-keygen-start[566]: |o . . ..++B .|1679host1 # [ 14.649331] sshd-keygen-start[566]: | +.=.o.=.|1680host1 # [ 14.650045] sshd-keygen-start[566]: | o+B=+ ooo|1681host1 # [ 14.650838] sshd-keygen-start[566]: +----[SHA256]-----+1682host1 # [ 14.676423] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1683host1 # [ 14.676936] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1684server # [ 12.979517] acme-server-start[657]: 'key.pem' -> '../out/key.pem'1685host1 # [ 14.680624] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -21686host1 # [ 14.680954] cfg80211: failed to load regulatory.db1687server # [ 12.982544] acme-server-start[610]: + cat out/cert.pem ca/cert.pem1688server # [ 13.009117] acme-server-start[610]: + cp ca/cert.pem out/chain.pem1689server # [ 13.013362] step-ca-pki-start[633]: Your certificate has been saved in intermediate_ca.crt.1690server # [ 13.027087] step-ca-pki-start[633]: Your private key has been saved in intermediate_ca.key.1691server # [ 13.036838] acme-server-start[610]: + cat out/key.pem out/fullchain.pem1692host1 # [ 14.716473] sshd-keygen-start[746]: Generating public/private ed25519 key pair.1693host1 # [ 14.717584] sshd-keygen-start[746]: Your identification has been saved in /etc/ssh/ssh_host_ed25519_key1694host1 # [ 14.718841] sshd-keygen-start[746]: Your public key has been saved in /etc/ssh/ssh_host_ed25519_key.pub1695server # [ 13.046342] acme-server-start[610]: + for fixpath in out certificates1696host1 # [ 14.727102] sshd-keygen-start[746]: The key fingerprint is:1697host1 # [ 14.727939] sshd-keygen-start[746]: SHA256:I52emBYMRavzWT2u/mkp437GxZx4Ar9BvR8ySeB3RRo root@host11698host1 # [ 14.733477] sshd-keygen-start[746]: The key's randomart image is:1699server # [ 13.054896] acme-server-start[610]: + '[' -d out ']'1700host1 # [ 14.734416] sshd-keygen-start[746]: +--[ED25519 256]--+1701host1 # [ 14.735141] sshd-keygen-start[746]: | .o E..|1702host1 # [ 14.735858] sshd-keygen-start[746]: | . . . o.|1703server # [ 13.058740] acme-server-start[610]: + chmod -R u=rwX,g=rX,o= out1704host1 # [ 14.745668] sshd-keygen-start[746]: | . . . o .. |1705host1 # [ 14.746570] sshd-keygen-start[746]: | + ..oo + . |1706host1 # [ 14.747307] sshd-keygen-start[746]: | o + S+o* = |1707server # [ 13.071899] acme-server-start[610]: + chown -R acme:nix-grpc-daemon out1708host1 # [ 14.758161] sshd-keygen-start[746]: | o O +=.@ . |1709host1 # [ 14.758995] sshd-keygen-start[746]: | * o..B + . |1710host1 # [ 14.759714] sshd-keygen-start[746]: | . o.B. . |1711host1 # [ 14.762507] sshd-keygen-start[746]: | +=Bo |1712host1 # [ 14.763278] sshd-keygen-start[746]: +----[SHA256]-----+1713server # [ 13.086291] systemd[1]: Finished step-ca-pki.service.1714host1 # [ 14.770430] systemd[1]: sshd-keygen.service: Deactivated successfully.1715server # [ 13.092583] acme-server-start[610]: + for fixpath in out certificates1716host1 # [ 14.771468] systemd[1]: Finished SSH Host Keys Generation.1717host1 # [ 14.777608] systemd[1]: Starting SSH Daemon...1718server # [ 13.101755] acme-server-start[610]: + '[' -d certificates ']'1719server # [ 13.109210] systemd[1]: Finished Ensure certificate for server.1720host1 # [ 14.786774] dhcpcd[710]: eth0: waiting for carrier[ 14.806946] 8021q: adding VLAN 0 to HW filter on device eth01721host1 # 1722host1 # [ 14.793870] dhcpcd[710]: libudev: received NULL device1723host1 # [ 14.794911] dhcpcd[710]: libudev: received NULL device1724host1 # [ 14.795674] dhcpcd[710]: eth0: carrier acquired1725host1 # [ 14.806614] dhcpcd[710]: DUID 00:01:00:01:32:71:34:06:52:54:00:12:34:561726host1 # [ 14.807624] dhcpcd[710]: eth0: IAID 00:12:34:561727host1 # [ 14.810689] dhcpcd[710]: eth0: adding address fe80::5054:ff:fe12:34561728server # [ 13.152565] dhcpcd[641]: dhcpcd-10.3.2 starting1729server # [ 13.159881] dhcpcd[712]: dev: loaded udev1730host1 # [ 14.844629] sshd[749]: Server listening on 0.0.0.0 port 22.1731host1 # [ 14.845540] systemd[1]: Started SSH Daemon.1732server # [ 13.166726] dhcpcd[712]: no valid interfaces found1733host1 # [ 14.846223] sshd[749]: Server listening on :: port 22.1734server # [ 13.169765] dhcpcd[712]: no valid interfaces found1735server # [ 13.176581] dhcpcd[712]: libudev: received NULL device1736server # [ 13.178902] dhcpcd[712]: libudev: received NULL device1737server # [ 13.215792] systemd[1]: Finished Extra networking commands..1738server # [ 13.219371] systemd[1]: Reached target Network.1739server # [ 13.229107] systemd[1]: Starting Permit User Sessions...1740server # [ 13.287187] systemd[1]: Finished Permit User Sessions.1741server # [ 13.291609] systemd[1]: Started Getty on tty1.1742server # [ 13.300229] systemd[1]: Reached target Login Prompts.1743host1 # [ 15.383925] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input31744server # [ 13.724766] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input31745host1 # [ 15.725509] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1746host1 # [ 15.736962] systemd[1]: Starting Virtual Console Setup...1747host1 # [ 15.760115] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1748host1 # [ 15.761281] systemd[1]: Stopped Virtual Console Setup.1749host1 # [ 15.767659] systemd[1]: Starting Virtual Console Setup...1750host1 # [ 15.827075] systemd-logind[548]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1751host1 # [ 15.918790] systemd-vconsole-setup[759]: Configuration of first virtual console was skipped, ignoring remaining ones.1752host1 # [ 15.923997] systemd[1]: Finished Virtual Console Setup.1753host1 # [ 16.002907] dhcpcd[710]: eth0: soliciting a DHCP lease1754host1 # [ 16.008871] dhcpcd[710]: eth0: offered 10.0.2.15 from 10.0.2.21755host1 # [ 16.012380] dhcpcd[710]: eth0: probing address 10.0.2.15/241756server # [ 14.470071] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1757server # [ 14.489008] systemd[1]: Starting Virtual Console Setup...1758server # [ 14.521972] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1759server # [ 14.527814] systemd[1]: Stopped Virtual Console Setup.1760server # [ 14.533060] systemd[1]: Starting Virtual Console Setup...1761host1 # [ 16.297243] dhcpcd[710]: eth0: soliciting an IPv6 router1762host1 # [ 16.299754] dhcpcd[710]: eth0: Router Advertisement from fe80::21763host1 # [ 16.301382] dhcpcd[710]: eth0: adding address fec0::5054:ff:fe12:3456/641764host1 # [ 16.303068] dhcpcd[710]: eth0: adding route to fec0::/641765host1 # [ 16.304453] dhcpcd[710]: eth0: adding default route via fe80::21766server # [ 14.889419] systemd-vconsole-setup[730]: Configuration of first virtual console was skipped, ignoring remaining ones.1767server # [ 14.902206] systemd[1]: Finished Virtual Console Setup.1768server # [ 15.055400] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.1769server # [ 15.176215] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.1770server # [ 15.181486] systemd[1]: Started backdoor.service.1771server # [ 15.302750] 8021q: 802.1Q VLAN Support v1.81772server # connecting to host...1773server # [ 15.341200] (udev-worker)[687]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name.1774server # [ 15.383787] (udev-worker)[693]: Network interface NamePolicy= disabled on kernel command line.1775server # [ 15.395902] (udev-worker)[687]: Network interface NamePolicy= disabled on kernel command line.[ 15.421417] cfg80211: Loading compiled-in X.509 certificates for regulatory database1776server # 1777server: Guest shell says: b'Spawning backdoor root shell...\n'1778server: connected to guest root shell1779server: (connecting took 15.92 seconds)1780server: (finished: waiting for the VM to finish booting, in 15.92 seconds)1781server # [ 15.471563] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'1782server # [ 15.473104] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'1783server # [ 15.475447] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -21784server # [ 15.475784] cfg80211: failed to load regulatory.db1785server # [ 15.692296] systemd[1]: Condition check resulted in Virtio network device being skipped.1786server # [ 15.707823] systemd[1]: Starting Address configuration of eth1...1787server # [ 15.811348] dhcpcd[712]: eth0: waiting for carrier[ 15.836851] 8021q: adding VLAN 0 to HW filter on device eth01788server # 1789server # [ 15.815134] dhcpcd[712]: eth0: carrier acquired1790server # [ 15.828209] dhcpcd[712]: DUID 00:01:00:01:32:71:34:09:52:54:00:12:34:561791server # [ 15.831771] dhcpcd[712]: eth0: IAID 00:12:34:56[ 15.857141] 8021q: adding VLAN 0 to HW filter on device eth11792server # 1793server # [ 15.838601] dhcpcd[712]: eth0: adding address fe80::5054:ff:fe12:34561794server # [ 15.854810] network-addresses-eth1-start[758]: adding address 192.168.1.2/24... done1795server # [ 15.868957] network-addresses-eth1-start[758]: adding address 2001:db8:1::2/64... done1796server # [ 15.893013] systemd[1]: Finished Address configuration of eth1.1797server # [ 16.023827] sshd-keygen-start[548]: Generating public/private rsa key pair.1798server # [ 16.026953] sshd-keygen-start[548]: Your identification has been saved in /etc/ssh/ssh_host_rsa_key1799server # [ 16.031658] sshd-keygen-start[548]: Your public key has been saved in /etc/ssh/ssh_host_rsa_key.pub1800server # [ 16.036132] sshd-keygen-start[548]: The key fingerprint is:1801server # [ 16.036970] sshd-keygen-start[548]: SHA256:mOz06n7W3sVHLbAXn9VVbBjT4cleFa0Wq0dD96sbtaY root@server1802server # [ 16.038138] sshd-keygen-start[548]: The key's randomart image is:1803server # [ 16.038996] sshd-keygen-start[548]: +---[RSA 4096]----+1804server # [ 16.039746] sshd-keygen-start[548]: | oBO|1805server # [ 16.050657] sshd-keygen-start[548]: | *.@|1806server # [ 16.051456] sshd-keygen-start[548]: | ...X=|1807server # [ 16.055383] sshd-keygen-start[548]: | . o oBo*|1808server # [ 16.057828] sshd-keygen-start[548]: | = S .+o==|1809server # [ 16.058609] sshd-keygen-start[548]: | o . .oo+.|1810server # [ 16.059325] sshd-keygen-start[548]: | . .. o+o.|1811server # [ 16.064844] sshd-keygen-start[548]: | .o .. o+. |1812server # [ 16.068126] sshd-keygen-start[548]: | o+o .. .E. |1813server # [ 16.068909] sshd-keygen-start[548]: +----[SHA256]-----+1814server # [ 16.069947] systemd-logind[523]: Watching system buttons on /dev/input/event0 (gpio-keys)1815server # [ 16.089496] sshd-keygen-start[796]: Generating public/private ed25519 key pair.1816server # [ 16.090583] sshd-keygen-start[796]: Your identification has been saved in /etc/ssh/ssh_host_ed25519_key1817server # [ 16.091823] sshd-keygen-start[796]: Your public key has been saved in /etc/ssh/ssh_host_ed25519_key.pub1818server # [ 16.102928] sshd-keygen-start[796]: The key fingerprint is:1819server # [ 16.103795] sshd-keygen-start[796]: SHA256:IPhFHoVEkj/riBEqlFw1Q7ttmJj/4UrllRO9CqKVaik root@server1820server # [ 16.113123] sshd-keygen-start[796]: The key's randomart image is:1821server # [ 16.114045] sshd-keygen-start[796]: +--[ED25519 256]--+1822server # [ 16.114765] sshd-keygen-start[796]: | +O=o. |1823server # [ 16.115479] sshd-keygen-start[796]: | o.+=. . |1824server # [ 16.119914] sshd-keygen-start[796]: |. + .o+ . . |1825server # [ 16.121657] sshd-keygen-start[796]: | +..ooO. o . |1826server # [ 16.122412] sshd-keygen-start[796]: |.. +.B BS+ . |1827server # [ 16.123140] sshd-keygen-start[796]: |o . * * o o |1828server # [ 16.123935] sshd-keygen-start[796]: |.E B = o . |1829server # [ 16.128913] sshd-keygen-start[796]: | + o + . |1830server # [ 16.132084] sshd-keygen-start[796]: | ..o |1831server # [ 16.132882] sshd-keygen-start[796]: +----[SHA256]-----+1832server # [ 16.139872] systemd[1]: sshd-keygen.service: Deactivated successfully.1833server # [ 16.142404] systemd[1]: Finished SSH Host Keys Generation.1834server # [ 16.143251] systemd[1]: sshd-keygen.service: Consumed 1.363s CPU time over 4.401s wall clock time, 3.2M memory peak.1835server # [ 16.149585] systemd[1]: Starting SSH Daemon...1836server # [ 16.180488] sshd[798]: Server listening on 0.0.0.0 port 22.1837server # [ 16.181428] systemd[1]: Started SSH Daemon.1838server # [ 16.182057] sshd[798]: Server listening on :: port 22.1839server # [ 16.369809] mousedev: PS/2 mouse device common for all mice1840server # [ 16.373176] dhcpcd[712]: eth0: soliciting a DHCP lease1841server # [ 16.380681] dhcpcd[712]: eth0: offered 10.0.2.15 from 10.0.2.21842server # [ 16.388264] dhcpcd[712]: eth0: probing address 10.0.2.15/241843server # [ 16.434485] systemd-logind[523]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)1844server # [ 17.413963] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.1845server # [ 17.426383] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1846server # [ 17.427538] systemd[1]: Stopped Virtual Console Setup.1847server # [ 17.437582] systemd[1]: Stopping Virtual Console Setup...1848server # [ 17.438454] systemd[1]: Starting Virtual Console Setup...1849server # [ 17.452210] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1850server # [ 17.453411] systemd[1]: Stopped Virtual Console Setup.1851server # [ 17.460322] systemd[1]: Starting Virtual Console Setup...1852server # [ 17.488790] systemd-logind[523]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)1853server # [ 17.568445] systemd-vconsole-setup[814]: Configuration of first virtual console was skipped, ignoring remaining ones.1854server # [ 17.573674] systemd[1]: Finished Virtual Console Setup.1855server # [ 18.122379] dhcpcd[712]: eth0: soliciting an IPv6 router1856server # [ 18.124508] dhcpcd[712]: eth0: Router Advertisement from fe80::21857server # [ 18.125918] dhcpcd[712]: eth0: adding address fec0::5054:ff:fe12:3456/641858server # [ 18.127355] dhcpcd[712]: eth0: adding route to fec0::/641859server # [ 18.128622] dhcpcd[712]: eth0: adding default route via fe80::21860host1 # [ 20.961812] dhcpcd[710]: eth0: leased 10.0.2.15 for 86400 seconds1861host1 # [ 20.962051] dhcpcd[710]: eth0: adding route to 10.0.2.0/241862host1 # [ 20.962130] dhcpcd[710]: eth0: adding default route via 10.0.2.21863host1 # [ 21.075637] systemd[1]: Started DHCP Client.1864host1 # [ 21.079470] systemd[1]: Reached target Network is Online.1865host1 # [ 21.081934] systemd[1]: Starting fetch-ca-root.service...1866host1 # [ 21.134078] fetch-ca-root-start[824]: curl: (7) Failed to connect to server:8443 after 6 ms: Could not connect to server1867host1 # [ 22.137110] fetch-ca-root-start[824]: curl: (7) Failed to connect to server:8443 after 1 ms: Could not connect to server1868host1 # [ 23.140161] fetch-ca-root-start[824]: curl: (7) Failed to connect to server:8443 after 1 ms: Could not connect to server1869server # [ 21.752426] dhcpcd[712]: eth0: leased 10.0.2.15 for 86400 seconds1870server # [ 21.752622] dhcpcd[712]: eth0: adding route to 10.0.2.0/241871server # [ 21.752694] dhcpcd[712]: eth0: adding default route via 10.0.2.21872server # [ 21.857629] systemd[1]: Started DHCP Client.1873server # [ 21.860447] systemd[1]: Reached target Network is Online.1874server # [ 21.864577] systemd[1]: Starting step-ca service...1875server # [ 22.195963] step-ca[913]: badger 2026/10/25 21:41:36 INFO: All 0 tables opened in 0s1876server # [ 22.210910] step-ca[913]: 2026/10/25 21:41:36 Building new tls configuration using step-ca x509 Signer Interface1877server # [ 22.224839] step-ca[913]: 2026/10/25 21:41:36 Starting Smallstep CA/0.30.2 (linux/arm64)1878server # [ 22.226036] step-ca[913]: 2026/10/25 21:41:36 Documentation: https://u.step.sm/docs/ca1879server # [ 22.227107] step-ca[913]: 2026/10/25 21:41:36 Community Discord: https://u.step.sm/discord1880server # [ 22.228305] step-ca[913]: 2026/10/25 21:41:36 Config file: /etc/smallstep/ca.json1881server # [ 22.229328] step-ca[913]: 2026/10/25 21:41:36 The primary server URL is https://server:84431882server # [ 22.230456] step-ca[913]: 2026/10/25 21:41:36 Root certificates are available at https://server:8443/roots.pem1883server # [ 22.231781] step-ca[913]: 2026/10/25 21:41:36 X.509 Root Fingerprint: 0d6fbcfb2be186f68feded8ccb3ddf83857e74a5dfcf9865406d89c28cabc6571884server # [ 22.238632] step-ca[913]: 2026/10/25 21:41:36 Serving HTTPS on 0.0.0.0:8443 ...1885server # [ 22.239746] systemd[1]: Started step-ca service.1886server # [ 22.241770] systemd[1]: Reached target Multi-User System.1887server # [ 22.244218] systemd[1]: Starting Order (and renew) ACME certificate for server...1888server # [ 22.295034] acme-order-renew-server-start[925]: Waiting to acquire lock in /run/acme/1889server # [ 22.301789] acme-order-renew-server-start[925]: + set -euo pipefail1890server # [ 22.302781] acme-order-renew-server-start[925]: + exec1891server # [ 22.303506] acme-order-renew-server-start[925]: + /nix/store/vf2h24m5aa7phb4v1kbc2qd9r41jdfqv-flock-0.4.0/bin/flock 111892server # [ 22.307282] acme-order-renew-server-start[933]: ++ find accounts -path '*/keys/*.key' -print -quit1893server # [ 22.314514] acme-order-renew-server-start[925]: + '[' -n '' ']'1894server # [ 22.315455] acme-order-renew-server-start[925]: + exec1895server # [ 22.316325] acme-order-renew-server-start[925]: + '[' -e certificates/server.key ']'1896server # [ 22.317424] acme-order-renew-server-start[925]: + 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-domains1897host1 # [ 24.161757] systemd[1]: Finished fetch-ca-root.service.1898host1 # [ 24.168360] systemd[1]: Reached target Multi-User System.1899host1 # [ 24.172840] systemd[1]: Starting Order (and renew) ACME certificate for host1...1900server # [ 22.530387] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.450565220Z INFO Private key saved. filepath=accounts/server_8443/root@example.org/root@example.org.key1901server # [ 22.543527] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.465109440Z INFO Registering the account. email=root@example.org1902server # [ 22.558995] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.480619360Z WARN !!!! HEADS UP !!!!1903server # [ 22.561735] acme-order-renew-server-start[934]: Your account credentials have been saved in your1904server # [ 22.563306] acme-order-renew-server-start[934]: configuration directory at "accounts".1905server # [ 22.564574] acme-order-renew-server-start[934]: You should make a secure backup of this folder now. This1906server # [ 22.566163] acme-order-renew-server-start[934]: configuration directory will also contain private keys1907host1 # [ 24.245380] acme-order-renew-host1-start[829]: Waiting to acquire lock in /run/acme/1908server # [ 22.567410] acme-order-renew-server-start[934]: generated by lego and certificates obtained from the ACME1909server # [ 22.569038] acme-order-renew-server-start[934]: server. Making regular backups of this folder is ideal.1910server # [ 22.570460] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.482286540Z INFO Obtaining bundled SAN certificate. domains=server1911host1 # [ 24.252971] acme-order-renew-host1-start[829]: + set -euo pipefail1912host1 # [ 24.254061] acme-order-renew-host1-start[829]: + exec1913host1 # [ 24.254871] acme-order-renew-host1-start[829]: + /nix/store/vf2h24m5aa7phb4v1kbc2qd9r41jdfqv-flock-0.4.0/bin/flock 111914host1 # [ 24.259022] acme-order-renew-host1-start[837]: ++ find accounts -path '*/keys/*.key' -print -quit1915host1 # [ 24.266071] acme-order-renew-host1-start[829]: + '[' -n '' ']'1916host1 # [ 24.267131] acme-order-renew-host1-start[829]: + exec1917host1 # [ 24.267863] acme-order-renew-host1-start[829]: + '[' -e certificates/host1.key ']'1918host1 # [ 24.269706] acme-order-renew-host1-start[829]: + 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-domains1919host1 # [ 24.401071] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.246244660Z INFO Private key saved. filepath=accounts/server_8443/root@example.org/root@example.org.key1920host1 # [ 24.412951] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.258504360Z INFO Registering the account. email=root@example.org1921server # [ 22.894623] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.815847840Z INFO Use solver. domain=server type=http-011922server # [ 22.901232] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.819764340Z INFO http01: Trying to solve HTTP-01. domain=server1923host1 # [ 24.651327] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.496941620Z WARN !!!! HEADS UP !!!!1924server # [ 22.974907] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.894526280Z INFO The server validated our request. domain=server1925host1 # [ 24.655286] acme-order-renew-host1-start[838]: Your account credentials have been saved in your1926host1 # [ 24.657399] acme-order-renew-host1-start[838]: configuration directory at "accounts".1927host1 # [ 24.659191] acme-order-renew-host1-start[838]: You should make a secure backup of this folder now. This1928server # [ 22.980484] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.894699880Z INFO Validations succeeded; requesting certificates. domains=server1929host1 # [ 24.661258] acme-order-renew-host1-start[838]: configuration directory will also contain private keys1930host1 # [ 24.663191] acme-order-renew-host1-start[838]: generated by lego and certificates obtained from the ACME1931host1 # [ 24.665242] acme-order-renew-host1-start[838]: server. Making regular backups of this folder is ideal.1932host1 # [ 24.667325] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.499676900Z INFO Obtaining bundled SAN certificate. domains=host11933server # [ 23.008382] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.928890800Z INFO Server responded with a certificate. domains=server1934server # [ 23.011082] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.929036720Z INFO Writing file. filepath=certificates/server.crt1935server # [ 23.019603] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.929317820Z INFO Writing file. filepath=certificates/server.issuer.crt1936server # [ 23.023709] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.929470700Z INFO Writing file. filepath=certificates/server.key1937server # [ 23.029253] acme-order-renew-server-start[934]: 2026-10-25T21:41:36.929663060Z INFO Writing file. filepath=certificates/server.json1938server # [ 23.031638] acme-order-renew-server-start[925]: + touch out/acme-success1939server # [ 23.034626] acme-order-renew-server-start[925]: + cmp -s certificates/server.crt out/fullchain.pem1940server # [ 23.039901] acme-order-renew-server-start[925]: + touch out/renewed1941server # [ 23.044849] acme-order-renew-server-start[925]: + echo Installing new certificate1942server # [ 23.046158] acme-order-renew-server-start[925]: Installing new certificate1943server # [ 23.047271] acme-order-renew-server-start[925]: + cp -vp certificates/server.crt out/fullchain.pem1944server # [ 23.054249] acme-order-renew-server-start[944]: 'certificates/server.crt' -> 'out/fullchain.pem'1945server # [ 23.057304] acme-order-renew-server-start[925]: + cp -vp certificates/server.key out/key.pem1946host1 # [ 24.738879] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.583079800Z INFO Use solver. domain=host1 type=http-011947host1 # [ 24.741943] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.583143800Z INFO http01: Trying to solve HTTP-01. domain=host11948server # [ 23.065580] acme-order-renew-server-start[945]: 'certificates/server.key' -> 'out/key.pem'1949server # [ 23.068858] acme-order-renew-server-start[925]: + cp -vp certificates/server.issuer.crt out/chain.pem1950host1 # [ 24.752104] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.597362600Z INFO The server validated our request. domain=host11951server # [ 23.075186] acme-order-renew-server-start[946]: 'certificates/server.issuer.crt' -> 'out/chain.pem'1952host1 # [ 24.754804] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.597499460Z INFO Validations succeeded; requesting certificates. domains=host11953server # [ 23.077984] acme-order-renew-server-start[925]: + ln -sf fullchain.pem out/cert.pem1954server # [ 23.083727] acme-order-renew-server-start[925]: + cat out/key.pem out/fullchain.pem1955server # [ 23.097774] acme-order-renew-server-start[925]: + for fixpath in out certificates1956server # [ 23.098935] acme-order-renew-server-start[925]: + '[' -d out ']'1957server # [ 23.099820] acme-order-renew-server-start[925]: + chmod -R u=rwX,g=rX,o= out1958server # [ 23.109442] acme-order-renew-server-start[925]: + chown -R acme:nix-grpc-daemon out1959host1 # [ 24.795178] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.639918500Z INFO Server responded with a certificate. domains=host11960server # [ 23.122355] acme-order-renew-server-start[925]: + for fixpath in out certificates1961host1 # [ 24.802105] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.640125840Z INFO Writing file. filepath=certificates/host1.crt1962server # [ 23.125904] acme-order-renew-server-start[925]: + '[' -d certificates ']'1963server # [ 23.127008] acme-order-renew-server-start[925]: + chmod -R u=rwX,g=rX,o= certificates1964host1 # [ 24.805171] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.640338800Z INFO Writing file. filepath=certificates/host1.issuer.crt1965host1 # [ 24.807729] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.640459900Z INFO Writing file. filepath=certificates/host1.key1966server # [ 23.132297] acme-order-renew-server-start[925]: + chown -R acme:nix-grpc-daemon certificates1967host1 # [ 24.810380] acme-order-renew-host1-start[838]: 2026-10-25T21:41:36.640724640Z INFO Writing file. filepath=certificates/host1.json1968host1 # [ 24.813670] acme-order-renew-host1-start[829]: + touch out/acme-success1969host1 # [ 24.820331] acme-order-renew-host1-start[829]: + cmp -s certificates/host1.crt out/fullchain.pem1970server # [ 23.144098] acme-order-renew-server-start[925]: + chmod -R u=rwX,g=,o= accounts/.1971host1 # [ 24.826880] acme-order-renew-host1-start[829]: + touch out/renewed1972host1 # [ 24.832478] acme-order-renew-host1-start[829]: + echo Installing new certificate1973host1 # [ 24.834177] acme-order-renew-host1-start[829]: Installing new certificate1974host1 # [ 24.835819] acme-order-renew-host1-start[829]: + cp -vp certificates/host1.crt out/fullchain.pem1975server: (finished: waiting for unit step-ca.service, in 23.64 seconds)1976host1 # [ 24.843204] acme-order-renew-host1-start[847]: 'certificates/host1.crt' -> 'out/fullchain.pem'1977server: waiting for unit nix-grpc-daemon.socket1978host1 # [ 24.845907] acme-order-renew-host1-start[829]: + cp -vp certificates/host1.key out/key.pem1979host1 # [ 24.851549] acme-order-renew-host1-start[848]: 'certificates/host1.key' -> 'out/key.pem'1980host1 # [ 24.854371] acme-order-renew-host1-start[829]: + cp -vp certificates/host1.issuer.crt out/chain.pem1981host1 # [ 24.859658] acme-order-renew-host1-start[849]: 'certificates/host1.issuer.crt' -> 'out/chain.pem'1982host1 # [ 24.862130] acme-order-renew-host1-start[829]: + ln -sf fullchain.pem out/cert.pem1983host1 # [ 24.867587] acme-order-renew-host1-start[829]: + cat out/key.pem out/fullchain.pem1984host1 # [ 24.872948] acme-order-renew-host1-start[829]: + for fixpath in out certificates1985host1 # [ 24.874200] acme-order-renew-host1-start[829]: + '[' -d out ']'1986host1 # [ 24.875232] acme-order-renew-host1-start[829]: + chmod -R u=rwX,g=rX,o= out1987host1 # [ 24.879880] acme-order-renew-host1-start[829]: + chown -R acme:acme out1988host1 # [ 24.886582] acme-order-renew-host1-start[829]: + for fixpath in out certificates1989host1 # [ 24.887732] acme-order-renew-host1-start[829]: + '[' -d certificates ']'1990host1 # [ 24.889047] acme-order-renew-host1-start[829]: + chmod -R u=rwX,g=rX,o= certificates1991host1 # [ 24.893130] acme-order-renew-host1-start[829]: + chown -R acme:acme certificates1992host1 # [ 24.898852] acme-order-renew-host1-start[829]: + chmod -R u=rwX,g=,o= accounts/.1993server: (finished: waiting for unit nix-grpc-daemon.socket, in 0.06 seconds)1994server: waiting for TCP port 50051 on localhost1995server # [ 23.225247] systemd[1]: acme-order-renew-server.service: Deactivated successfully.1996server # [ 23.229366] systemd[1]: Finished Order (and renew) ACME certificate for server.1997server # [ 23.241335] systemd[1]: Startup finished in 2.658s (kernel) + 4.183s (initrd) + 16.398s (userspace) = 23.240s.1998server # [ 23.242807] systemd[1]: acme-order-renew-server.service: Consumed 247ms CPU time over 983ms wall clock time, 54M memory peak, 4K written to disk, 10.4K incoming IP traffic, 8.1K outgoing IP traffic.1999host1 # [ 24.943639] systemd[1]: acme-order-renew-host1.service: Deactivated successfully.2000server # Connection to localhost (127.0.0.1) 50051 port [tcp/*] succeeded!2001host1 # [ 24.946621] systemd[1]: Finished Order (and renew) ACME certificate for host1.2002server # [ 23.269528] systemd[1]: Starting Order (and renew) ACME certificate for server...2003host1 # [ 24.949747] systemd[1]: Startup finished in 2.740s (kernel) + 5.073s (initrd) + 17.133s (userspace) = 24.947s.2004host1 # [ 24.951257] systemd[1]: acme-order-renew-host1.service: Consumed 245ms CPU time over 773ms wall clock time, 55.8M memory peak, 4K written to disk, 10.4K incoming IP traffic, 8.2K outgoing IP traffic.2005server: (finished: waiting for TCP port 50051 on localhost, in 0.05 seconds)20062007running 4 tests2008server # [ 23.328834] acme-order-renew-server-start[976]: Waiting to acquire lock in /run/acme/2009server # [ 23.335771] acme-order-renew-server-start[976]: + set -euo pipefail2010server # [ 23.337015] acme-order-renew-server-start[976]: + exec2011server # [ 23.337748] acme-order-renew-server-start[976]: + /nix/store/vf2h24m5aa7phb4v1kbc2qd9r41jdfqv-flock-0.4.0/bin/flock 112012server # [ 23.341520] acme-order-renew-server-start[984]: ++ find accounts -path '*/keys/*.key' -print -quit2013server # [ 23.346732] acme-order-renew-server-start[976]: + '[' -n '' ']'2014server # [ 23.347742] acme-order-renew-server-start[976]: + exec2015server # [ 23.348731] acme-order-renew-server-start[976]: + '[' -e certificates/server.key ']'2016server # [ 23.349805] acme-order-renew-server-start[976]: + '[' -e certificates/server.crt ']'2017server # [ 23.351873] acme-order-renew-server-start[985]: ++ find accounts -name root@example.org.key2018server # [ 23.357901] acme-order-renew-server-start[976]: + '[' -n accounts/server_8443/root@example.org/root@example.org.key ']'2019server # [ 23.359428] acme-order-renew-server-start[976]: + 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-domains2020server # [ 23.393724] acme-order-renew-server-start[986]: 2026-10-25T21:41:37.313982160Z INFO Renewing certificate cert-name=server2021server # [ 23.401580] acme-order-renew-server-start[986]: 2026-10-25T21:41:37.323204720Z 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"2022server # [ 23.407877] acme-order-renew-server-start[986]: 2026-10-25T21:41:37.326600860Z INFO Skip renewal: The certificate expires at 2026-10-26T21:41:36Z, the renewal can be performed in 11h59m28s673487680ns. cert-name=server2023server # [ 23.413291] acme-order-renew-server-start[976]: + touch out/acme-success2024server # [ 23.416616] acme-order-renew-server-start[976]: + cmp -s certificates/server.crt out/fullchain.pem2025server # [ 23.420432] acme-order-renew-server-start[976]: + for fixpath in out certificates2026server # [ 23.421522] acme-order-renew-server-start[976]: + '[' -d out ']'2027server # [ 23.422347] acme-order-renew-server-start[976]: + chmod -R u=rwX,g=rX,o= out2028server # [ 23.427277] acme-order-renew-server-start[976]: + chown -R acme:nix-grpc-daemon out2029server # [ 23.434282] acme-order-renew-server-start[976]: + for fixpath in out certificates2030server # [ 23.435439] acme-order-renew-server-start[976]: + '[' -d certificates ']'2031server # [ 23.437256] acme-order-renew-server-start[976]: + chmod -R u=rwX,g=rX,o= certificates2032server # [ 23.442377] acme-order-renew-server-start[976]: + chown -R acme:nix-grpc-daemon certificates2033server # [ 23.449486] acme-order-renew-server-start[976]: + chmod -R u=rwX,g=,o= accounts/.2034server # [ 23.497593] systemd[1]: acme-order-renew-server.service: Deactivated successfully.2035server # [ 23.499972] systemd[1]: Finished Order (and renew) ACME certificate for server.2036server # [ 23.502423] systemd[1]: acme-order-renew-server.service: Consumed 139ms CPU time over 230ms wall clock time, 13.8M memory peak, 3.3K incoming IP traffic, 2.2K outgoing IP traffic.2037server # [ 23.512500] systemd[1]: Starting Nix worker-protocol over gRPC...2038server # [ 23.656718] nix-grpc-daemon[1006]: ts=2026-10-25T21:41:37Z level=info event=roles builder=1 scheduler=1 scheduler_addr="" advertise=0.0.0.0:50051 niks3="" max_jobs=12039server # [ 23.673947] nix-grpc-daemon[1006]: WARNING: All log messages before absl::InitializeLog() is called are written to STDERR2040server # [ 23.677981] nix-grpc-daemon[1006]: E0000 00:00:1792964497.595079 1006 tls_security_connector.cc:771] TlsServerCertificateWatcher getting identity_cert_error: UNKNOWN:Unable to get latest identity certificates.2041server # [ 23.682779] nix-grpc-daemon[1006]: E0000 00:00:1792964497.604151 1006 tls_security_connector.cc:767] TlsServerCertificateWatcher getting root_cert_error: UNKNOWN:Unable to get latest root certificates.2042server # [ 23.687419] nix-grpc-daemon[1006]: ts=2026-10-25T21:41:37Z level=info event=startup listen=systemd proxy_socket=/nix/var/nix/daemon-socket/socket2043server # [ 23.692653] nix-grpc-daemon[1006]: ts=2026-10-25T21:41:37Z level=info event=worker_hello addr=0.0.0.0:50051 systems=aarch64-linux max_jobs=1 running=02044server # [ 23.694478] systemd[1]: Started Nix worker-protocol over gRPC.2045server # [ 23.695315] nix-grpc-daemon[1006]: ts=2026-10-25T21:41:37Z level=info event=unhealthy reason=min_free2046host1 # [ 25.823583] systemd[1]: Created slice Slice /system/sshd-vsock.2047host1 # [ 25.823853] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2048host1 # [ 25.829487] systemd[1]: Started SSH per-connection Daemon (vsock:2:0).2049host1 # [ 25.944823] sshd-session[867]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2050host1 # [ 25.954478] sshd-session[867]: Accepted none for root from UNKNOWN port 65535 ssh22051host1 # [ 25.963296] sshd-session[867]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2052host1 # [ 25.991328] systemd-logind[548]: New session '1' of user 'root' with class 'user' and type 'tty'.2053host1 # [ 26.000792] systemd[1]: Created slice Slice /user/0.2054host1 # [ 26.004944] systemd[1]: Starting User Runtime Directory /run/user/0...2055host1 # [ 26.066343] systemd[1]: Finished User Runtime Directory /run/user/0.2056host1 # [ 26.072223] systemd[1]: Starting User Manager for UID 0...2057host1 # [ 26.095246] (systemd)[876]: pam_unix(systemd-user:session): session opened for user root(uid=0) by (uid=0)2058host1 # [ 26.101568] systemd-logind[548]: New session '2' of user 'root' with class 'manager-early' and type 'unspecified'.2059host1 # [ 26.203761] systemd[876]: Failed to adjust io pressure threshold, ignoring: Device or resource busy2060host1 # [ 26.360913] systemd[876]: Queued start job for default target Main User Target.2061host1 # [ 26.369085] systemd[876]: Failed to adjust io pressure threshold, ignoring: Device or resource busy2062host1 # [ 26.373362] systemd[876]: Created slice User Application Slice.2063host1 # [ 26.374505] systemd[876]: Started Daily Cleanup of User's Temporary Directories.2064host1 # [ 26.375609] systemd[876]: Reached target Paths.2065host1 # [ 26.376647] systemd[876]: Reached target Timers.2066host1 # [ 26.379455] systemd[876]: Starting D-Bus User Message Bus Socket...2067host1 # [ 26.381790] systemd[876]: Starting Create User Files and Directories...2068host1 # [ 26.432184] systemd[876]: Finished Create User Files and Directories.2069host1 # [ 26.448607] systemd[876]: Listening on D-Bus User Message Bus Socket.2070host1 # [ 26.449696] systemd[876]: Reached target Sockets.2071host1 # [ 26.450480] systemd[876]: Reached target Basic System.2072host1 # [ 26.455425] systemd[876]: Run user-specific NixOS activation skipped, unmet condition check ConditionUser=!@system2073host1 # [ 26.457133] systemd[876]: Reached target Main User Target.2074host1 # [ 26.457936] systemd[876]: Startup finished in 331ms.2075host1 # [ 26.458804] systemd[1]: Started User Manager for UID 0.2076host1 # [ 26.463744] systemd[1]: Started Session 1 of User root.2077host1 # [ 26.480956] sshd-session[889]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2078host1 # [ 26.482494] sshd-session[889]: Disconnected from user root UNKNOWN port 655352079host1 # [ 26.483992] sshd-session[867]: pam_unix(sshd:session): session closed for user root2080host1 # [ 26.488106] systemd[1]: sshd-vsock@0-1-3:22-2:0.service: Deactivated successfully.2081host1 # [ 26.493775] systemd[1]: session-1.scope: Deactivated successfully.2082host1 # [ 26.497489] systemd-logind[548]: Session 1 logged out. Waiting for processes to exit.2083host1 # [ 26.500479] systemd-logind[548]: Removed session 1.2084server # [ 25.445843] systemd[1]: Created slice Slice /system/sshd-vsock.2085server # [ 25.448386] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2086host1 # [ 27.128696] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2087server # [ 25.454868] systemd[1]: Started SSH per-connection Daemon (vsock:2:0).2088host1 # [ 27.135832] systemd[1]: Started SSH per-connection Daemon (vsock:2:1).2089host1 # [ 27.231551] sshd-session[894]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2090server # [ 25.559198] sshd-session[1020]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2091host1 # [ 27.240808] sshd-session[894]: Accepted none for root from UNKNOWN port 65535 ssh22092server # [ 25.566898] sshd-session[1020]: Accepted none for root from UNKNOWN port 65535 ssh22093host1 # [ 27.249704] sshd-session[894]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2094server # [ 25.574699] sshd-session[1020]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2095host1 # [ 27.258621] systemd-logind[548]: New session '3' of user 'root' with class 'user' and type 'tty'.2096host1 # [ 27.264844] systemd[1]: Started Session 3 of User root.2097server # [ 25.594068] systemd[1]: Created slice Slice /user/0.2098server # [ 25.597764] systemd[1]: Starting User Runtime Directory /run/user/0...2099server # [ 25.606576] systemd-logind[523]: New session '1' of user 'root' with class 'user' and type 'tty'.2100server # [ 25.636188] systemd[1]: Finished User Runtime Directory /run/user/0.2101host1 # [ 27.318686] sshd-session[900]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2102server # [ 25.642034] systemd[1]: Starting User Manager for UID 0...2103host1 # [ 27.321229] sshd-session[900]: Disconnected from user root UNKNOWN port 655352104host1 # [ 27.322530] sshd-session[894]: pam_unix(sshd:session): session closed for user root2105host1 # [ 27.326803] systemd[1]: sshd-vsock@1-2-3:22-2:1.service: Deactivated successfully.2106host1 # [ 27.331151] systemd[1]: session-3.scope: Deactivated successfully.2107host1 # [ 27.334940] systemd-logind[548]: Session 3 logged out. Waiting for processes to exit.2108host1 # [ 27.337288] systemd-logind[548]: Removed session 3.2109server # [ 25.665554] (systemd)[1028]: pam_unix(systemd-user:session): session opened for user root(uid=0) by (uid=0)2110server # [ 25.671381] systemd-logind[523]: New session '2' of user 'root' with class 'manager-early' and type 'unspecified'.2111server # [ 25.762404] systemd[1028]: Failed to adjust io pressure threshold, ignoring: Device or resource busy2112server # [ 25.899934] systemd[1028]: Queued start job for default target Main User Target.2113server # [ 25.909096] systemd[1028]: Failed to adjust io pressure threshold, ignoring: Device or resource busy2114server # [ 25.914158] systemd[1028]: Created slice User Application Slice.2115server # [ 25.915069] systemd[1028]: Started Daily Cleanup of User's Temporary Directories.2116server # [ 25.918033] systemd[1028]: Reached target Paths.2117server # [ 25.918713] systemd[1028]: Reached target Timers.2118server # [ 25.919385] systemd[1028]: Starting D-Bus User Message Bus Socket...2119server # [ 25.922719] systemd[1028]: Starting Create User Files and Directories...2120server # [ 25.959700] systemd[1028]: Finished Create User Files and Directories.2121server # [ 25.975098] systemd[1028]: Listening on D-Bus User Message Bus Socket.2122server # [ 25.979485] systemd[1028]: Reached target Sockets.2123server # [ 25.980421] systemd[1028]: Reached target Basic System.2124server # [ 25.981202] systemd[1028]: Run user-specific NixOS activation skipped, unmet condition check ConditionUser=!@system2125server # [ 25.982583] systemd[1028]: Reached target Main User Target.2126server # [ 25.983373] systemd[1028]: Startup finished in 288ms.2127server # [ 25.987341] systemd[1]: Started User Manager for UID 0.2128server # [ 25.988972] systemd[1]: Started Session 1 of User root.2129server # [ 26.001762] sshd-session[1041]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2130server # [ 26.004717] sshd-session[1041]: Disconnected from user root UNKNOWN port 655352131server # [ 26.005775] sshd-session[1020]: pam_unix(sshd:session): session closed for user root2132server # [ 26.009048] systemd[1]: sshd-vsock@0-1-4:22-2:0.service: Deactivated successfully.2133server # [ 26.014226] systemd[1]: session-1.scope: Deactivated successfully.2134server # [ 26.018109] systemd-logind[523]: Session 1 logged out. Waiting for processes to exit.2135server # [ 26.020417] systemd-logind[523]: Removed session 1.2136server # [ 26.107900] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2137host1 # [ 27.792648] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2138server # [ 26.116104] systemd[1]: Started SSH per-connection Daemon (vsock:2:1).2139host1 # [ 27.802788] systemd[1]: Started SSH per-connection Daemon (vsock:2:2).2140host1 # [ 27.808734] systemd[1]: Started SSH per-connection Daemon (vsock:2:3).2141host1 # [ 27.820459] systemd[1]: Started SSH per-connection Daemon (vsock:2:4).2142server # [ 26.207834] sshd-session[1046]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2143server # [ 26.216524] sshd-session[1046]: Accepted none for root from UNKNOWN port 65535 ssh22144server # [ 26.225306] sshd-session[1046]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2145server # [ 26.235616] systemd-logind[523]: New session '3' of user 'root' with class 'user' and type 'tty'.2146server # [ 26.240468] systemd[1]: Started Session 3 of User root.2147host1 # [ 28.051274] sshd-session[905]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2148host1 # [ 28.057485] sshd-session[906]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2149host1 # [ 28.059439] sshd-session[907]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2150host1 # [ 28.071387] sshd-session[905]: Accepted none for root from UNKNOWN port 65535 ssh22151host1 # [ 28.077397] sshd-session[907]: Accepted none for root from UNKNOWN port 65535 ssh22152host1 # [ 28.078518] sshd-session[906]: Accepted none for root from UNKNOWN port 65535 ssh22153host1 # [ 28.090548] sshd-session[907]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2154host1 # [ 28.095275] sshd-session[905]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2155host1 # [ 28.106198] sshd-session[906]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2156host1 # [ 28.107613] systemd-logind[548]: New session '4' of user 'root' with class 'user' and type 'tty'.2157host1 # [ 28.112446] systemd[1]: Started Session 4 of User root.2158host1 # [ 28.120154] systemd-logind[548]: New session '5' of user 'root' with class 'user' and type 'tty'.2159host1 # [ 28.124678] systemd[1]: Started Session 5 of User root.2160host1 # [ 28.128749] systemd-logind[548]: New session '6' of user 'root' with class 'user' and type 'tty'.2161host1 # [ 28.135316] systemd[1]: Started Session 6 of User root.2162host1 # [ 28.197878] sshd-session[926]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2163host1 # [ 28.204103] sshd-session[926]: Disconnected from user root UNKNOWN port 655352164host1 # [ 28.208626] sshd-session[906]: pam_unix(sshd:session): session closed for user root2165host1 # [ 28.213472] systemd[1]: sshd-vsock@3-4-3:22-2:3.service: Deactivated successfully.2166host1 # [ 28.221652] systemd[1]: session-6.scope: Deactivated successfully.2167host1 # [ 28.229208] systemd-logind[548]: Session 6 logged out. Waiting for processes to exit.2168host1 # [ 28.231273] systemd-logind[548]: Removed session 6.2169host1 # [ 28.257698] sshd-session[924]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2170host1 # [ 28.259428] sshd-session[924]: Disconnected from user root UNKNOWN port 655352171host1 # [ 28.261762] sshd-session[925]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2172host1 # [ 28.265730] sshd-session[925]: Disconnected from user root UNKNOWN port 655352173host1 # [ 28.266863] sshd-session[907]: pam_unix(sshd:session): session closed for user root2174host1 # [ 28.267902] sshd-session[905]: pam_unix(sshd:session): session closed for user root2175host1 # [ 28.272891] systemd[1]: sshd-vsock@4-5-3:22-2:4.service: Deactivated successfully.2176host1 # [ 28.276679] systemd[1]: sshd-vsock@2-3-3:22-2:2.service: Deactivated successfully.2177host1 # [ 28.281549] systemd[1]: session-5.scope: Deactivated successfully.2178host1 # [ 28.283986] systemd[1]: session-4.scope: Deactivated successfully.2179host1 # [ 28.288815] systemd-logind[548]: Session 4 logged out. Waiting for processes to exit.2180host1 # [ 28.292970] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2181host1 # [ 28.297678] systemd[1]: Started SSH per-connection Daemon (vsock:2:5).2182host1 # [ 28.306100] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2183host1 # [ 28.307407] systemd[1]: Started SSH per-connection Daemon (vsock:2:6).2184host1 # [ 28.316771] systemd-logind[548]: Removed session 4.2185host1 # [ 28.317575] systemd-logind[548]: Session 5 logged out. Waiting for processes to exit.2186host1 # [ 28.322023] systemd-logind[548]: Removed session 5.2187host1 # [ 28.437774] sshd-session[940]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2188host1 # [ 28.444962] sshd-session[939]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2189host1 # [ 28.451342] sshd-session[940]: Accepted none for root from UNKNOWN port 65535 ssh22190host1 # [ 28.458848] sshd-session[939]: Accepted none for root from UNKNOWN port 65535 ssh22191host1 # [ 28.467295] sshd-session[940]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2192host1 # [ 28.473669] sshd-session[939]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2193host1 # [ 28.480241] systemd-logind[548]: New session '7' of user 'root' with class 'user' and type 'tty'.2194host1 # [ 28.488545] systemd[1]: Started Session 7 of User root.2195host1 # [ 28.493563] systemd-logind[548]: New session '8' of user 'root' with class 'user' and type 'tty'.2196host1 # [ 28.498935] systemd[1]: Started Session 8 of User root.2197host1 # [ 28.562391] sshd-session[951]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2198host1 # [ 28.565851] sshd-session[951]: Disconnected from user root UNKNOWN port 655352199host1 # [ 28.566914] sshd-session[940]: pam_unix(sshd:session): session closed for user root2200test acme::host1_obtains_a_certificate_via_acme ... ok2201host1 # [ 28.576147] systemd[1]: sshd-vsock@6-7-3:22-2:6.service: Deactivated successfully.2202host1 # [ 28.579853] systemd[1]: session-7.scope: Deactivated successfully.2203host1 # [ 28.586580] systemd-logind[548]: Session 7 logged out. Waiting for processes to exit.2204host1 # [ 28.593025] systemd-logind[548]: Removed session 7.2205server # [ 27.046008] systemd[1]: Started Nix Daemon.2206server # [ 27.344783] nix-daemon[1061]: accepted connection from pid 1006, user nix-grpc-daemon (trusted)2207server # [ 27.365870] nix-grpc-daemon[1006]: ts=2026-10-25T21:41:41Z level=info event=denied method=Connect cn=host1 role=read-only2208host1 # [ 29.082357] sshd-session[952]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2209host1 # [ 29.084843] sshd-session[952]: Disconnected from user root UNKNOWN port 655352210host1 # [ 29.086594] sshd-session[939]: pam_unix(sshd:session): session closed for user root2211host1 # [ 29.092765] systemd[1]: sshd-vsock@5-6-3:22-2:5.service: Deactivated successfully.2212host1 # [ 29.098881] systemd[1]: session-8.scope: Deactivated successfully.2213host1 # [ 29.101123] systemd[1]: session-8.scope: Consumed 172ms CPU time over 605ms wall clock time, 38.8M memory peak, 5.2K incoming IP traffic, 4.1K outgoing IP traffic.2214host1 # [ 29.106808] systemd-logind[548]: Session 8 logged out. Waiting for processes to exit.2215host1 # [ 29.109908] systemd-logind[548]: Removed session 8.2216server # [ 27.437582] sshd-session[1052]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2217server # [ 27.438966] sshd-session[1052]: Disconnected from user root UNKNOWN port 655352218server # [ 27.440811] sshd-session[1046]: pam_unix(sshd:session): session closed for user root2219server # [ 27.445345] systemd[1]: sshd-vsock@1-2-4:22-2:1.service: Deactivated successfully.2220server # [ 27.450140] systemd[1]: session-3.scope: Deactivated successfully.2221server # [ 27.452236] systemd[1]: session-3.scope: Consumed 332ms CPU time over 1.210s wall clock time, 47.3M memory peak, 1.4K outgoing IP traffic.2222server # [ 27.456741] systemd-logind[523]: Session 3 logged out. Waiting for processes to exit.2223server # [ 27.458939] systemd-logind[523]: Removed session 3.2224server # [ 27.508886] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2225server # [ 27.522151] systemd[1]: Started SSH per-connection Daemon (vsock:2:2).2226server # [ 27.531883] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2227server # [ 27.536461] systemd[1]: Started SSH per-connection Daemon (vsock:2:3).2228server # [ 27.659778] sshd-session[1076]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2229server # [ 27.665924] sshd-session[1077]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2230server # [ 27.672187] sshd-session[1076]: Accepted none for root from UNKNOWN port 65535 ssh22231server # [ 27.677357] sshd-session[1077]: Accepted none for root from UNKNOWN port 65535 ssh22232server # [ 27.690707] sshd-session[1077]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2233server # [ 27.694859] sshd-session[1076]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2234server # [ 27.703470] systemd-logind[523]: New session '4' of user 'root' with class 'user' and type 'tty'.2235server # [ 27.712420] systemd[1]: Started Session 4 of User root.2236server # [ 27.718882] systemd-logind[523]: New session '5' of user 'root' with class 'user' and type 'tty'.2237server # [ 27.723137] systemd[1]: Started Session 5 of User root.2238server # [ 27.759021] sshd-session[1088]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2239server # [ 27.762844] sshd-session[1088]: Disconnected from user root UNKNOWN port 655352240server # [ 27.763923] sshd-session[1077]: pam_unix(sshd:session): session closed for user root2241server # [ 27.768973] systemd[1]: sshd-vsock@3-4-4:22-2:3.service: Deactivated successfully.2242server # [ 27.773592] systemd[1]: session-4.scope: Deactivated successfully.2243server # [ 27.779112] systemd-logind[523]: Session 4 logged out. Waiting for processes to exit.2244server # [ 27.782578] systemd-logind[523]: Removed session 4.2245test acme::a_read_only_host_cannot_write ... ok2246server # [ 27.906625] sshd-session[1089]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2247server # [ 27.908442] sshd-session[1089]: Disconnected from user root UNKNOWN port 655352248server # [ 27.909804] sshd-session[1076]: pam_unix(sshd:session): session closed for user root2249server # [ 27.913676] systemd[1]: sshd-vsock@2-3-4:22-2:2.service: Deactivated successfully.2250server # [ 27.918463] systemd[1]: session-5.scope: Deactivated successfully.2251server # [ 27.922458] systemd-logind[523]: Session 5 logged out. Waiting for processes to exit.2252server # [ 27.925211] systemd-logind[523]: Removed session 5.2253server # [ 28.010418] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2254host1 # [ 29.691315] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2255server # [ 28.018854] systemd[1]: Started SSH per-connection Daemon (vsock:2:4).2256host1 # [ 29.700117] systemd[1]: Started SSH per-connection Daemon (vsock:2:7).2257server # [ 28.114327] sshd-session[1100]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2258host1 # [ 29.798896] sshd-session[971]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2259server # [ 28.123299] sshd-session[1100]: Accepted none for root from UNKNOWN port 65535 ssh22260host1 # [ 29.807781] sshd-session[971]: Accepted none for root from UNKNOWN port 65535 ssh22261server # [ 28.131874] sshd-session[1100]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2262host1 # [ 29.816587] sshd-session[971]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2263server # [ 28.143039] systemd-logind[523]: New session '6' of user 'root' with class 'user' and type 'tty'.2264server # [ 28.148799] systemd[1]: Started Session 6 of User root.2265host1 # [ 29.827960] systemd-logind[548]: New session '9' of user 'root' with class 'user' and type 'tty'.2266host1 # [ 29.832861] systemd[1]: Started Session 9 of User root.2267host1 # [ 29.849359] sshd-session[977]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2268host1 # [ 29.851871] sshd-session[977]: Disconnected from user root UNKNOWN port 655352269host1 # [ 29.853473] sshd-session[971]: pam_unix(sshd:session): session closed for user root2270host1 # [ 29.858080] systemd[1]: sshd-vsock@7-8-3:22-2:7.service: Deactivated successfully.2271host1 # [ 29.862475] systemd[1]: session-9.scope: Deactivated successfully.2272host1 # [ 29.867208] systemd-logind[548]: Session 9 logged out. Waiting for processes to exit.2273host1 # [ 29.870216] systemd-logind[548]: Removed session 9.2274server # [ 28.295507] sshd-session[1106]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2275server # [ 28.298209] sshd-session[1106]: Disconnected from user root UNKNOWN port 655352276server # [ 28.300223] sshd-session[1100]: pam_unix(sshd:session): session closed for user root2277server # [ 28.303931] systemd[1]: sshd-vsock@4-5-4:22-2:4.service: Deactivated successfully.2278server # [ 28.309665] systemd[1]: session-6.scope: Deactivated successfully.2279server # [ 28.313635] systemd-logind[523]: Session 6 logged out. Waiting for processes to exit.2280server # [ 28.316393] systemd-logind[523]: Removed session 6.2281test acme::server_builds_and_signs_a_path ... ok2282host1 # [ 34.071807] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2283host1 # [ 34.079556] systemd[1]: Started SSH per-connection Daemon (vsock:2:8).2284host1 # [ 34.179589] sshd-session[983]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2285host1 # [ 34.188393] sshd-session[983]: Accepted none for root from UNKNOWN port 65535 ssh22286host1 # [ 34.197431] sshd-session[983]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2287host1 # [ 34.208548] systemd-logind[548]: New session '10' of user 'root' with class 'user' and type 'tty'.2288host1 # [ 34.217105] systemd[1]: Started Session 10 of User root.2289server # [ 33.516343] nix-grpc-daemon[1006]: ts=2026-10-25T21:41:47Z level=info event=rpc method=FetchNars cn=host1 peer=ipv4:192.168.1.1:38158 duration_s=0 paths=1 nar_bytes_out=1282290host1 # [ 35.231483] sshd-session[989]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2291host1 # [ 35.231760] sshd-session[989]: Disconnected from user root UNKNOWN port 655352292host1 # [ 35.236812] sshd-session[983]: pam_unix(sshd:session): session closed for user root2293host1 # [ 35.243773] systemd[1]: sshd-vsock@8-9-3:22-2:8.service: Deactivated successfully.2294host1 # [ 35.251076] systemd[1]: session-10.scope: Deactivated successfully.2295host1 # [ 35.253568] systemd[1]: session-10.scope: Consumed 199ms CPU time over 1.036s wall clock time, 42.6M memory peak, 10K incoming IP traffic, 9.1K outgoing IP traffic.2296host1 # [ 35.261392] systemd-logind[548]: Session 10 logged out. Waiting for processes to exit.2297host1 # [ 35.262831] systemd-logind[548]: Removed session 10.2298host1 # [ 35.303677] systemd[1]: SSH Host Keys Generation skipped, no trigger condition checks were met.2299host1 # [ 35.311990] systemd[1]: Started SSH per-connection Daemon (vsock:2:9).2300host1 # [ 35.408564] sshd-session[1010]: pam_unix(sshd:auth): user [root] has blank password; authenticated without it2301host1 # [ 35.417038] sshd-session[1010]: Accepted none for root from UNKNOWN port 65535 ssh22302host1 # [ 35.425105] sshd-session[1010]: pam_unix(sshd:session): session opened for user root(uid=0) by (uid=0)2303host1 # [ 35.433084] systemd-logind[548]: New session '11' of user 'root' with class 'user' and type 'tty'.2304host1 # [ 35.444949] systemd[1]: Started Session 11 of User root.2305host1 # [ 35.467891] sshd-session[1016]: Received disconnect from UNKNOWN port 65535:11: disconnected by user2306host1 # [ 35.469622] sshd-session[1016]: Disconnected from user root UNKNOWN port 655352307host1 # [ 35.471433] sshd-session[1010]: pam_unix(sshd:session): session closed for user root2308test acme::host1_substitutes_the_signed_path_with_a_read_only_cert ... ok23092310test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 54 filtered out; finished in 10.52s23112312host1 # [ 35.475659] systemd[1]: sshd-vsock@9-10-3:22-2:9.service: Deactivated successfully.2313(finished: run the VM test script, in 40.39 seconds)2314host1 # [ 35.480380] systemd[1]: session-11.scope: Deactivated successfully.2315host1 # [ 35.484563] systemd-logind[548]: Session 11 logged out. Waiting for processes to exit.2316host1 # [ 35.486645] systemd-logind[548]: Removed session 11.2317test script finished in 41.07s2318cleanup2319kill QemuMachine (pid 54)2320host1 # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/81ag9nxz1flw3xjkv1vvqg8y2ipx2ins-python3-3.14.7/bin/python3.14)2321host1 # [2026-10-25T21:41:48Z INFO virtiofsd] Client disconnected, shutting down2322host1 # [2026-10-25T21:41:48Z INFO virtiofsd] Client disconnected, shutting down2323host1 # [2026-10-25T21:41:48Z INFO virtiofsd] Client disconnected, shutting down2324kill QemuMachine (pid 55)2325server # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/81ag9nxz1flw3xjkv1vvqg8y2ipx2ins-python3-3.14.7/bin/python3.14)2326server # [2026-10-25T21:41:48Z INFO virtiofsd] Client disconnected, shutting down2327server # [2026-10-25T21:41:48Z INFO virtiofsd] Client disconnected, shutting down2328server # [2026-10-25T21:41:48Z INFO virtiofsd] Client disconnected, shutting down2329(finished: cleanup, in 0.44 seconds)2330SSH backdoor enabled, the machines can be accessed like this:2331Note: this requires systemd-ssh-proxy(1) to be enabled (default on NixOS 25.05 and newer).2332 host1: ssh -o User=root vsock-mux//build/tmphevomhi3/host1_host.socket2333 server: ssh -o User=root vsock-mux//build/tmphevomhi3/server_host.socket2334additionally exposed symbols:2335 host1, server,2336 vlan1,2337 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