[ 0.000000] Linux version 4.18.0rh8.10-debug (green@maintenance) (gcc version 8.5.0 20210514 (Red Hat 8.5.0-26) (GCC)) #2 SMP Mon Jul 14 01:24:22 EDT 2025 [ 0.000000] Command line: rd.shell root=nbd:192.168.200.253:rocky8.10:ext4:ro:-p,-b4096 ro crashkernel=256M panic=1 nomodeset ipmtu=9000 ip=dhcp rd.neednet=1 init_on_free=off mitigations=off console=ttyS1,115200 audit=0 [ 0.000000] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers' [ 0.000000] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256 [ 0.000000] x86/fpu: Enabled xstate features 0x7, context size is 832 bytes, using 'standard' format. [ 0.000000] signal: max sigframe size: 1776 [ 0.000000] BIOS-provided physical RAM map: [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x00000000bffd9fff] usable [ 0.000000] BIOS-e820: [mem 0x00000000bffda000-0x00000000bfffffff] reserved [ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved [ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved [ 0.000000] BIOS-e820: [mem 0x0000000100000000-0x0000000146dfffff] usable [ 0.000000] NX (Execute Disable) protection: active [ 0.000000] SMBIOS 2.8 present. [ 0.000000] DMI: QEMU Standard PC (i440FX + PIIX, 1996), BIOS 1.17.0-8.fc42 06/10/2025 [ 0.000000] Hypervisor detected: KVM [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00 [ 0.000000] kvm-clock: using sched offset of 496417107 cycles [ 0.000000] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns [ 0.000000] tsc: Detected 2399.998 MHz processor [ 0.000000] last_pfn = 0x146e00 max_arch_pfn = 0x400000000 [ 0.000000] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT [ 0.000000] last_pfn = 0xbffda max_arch_pfn = 0x400000000 [ 0.000000] found SMP MP-table at [mem 0x000f54d0-0x000f54df] [ 0.000000] RAMDISK: [mem 0xbcc64000-0xbffcffff] [ 0.000000] ACPI: Early table checksum verification disabled [ 0.000000] ACPI: RSDP 0x00000000000F52F0 000014 (v00 BOCHS ) [ 0.000000] ACPI: RSDT 0x00000000BFFE2421 000034 (v01 BOCHS BXPC 00000001 BXPC 00000001) [ 0.000000] ACPI: FACP 0x00000000BFFE22BD 000074 (v01 BOCHS BXPC 00000001 BXPC 00000001) [ 0.000000] ACPI: DSDT 0x00000000BFFE0040 00227D (v01 BOCHS BXPC 00000001 BXPC 00000001) [ 0.000000] ACPI: FACS 0x00000000BFFE0000 000040 [ 0.000000] ACPI: APIC 0x00000000BFFE2331 000090 (v03 BOCHS BXPC 00000001 BXPC 00000001) [ 0.000000] ACPI: HPET 0x00000000BFFE23C1 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001) [ 0.000000] ACPI: WAET 0x00000000BFFE23F9 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001) [ 0.000000] ACPI: Reserving FACP table memory at [mem 0xbffe22bd-0xbffe2330] [ 0.000000] ACPI: Reserving DSDT table memory at [mem 0xbffe0040-0xbffe22bc] [ 0.000000] ACPI: Reserving FACS table memory at [mem 0xbffe0000-0xbffe003f] [ 0.000000] ACPI: Reserving APIC table memory at [mem 0xbffe2331-0xbffe23c0] [ 0.000000] ACPI: Reserving HPET table memory at [mem 0xbffe23c1-0xbffe23f8] [ 0.000000] ACPI: Reserving WAET table memory at [mem 0xbffe23f9-0xbffe2420] [ 0.000000] No NUMA configuration found [ 0.000000] Faking a node at [mem 0x0000000000000000-0x0000000146dfffff] [ 0.000000] NODE_DATA(0) allocated [mem 0x1465a3000-0x1465cdfff] [ 0.000000] Reserving 256MB of memory at 2752MB for crashkernel (System RAM: 4205MB) [ 0.000000] Zone ranges: [ 0.000000] DMA [mem 0x0000000000001000-0x0000000000ffffff] [ 0.000000] DMA32 [mem 0x0000000001000000-0x00000000ffffffff] [ 0.000000] Normal [mem 0x0000000100000000-0x0000000146dfffff] [ 0.000000] Device empty [ 0.000000] Movable zone start for each node [ 0.000000] Early memory node ranges [ 0.000000] node 0: [mem 0x0000000000001000-0x000000000009efff] [ 0.000000] node 0: [mem 0x0000000000100000-0x00000000bffd9fff] [ 0.000000] node 0: [mem 0x0000000100000000-0x0000000146dfffff] [ 0.000000] Zeroed struct page in unavailable ranges: 4744 pages [ 0.000000] Initmem setup node 0 [mem 0x0000000000001000-0x0000000146dfffff] [ 0.000000] ACPI: PM-Timer IO Port: 0x608 [ 0.000000] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1]) [ 0.000000] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23 [ 0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl) [ 0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level) [ 0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level) [ 0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level) [ 0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level) [ 0.000000] Using ACPI (MADT) for SMP configuration information [ 0.000000] ACPI: HPET id: 0x8086a201 base: 0xfed00000 [ 0.000000] TSC deadline timer available [ 0.000000] smpboot: Allowing 4 CPUs, 0 hotplug CPUs [ 0.000000] kvm-guest: KVM setup pv remote TLB flush [ 0.000000] kvm-guest: setup PV sched yield [ 0.000000] PM: Registered nosave memory: [mem 0x00000000-0x00000fff] [ 0.000000] PM: Registered nosave memory: [mem 0x0009f000-0x0009ffff] [ 0.000000] PM: Registered nosave memory: [mem 0x000a0000-0x000effff] [ 0.000000] PM: Registered nosave memory: [mem 0x000f0000-0x000fffff] [ 0.000000] PM: Registered nosave memory: [mem 0xbffda000-0xbfffffff] [ 0.000000] PM: Registered nosave memory: [mem 0xc0000000-0xfeffbfff] [ 0.000000] PM: Registered nosave memory: [mem 0xfeffc000-0xfeffffff] [ 0.000000] PM: Registered nosave memory: [mem 0xff000000-0xfffbffff] [ 0.000000] PM: Registered nosave memory: [mem 0xfffc0000-0xffffffff] [ 0.000000] [mem 0xc0000000-0xfeffbfff] available for PCI devices [ 0.000000] Booting paravirtualized kernel on KVM [ 0.000000] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns [ 0.000000] setup_percpu: NR_CPUS:8192 nr_cpumask_bits:4 nr_cpu_ids:4 nr_node_ids:1 [ 0.000000] percpu: Embedded 63 pages/cpu s221184 r8192 d28672 u524288 [ 0.000000] kvm-guest: PV spinlocks enabled [ 0.000000] PV qspinlock hash table entries: 256 (order: 0, 4096 bytes, linear) [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 1059618 [ 0.000000] Policy zone: Normal [ 0.000000] Kernel command line: rd.shell root=nbd:192.168.200.253:rocky8.10:ext4:ro:-p,-b4096 ro crashkernel=256M panic=1 nomodeset ipmtu=9000 ip=dhcp rd.neednet=1 init_on_free=off mitigations=off console=ttyS1,115200 audit=0 [ 0.000000] Specific versions of hardware are certified with Red Hat Enterprise Linux 8. Please see the list of hardware certified with Red Hat Enterprise Linux 8 at https://catalog.redhat.com. [ 0.000000] audit: disabled (until reboot) [ 0.000000] software IO TLB: area num 4. [ 0.000000] Memory: 2895288K/4306400K available (18435K kernel code, 11221K rwdata, 7248K rodata, 2908K init, 18040K bss, 524580K reserved, 0K cma-reserved) [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 [ 0.000000] kmemleak: Kernel memory leak detector disabled [ 0.000000] ftrace: allocating 41240 entries in 162 pages [ 0.000000] ftrace: allocated 162 pages with 3 groups [ 0.000000] rcu: Hierarchical RCU implementation. [ 0.000000] rcu: RCU event tracing is enabled. [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=8192 to nr_cpu_ids=4. [ 0.000000] rcu: RCU callback double-/use-after-free debug enabled. [ 0.000000] Rude variant of Tasks RCU enabled. [ 0.000000] Tracing variant of Tasks RCU enabled. [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=4 [ 0.000000] NR_IRQS: 524544, nr_irqs: 456, preallocated irqs: 16 [ 0.000000] random: get_random_bytes called from start_kernel+0x622/0x9a8 with crng_init=0 [ 0.001000] Console: colour *CGA 80x25 [ 0.001000] printk: console [ttyS1] enabled [ 0.001000] ACPI: Core revision 20220331 [ 0.001000] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns [ 0.001011] APIC: Switch to symmetric I/O mode setup [ 0.002410] x2apic enabled [ 0.003009] Switched APIC routing to physical x2apic. [ 0.004015] kvm-guest: setup PV IPIs [ 0.007534] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1 [ 0.008000] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x229835b7123, max_idle_ns: 440795242976 ns [ 0.008024] Calibrating delay loop (skipped) preset value.. 4799.99 BogoMIPS (lpj=2399998) [ 0.009019] pid_max: default: 32768 minimum: 301 [ 0.010186] LSM: Security Framework initializing [ 0.011077] Yama: becoming mindful. [ 0.012064] SELinux: Initializing. [ 0.014109] *** VALIDATE selinux *** [ 0.024432] Dentry cache hash table entries: 1048576 (order: 11, 8388608 bytes, vmalloc) [ 0.030104] Inode-cache hash table entries: 524288 (order: 10, 4194304 bytes, vmalloc) [ 0.031196] Mount-cache hash table entries: 16384 (order: 5, 131072 bytes, vmalloc) [ 0.032148] Mountpoint-cache hash table entries: 16384 (order: 5, 131072 bytes, vmalloc) [ 0.033143] *** VALIDATE tmpfs *** [ 0.035422] *** VALIDATE proc *** [ 0.037111] *** VALIDATE cgroup *** [ 0.038008] *** VALIDATE cgroup2 *** [ 0.040113] x86/cpu: User Mode Instruction Prevention (UMIP) activated [ 0.042082] Last level iTLB entries: 4KB 0, 2MB 0, 4MB 0 [ 0.043016] Last level dTLB entries: 4KB 0, 2MB 0, 4MB 0, 1GB 0 [ 0.044032] Spectre V2 : User space: Vulnerable [ 0.045009] Speculative Store Bypass: Vulnerable [ 0.048741] debug: unmapping init [mem 0xffffffffa5059000-0xffffffffa5060fff] [ 0.050209] smpboot: CPU0: Intel(R) Xeon(R) CPU E5-2695 v2 @ 2.40GHz (family: 0x6, model: 0x3e, stepping: 0x4) [ 0.051991] Performance Events: IvyBridge events, full-width counters, Intel PMU driver. [ 0.053028] ... version: 2 [ 0.054014] ... bit width: 48 [ 0.055013] ... generic registers: 4 [ 0.056026] ... value mask: 0000ffffffffffff [ 0.057022] ... max period: 00007fffffffffff [ 0.058022] ... fixed-purpose events: 3 [ 0.059018] ... event mask: 000000070000000f [ 0.060314] rcu: Hierarchical SRCU implementation. [ 0.062379] smp: Bringing up secondary CPUs ... [ 0.063702] x86: Booting SMP configuration: [ 0.064047] .... node #0, CPUs: #1 #2 #3 [ 0.068110] smp: Brought up 1 node, 4 CPUs [ 0.070021] smpboot: Max logical packages: 1 [ 0.071036] smpboot: Total of 4 processors activated (19199.98 BogoMIPS) [ 0.237270] node 0 deferred pages initialised in 164ms [ 0.241049] devtmpfs: initialized [ 0.241942] x86/mm: Memory block size: 128MB [ 0.244818] gcov: version magic: 0x41383552 [ 0.247233] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns [ 0.248155] futex hash table entries: 1024 (order: 4, 65536 bytes, vmalloc) [ 0.249287] pinctrl core: initialized pinctrl subsystem [ 0.250293] [ 0.250824] ************************************************************* [ 0.251017] ** NOTICE NOTICE NOTICE NOTICE NOTICE NOTICE NOTICE ** [ 0.252015] ** ** [ 0.253015] ** IOMMU DebugFS SUPPORT HAS BEEN ENABLED IN THIS KERNEL ** [ 0.254015] ** ** [ 0.255024] ** This means that this kernel is built to expose internal ** [ 0.256017] ** IOMMU data structures, which may compromise security on ** [ 0.257031] ** your system. ** [ 0.258014] ** ** [ 0.259016] ** If you see this message and you are not debugging the ** [ 0.260016] ** kernel, report this immediately to your vendor! ** [ 0.261013] ** ** [ 0.262019] ** NOTICE NOTICE NOTICE NOTICE NOTICE NOTICE NOTICE ** [ 0.263022] ************************************************************* [ 0.264879] NET: Registered protocol family 16 [ 0.265608] DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations [ 0.266105] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations [ 0.267090] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations [ 0.269023] cpuidle: using governor menu [ 0.270000] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 [ 0.273691] PCI: Using configuration type 1 for base access [ 0.276225] core: PMU erratum BJ122, BV98, HSD29 worked around, HT is on [ 0.286132] HugeTLB registered 1.00 GiB page size, pre-allocated 0 pages [ 0.287036] HugeTLB registered 2.00 MiB page size, pre-allocated 0 pages [ 0.289143] cryptd: max_cpu_qlen set to 1000 [ 0.293197] ACPI: Added _OSI(Module Device) [ 0.295014] ACPI: Added _OSI(Processor Device) [ 0.296012] ACPI: Added _OSI(3.0 _SCP Extensions) [ 0.298015] ACPI: Added _OSI(Processor Aggregator Device) [ 0.303231] ACPI: 1 ACPI AML tables successfully acquired and loaded [ 0.308607] ACPI: Interpreter enabled [ 0.310060] ACPI: PM: (supports S0 S3 S4 S5) [ 0.311012] ACPI: Using IOAPIC for interrupt routing [ 0.313271] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug [ 0.317654] ACPI: Enabled 2 GPEs in block 00 to 0F [ 0.331931] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) [ 0.335070] acpi PNP0A03:00: _OSC: OS supports [ASPM ClockPM Segments MSI HPX-Type3] [ 0.337028] acpi PNP0A03:00: _OSC: not requesting OS control; OS requires [ExtendedConfig ASPM ClockPM MSI] [ 0.340107] acpi PNP0A03:00: fail to add MMCONFIG information, can't access extended PCI configuration space under this bridge. [ 0.346509] acpiphp: Slot [2] registered [ 0.348199] acpiphp: Slot [5] registered [ 0.350159] acpiphp: Slot [6] registered [ 0.351155] acpiphp: Slot [3] registered [ 0.353131] acpiphp: Slot [4] registered [ 0.354127] acpiphp: Slot [7] registered [ 0.356170] acpiphp: Slot [8] registered [ 0.357167] acpiphp: Slot [9] registered [ 0.359147] acpiphp: Slot [10] registered [ 0.360146] acpiphp: Slot [11] registered [ 0.362135] acpiphp: Slot [12] registered [ 0.363137] acpiphp: Slot [13] registered [ 0.365133] acpiphp: Slot [14] registered [ 0.367140] acpiphp: Slot [15] registered [ 0.368151] acpiphp: Slot [16] registered [ 0.370139] acpiphp: Slot [17] registered [ 0.371128] acpiphp: Slot [18] registered [ 0.373186] acpiphp: Slot [19] registered [ 0.375177] acpiphp: Slot [20] registered [ 0.376131] acpiphp: Slot [21] registered [ 0.378161] acpiphp: Slot [22] registered [ 0.379120] acpiphp: Slot [23] registered [ 0.382173] acpiphp: Slot [24] registered [ 0.383146] acpiphp: Slot [25] registered [ 0.384128] acpiphp: Slot [26] registered [ 0.386143] acpiphp: Slot [27] registered [ 0.388101] acpiphp: Slot [28] registered [ 0.389106] acpiphp: Slot [29] registered [ 0.392201] acpiphp: Slot [30] registered [ 0.393112] acpiphp: Slot [31] registered [ 0.394059] PCI host bridge to bus 0000:00 [ 0.396026] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window] [ 0.398021] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window] [ 0.400022] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window] [ 0.402023] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window] [ 0.404025] pci_bus 0000:00: root bus resource [mem 0xe0000000000-0xe007fffffff window] [ 0.407026] pci_bus 0000:00: root bus resource [bus 00-ff] [ 0.409170] pci 0000:00:00.0: [8086:1237] type 00 class 0x060000 [ 0.412038] pci 0000:00:01.0: [8086:7000] type 00 class 0x060100 [ 0.415865] pci 0000:00:01.1: [8086:7010] type 00 class 0x010180 [ 0.422973] pci 0000:00:01.1: reg 0x20: [io 0xc120-0xc12f] [ 0.427073] pci 0000:00:01.1: legacy IDE quirk: reg 0x10: [io 0x01f0-0x01f7] [ 0.429022] pci 0000:00:01.1: legacy IDE quirk: reg 0x14: [io 0x03f6] [ 0.432018] pci 0000:00:01.1: legacy IDE quirk: reg 0x18: [io 0x0170-0x0177] [ 0.434019] pci 0000:00:01.1: legacy IDE quirk: reg 0x1c: [io 0x0376] [ 0.436584] pci 0000:00:01.3: [8086:7113] type 00 class 0x068000 [ 0.439778] pci 0000:00:01.3: quirk: [io 0x0600-0x063f] claimed by PIIX4 ACPI [ 0.444075] pci 0000:00:01.3: quirk: [io 0x0700-0x070f] claimed by PIIX4 SMB [ 0.447015] pci 0000:00:02.0: [1af4:1000] type 00 class 0x020000 [ 0.452021] pci 0000:00:02.0: reg 0x10: [io 0xc100-0xc11f] [ 0.463022] pci 0000:00:02.0: reg 0x20: [mem 0xe0000000000-0xe0000003fff 64bit pref] [ 0.467813] pci 0000:00:02.0: reg 0x30: [mem 0xfeb80000-0xfebbffff pref] [ 0.474291] pci 0000:00:05.0: [1af4:1001] type 00 class 0x010000 [ 0.484019] pci 0000:00:05.0: reg 0x10: [io 0xc000-0xc07f] [ 0.491018] pci 0000:00:05.0: reg 0x14: [mem 0xfebc0000-0xfebc0fff] [ 0.514017] pci 0000:00:05.0: reg 0x20: [mem 0xe0000004000-0xe0000007fff 64bit pref] [ 0.527000] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 [ 0.535104] pci 0000:00:06.0: reg 0x10: [io 0xc080-0xc0ff] [ 0.543028] pci 0000:00:06.0: reg 0x14: [mem 0xfebc1000-0xfebc1fff] [ 0.565026] pci 0000:00:06.0: reg 0x20: [mem 0xe0000008000-0xe000000bfff 64bit pref] [ 0.576731] ACPI: PCI: Interrupt link LNKA configured for IRQ 10 [ 0.579592] ACPI: PCI: Interrupt link LNKB configured for IRQ 10 [ 0.581367] ACPI: PCI: Interrupt link LNKC configured for IRQ 11 [ 0.584420] ACPI: PCI: Interrupt link LNKD configured for IRQ 11 [ 0.586237] ACPI: PCI: Interrupt link LNKS configured for IRQ 9 [ 0.591052] iommu: Default domain type: Passthrough [ 0.593755] SCSI subsystem initialized [ 0.595306] ACPI: bus type USB registered [ 0.597142] usbcore: registered new interface driver usbfs [ 0.599165] usbcore: registered new interface driver hub [ 0.602125] usbcore: registered new device driver usb [ 0.604248] pps_core: LinuxPPS API ver. 1 registered [ 0.606018] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti [ 0.609091] PTP clock support registered [ 0.612127] EDAC MC: Ver: 3.0.0 [ 0.614150] PCI: Using ACPI for IRQ routing [ 0.616053] NetLabel: Initializing [ 0.617016] NetLabel: domain hash size = 128 [ 0.620012] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO [ 0.621085] NetLabel: unlabeled traffic allowed by default [ 0.624041] vgaarb: loaded [ 0.625286] hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0 [ 0.627015] hpet0: 3 comparators, 64-bit 100.000000 MHz counter [ 0.635000] clocksource: Switched to clocksource kvm-clock [ 0.754839] VFS: Disk quotas dquot_6.6.0 [ 0.756182] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) [ 0.758605] *** VALIDATE ramfs *** [ 0.759737] *** VALIDATE hugetlbfs *** [ 0.761034] pnp: PnP ACPI init [ 0.763509] pnp: PnP ACPI: found 6 devices [ 0.779179] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns [ 0.783696] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window] [ 0.786825] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window] [ 0.789905] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window] [ 0.792869] pci_bus 0000:00: resource 7 [mem 0xc0000000-0xfebfffff window] [ 0.796087] pci_bus 0000:00: resource 8 [mem 0xe0000000000-0xe007fffffff window] [ 0.799811] NET: Registered protocol family 2 [ 0.803503] IP idents hash table entries: 131072 (order: 8, 1048576 bytes, vmalloc) [ 0.809214] tcp_listen_portaddr_hash hash table entries: 4096 (order: 5, 163840 bytes, vmalloc) [ 0.812698] TCP established hash table entries: 65536 (order: 7, 524288 bytes, vmalloc) [ 0.818500] TCP bind hash table entries: 65536 (order: 9, 2097152 bytes, vmalloc) [ 0.821112] TCP: Hash tables configured (established 65536 bind 65536) [ 0.823218] MPTCP token hash table entries: 8192 (order: 6, 393216 bytes, vmalloc) [ 0.825358] UDP hash table entries: 4096 (order: 6, 393216 bytes, vmalloc) [ 0.827339] UDP-Lite hash table entries: 4096 (order: 6, 393216 bytes, vmalloc) [ 0.829743] NET: Registered protocol family 1 [ 0.831699] RPC: Registered named UNIX socket transport module. [ 0.834093] RPC: Registered udp transport module. [ 0.836287] RPC: Registered tcp transport module. [ 0.837862] RPC: Registered tcp NFSv4.1 backchannel transport module. [ 0.839810] NET: Registered protocol family 44 [ 0.841489] pci 0000:00:00.0: Limiting direct PCI/PCI transfers [ 0.843744] pci 0000:00:01.0: PIIX3: Enabling Passive Release [ 0.846257] pci 0000:00:01.0: Activating ISA DMA hang workarounds [ 0.848991] PCI: CLS 0 bytes, default 64 [ 0.850791] Unpacking initramfs... [ 2.237318] debug: unmapping init [mem 0xffff90fcbcc64000-0xffff90fcbffcffff] [ 2.241477] PCI-DMA: Using software bounce buffering for IO (SWIOTLB) [ 2.243810] software IO TLB: mapped [mem 0x00000000a8000000-0x00000000ac000000] (64MB) [ 2.246981] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x229835b7123, max_idle_ns: 440795242976 ns [ 2.789748] Initialise system trusted keyrings [ 2.791685] Key type blacklist registered [ 2.793743] workingset: timestamp_bits=36 max_order=20 bucket_order=0 [ 2.803412] zbud: loaded [ 2.806796] *** VALIDATE nfs *** [ 2.809508] *** VALIDATE nfs4 *** [ 2.812189] pstore: using deflate compression [ 2.817633] Platform Keyring initialized [ 3.013914] NET: Registered protocol family 38 [ 3.015800] Key type asymmetric registered [ 3.017886] Asymmetric key parser 'x509' registered [ 3.019635] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 247) [ 3.023372] io scheduler mq-deadline registered [ 3.025029] io scheduler kyber registered [ 3.027319] io scheduler bfq registered [ 3.029479] atomic64_test: passed for x86-64 platform with CX8 and with SSE [ 3.037466] shpchp: Standard Hot Plug PCI Controller Driver version: 0.4 [ 3.040951] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input0 [ 3.044701] ACPI: Power Button [PWRF] [ 3.052956] ACPI: \_SB_.LNKB: Enabled at IRQ 10 [ 3.060902] ACPI: \_SB_.LNKA: Enabled at IRQ 11 [ 3.072396] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled [ 3.100971] 00:03: ttyS1 at I/O 0x2f8 (irq = 3, base_baud = 115200) is a 16550A [ 3.142612] 00:04: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A [ 3.155212] Non-volatile memory driver v1.3 [ 3.157468] Linux agpgart interface v0.103 [ 3.223698] virtio_blk virtio1: [vda] 134592 512-byte logical blocks (68.9 MB/65.7 MiB) [ 3.249312] vda: detected capacity change from 0 to 68911104 [ 3.305856] virtio_blk virtio2: [vdb] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB) [ 3.316774] vdb: detected capacity change from 0 to 1073741824 [ 3.332861] libphy: Fixed MDIO Bus: probed [ 3.362952] usbcore: registered new interface driver usbserial_generic [ 3.365266] usbserial: USB Serial support registered for generic [ 3.373845] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12 [ 3.385030] serio: i8042 KBD port at 0x60,0x64 irq 1 [ 3.388691] serio: i8042 AUX port at 0x60,0x64 irq 12 [ 3.400484] mousedev: PS/2 mouse device common for all mice [ 3.406733] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input1 [ 3.409449] rtc_cmos 00:05: RTC can wake from S4 [ 3.441763] rtc_cmos 00:05: registered as rtc0 [ 3.445073] rtc_cmos 00:05: alarms up to one day, y3k, 242 bytes nvram, hpet irqs [ 3.450963] intel_pstate: CPU model not supported [ 3.457670] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input4 [ 3.460385] hid: raw HID events driver (C) Jiri Kosina [ 3.476410] input: VirtualPS/2 VMware VMMouse as /devices/platform/i8042/serio1/input/input3 [ 3.478959] usbcore: registered new interface driver usbhid [ 3.478968] usbhid: USB HID core driver [ 3.480322] drop_monitor: Initializing network drop monitor service [ 3.480473] Initializing XFRM netlink socket [ 3.480849] NET: Registered protocol family 10 [ 3.491566] Segment Routing with IPv6 [ 3.507155] NET: Registered protocol family 17 [ 3.510587] mpls_gso: MPLS GSO support [ 3.528499] RAS: Correctable Errors collector initialized. [ 3.532779] AVX version of gcm_enc/dec engaged. [ 3.535797] AES CTR mode by8 optimization enabled [ 3.779990] sched_clock: Marking stable (3779855133, 0)->(4686621406, -906766273) [ 3.785752] registered taskstats version 1 [ 3.792591] Loading compiled-in X.509 certificates [ 3.795073] zswap: loaded using pool lzo/zbud [ 3.835718] Key type big_key registered [ 3.851370] Key type encrypted registered [ 3.853235] ima: No TPM chip found, activating TPM-bypass! [ 3.855813] ima: Allocated hash algorithm: sha1 [ 3.857919] ima: No architecture policies found [ 3.859967] evm: Initialising EVM extended attributes: [ 3.862297] evm: security.selinux [ 3.863776] evm: security.ima [ 3.864954] evm: security.capability [ 3.866682] evm: HMAC attrs: 0x1 [ 3.869817] rtc_cmos 00:05: setting system clock to 2026-03-15 20:31:16 UTC (1773606676) [ 3.878466] debug: unmapping init [mem 0xffffffffa6003000-0xffffffffa61fffff] [ 3.882575] debug: unmapping init [mem 0xffffffffa4d82000-0xffffffffa5058fff] [ 3.897137] Write protecting the kernel read-only data: 28672k [ 3.901657] debug: unmapping init [mem 0xffffffffa3403000-0xffffffffa35fffff] [ 3.905994] debug: unmapping init [mem 0xffffffffa3d14000-0xffffffffa3dfffff] [ 3.950435] systemd[1]: systemd 239 (239-82.el8_10.5) running in system mode. (+PAM +AUDIT +SELINUX +IMA -APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +SECCOMP +BLKID +ELFUTILS +KMOD +IDN2 -IDN +PCRE2 default-hierarchy=legacy) [ 3.959490] systemd[1]: Detected virtualization kvm. [ 3.961515] systemd[1]: Detected architecture x86-64. [ 3.963686] systemd[1]: Running in initial RAM disk. Welcome to Rocky Linux 8.10 (Green Obsidian) dracut-049-233.git20240115.el8 (Initramfs)! [ 3.998548] systemd[1]: No hostname configured. [ 4.001326] systemd[1]: Set hostname to . [ 4.003814] random: systemd: uninitialized urandom read (16 bytes read) [ 4.008969] systemd[1]: Initializing machine ID from random generator. [ 4.144746] random: ln: uninitialized urandom read (6 bytes read) [ 4.333489] random: systemd: uninitialized urandom read (16 bytes read) [ 4.337684] systemd[1]: Listening on Journal Socket. [ OK ] Listening on Journal Socket. [ 4.356407] systemd[1]: Started Memstrack Anylazing Service. [ OK ] Started Memstrack Anylazing Service. [ 4.388680] systemd[1]: Reached target Swap. [ OK ] Reached target Swap. [ OK ] Listening on Journal Socket (/dev/log). Starting Journal Service... [ OK ] Reached target Slices. [ OK ] Listening on udev Kernel Socket. [ OK ] Reached target Initrd Root Device. [ OK ] Started Dispatch Password Requests to Console Directory Watch. [ OK ] Reached target Paths. [ OK ] Reached target Timers. [ OK ] Reached target Local File Systems. Starting Create Volatile Files and Directories... Starting Create list of required st…ce nodes for the current kernel... [ OK ] Reached target Local Encrypted Volumes. [ OK ] Listening on udev Control Socket. [ OK ] Reached target Sockets. Starting Setup Virtual Console... Starting Apply Kernel Variables... [ OK ] Started Create Volatile Files and Directories. [ OK ] Started Create list of required sta…vice nodes for the current kernel. [ OK ] Started Journal Service. [ OK ] Started Setup Virtual Console. [ OK ] Started Apply Kernel Variables. Starting dracut cmdline hook... Starting Create Static Device Nodes in /dev... [ OK ] Started Create Static Device Nodes in /dev. [ OK ] Started dracut cmdline hook. Starting dracut pre-udev hook... [ 5.631368] device-mapper: uevent: version 1.0.3 [ 5.635598] device-mapper: ioctl: 4.46.0-ioctl (2022-02-22) initialised: dm-devel@redhat.com [ OK ] Started dracut pre-udev hook. Starting udev Kernel Device Manager... [ OK ] Started udev Kernel Device Manager. Starting dracut pre-trigger hook... [ OK ] Started dracut pre-trigger hook. Starting udev Coldplug all Devices... Mounting Kernel Configuration File System... [ OK ] Mounted Kernel Configuration File System. [ OK ] Started udev Coldplug all Devices. [ OK ] Reached target System Initialization. [ OK ] Reached target Basic System. [ OK ] Started Hardware RNG Entropy Gatherer Daemon. Starting dracut initqueue hook... [ 7.596505] virtio_net virtio0 ens2: renamed from eth0 [ 7.856842] scsi host0: ata_piix [ 7.893275] scsi host1: ata_piix [ 7.897272] ata1: PATA max MWDMA2 cmd 0x1f0 ctl 0x3f6 bmdma 0xc120 irq 14 [ 7.903502] ata2: PATA max MWDMA2 cmd 0x170 ctl 0x376 bmdma 0xc128 irq 15 [ 13.377253] random: crng init done [ 13.378839] random: 7 urandom warning(s) missed due to ratelimiting [ 14.694978] dracut-initqueue[592]: RTNETLINK answers: File exists Starting nbd nbd0... [ OK ] Started nbd nbd0. [ OK ] Started dracut initqueue hook. [ OK ] Reached target Remote File Systems (Pre). [ OK ] Reached target Remote File Systems. Mounting /sysroot... [ 16.208392] hrtimer: interrupt took 6249030 ns [ 16.233620] EXT4-fs (nbd0): mounted filesystem with ordered data mode. Opts: (null) [ OK ] Mounted /sysroot. [ OK ] Reached target Initrd Root File System. Starting Reload Configuration from the Real Root... [ OK ] Started Reload Configuration from the Real Root. [ OK ] Reached target Initrd File Systems. [ OK ] Reached target Initrd Default Target. Starting dracut pre-pivot and cleanup hook... [ OK ] Started dracut pre-pivot and cleanup hook. Starting Cleaning Up and Shutting Down Daemons... [ OK ] Stopped target Timers. [ OK ] Stopped dracut pre-pivot and cleanup hook. [ OK ] Stopped target Initrd Default Target. [ OK ] Stopped target Initrd Root Device. [ OK ] Stopped target Remote File Systems. [ OK ] Stopped target Remote File Systems (Pre). [ OK ] Stopped dracut initqueue hook. Stopping Hardware RNG Entropy Gatherer Daemon... [ OK ] Stopped Hardware RNG Entropy Gatherer Daemon. [ OK ] Stopped target Basic System. [ OK ] Stopped target Sockets. [ OK ] Stopped target Paths. [ OK ] Stopped target Slices. [ OK ] Stopped target System Initialization. [ OK ] Stopped target Swap. [ OK ] Stopped Create Volatile Files and Directories. [ OK ] Stopped target Local Encrypted Volumes. [ OK ] Stopped Dispatch Password Requests to Console Directory Watch. [ OK ] Stopped Apply Kernel Variables. [ OK ] Stopped target Local File Systems. [ OK ] Stopped udev Coldplug all Devices. [ OK ] Stopped dracut pre-trigger hook. Stopping udev Kernel Device Manager... [ OK ] Started Cleaning Up and Shutting Down Daemons. [ OK ] Stopped udev Kernel Device Manager. [ OK ] Stopped dracut pre-udev hook. [ OK ] Stopped dracut cmdline hook. [ OK ] Stopped Create Static Device Nodes in /dev. [ OK ] Stopped Create list of required sta…vice nodes for the current kernel. [ OK ] Closed udev Kernel Socket. [ OK ] Closed udev Control Socket. Starting Cleanup udevd DB... [ OK ] Started Cleanup udevd DB. [ OK ] Reached target Switch Root. Starting Switch Root... [ 18.673297] printk: systemd: 20 output lines suppressed due to ratelimiting [ 19.550050] SELinux: Disabled at runtime. [ 19.646260] systemd[1]: systemd 239 (239-82.el8_10.5) running in system mode. (+PAM +AUDIT +SELINUX +IMA -APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +SECCOMP +BLKID +ELFUTILS +KMOD +IDN2 -IDN +PCRE2 default-hierarchy=legacy) [ 19.671196] systemd[1]: Detected virtualization kvm. [ 19.678304] systemd[1]: Detected architecture x86-64. Welcome to Rocky Linux 8.10 (Green Obsidian)! [ 21.426664] systemd[1]: initrd-switch-root.service: Succeeded. [ 21.437240] systemd[1]: Stopped Switch Root. [ OK ] Stopped Switch Root. [ 21.455647] systemd[1]: systemd-journald.service: Service has no hold-off time (RestartSec=0), scheduling restart. [ 21.468314] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. [ 21.474056] systemd[1]: Stopped Journal Service. [ OK ] Stopped Journal Service. [ 21.492434] systemd[1]: Starting Journal Service... Starting Journal Service... [ 21.515220] systemd[1]: Listening on initctl Compatibility Named Pipe. [ OK ] Listening on initctl Compatibility Named Pipe. Mounting Kernel Debug File System... [ OK ] Listening on Process Core Dump Socket. Starting Create list of required st…ce nodes for the current kernel... [ OK ] Created slice system-getty.slice. [ OK ] Started Dispatch Password Requests to Console Directory Watch. Mounting Huge Pages File System... [ OK ] Listening on udev Control Socket. Starting Remount Root and Kernel File Systems... [ OK ] Created slice system-serial\x2dgetty.slice. Mounting POSIX Message Queue File System... [ OK ] Stopped target Switch Root. [ OK ] Stopped target Initrd Root File System. [ OK ] Reached target rpc_pipefs.target. Activating swap /dev/disk/by-label/SWAP... [ OK ] Listening on udev Kernel Socket. Starting udev Coldplug all Devices... [ OK ] Started Forward Password Requests to Wall Directory Watch. [ OK ] Reached target Local Encrypte[ 21.879785] Adding 1048572k swap on /dev/vdb. Priority:-2 extents:1 across:1048572k FS d Volumes. [FAILED] Failed to set up automount Arbitrar…rmats File System Automount Point. See 'systemctl status proc-sys-fs-binfmt_misc.automount' for details. [ OK ] Created slice User and Session Slice. [ OK ] Reached target Slices. Starting Apply Kernel Variables... [ OK ] Created slice system-sshd\x2dkeygen.slice. [ OK ] Reached target Paths. [ OK ] Listening on RPCbind Server Activation Socket. [ OK ] Reached target RPC Port Mapper. [ OK ] Stopped target Initrd File Systems. [ OK ] Started Journal Service. [ OK ] Mounted Kernel Debug File System. [ OK ] Started Create list of required sta…vice nodes for the current kernel. [ OK ] Mounted Huge Pages File System. [FAILED] Failed to start Remount Root and Kernel File Systems. See 'systemctl status systemd-remount-fs.service' for details. [ OK ] Mounted POSIX Message Queue File System. [ OK ] Activated swap /dev/disk/by-label/SWAP. [ OK ] Started Apply Kernel Variables. [ OK ] Reached target Swap. Starting Configure read-only root support... Starting Create Static Device Nodes in /dev... Starting Flush Journal to Persistent Storage... [ OK ] Started Flush Journal to Persistent Storage. [ OK ] Started udev Coldplug all Devices. [ OK ] Started Create Static Device Nodes in /dev. Starting udev Kernel Device Manager... [ OK ] Reached target Local File Systems (Pre). Mounting /mnt... Mounting /home/green/git/lustre-release... [ OK ] Mounted /mnt. [ 23.119183] squashfs: version 4.0 (2009/01/31) Phillip Lougher [ OK ] Mounted /home/green/git/lustre-release. [ OK ] Started udev Kernel Device Manager. [ 24.364383] input: PC Speaker as /devices/platform/pcspkr/input/input5 [ 24.398113] piix4_smbus 0000:00:01.3: SMBus Host Controller at 0x700, revision 0 [ 24.804356] RAPL PMU: API unit is 2^-32 Joules, 0 fixed counters, 10737418240 ms ovfl timer [ 24.907979] EDAC sbridge: Ver: 1.1.2 [* ] A start job is running for Configur…-only root support (7s / no limit)[ 29.364709] Key type dns_resolver registered [** ] A start job is running for Configur…-only root support (8s / no limit)[ 30.311309] NFS: Registering the id_resolver key type [ 30.319729] Key type id_resolver registered [ 30.328757] Key type id_legacy registered [*** ] A start job is running for Configur…-only root support (9s / no limit) [ *** ] A start job is running for Configur…-only root support (9s / no limit) [ OK ] Started Configure read-only root support. [ OK ] Reached target Local File Systems. Starting Mark the need to relabel after reboot... Starting Rebuild Dynamic Linker Cache... Starting Create Volatile Files and Directories... Starting Load/Save Random Seed... [ OK ] Started Mark the need to relabel after reboot. [ OK ] Started Create Volatile Files and Directories. [ OK ] Started Load/Save Random Seed. Starting RPC Bind... Starting Update UTMP about System Boot/Shutdown... [ OK ] Started Update UTMP about System Boot/Shutdown. [ OK ] Started RPC Bind. [ OK ] Started Rebuild Dynamic Linker Cache. Starting Update is Completed... [ OK ] Started Update is Completed. [ OK ] Reached target System Initialization. [ OK ] Started dnf makecache --timer. [ OK ] Started Daily Cleanup of Temporary Directories. [ OK ] Started daily update of the root trust anchor for DNSSEC. [ OK ] Reached target Timers. [ OK ] Listening on D-Bus System Message Bus Socket. [ OK ] Reached target Sockets. [ OK ] Reached target Basic System. Starting Restore /run/initramfs on shutdown... [ OK ] Started Hardware RNG Entropy Gatherer Daemon. [ OK ] Started irqbalance daemon. Starting Login Service... [ OK ] Reached target sshd-keygen.target. [ OK ] Started D-Bus System Message Bus. Starting Network Manager... [ OK ] Started Restore /run/initramfs on shutdown. [ OK ] Started Network Manager. [ OK ] Reached target Network. Starting GSSAPI Proxy Daemon... Starting OpenSSH server daemon... Starting Dynamic System Tuning Daemon... Starting Network Manager Wait Online... [ OK ] Started Login Service. Starting Hostname Service... [ OK ] Started GSSAPI Proxy Daemon. [ OK ] Reached target NFS client services. [ OK ] Reached target Remote File Systems (Pre). [ OK ] Reached target Remote File Systems. Starting Permit User Sessions... [ OK ] Started OpenSSH server daemon. [ OK ] Started Permit User Sessions. [ OK ] Started Serial Getty on ttyS0. [ OK ] Started Serial Getty on ttyS1. [ OK ] Started Getty on tty1. [ OK ] Reached target Login Prompts. [ OK ] Started Command Scheduler. [ OK ] Started Hostname Service. Starting Network Manager Script Dispatcher Service... [ OK ] Started Network Manager Script Dispatcher Service. [ OK ] Started Network Manager Wait Online. [ OK ] Reached target Network is Online. Starting Crash recovery kernel arming... Starting Notify NFS peers of a restart... Starting System Logging Service... [ OK ] Started Notify NFS peers of a restart. [ OK ] Started System Logging Service. Rocky Linux 8.10 (Green Obsidian) Kernel 4.18.0rh8.10-debug on an x86_64 oleg334-client login: [ 103.220232] libcfs: loading out-of-tree module taints kernel. [ 103.303785] Key type ._llcrypt registered [ 103.305644] Key type .llcrypt registered [ 104.161509] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [ 104.170745] alg: No test for adler32 (adler32-zlib) [ 105.615910] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 106.510758] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 108.295171] Key type lgssc registered [ 110.053628] Lustre: Echo OBD driver; http://www.lustre.org/ [ 297.685830] Lustre: Mounted lustre-client [ 302.795581] Lustre: DEBUG MARKER: Using TIMEOUT=20 [ 318.767424] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing check_logdir /tmp/testlogs/ [ 323.557818] Lustre: lustre-OST0000-osc-ffff90fd050d4000: disconnect after 24s idle [ 324.381644] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing yml_node [ 328.786583] Lustre: DEBUG MARKER: Client: 2.17.51.2 [ 331.274258] Lustre: DEBUG MARKER: MDS: 2.17.51.2 [ 334.325925] Lustre: DEBUG MARKER: OSS: 2.17.51.2 [ 335.849230] Lustre: DEBUG MARKER: -----============= acceptance-small: conf-sanity ============----- Sun Mar 15 16:36:47 EDT 2026 [ 356.456731] Lustre: DEBUG MARKER: excepting tests: 55 63 67 32newtarball [ 358.123870] Lustre: DEBUG MARKER: skipping tests SLOW=no: 45 69 106 111 114 [ 361.424613] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 371.876343] Lustre: Unmounted lustre-client [ 504.399768] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 510.604159] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 536.775921] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 578.775516] Lustre: DEBUG MARKER: == conf-sanity test 33a: Mount ost with a large index number ========================================================== 16:40:49 (1773607249) [ 581.164302] Lustre: DEBUG MARKER: SKIP: conf-sanity test_33a mixed loopback and real device not working [ 582.971842] Lustre: DEBUG MARKER: == conf-sanity test 33b: Drop cancel during umount ======= 16:40:54 (1773607254) [ 619.464575] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 623.704238] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 645.294559] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 645.893878] Lustre: Mounted lustre-client [ 653.174668] LustreError: 14445:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd18165800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 653.318475] Lustre: Unmounted lustre-client [ 683.197624] Key type lgssc unregistered [ 683.557849] LNet: 14854:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 683.579551] LNetError: 14854:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 683.609147] LNet: Removed LNI 192.168.203.34@tcp [ 684.632423] Key type .llcrypt unregistered [ 684.634112] Key type ._llcrypt unregistered [ 701.978939] Key type ._llcrypt registered [ 701.982849] Key type .llcrypt registered [ 703.671383] Lustre: DEBUG MARKER: == conf-sanity test 33c: Mount ost with a large index number ========================================================== 16:42:54 (1773607374) [ 705.296607] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 705.318551] alg: No test for adler32 (adler32-zlib) [ 706.443186] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 706.792805] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 708.479218] Key type lgssc registered [ 709.872223] Lustre: Echo OBD driver; http://www.lustre.org/ [ 793.270263] Lustre: Mounted lustre-client [ 882.922920] LustreError: 18177:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd10d9f800: lov tgt 1990 not cleaned! deathrow=0, lovrc=1 [ 883.001107] Lustre: Unmounted lustre-client [ 908.628325] Key type lgssc unregistered [ 908.969205] LNet: 18640:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 908.974226] LNetError: 18640:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 908.996302] LNet: Removed LNI 192.168.203.34@tcp [ 909.927617] Key type .llcrypt unregistered [ 909.929144] Key type ._llcrypt unregistered [ 923.880984] Key type ._llcrypt registered [ 923.887577] Key type .llcrypt registered [ 926.005251] Lustre: DEBUG MARKER: == conf-sanity test 33d: Don't panic when enable project quota ========================================================== 16:46:36 (1773607596) [ 928.591597] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 928.688850] alg: No test for adler32 (adler32-zlib) [ 929.710919] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 929.962591] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 931.623226] Key type lgssc registered [ 932.931128] Lustre: Echo OBD driver; http://www.lustre.org/ [ 986.277642] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 989.460977] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 1007.726793] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 1009.605297] Lustre: Mounted lustre-client [ 1019.762061] LustreError: 21757:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd04050000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 1019.852209] Lustre: Unmounted lustre-client [ 1049.686905] Key type lgssc unregistered [ 1050.029781] LNet: 22160:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 1050.046351] LNetError: 22160:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 1050.087682] LNet: Removed LNI 192.168.203.34@tcp [ 1050.975911] Key type .llcrypt unregistered [ 1050.982311] Key type ._llcrypt unregistered [ 1067.161266] Key type ._llcrypt registered [ 1067.163505] Key type .llcrypt registered [ 1069.265792] Lustre: DEBUG MARKER: == conf-sanity test 34a: umount with opened file should be fail ========================================================== 16:48:59 (1773607739) [ 1073.041705] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 1073.263400] alg: No test for adler32 (adler32-zlib) [ 1074.523118] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 1074.991722] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 1076.792053] Key type lgssc registered [ 1078.254913] Lustre: Echo OBD driver; http://www.lustre.org/ [ 1130.883933] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 1135.462341] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 1158.200573] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 1161.054815] Lustre: Mounted lustre-client [ 1168.167932] LustreError: 24868:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd110bd800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 1168.230153] Lustre: Unmounted lustre-client [ 1198.459196] Key type lgssc unregistered [ 1198.813898] LNet: 25271:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 1198.817397] LNetError: 25271:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 1198.839110] LNet: Removed LNI 192.168.203.34@tcp [ 1199.558517] Key type .llcrypt unregistered [ 1199.568984] Key type ._llcrypt unregistered [ 1218.321787] Key type ._llcrypt registered [ 1218.327715] Key type .llcrypt registered [ 1219.905195] Lustre: DEBUG MARKER: == conf-sanity test 34b: force umount with failed mds should be normal ========================================================== 16:51:30 (1773607890) [ 1222.480443] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 1222.519041] alg: No test for adler32 (adler32-zlib) [ 1223.588230] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 1223.730439] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 1225.383258] Key type lgssc registered [ 1227.008879] Lustre: Echo OBD driver; http://www.lustre.org/ [ 1282.396967] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 1286.932789] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 1306.403112] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 1309.144362] Lustre: Mounted lustre-client [ 1324.524575] Lustre: lustre-MDT0000-mdc-ffff90fd100d2000: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 1334.763901] Lustre: lustre-MDT0001-mdc-ffff90fd100d2000: Connection to lustre-MDT0001 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 1341.413852] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 1346.017192] Lustre: 26230:0:(client.c:2478:ptlrpc_expire_one_request()) @@@ Request sent has timed out for slow reply: [sent 1773608002/real 1773608002] req@000000008a34a243 x1859762673163008/t0(0) o400->MGC192.168.203.134@tcp@192.168.203.134@tcp:26/25 lens 224/224 e 0 to 1 dl 1773608018 ref 1 fl Rpc:XNQr/200/ffffffff rc 0/-1 job:'' uid:0 gid:0 projid:4294967295 [ 1346.050481] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [ 1351.791825] Lustre: Unmounted lustre-client [ 1364.930446] Key type lgssc unregistered [ 1365.136456] LNet: 28847:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 1365.146829] LNetError: 28847:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 1365.177149] LNet: Removed LNI 192.168.203.34@tcp [ 1365.904837] Key type .llcrypt unregistered [ 1365.907202] Key type ._llcrypt unregistered [ 1381.179113] Key type ._llcrypt registered [ 1381.185060] Key type .llcrypt registered [ 1382.553508] Lustre: DEBUG MARKER: == conf-sanity test 34c: force umount with failed ost should be normal ========================================================== 16:54:13 (1773608053) [ 1384.595484] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 1384.695580] alg: No test for adler32 (adler32-zlib) [ 1385.705242] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 1385.873125] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 1387.560051] Key type lgssc registered [ 1388.773555] Lustre: Echo OBD driver; http://www.lustre.org/ [ 1433.263863] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 1436.960529] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 1459.234484] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 1461.856202] Lustre: Mounted lustre-client [ 1466.867320] Lustre: lustre-OST0000-osc-ffff90fd11135800: Connection to lustre-OST0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 1474.117872] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 1484.485164] Lustre: Unmounted lustre-client [ 1512.040370] Key type lgssc unregistered [ 1512.305849] LNet: 32379:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 1512.321194] LNetError: 32379:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 1512.336127] LNet: Removed LNI 192.168.203.34@tcp [ 1512.798843] Key type .llcrypt unregistered [ 1512.801718] Key type ._llcrypt unregistered [ 1528.311231] Key type ._llcrypt registered [ 1528.314748] Key type .llcrypt registered [ 1530.288296] Lustre: DEBUG MARKER: == conf-sanity test 35a: Reconnect to the last active server first ========================================================== 16:56:40 (1773608200) [ 1533.202912] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 1533.335892] alg: No test for adler32 (adler32-zlib) [ 1534.441299] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 1534.626831] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 1536.335218] Key type lgssc registered [ 1537.780689] Lustre: Echo OBD driver; http://www.lustre.org/ [ 1589.948264] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 1595.341580] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 1614.351484] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 1617.016224] Lustre: Mounted lustre-client [ 1620.576544] Lustre: DEBUG MARKER: Set up a fake failnode for the MDS [ 1624.003436] Lustre: DEBUG MARKER: Wait for RECONNECT_INTERVAL seconds (10s) [ 1635.803795] Lustre: DEBUG MARKER: conf-sanity.sh test_35a 2026-03-1516h58m26s [ 1638.358690] Lustre: DEBUG MARKER: Stopping the MDT: lustre-MDT0000 [ 1643.006846] Lustre: lustre-MDT0000-mdc-ffff90fd07f0c000: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 1649.171584] LustreError: 36099:0:(lmv_obd.c:1434:lmv_statfs()) lustre-MDT0000-mdc-ffff90fd07f0c000: can't stat MDS #0: rc = -19 [ 1650.578387] Lustre: DEBUG MARKER: Restarting the MDT: lustre-MDT0000 [ 1659.370856] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [ 1659.387500] Lustre: Evicted from MGS (at 192.168.203.134@tcp) after server handle changed from 0x7e8cf2b891431af to 0x7e8cf2b8914346b [ 1659.397364] Lustre: MGC192.168.203.134@tcp: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 1660.464532] LustreError: lustre-MDT0000-mdc-ffff90fd07f0c000: This client was evicted by lustre-MDT0000; in progress operations using this service will fail. [ 1660.488577] Lustre: lustre-MDT0000-mdc-ffff90fd07f0c000: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 1664.997434] Lustre: DEBUG MARKER: Wait for df (36099) ... [ 1666.667160] Lustre: DEBUG MARKER: done [ 1668.942454] LustreError: 36716:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07f0c000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 1669.026213] Lustre: Unmounted lustre-client [ 1695.291633] Key type lgssc unregistered [ 1695.485492] LNet: 37120:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 1695.498721] LNetError: 37120:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 1695.511989] LNet: Removed LNI 192.168.203.34@tcp [ 1696.047357] Key type .llcrypt unregistered [ 1696.049635] Key type ._llcrypt unregistered [ 1725.092155] Key type ._llcrypt registered [ 1725.098299] Key type .llcrypt registered [ 1726.271670] Lustre: DEBUG MARKER: == conf-sanity test 35b: Continue reconnection retries, if the active server is busy ========================================================== 16:59:57 (1773608397) [ 1728.216806] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 1728.265369] alg: No test for adler32 (adler32-zlib) [ 1729.309822] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 1729.465252] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 1731.127147] Key type lgssc registered [ 1732.193373] Lustre: Echo OBD driver; http://www.lustre.org/ [ 1779.971786] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 1783.455441] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 1803.698218] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 1805.431953] Lustre: Mounted lustre-client [ 1810.342083] Lustre: DEBUG MARKER: conf-sanity.sh test_35b 2026-03-1517h01m21s [ 1812.023182] Lustre: DEBUG MARKER: Set up a fake failnode for the MDS [ 1818.942891] Lustre: DEBUG MARKER: Injecting EBUSY on MDS [ 1821.193434] Lustre: DEBUG MARKER: Creating a test file and stat it [ 1841.631441] Lustre: 41190:0:(client.c:2478:ptlrpc_expire_one_request()) @@@ Request sent has timed out for slow reply: [sent 1773608493/real 1773608493] req@000000001a4b62aa x1859763203742336/t0(0) o101->lustre-MDT0000-mdc-ffff90fd06335000@192.168.203.134@tcp:12/10 lens 576/1152 e 0 to 1 dl 1773608513 ref 2 fl Rpc:XQr/600/ffffffff rc 0/-1 job:'' uid:0 gid:0 projid:1 [ 1841.674199] Lustre: lustre-MDT0000-mdc-ffff90fd06335000: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 1841.722769] Lustre: lustre-MDT0000-mdc-ffff90fd06335000: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 1862.882431] Lustre: DEBUG MARKER: Stop injecting EBUSY on MDS [ 1866.068986] Lustre: DEBUG MARKER: done [ 1870.764310] LustreError: 41673:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06335000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 1870.884699] Lustre: Unmounted lustre-client [ 1899.033410] Key type lgssc unregistered [ 1899.418427] LNet: 42076:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 1899.433808] LNetError: 42076:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 1899.460502] LNet: Removed LNI 192.168.203.34@tcp [ 1900.139517] Key type .llcrypt unregistered [ 1900.141127] Key type ._llcrypt unregistered [ 1937.243375] Key type ._llcrypt registered [ 1937.246711] Key type .llcrypt registered [ 1938.740899] Lustre: DEBUG MARKER: == conf-sanity test 36: df report consistency on OSTs with different block size ========================================================== 17:03:29 (1773608609) [ 1940.214942] Lustre: DEBUG MARKER: SKIP: conf-sanity test_36 remote OST [ 1942.164209] Lustre: DEBUG MARKER: == conf-sanity test 37: verify set tunables works for symlink device ========================================================== 17:03:33 (1773608613) [ 1946.743562] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 1946.767645] alg: No test for adler32 (adler32-zlib) [ 1947.919546] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 1948.247786] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 1950.047180] Key type lgssc registered [ 1951.266322] Lustre: Echo OBD driver; http://www.lustre.org/ [ 1977.722820] Lustre: DEBUG MARKER: == conf-sanity test 38: MDS recreates missing lov_objid file from OST data ========================================================== 17:04:09 (1773608649) [ 2010.590402] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 2015.775352] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 2033.131390] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 2035.984847] Lustre: Mounted lustre-client [ 2039.470331] Lustre: DEBUG MARKER: copying 10 files to /mnt/lustre/d38.conf-sanity [ 2042.925978] LustreError: 46423:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09160800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 2043.016113] Lustre: Unmounted lustre-client [ 2059.491174] Lustre: DEBUG MARKER: delete lov_objid file on MDS [ 2106.321092] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 2111.325675] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 2112.010623] Lustre: Mounted lustre-client [ 2117.219677] LustreError: 47681:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06ba8800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 2117.363041] Lustre: Unmounted lustre-client [ 2179.153610] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 2182.962811] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 2183.746358] Lustre: Mounted lustre-client [ 2187.599733] LustreError: 48801:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07f09800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 2187.724325] Lustre: Unmounted lustre-client [ 2210.560803] Lustre: DEBUG MARKER: files compared the same [ 2232.797092] Key type lgssc unregistered [ 2233.059050] LNet: 49507:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 2233.067391] LNetError: 49507:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 2234.096168] LNet: Removed LNI 192.168.203.34@tcp [ 2234.863700] Key type .llcrypt unregistered [ 2234.865877] Key type ._llcrypt unregistered [ 2249.187449] Key type ._llcrypt registered [ 2249.190269] Key type .llcrypt registered [ 2250.764413] Lustre: DEBUG MARKER: == conf-sanity test 39: leak_finder recognizes both LUSTRE and LNET malloc messages ========================================================== 17:08:41 (1773608921) [ 2253.610915] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 2253.645490] alg: No test for adler32 (adler32-zlib) [ 2254.702837] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 2254.862095] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 2256.535141] Key type lgssc registered [ 2258.232565] Lustre: Echo OBD driver; http://www.lustre.org/ [ 2307.706242] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 2311.320675] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 2329.153522] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 2331.921236] Lustre: Mounted lustre-client [ 2335.672653] LustreError: 52604:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd18161000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 2335.786609] Lustre: Unmounted lustre-client [ 2371.680615] Key type lgssc unregistered [ 2371.897752] LNet: 53008:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 2371.902334] LNetError: 53008:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 2371.926270] LNet: Removed LNI 192.168.203.34@tcp [ 2372.692568] Key type .llcrypt unregistered [ 2372.696688] Key type ._llcrypt unregistered [ 2388.582329] Key type ._llcrypt registered [ 2388.584271] Key type .llcrypt registered [ 2390.005561] Lustre: DEBUG MARKER: == conf-sanity test 40: race during service thread startup ========================================================== 17:11:01 (1773609061) [ 2392.252330] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 2392.387253] alg: No test for adler32 (adler32-zlib) [ 2393.394306] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 2393.616601] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 2395.248345] Key type lgssc registered [ 2396.439789] Lustre: Echo OBD driver; http://www.lustre.org/ [ 2473.667861] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 2503.112710] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 2507.068968] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 2541.950548] Key type lgssc unregistered [ 2542.188633] LNet: 56406:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 2542.191924] LNetError: 56406:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 2542.205951] LNet: Removed LNI 192.168.203.34@tcp [ 2542.718556] Key type .llcrypt unregistered [ 2542.719783] Key type ._llcrypt unregistered [ 2555.802582] Key type ._llcrypt registered [ 2555.805430] Key type .llcrypt registered [ 2557.206284] Lustre: DEBUG MARKER: == conf-sanity test 41a: mount mds with --nosvc and --nomgs ========================================================== 17:13:48 (1773609228) [ 2560.605792] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 2560.706731] alg: No test for adler32 (adler32-zlib) [ 2561.733672] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 2561.957806] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 2563.647174] Key type lgssc registered [ 2564.826344] Lustre: Echo OBD driver; http://www.lustre.org/ [ 2640.382443] Lustre: Mounted lustre-client [ 2647.861217] LustreError: 58902:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09163000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 2647.961149] Lustre: Unmounted lustre-client [ 2685.839648] Lustre: DEBUG MARKER: == conf-sanity test 41b: mount mds with --nosvc and --nomgs on first mount ========================================================== 17:15:56 (1773609356) [ 2812.892777] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 2832.960756] Lustre: Mounted lustre-client [ 2840.379036] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 2840.384486] LustreError: 62866:0:(file.c:249:ll_close_inode_openhandle()) lustre-clilmv-ffff90fd100d5800: inode [0x200000402:0x1:0x0] mdc close failed: rc = -108 [ 2840.407688] Lustre: 57389:0:(llite_lib.c:4158:ll_dirty_page_discard_warn()) lustre: dirty page discard: 192.168.203.134@tcp:/lustre/fid: [0x200000402:0x1:0x0]/ may get corrupted (rc -108) [ 2850.731772] Lustre: Unmounted lustre-client [ 2903.217224] Lustre: DEBUG MARKER: == conf-sanity test 41c: concurrent mounts of MDT/OST should all fail but one ========================================================== 17:19:34 (1773609574) [ 2915.421698] Key type lgssc unregistered [ 2915.658631] LNet: 64078:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 2915.663841] LNetError: 64078:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 2915.683907] LNet: Removed LNI 192.168.203.34@tcp [ 2916.314975] Key type .llcrypt unregistered [ 2916.320656] Key type ._llcrypt unregistered [ 2929.226567] Key type ._llcrypt registered [ 2929.231712] Key type .llcrypt registered [ 2929.787546] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [ 2929.799759] alg: No test for adler32 (adler32-zlib) [ 2930.842989] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 2931.045439] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 2932.711171] Key type lgssc registered [ 2934.222402] Lustre: Echo OBD driver; http://www.lustre.org/ [ 2989.723679] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 2994.224571] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 3014.141060] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 3015.813787] Lustre: Mounted lustre-client [ 3023.605390] LustreError: 66606:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd10d9f000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3023.707317] Lustre: Unmounted lustre-client [ 3054.006278] Key type lgssc unregistered [ 3054.222307] LNet: 67009:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 3054.228833] LNetError: 67009:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 3054.241878] LNet: Removed LNI 192.168.203.34@tcp [ 3055.117187] Key type .llcrypt unregistered [ 3055.123736] Key type ._llcrypt unregistered [ 3066.357908] Key type ._llcrypt registered [ 3066.363646] Key type .llcrypt registered [ 3066.711201] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [ 3066.742602] alg: No test for adler32 (adler32-zlib) [ 3067.984803] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 3068.365303] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 3070.193794] Key type lgssc registered [ 3071.516543] Lustre: Echo OBD driver; http://www.lustre.org/ [ 3180.075341] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 3184.296984] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 3203.023434] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 3204.725534] Lustre: Mounted lustre-client [ 3207.441759] LustreError: 69955:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd100d3800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3207.576662] Lustre: Unmounted lustre-client [ 3244.624086] Key type lgssc unregistered [ 3244.991475] LNet: 70370:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 3245.000189] LNetError: 70370:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 3245.020309] LNet: Removed LNI 192.168.203.34@tcp [ 3245.759437] Key type .llcrypt unregistered [ 3245.765186] Key type ._llcrypt unregistered [ 3261.585584] Key type ._llcrypt registered [ 3261.589865] Key type .llcrypt registered [ 3262.852418] Lustre: DEBUG MARKER: == conf-sanity test 42: allow client/server mount/unmount with invalid config param ========================================================== 17:25:34 (1773609934) [ 3265.421537] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 3265.581473] alg: No test for adler32 (adler32-zlib) [ 3266.725717] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 3266.964335] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 3268.671189] Key type lgssc registered [ 3269.963497] Lustre: Echo OBD driver; http://www.lustre.org/ [ 3325.263702] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 3330.101382] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 3351.583560] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 3353.652771] Lustre: Mounted lustre-client [ 3360.309634] LustreError: 73501:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07242000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3360.415715] Lustre: Unmounted lustre-client [ 3360.914818] Lustre: Mounted lustre-client [ 3364.514183] LustreError: 73580:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd100d5000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3364.621827] Lustre: Unmounted lustre-client [ 3400.743965] Key type lgssc unregistered [ 3400.968419] LNet: 73985:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 3400.982843] LNetError: 73985:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 3401.000875] LNet: Removed LNI 192.168.203.34@tcp [ 3401.638957] Key type .llcrypt unregistered [ 3401.640922] Key type ._llcrypt unregistered [ 3414.462234] Key type ._llcrypt registered [ 3414.468103] Key type .llcrypt registered [ 3414.975221] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [ 3414.989525] alg: No test for adler32 (adler32-zlib) [ 3416.067299] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 3416.408475] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 3418.207300] Key type lgssc registered [ 3419.633547] Lustre: Echo OBD driver; http://www.lustre.org/ [ 3471.274273] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 3476.011562] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 3497.084700] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 3499.100735] Lustre: Mounted lustre-client [ 3503.988135] LustreError: 76533:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd110bf000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3504.103482] Lustre: Unmounted lustre-client [ 3533.597707] Key type lgssc unregistered [ 3533.814860] LNet: 76937:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 3533.821616] LNetError: 76937:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 3533.842326] LNet: Removed LNI 192.168.203.34@tcp [ 3534.626630] Key type .llcrypt unregistered [ 3534.630151] Key type ._llcrypt unregistered [ 3552.189310] Key type ._llcrypt registered [ 3552.195828] Key type .llcrypt registered [ 3554.019447] Lustre: DEBUG MARKER: == conf-sanity test 43a: check root_squash and nosquash_nids ========================================================== 17:30:24 (1773610224) [ 3557.218916] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 3557.271994] alg: No test for adler32 (adler32-zlib) [ 3558.591038] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 3559.008559] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 3560.832393] Key type lgssc registered [ 3562.679860] Lustre: Echo OBD driver; http://www.lustre.org/ [ 3616.617195] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 3621.103082] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 3643.439387] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 3645.327593] Lustre: Mounted lustre-client [ 3659.813986] Lustre: lustre: nosquash_nids is cleared [ 3659.841930] Lustre: lustre: root_squash is set to 500:500 [ 3681.814303] Lustre: lustre: nosquash_nids set to 2@gni 0@lo 192.168.203.34@tcp 192.168.0.[2,10]@tcp [ 3688.422366] Lustre: lustre: nosquash_nids set to 192.168.203.34/24@tcp [ 3697.660075] LustreError: 80454:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd110ba800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3697.768088] Lustre: Unmounted lustre-client [ 3731.828453] Key type lgssc unregistered [ 3732.354225] LNet: 80858:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 3732.380575] LNetError: 80858:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 3732.404370] LNet: Removed LNI 192.168.203.34@tcp [ 3733.068420] Key type .llcrypt unregistered [ 3733.071782] Key type ._llcrypt unregistered [ 3750.121309] Key type ._llcrypt registered [ 3750.124461] Key type .llcrypt registered [ 3751.271848] Lustre: DEBUG MARKER: == conf-sanity test 43b: parse nosquash_nids with commas in expr_list ========================================================== 17:33:42 (1773610422) [ 3753.475877] Lustre: DEBUG MARKER: SKIP: conf-sanity test_43b mixed loopback and real device not working [ 3755.351437] Lustre: DEBUG MARKER: == conf-sanity test 44: mounted client proc entry exists ========================================================== 17:33:46 (1773610426) [ 3757.944708] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 3757.991697] alg: No test for adler32 (adler32-zlib) [ 3759.139653] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 3759.367205] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 3761.063223] Key type lgssc registered [ 3762.397762] Lustre: Echo OBD driver; http://www.lustre.org/ [ 3811.762519] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 3815.253430] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 3833.837423] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 3834.522402] Lustre: lustre: root_squash is set to 500:500 [ 3834.549408] Lustre: lustre: nosquash_nids set to 192.168.203.34/24@tcp [ 3835.553240] Lustre: Mounted lustre-client [ 3841.014836] LustreError: 84331:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07f71800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 3841.155188] Lustre: Unmounted lustre-client [ 3876.769343] Key type lgssc unregistered [ 3877.036456] LNet: 84735:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 3877.044027] LNetError: 84735:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 3877.065026] LNet: Removed LNI 192.168.203.34@tcp [ 3877.757824] Key type .llcrypt unregistered [ 3877.763266] Key type ._llcrypt unregistered [ 3894.849716] Key type ._llcrypt registered [ 3894.851061] Key type .llcrypt registered [ 3896.093069] Lustre: DEBUG MARKER: SKIP: conf-sanity test_45 skipping SLOW test 45 [ 3897.707941] Lustre: DEBUG MARKER: == conf-sanity test 46a: handle ost additional - wide striped file ========================================================== 17:36:08 (1773610568) [ 3917.031691] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 3917.213704] alg: No test for adler32 (adler32-zlib) [ 3918.635604] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 3918.849690] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 3920.563251] Key type lgssc registered [ 3921.617372] Lustre: Echo OBD driver; http://www.lustre.org/ [ 4002.053743] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 4005.732979] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 4030.326529] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 4097.064643] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 4100.672216] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 4120.408821] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 4135.104594] Lustre: Mounted lustre-client [ 4165.289193] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state (FULL|IDLE) osc.lustre-OST0001-osc-ffff90fd06335800.ost_server_uuid 50 [ 4166.788677] Lustre: DEBUG MARKER: osc.lustre-OST0001-osc-ffff90fd06335800.ost_server_uuid in FULL state after 0 sec [ 4167.516662] Lustre: Mounted lustre-client [ 4170.717693] LustreError: 91649:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09161000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 4170.887539] Lustre: Unmounted lustre-client [ 4172.651996] LustreError: 91668:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06335800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 4172.660397] LustreError: 91668:0:(lov_obd.c:783:lov_cleanup()) Skipped 1 previous similar message [ 4172.763186] Lustre: Unmounted lustre-client [ 4221.864083] Key type lgssc unregistered [ 4222.083318] LNet: 92224:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 4222.093606] LNetError: 92224:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 4222.106830] LNet: Removed LNI 192.168.203.34@tcp [ 4222.688360] Key type .llcrypt unregistered [ 4222.690244] Key type ._llcrypt unregistered [ 4253.347184] Key type ._llcrypt registered [ 4253.351370] Key type .llcrypt registered [ 4254.774460] Lustre: DEBUG MARKER: == conf-sanity test 47a: server restart does not lose lru_resize ========================================================== 17:42:05 (1773610925) [ 4275.741871] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 4275.780610] alg: No test for adler32 (adler32-zlib) [ 4276.897118] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 4277.089030] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 4278.775198] Key type lgssc registered [ 4280.178392] Lustre: Echo OBD driver; http://www.lustre.org/ [ 4359.318568] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 4363.874295] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 4388.650074] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 4391.489298] Lustre: Mounted lustre-client [ 4396.607369] Lustre: lustre-OST0000-osc-ffff90fd06bae800: Connection to lustre-OST0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 4432.366145] Lustre: lustre-MDT0000-mdc-ffff90fd06bae800: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 4447.711425] Lustre: 93592:0:(client.c:2478:ptlrpc_expire_one_request()) @@@ Request sent has timed out for slow reply: [sent 1773611104/real 1773611104] req@00000000b8908481 x1859765874467200/t0(0) o400->MGC192.168.203.134@tcp@192.168.203.134@tcp:26/25 lens 224/224 e 0 to 1 dl 1773611120 ref 1 fl Rpc:XNQr/200/ffffffff rc 0/-1 job:'' uid:0 gid:0 projid:4294967295 [ 4447.741267] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [ 4455.425107] Lustre: lustre-OST0000-osc-ffff90fd06bae800: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 4457.445940] Lustre: Evicted from MGS (at 192.168.203.134@tcp) after server handle changed from 0x73854e6252da231a to 0x73854e6252da25a5 [ 4457.466769] Lustre: MGC192.168.203.134@tcp: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 4460.774205] Lustre: lustre-MDT0000-mdc-ffff90fd06bae800: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 4469.022974] LustreError: 97422:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06bae800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 4469.132754] Lustre: Unmounted lustre-client [ 4507.366599] Key type lgssc unregistered [ 4507.596165] LNet: 97827:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 4507.606356] LNetError: 97827:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 4507.635254] LNet: Removed LNI 192.168.203.34@tcp [ 4508.429400] Key type .llcrypt unregistered [ 4508.435105] Key type ._llcrypt unregistered [ 4524.933289] Key type ._llcrypt registered [ 4524.935764] Key type .llcrypt registered [ 4526.202883] Lustre: DEBUG MARKER: == conf-sanity test 47b: client restart does not lose lru_resize ========================================================== 17:46:37 (1773611197) [ 4541.187789] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 4541.235035] alg: No test for adler32 (adler32-zlib) [ 4542.481750] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 4542.769704] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 4544.415224] Key type lgssc registered [ 4545.649480] Lustre: Echo OBD driver; http://www.lustre.org/ [ 4584.850884] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 4676.860180] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 4680.898985] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 4703.752562] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 4706.783165] Lustre: Mounted lustre-client [ 4709.091617] Lustre: DEBUG MARKER: SKIP: conf-sanity test_47b Can not create symlink /usr/sbin/lctl [ 4711.248770] Lustre: DEBUG MARKER: == conf-sanity test 48: too many acls on file ============ 17:49:42 (1773611382) [ 4911.396401] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 4921.795304] Lustre: Unmounted lustre-client [ 5050.537291] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5055.946241] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5081.939599] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5123.373592] Lustre: DEBUG MARKER: == conf-sanity test 49a: check PARAM_SYS_LDLM_TIMEOUT option of mkfs.lustre ========================================================== 17:56:34 (1773611794) [ 5209.385413] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5212.851914] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5233.072695] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5233.685355] Lustre: Mounted lustre-client [ 5237.972701] LustreError: 116038:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07f75800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 5238.130115] Lustre: Unmounted lustre-client [ 5278.252716] Lustre: DEBUG MARKER: == conf-sanity test 49b: check PARAM_SYS_LDLM_TIMEOUT option of mkfs.lustre ========================================================== 17:59:09 (1773611949) [ 5371.840979] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5375.197977] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5396.192525] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5396.570516] Lustre: Mounted lustre-client [ 5400.568952] LustreError: 120106:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd10d99000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 5400.679562] Lustre: Unmounted lustre-client [ 5426.758799] Key type lgssc unregistered [ 5426.999919] LNet: 120512:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 5427.011569] LNetError: 120512:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 5427.033666] LNet: Removed LNI 192.168.203.34@tcp [ 5427.706142] Key type .llcrypt unregistered [ 5427.708572] Key type ._llcrypt unregistered [ 5442.329593] Key type ._llcrypt registered [ 5442.331215] Key type .llcrypt registered [ 5443.772371] Lustre: DEBUG MARKER: == conf-sanity test 50a: lazystatfs all servers available ========================================================== 18:01:54 (1773612114) [ 5446.294642] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 5446.341841] alg: No test for adler32 (adler32-zlib) [ 5447.394614] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 5447.704250] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 5449.344449] Key type lgssc registered [ 5451.280817] Lustre: Echo OBD driver; http://www.lustre.org/ [ 5497.095618] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5504.235571] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5529.244966] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5531.219525] Lustre: Mounted lustre-client [ 5547.971826] LustreError: 123627:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd110bb800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 5548.079508] Lustre: Unmounted lustre-client [ 5575.660534] Key type lgssc unregistered [ 5575.859833] LNet: 124030:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 5575.864158] LNetError: 124030:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 5576.948538] LNet: Removed LNI 192.168.203.34@tcp [ 5577.711647] Key type .llcrypt unregistered [ 5577.716305] Key type ._llcrypt unregistered [ 5591.742683] Key type ._llcrypt registered [ 5591.744666] Key type .llcrypt registered [ 5593.024918] Lustre: DEBUG MARKER: == conf-sanity test 50b: lazystatfs all servers down ===== 18:04:24 (1773612264) [ 5595.292597] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 5595.331773] alg: No test for adler32 (adler32-zlib) [ 5596.300360] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 5596.532641] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 5598.191160] Key type lgssc registered [ 5599.444484] Lustre: Echo OBD driver; http://www.lustre.org/ [ 5647.283616] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5651.376636] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5670.525810] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5673.244521] Lustre: Mounted lustre-client [ 5678.590544] Lustre: lustre-OST0000-osc-ffff90fd07a5b000: Connection to lustre-OST0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 5689.428439] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state DISCONN osc.lustre-OST0000-osc-ffff90fd07a5b000.ost_server_uuid 50 [ 5691.249514] Lustre: DEBUG MARKER: OSCs should all be DISCONN [ 5702.789375] LustreError: 127577:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07a5b000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 5702.878626] Lustre: Unmounted lustre-client [ 5724.034443] Lustre: DEBUG MARKER: == conf-sanity test 50c: lazystatfs one server down ====== 18:06:35 (1773612395) [ 5752.092592] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5755.285695] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5772.169435] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5791.824860] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 5792.441558] Lustre: Mounted lustre-client [ 5797.873346] Lustre: lustre-OST0000-osc-ffff90fd181a1800: Connection to lustre-OST0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 5823.077206] LustreError: 130240:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd181a1800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 5823.177644] Lustre: Unmounted lustre-client [ 5871.008780] Lustre: DEBUG MARKER: == conf-sanity test 50d: lazystatfs client/server conn race ========================================================== 18:09:02 (1773612542) [ 5901.340552] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 5905.494762] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 5925.237903] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 5943.461905] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 5944.078977] Lustre: Mounted lustre-client [ 5949.421054] Lustre: lustre-OST0000-osc-ffff90fd106c6800: Connection to lustre-OST0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 5965.153510] LustreError: 133007:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd106c6800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 5965.168600] LustreError: 133007:0:(lov_obd.c:783:lov_cleanup()) Skipped 1 previous similar message [ 5965.309870] Lustre: Unmounted lustre-client [ 6010.191986] Lustre: DEBUG MARKER: == conf-sanity test 50e: normal statfs all servers down == 18:11:21 (1773612681) [ 6095.951685] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 6099.332672] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6119.931761] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6182.149904] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 6185.236533] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6202.967781] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6230.510534] Lustre: Mounted lustre-client [ 6269.236421] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6277.425503] Lustre: DEBUG MARKER: osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid in FULL state after 6 sec [ 6279.346359] LustreError: 139660:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09160000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 6279.355616] LustreError: 139660:0:(lov_obd.c:783:lov_cleanup()) Skipped 1 previous similar message [ 6279.420696] Lustre: Unmounted lustre-client [ 6307.712590] Lustre: DEBUG MARKER: == conf-sanity test 50f: normal statfs one server in down ========================================================== 18:16:19 (1773612979) [ 6332.799406] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 6335.764093] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6352.183886] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6382.420308] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 6407.104973] Lustre: Mounted lustre-client [ 6442.729660] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 6444.220935] Lustre: DEBUG MARKER: osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid in FULL state after 0 sec [ 6448.112213] Lustre: lustre-OST0001-osc-ffff90fd20692000: Connection to lustre-OST0001 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 6455.301446] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 6465.642276] Lustre: Unmounted lustre-client [ 6511.519847] Lustre: DEBUG MARKER: == conf-sanity test 50g: deactivated OST should not cause panic ========================================================== 18:19:43 (1773613183) [ 6534.210182] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 6537.231934] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6553.127669] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6553.642649] Lustre: Mounted lustre-client [ 6570.218280] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 6571.403374] Lustre: DEBUG MARKER: osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid in FULL state after 0 sec [ 6579.531203] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state (FULL|IDLE) osc.lustre-OST0001-osc-ffff90fd11132000.ost_server_uuid 50 [ 6580.377607] Lustre: DEBUG MARKER: osc.lustre-OST0001-osc-ffff90fd11132000.ost_server_uuid in FULL state after 0 sec [ 6582.093345] LustreError: 146671:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd11132000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 6582.160784] Lustre: Unmounted lustre-client [ 6582.452829] Lustre: setting import lustre-OST0001_UUID INACTIVE by administrator request [ 6582.459546] Lustre: Skipped 3 previous similar messages [ 6582.543980] Lustre: Mounted lustre-client [ 6583.294351] LustreError: 146734:0:(sec.c:413:import_sec_validate_get()) import 0000000076b0cedc (NEW) with no sec [ 6647.384079] Lustre: DEBUG MARKER: == conf-sanity test 50h: LU-642: activate deactivated OST ========================================================== 18:21:58 (1773613318) [ 6673.524624] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 6676.465489] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6695.682342] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6722.963193] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 6723.903175] Lustre: setting import lustre-OST0000_UUID INACTIVE by administrator request [ 6724.175526] Lustre: Mounted lustre-client [ 6738.033967] LustreError: 149587:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07f73000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 6738.049955] LustreError: 149587:0:(lov_obd.c:783:lov_cleanup()) Skipped 2 previous similar messages [ 6738.201083] Lustre: Unmounted lustre-client [ 6738.203557] Lustre: Skipped 1 previous similar message [ 6785.117642] Key type lgssc unregistered [ 6785.446187] LNet: 150039:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 6785.453647] LNetError: 150039:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 6785.474837] LNet: Removed LNI 192.168.203.34@tcp [ 6786.114947] Key type .llcrypt unregistered [ 6786.122130] Key type ._llcrypt unregistered [ 6800.960791] Key type ._llcrypt registered [ 6800.962469] Key type .llcrypt registered [ 6802.124659] Lustre: DEBUG MARKER: == conf-sanity test 50i: activate deactivated MDT ======== 18:24:33 (1773613473) [ 6803.081943] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 6803.267188] alg: No test for adler32 (adler32-zlib) [ 6804.409276] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 6804.562965] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 6806.185100] Key type lgssc registered [ 6807.377156] Lustre: Echo OBD driver; http://www.lustre.org/ [ 6862.928585] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 6867.891697] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6889.247760] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 6907.321350] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 6907.773160] Lustre: setting import lustre-MDT0001_UUID INACTIVE by administrator request [ 6908.950919] Lustre: Mounted lustre-client [ 6916.639103] LustreError: lustre-MDT0001-mdc-ffff90fd05604800: This client was evicted by lustre-MDT0001; in progress operations using this service will fail. [ 6916.673212] Lustre: lustre-MDT0001-mdc-ffff90fd05604800: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 6920.159242] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 6921.995813] Lustre: DEBUG MARKER: mdc.lustre-MDT0001-mdc-*.mds_server_uuid in FULL state after 0 sec [ 6943.244908] Lustre: setting import lustre-MDT0001_UUID INACTIVE by administrator request [ 6953.019584] LustreError: 154291:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd05604800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 6953.103360] Lustre: Unmounted lustre-client [ 6985.494182] Lustre: DEBUG MARKER: == conf-sanity test 51: Verify that mdt_reint handles RMF_MDT_MD correctly when an OST is added ========================================================== 18:27:36 (1773613656) [ 7075.524700] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 7080.334692] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 7101.636965] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 7102.254158] Lustre: Mounted lustre-client [ 7129.434572] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 7131.852780] Lustre: DEBUG MARKER: osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid in FULL state after 0 sec [ 7144.702352] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [ 7155.055763] Lustre: Unmounted lustre-client [ 7189.540957] Key type lgssc unregistered [ 7189.963656] LNet: 159437:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 7189.977261] LNetError: 159437:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 7190.004921] LNet: Removed LNI 192.168.203.34@tcp [ 7190.757767] Key type .llcrypt unregistered [ 7190.764087] Key type ._llcrypt unregistered [ 7227.628625] Key type ._llcrypt registered [ 7227.631396] Key type .llcrypt registered [ 7229.156551] Lustre: DEBUG MARKER: == conf-sanity test 52: check recovering objects from lost+found ========================================================== 18:31:40 (1773613900) [ 7231.890952] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 7232.136333] alg: No test for adler32 (adler32-zlib) [ 7233.251928] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 7233.522208] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 7235.223461] Key type lgssc registered [ 7236.694193] Lustre: Echo OBD driver; http://www.lustre.org/ [ 7287.837993] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 7291.965325] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 7312.743471] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 7315.644274] Lustre: Mounted lustre-client [ 7362.837752] LustreError: 162720:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd110bb800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 7362.990478] Lustre: Unmounted lustre-client [ 7403.124582] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 7403.630908] Lustre: Mounted lustre-client [ 7440.584369] LustreError: 163374:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd058ba800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 7440.697483] Lustre: Unmounted lustre-client [ 7470.410393] Key type lgssc unregistered [ 7470.694046] LNet: 163783:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 7470.700891] LNetError: 163783:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 7470.719052] LNet: Removed LNI 192.168.203.34@tcp [ 7471.276112] Key type .llcrypt unregistered [ 7471.278963] Key type ._llcrypt unregistered [ 7485.701279] Key type ._llcrypt registered [ 7485.704045] Key type .llcrypt registered [ 7487.056521] Lustre: DEBUG MARKER: == conf-sanity test 53a: check OSS thread count params === 18:35:58 (1773614158) [ 7489.525945] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 7489.753408] alg: No test for adler32 (adler32-zlib) [ 7490.927314] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 7491.336165] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 7493.112429] Key type lgssc registered [ 7494.731879] Lustre: Echo OBD driver; http://www.lustre.org/ [ 7548.784531] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 7552.732090] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 7573.576471] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 7576.465222] Lustre: Mounted lustre-client [ 7595.321667] LustreError: 167051:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd10d9b000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 7595.422159] Lustre: Unmounted lustre-client [ 7622.535104] Key type lgssc unregistered [ 7622.796363] LNet: 167454:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 7622.812810] LNetError: 167454:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 7622.843933] LNet: Removed LNI 192.168.203.34@tcp [ 7623.607815] Key type .llcrypt unregistered [ 7623.611264] Key type ._llcrypt unregistered [ 7637.735227] Key type ._llcrypt registered [ 7637.750816] Key type .llcrypt registered [ 7638.559800] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [ 7638.589568] alg: No test for adler32 (adler32-zlib) [ 7639.702640] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 7639.964775] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 7641.727204] Key type lgssc registered [ 7643.227566] Lustre: Echo OBD driver; http://www.lustre.org/ [ 7700.972309] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 7705.703421] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 7729.042991] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 7731.932788] Lustre: Mounted lustre-client [ 7739.826190] LustreError: 170047:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06c73800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 7739.924130] Lustre: Unmounted lustre-client [ 7766.280630] Key type lgssc unregistered [ 7766.469966] LNet: 170448:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 7766.478388] LNetError: 170448:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 7766.495594] LNet: Removed LNI 192.168.203.34@tcp [ 7767.132173] Key type .llcrypt unregistered [ 7767.133912] Key type ._llcrypt unregistered [ 7783.701233] Key type ._llcrypt registered [ 7783.706187] Key type .llcrypt registered [ 7785.030188] Lustre: DEBUG MARKER: == conf-sanity test 53b: check MDS thread count params === 18:40:56 (1773614456) [ 7787.642299] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 7787.659686] alg: No test for adler32 (adler32-zlib) [ 7788.995619] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 7789.313257] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 7791.064771] Key type lgssc registered [ 7792.781315] Lustre: Echo OBD driver; http://www.lustre.org/ [ 7845.548270] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 7850.068913] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 7871.675295] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 7873.439397] Lustre: Mounted lustre-client [ 7896.339820] LustreError: 173714:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09167800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 7896.475559] Lustre: Unmounted lustre-client [ 7929.473160] Key type lgssc unregistered [ 7929.752725] LNet: 174118:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 7929.774668] LNetError: 174118:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 7929.789270] LNet: Removed LNI 192.168.203.34@tcp [ 7930.553176] Key type .llcrypt unregistered [ 7930.560933] Key type ._llcrypt unregistered [ 7944.628664] Key type ._llcrypt registered [ 7944.638280] Key type .llcrypt registered [ 7945.426276] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [ 7945.436483] alg: No test for adler32 (adler32-zlib) [ 7946.619590] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 7946.863990] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 7948.520574] Key type lgssc registered [ 7950.312191] Lustre: Echo OBD driver; http://www.lustre.org/ [ 8005.016432] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 8009.520966] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 8030.770852] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 8033.980235] Lustre: Mounted lustre-client [ 8041.420933] LustreError: 176697:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd18160000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 8041.515215] Lustre: Unmounted lustre-client [ 8068.927727] Key type lgssc unregistered [ 8069.172561] LNet: 177099:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 8069.189478] LNetError: 177099:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 8069.214900] LNet: Removed LNI 192.168.203.34@tcp [ 8069.848223] Key type .llcrypt unregistered [ 8069.852527] Key type ._llcrypt unregistered [ 8087.195109] Key type ._llcrypt registered [ 8087.203378] Key type .llcrypt registered [ 8089.516602] Lustre: DEBUG MARKER: == conf-sanity test 54a: test llverdev and partial verify of device ========================================================== 18:45:59 (1773614759) [ 8112.141960] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 8112.273123] alg: No test for adler32 (adler32-zlib) [ 8113.436890] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 8113.785429] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 8115.511184] Key type lgssc registered [ 8117.131066] Lustre: Echo OBD driver; http://www.lustre.org/ [ 8201.310381] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 8204.876657] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 8225.818551] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 8277.987905] Lustre: DEBUG MARKER: == conf-sanity test 54b: test llverfs and partial verify of filesystem ========================================================== 18:49:09 (1773614949) [ 8308.935745] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 8312.801691] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 8332.580662] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 8334.422104] Lustre: Mounted lustre-client [ 8339.495958] LustreError: 183625:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd080d5000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 8339.597187] Lustre: Unmounted lustre-client [ 8359.590419] Key type lgssc unregistered [ 8359.779980] LNet: 184028:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 8359.786052] LNetError: 184028:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 8359.812523] LNet: Removed LNI 192.168.203.34@tcp [ 8360.596773] Key type .llcrypt unregistered [ 8360.599401] Key type ._llcrypt unregistered [ 8377.260550] Key type ._llcrypt registered [ 8377.269216] Key type .llcrypt registered [ 8378.334054] Lustre: DEBUG MARKER: SKIP: conf-sanity test_55 skipping excluded test 55 [ 8380.207902] Lustre: DEBUG MARKER: == conf-sanity test 56a: check big OST indexes and out-of-index-order start ========================================================== 18:50:51 (1773615051) [ 8400.276931] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 8400.329698] alg: No test for adler32 (adler32-zlib) [ 8401.408588] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 8401.690089] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 8403.383157] Key type lgssc registered [ 8404.577753] Lustre: Echo OBD driver; http://www.lustre.org/ [ 8503.563616] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 8509.379990] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 8533.142742] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST2710-osc-[-0-9a-f]*.ost_server_uuid [ 8553.617460] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST03e8-osc-[-0-9a-f]*.ost_server_uuid [ 8555.370398] Lustre: Mounted lustre-client [ 8582.430682] LustreError: 189577:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd047ff000: lov tgt 1000 not cleaned! deathrow=0, lovrc=1 [ 8582.585357] Lustre: Unmounted lustre-client [ 8721.608584] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 8725.112192] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 8746.939815] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 8796.950219] Lustre: DEBUG MARKER: == conf-sanity test 56b: test target_obd correctness with nonconsecutive MDTs ========================================================== 18:57:48 (1773615468) [ 8798.647317] Lustre: DEBUG MARKER: SKIP: conf-sanity test_56b needs >= 3 MDTs [ 8800.550473] Lustre: DEBUG MARKER: == conf-sanity test 57a: initial registration from failnode should fail (should return errs) ========================================================== 18:57:51 (1773615471) [ 8864.504490] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 8869.601229] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 8911.775395] Key type lgssc unregistered [ 8912.070054] LNet: 195769:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 8912.075768] LNetError: 195769:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 8912.089894] LNet: Removed LNI 192.168.203.34@tcp [ 8912.871204] Key type .llcrypt unregistered [ 8912.873120] Key type ._llcrypt unregistered [ 8929.265285] Key type ._llcrypt registered [ 8929.267313] Key type .llcrypt registered [ 8930.806750] Lustre: DEBUG MARKER: == conf-sanity test 57b: initial registration from servicenode should not fail ========================================================== 19:00:01 (1773615601) [ 8988.819053] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 8988.850338] alg: No test for adler32 (adler32-zlib) [ 8989.993774] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 8990.210364] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 8991.895389] Key type lgssc registered [ 8993.087496] Lustre: Echo OBD driver; http://www.lustre.org/ [ 9040.921476] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9045.676664] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9082.220883] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 9113.068788] Key type lgssc unregistered [ 9113.311892] LNet: 199428:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 9113.318500] LNetError: 199428:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 9113.329923] LNet: Removed LNI 192.168.203.34@tcp [ 9114.140495] Key type .llcrypt unregistered [ 9114.145796] Key type ._llcrypt unregistered [ 9130.742467] Key type ._llcrypt registered [ 9130.744181] Key type .llcrypt registered [ 9131.923691] Lustre: DEBUG MARKER: == conf-sanity test 58: missing llog files must not prevent MDT from mounting ========================================================== 19:03:23 (1773615803) [ 9134.656288] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 9134.684978] alg: No test for adler32 (adler32-zlib) [ 9135.607286] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 9135.754585] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 9137.399222] Key type lgssc registered [ 9138.887837] Lustre: Echo OBD driver; http://www.lustre.org/ [ 9190.696081] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9194.541241] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9216.504472] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 9219.103271] Lustre: Mounted lustre-client [ 9234.418843] Lustre: lustre-MDT0000-mdc-ffff90fd11399800: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 9244.645498] Lustre: lustre-MDT0001-mdc-ffff90fd11399800: Connection to lustre-MDT0001 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 9255.905097] Lustre: 200415:0:(client.c:2478:ptlrpc_expire_one_request()) @@@ Request sent has timed out for slow reply: [sent 1773615912/real 1773615912] req@00000000886da36d x1859770969572224/t0(0) o400->MGC192.168.203.134@tcp@192.168.203.134@tcp:26/25 lens 224/224 e 0 to 1 dl 1773615928 ref 1 fl Rpc:XNQr/200/ffffffff rc 0/-1 job:'' uid:0 gid:0 projid:4294967295 [ 9255.930734] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [ 9280.498244] Lustre: Evicted from MGS (at 192.168.203.134@tcp) after server handle changed from 0x10f749e48ecbcd4b to 0x10f749e48ecbe94b [ 9280.504690] Lustre: MGC192.168.203.134@tcp: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 9311.221214] LustreError: lustre-MDT0000-mdc-ffff90fd11399800: This client was evicted by lustre-MDT0000; in progress operations using this service will fail. [ 9311.317854] Lustre: lustre-MDT0000-mdc-ffff90fd11399800: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 9320.306795] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9322.027472] Lustre: DEBUG MARKER: mdc.lustre-MDT0000-mdc-*.mds_server_uuid in FULL state after 0 sec [ 9325.600121] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9327.411510] Lustre: DEBUG MARKER: mdc.lustre-MDT0001-mdc-*.mds_server_uuid in FULL state after 0 sec [ 9330.533515] LustreError: 203850:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd11399800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [ 9330.605518] Lustre: Unmounted lustre-client [ 9367.963337] Key type lgssc unregistered [ 9368.291525] LNet: 204256:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 9368.300515] LNetError: 204256:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 9368.324181] LNet: Removed LNI 192.168.203.34@tcp [ 9369.256243] Key type .llcrypt unregistered [ 9369.261507] Key type ._llcrypt unregistered [ 9386.703878] Key type ._llcrypt registered [ 9386.709379] Key type .llcrypt registered [ 9388.473389] Lustre: DEBUG MARKER: == conf-sanity test 59: writeconf mount option =========== 19:07:39 (1773616059) [ 9391.282185] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 9391.633672] alg: No test for adler32 (adler32-zlib) [ 9392.673555] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 9392.879566] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 9394.695183] Key type lgssc registered [ 9396.384743] Lustre: Echo OBD driver; http://www.lustre.org/ [ 9450.719480] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9454.557987] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9513.133811] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9518.995203] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9559.455742] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 9579.946943] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [ 9623.312846] Key type lgssc unregistered [ 9623.554627] LNet: 209380:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [ 9623.560745] LNetError: 209380:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [ 9623.577614] LNet: Removed LNI 192.168.203.34@tcp [ 9624.230181] Key type .llcrypt unregistered [ 9624.232547] Key type ._llcrypt unregistered [ 9668.911253] Key type ._llcrypt registered [ 9668.915684] Key type .llcrypt registered [ 9670.376741] Lustre: DEBUG MARKER: == conf-sanity test 60a: check mkfs.lustre --mkfsoptions -E -O options setting ========================================================== 19:12:21 (1773616341) [ 9710.611992] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [ 9710.649551] alg: No test for adler32 (adler32-zlib) [ 9711.854947] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [ 9712.115519] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [ 9713.816515] Key type lgssc registered [ 9715.199331] Lustre: Echo OBD driver; http://www.lustre.org/ [ 9812.172859] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9815.933626] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9836.486914] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 9874.600811] Lustre: DEBUG MARKER: == conf-sanity test 60b: check mkfs.lustre MDT default features ========================================================== 19:15:45 (1773616545) [ 9881.986111] Lustre: DEBUG MARKER: == conf-sanity test 61a: large xattr ===================== 19:15:53 (1773616553) [ 9911.525770] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9914.225678] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [ 9931.053098] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [ 9938.003600] Lustre: Mounted lustre-client [ 9942.855941] Lustre: DEBUG MARKER: save large xattr of 65536 bytes on trusted.big on /mnt/lustre/f61a.conf-sanity [ 9944.728657] Lustre: DEBUG MARKER: shrink value of trusted.big on /mnt/lustre/f61a.conf-sanity [ 9945.996338] Lustre: DEBUG MARKER: grow value of trusted.big on /mnt/lustre/f61a.conf-sanity [ 9947.251388] Lustre: DEBUG MARKER: check value of trusted.big on /mnt/lustre/f61a.conf-sanity after remounting MDS [ 9953.256080] Lustre: lustre-MDT0000-mdc-ffff90fd07a59800: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [ 9968.608597] Lustre: 211280:0:(client.c:2478:ptlrpc_expire_one_request()) @@@ Request sent has timed out for slow reply: [sent 1773616625/real 1773616625] req@000000001c538d89 x1859771573479424/t0(0) o400->MGC192.168.203.134@tcp@192.168.203.134@tcp:26/25 lens 224/224 e 0 to 1 dl 1773616641 ref 1 fl Rpc:XNQr/200/ffffffff rc 0/-1 job:'' uid:0 gid:0 projid:4294967295 [ 9968.643694] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [ 9978.866858] Lustre: Evicted from MGS (at 192.168.203.134@tcp) after server handle changed from 0xa080959be8ec9443 to 0xa080959be8ec96c0 [ 9978.881794] Lustre: MGC192.168.203.134@tcp: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 9983.699462] Lustre: lustre-MDT0000-mdc-ffff90fd07a59800: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [ 9990.448334] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) mdc.lustre-MDT0000-mdc-*.mds_server_uuid [ 9991.967719] Lustre: DEBUG MARKER: mdc.lustre-MDT0000-mdc-*.mds_server_uuid in FULL state after 0 sec [ 9995.388296] Lustre: DEBUG MARKER: remove large xattr trusted.big from /mnt/lustre/f61a.conf-sanity [ 9999.336255] Lustre: lustre-MDT0000-mdc-ffff90fd07a59800: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [10014.687984] Lustre: 211278:0:(client.c:2478:ptlrpc_expire_one_request()) @@@ Request sent has timed out for slow reply: [sent 1773616671/real 1773616671] req@000000005208c1f9 x1859771573487616/t0(0) o400->MGC192.168.203.134@tcp@192.168.203.134@tcp:26/25 lens 224/224 e 0 to 1 dl 1773616687 ref 1 fl Rpc:XNQr/200/ffffffff rc 0/-1 job:'' uid:0 gid:0 projid:4294967295 [10014.728729] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [10024.944202] Lustre: Evicted from MGS (at 192.168.203.134@tcp) after server handle changed from 0xa080959be8ec96c0 to 0xa080959be8ec98d4 [10024.957827] Lustre: MGC192.168.203.134@tcp: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [10031.338945] Lustre: lustre-MDT0000-mdc-ffff90fd07a59800: Connection restored to 192.168.203.134@tcp (at 192.168.203.134@tcp) [10037.111900] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10038.761085] Lustre: DEBUG MARKER: mdc.lustre-MDT0000-mdc-*.mds_server_uuid in FULL state after 0 sec [10042.259979] LustreError: 219558:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07a59800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [10042.329828] Lustre: Unmounted lustre-client [10104.762813] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10108.129275] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10125.403352] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10131.524292] Lustre: Mounted lustre-client [10134.028191] LustreError: 221177:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09161000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [10134.131750] Lustre: Unmounted lustre-client [10160.328704] Key type lgssc unregistered [10160.600445] LNet: 221580:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [10160.610052] LNetError: 221580:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [10160.628905] LNet: Removed LNI 192.168.203.34@tcp [10161.310714] Key type .llcrypt unregistered [10161.312448] Key type ._llcrypt unregistered [10173.468936] Key type ._llcrypt registered [10173.474552] Key type .llcrypt registered [10174.450828] Lustre: DEBUG MARKER: == conf-sanity test 61b: large xattr ===================== 19:20:46 (1773616846) [10177.952282] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [10178.080665] alg: No test for adler32 (adler32-zlib) [10179.120576] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [10179.314869] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [10180.944576] Key type lgssc registered [10181.934538] Lustre: Echo OBD driver; http://www.lustre.org/ [10220.464146] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10223.070345] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10238.017547] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10249.275556] Lustre: Mounted lustre-client [10254.669260] LustreError: 224759:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd080d0800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [10254.741746] Lustre: Unmounted lustre-client [10312.213303] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10315.228582] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10330.022806] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10340.933757] Lustre: Mounted lustre-client [10351.018532] LustreError: 226362:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd18163800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [10351.112319] Lustre: Unmounted lustre-client [10409.110418] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10412.173660] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10426.483576] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10437.681238] Lustre: Mounted lustre-client [10439.017250] LustreError: 227984:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd21fd3000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [10439.076310] Lustre: Unmounted lustre-client [10464.210940] Key type lgssc unregistered [10464.415084] LNet: 228386:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [10464.418579] LNetError: 228386:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [10464.430397] LNet: Removed LNI 192.168.203.34@tcp [10464.899515] Key type .llcrypt unregistered [10464.901263] Key type ._llcrypt unregistered [10478.778450] Key type ._llcrypt registered [10478.779630] Key type .llcrypt registered [10479.840768] Lustre: DEBUG MARKER: == conf-sanity test 62: start with disabled journal ====== 19:25:51 (1773617151) [10482.522440] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [10482.541238] alg: No test for adler32 (adler32-zlib) [10483.563107] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [10483.731560] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [10485.367183] Key type lgssc registered [10486.246539] Lustre: Echo OBD driver; http://www.lustre.org/ [10520.752388] Key type lgssc unregistered [10521.018418] LNet: 230708:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [10521.027423] LNetError: 230708:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [10521.044552] LNet: Removed LNI 192.168.203.34@tcp [10521.659314] Key type .llcrypt unregistered [10521.663511] Key type ._llcrypt unregistered [10545.712198] Key type ._llcrypt registered [10545.714573] Key type .llcrypt registered [10546.082610] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [10546.092095] alg: No test for adler32 (adler32-zlib) [10547.066880] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [10547.218821] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [10548.887122] Key type lgssc registered [10549.746095] Lustre: Echo OBD driver; http://www.lustre.org/ [10609.813995] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10612.714447] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10629.625761] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10672.280379] Lustre: DEBUG MARKER: SKIP: conf-sanity test_63 skipping excluded test 63 [10673.901251] Lustre: DEBUG MARKER: == conf-sanity test 64: check lfs df --lazy ============== 19:29:05 (1773617345) [10700.890514] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10704.080139] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10717.654914] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10733.433797] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0001-osc-[-0-9a-f]*.ost_server_uuid [10734.972414] Lustre: Mounted lustre-client [10740.203869] Lustre: lustre-OST0001-osc-ffff90fd04050000: Connection to lustre-OST0001 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [10745.315126] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [10755.667038] Lustre: Unmounted lustre-client [10785.600886] Key type lgssc unregistered [10785.818691] LNet: 237627:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [10785.827348] LNetError: 237627:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [10785.850583] LNet: Removed LNI 192.168.203.34@tcp [10786.349387] Key type .llcrypt unregistered [10786.351158] Key type ._llcrypt unregistered [10808.354272] Key type ._llcrypt registered [10808.357779] Key type .llcrypt registered [10809.297355] Lustre: DEBUG MARKER: == conf-sanity test 65: re-create the lost last_rcvd file when server mount ========================================================== 19:31:20 (1773617480) [10818.712475] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [10818.729748] alg: No test for adler32 (adler32-zlib) [10819.713498] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [10819.879133] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [10821.512156] Key type lgssc registered [10822.465201] Lustre: Echo OBD driver; http://www.lustre.org/ [10853.595465] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10855.714275] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10880.477723] Lustre: DEBUG MARKER: == conf-sanity test 66: replace nids ===================== 19:32:32 (1773617552) [10900.403838] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [10902.586478] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [10914.929954] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [10921.463550] Lustre: Mounted lustre-client [10933.265755] Lustre: setting import lustre-OST0000_UUID INACTIVE by administrator request [10934.871309] Lustre: Unmounted lustre-client [11004.273466] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11006.634111] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11039.677046] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11045.409018] Lustre: Mounted lustre-client [11046.342230] LustreError: 244675:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd0692c000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11046.437093] Lustre: Unmounted lustre-client [11066.906901] Key type lgssc unregistered [11067.051103] LNet: 245078:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11067.056273] LNetError: 245078:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11067.069340] LNet: Removed LNI 192.168.203.34@tcp [11067.384276] Key type .llcrypt unregistered [11067.386277] Key type ._llcrypt unregistered [11081.571483] Key type ._llcrypt registered [11081.576026] Key type .llcrypt registered [11081.797784] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [11081.805627] alg: No test for adler32 (adler32-zlib) [11082.825503] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11082.938668] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11084.527543] Key type lgssc registered [11085.054805] Lustre: Echo OBD driver; http://www.lustre.org/ [11128.825928] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11130.880875] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11141.407094] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11178.699162] Lustre: DEBUG MARKER: SKIP: conf-sanity test_67 skipping excluded test 67 [11179.658865] Lustre: DEBUG MARKER: == conf-sanity test 68: be able to reserve specific sequences in FLDB ========================================================== 19:37:31 (1773617851) [11196.876151] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11198.889604] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11209.334259] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11213.019726] Lustre: Mounted lustre-client [11219.575994] LustreError: 251130:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd04054000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11219.629982] Lustre: Unmounted lustre-client [11239.357728] Key type lgssc unregistered [11239.521260] LNet: 251533:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11239.528830] LNetError: 251533:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11239.542342] LNet: Removed LNI 192.168.203.34@tcp [11239.838236] Key type .llcrypt unregistered [11239.839454] Key type ._llcrypt unregistered [11246.961057] Key type ._llcrypt registered [11246.962522] Key type .llcrypt registered [11247.669213] Lustre: DEBUG MARKER: SKIP: conf-sanity test_69 skipping SLOW test 69 [11248.532806] Lustre: DEBUG MARKER: == conf-sanity test 70a: start MDT0, then OST, then MDT1 ========================================================== 19:38:40 (1773617920) [11253.087376] Key type .llcrypt unregistered [11253.089062] Key type ._llcrypt unregistered [11257.019393] Key type ._llcrypt registered [11257.020989] Key type .llcrypt registered [11257.280573] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [11257.290966] alg: No test for adler32 (adler32-zlib) [11258.205456] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11258.327511] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11259.959420] Key type lgssc registered [11260.560967] Lustre: Echo OBD driver; http://www.lustre.org/ [11287.756351] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11300.877820] Lustre: Mounted lustre-client [11301.823887] LustreError: 254552:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06c5e000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11301.874365] Lustre: Unmounted lustre-client [11321.480966] Key type lgssc unregistered [11321.616884] LNet: 254954:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11321.622857] LNetError: 254954:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11321.633840] LNet: Removed LNI 192.168.203.34@tcp [11321.954737] Key type .llcrypt unregistered [11321.956809] Key type ._llcrypt unregistered [11329.621851] Key type ._llcrypt registered [11329.623129] Key type .llcrypt registered [11330.262797] Lustre: DEBUG MARKER: == conf-sanity test 70b: start OST, MDT1, MDT0 =========== 19:40:02 (1773618002) [11331.531333] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [11331.572477] alg: No test for adler32 (adler32-zlib) [11332.509404] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11332.679640] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11334.319461] Key type lgssc registered [11334.954391] Lustre: Echo OBD driver; http://www.lustre.org/ [11399.923727] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11416.559408] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11418.547637] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11420.979729] Lustre: Mounted lustre-client [11422.342093] LustreError: 258001:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd0726d000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11422.405369] Lustre: Unmounted lustre-client [11438.413589] Key type lgssc unregistered [11438.582685] LNet: 258402:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11438.586752] LNetError: 258402:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11438.600112] LNet: Removed LNI 192.168.203.34@tcp [11438.937586] Key type .llcrypt unregistered [11438.942082] Key type ._llcrypt unregistered [11446.174386] Key type ._llcrypt registered [11446.175411] Key type .llcrypt registered [11446.895610] Lustre: DEBUG MARKER: == conf-sanity test 70c: stop MDT0, mkdir fail, create remote dir fail ========================================================== 19:41:58 (1773618118) [11448.051690] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [11448.114574] alg: No test for adler32 (adler32-zlib) [11449.075837] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11449.212534] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11450.815162] Key type lgssc registered [11451.594749] Lustre: Echo OBD driver; http://www.lustre.org/ [11476.708610] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11478.549826] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11487.810207] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11494.391579] Lustre: Mounted lustre-client [11499.490848] Lustre: lustre-MDT0000-mdc-ffff90fd09167800: Connection to lustre-MDT0000 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [11502.240830] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [11502.254850] LustreError: 261467:0:(file.c:6089:ll_inode_revalidate_fini()) lustre: revalidate FID [0x200000007:0x1:0x0] error: rc = -108 [11502.386074] LustreError: 261486:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09167800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11502.387534] LustreError: MGC192.168.203.134@tcp: Connection to MGS (at 192.168.203.134@tcp) was lost; in progress operations using this service will fail [11502.412867] Lustre: Unmounted lustre-client [11513.982996] Key type lgssc unregistered [11514.120709] LNet: 261878:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11514.123579] LNetError: 261878:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11514.139534] LNet: Removed LNI 192.168.203.34@tcp [11514.419139] Key type .llcrypt unregistered [11514.421343] Key type ._llcrypt unregistered [11520.888788] Key type ._llcrypt registered [11520.890235] Key type .llcrypt registered [11521.616474] Lustre: DEBUG MARKER: == conf-sanity test 70d: stop MDT1, mkdir succeed, create remote dir fail ========================================================== 19:43:13 (1773618193) [11522.664747] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [11522.736077] alg: No test for adler32 (adler32-zlib) [11523.626521] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11523.747185] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11525.359162] Key type lgssc registered [11525.813199] Lustre: Echo OBD driver; http://www.lustre.org/ [11547.828082] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11549.426920] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11558.786780] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11565.571590] Lustre: Mounted lustre-client [11570.661087] Lustre: lustre-MDT0001-mdc-ffff90fd09161000: Connection to lustre-MDT0001 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [11573.691467] Lustre: setting import lustre-MDT0001_UUID INACTIVE by administrator request [11574.317196] LustreError: 264972:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09161000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11574.358317] Lustre: Unmounted lustre-client [11587.383718] Key type lgssc unregistered [11587.552685] LNet: 265368:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11587.557698] LNetError: 265368:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11587.570581] LNet: Removed LNI 192.168.203.34@tcp [11587.898994] Key type .llcrypt unregistered [11587.901449] Key type ._llcrypt unregistered [11595.641349] Key type ._llcrypt registered [11595.642835] Key type .llcrypt registered [11596.354751] Lustre: DEBUG MARKER: == conf-sanity test 70e: Sync-on-Cancel will be enabled by default on DNE ========================================================== 19:44:28 (1773618268) [11604.894785] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [11604.908061] alg: No test for adler32 (adler32-zlib) [11605.810197] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11605.942777] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11607.551155] Key type lgssc registered [11608.105492] Lustre: Echo OBD driver; http://www.lustre.org/ [11663.449887] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11664.850643] Lustre: Mounted lustre-client [11686.374598] Lustre: lustre-MDT0001-mdc-ffff90fd05941800: Connection to lustre-MDT0001 (at 192.168.203.134@tcp) was lost; in progress operations using this service will wait for recovery to complete [11693.544551] Lustre: setting import lustre-MDT0000_UUID INACTIVE by administrator request [11703.806027] Lustre: Unmounted lustre-client [11731.538495] Key type lgssc unregistered [11731.685429] LNet: 271111:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [11731.688367] LNetError: 271111:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [11731.697695] LNet: Removed LNI 192.168.203.34@tcp [11732.002056] Key type .llcrypt unregistered [11732.003782] Key type ._llcrypt unregistered [11739.344590] Key type ._llcrypt registered [11739.345984] Key type .llcrypt registered [11739.972889] Lustre: DEBUG MARKER: == conf-sanity test 71a: start MDT0 OST0, MDT1, OST1 ===== 19:46:51 (1773618411) [11740.830956] Lustre: DEBUG MARKER: SKIP: conf-sanity test_71a needs separate MGS/MDT [11741.715888] Lustre: DEBUG MARKER: == conf-sanity test 71b: start MDT1, OST0, MDT0, OST1 ==== 19:46:53 (1773618413) [11742.462259] Lustre: DEBUG MARKER: SKIP: conf-sanity test_71b needs separate MGS/MDT [11743.355633] Lustre: DEBUG MARKER: == conf-sanity test 71c: start OST0, OST1, MDT1, MDT0 ==== 19:46:55 (1773618415) [11744.260960] Lustre: DEBUG MARKER: SKIP: conf-sanity test_71c needs separate MGS/MDT [11745.213427] Lustre: DEBUG MARKER: == conf-sanity test 71d: start OST0, MDT1, MDT0, OST1 ==== 19:46:57 (1773618417) [11746.099656] Lustre: DEBUG MARKER: SKIP: conf-sanity test_71d needs separate MGS/MDT [11747.044157] Lustre: DEBUG MARKER: == conf-sanity test 71e: start OST0, MDT1, OST1, MDT0 ==== 19:46:58 (1773618418) [11747.849850] Lustre: DEBUG MARKER: SKIP: conf-sanity test_71e needs separate MGS/MDT [11748.679850] Lustre: DEBUG MARKER: == conf-sanity test 72: test fast symlink with extents flag enabled ========================================================== 19:47:00 (1773618420) [11753.282745] Key type .llcrypt unregistered [11753.284415] Key type ._llcrypt unregistered [11756.567416] Key type ._llcrypt registered [11756.569205] Key type .llcrypt registered [11756.740563] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [11756.748454] alg: No test for adler32 (adler32-zlib) [11757.676973] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [11757.777851] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [11759.375256] Key type lgssc registered [11759.970152] Lustre: Echo OBD driver; http://www.lustre.org/ [11792.807116] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11794.490586] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11803.982645] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11805.263426] Lustre: Mounted lustre-client [11806.164687] LustreError: 276699:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd04195800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11806.226165] Lustre: Unmounted lustre-client [11831.605819] Lustre: DEBUG MARKER: == conf-sanity test 73a: failnode to update from mountdata properly ========================================================== 19:48:23 (1773618503) [11844.624450] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [11846.064656] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [11866.725950] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [11882.486387] Lustre: Mounted lustre-client [11882.918631] LustreError: 278815:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd10d9f800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [11882.960244] Lustre: Unmounted lustre-client [11917.535230] LNet: 1 local NIs in recovery (showing 1): 192.168.203.34@tcp [11918.861124] Lustre: DEBUG MARKER: == conf-sanity test 73b: Large failnode NID list in mountdata ========================================================== 19:49:50 (1773618590) [12512.562593] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [12513.906370] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [12534.795452] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [12589.439352] Lustre: DEBUG MARKER: == conf-sanity test 73c: Server mount doesn't fail with > 32 nets ========================================================== 20:01:01 (1773619261) [12594.345095] Key type lgssc unregistered [12594.463635] LNet: 284362:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [12594.466662] LNetError: 284362:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [12594.475990] LNet: Removed LNI 192.168.203.34@tcp [12594.734134] Key type .llcrypt unregistered [12594.735542] Key type ._llcrypt unregistered [12663.333560] Key type ._llcrypt registered [12663.342499] Key type .llcrypt registered [12663.481956] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [12663.488172] alg: No test for adler32 (adler32-zlib) [12664.360600] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [12664.447866] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [12666.039150] Key type lgssc registered [12666.489365] Lustre: Echo OBD driver; http://www.lustre.org/ [12701.616393] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [12702.923881] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [12710.986800] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [12731.077832] Key type lgssc unregistered [12731.194435] LNet: 287948:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [12731.197353] LNetError: 287948:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [12731.204615] LNet: Removed LNI 192.168.203.34@tcp [12731.448681] Key type .llcrypt unregistered [12731.450490] Key type ._llcrypt unregistered [12750.907196] Key type ._llcrypt registered [12750.908420] Key type .llcrypt registered [12751.465630] Lustre: DEBUG MARKER: == conf-sanity test 73d: erase + new parameter doesn't corrupt mountdata ========================================================== 20:03:43 (1773619423) [12759.672828] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [12759.682507] alg: No test for adler32 (adler32-zlib) [12760.544259] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [12760.654060] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [12762.247136] Key type lgssc registered [12762.689853] Lustre: Echo OBD driver; http://www.lustre.org/ [12781.449600] Lustre: DEBUG MARKER: == conf-sanity test 73e: Mount client with dynamic server NIDs ========================================================== 20:04:13 (1773619453) [12785.810995] Key type lgssc unregistered [12785.929737] LNet: 291493:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [12785.934107] LNetError: 291493:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [12785.942158] LNet: Removed LNI 192.168.203.34@tcp [12786.176664] Key type .llcrypt unregistered [12786.178411] Key type ._llcrypt unregistered [12790.085722] Key type ._llcrypt registered [12790.087307] Key type .llcrypt registered [12790.337363] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [12790.370131] alg: No test for adler32 (adler32-zlib) [12791.243805] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [12791.335361] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [12792.927198] Key type lgssc registered [12793.373697] Lustre: Echo OBD driver; http://www.lustre.org/ [12815.141716] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [12816.468981] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [12824.724258] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [12911.742220] LNet: Added LNI 192.168.203.34@tcp50 [8/256/0/180] [12912.619720] LNet: Removed LNI 192.168.203.34@tcp [12914.028750] Lustre: 295764:0:(ldlm_lib.c:562:client_obd_setup()) lustre-MDT0000-mdc-ffff90fd09160800: config has no valid NIDs, force dynamic NIDs [12915.074968] Lustre: Mounted lustre-client [12915.097174] LustreError: 295779:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd09160800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [12915.128486] Lustre: Unmounted lustre-client [12916.112345] Key type lgssc unregistered [12916.254742] LNet: 296030:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [12916.257511] LNetError: 296030:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [12916.266481] LNet: Removed LNI 192.168.203.34@tcp50 [12916.480227] Key type .llcrypt unregistered [12916.481453] Key type ._llcrypt unregistered [12926.578356] Key type ._llcrypt registered [12926.579832] Key type .llcrypt registered [12926.760310] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 2 [12926.766096] alg: No test for adler32 (adler32-zlib) [12927.644993] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [12927.737970] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [12929.327118] Key type lgssc registered [12929.739036] Lustre: Echo OBD driver; http://www.lustre.org/ [12957.365364] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [12958.597145] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [12961.216916] LNet: Added LNI 192.168.203.34@tcp50 [8/256/0/180] [12961.496948] LNet: Removed LNI 192.168.203.34@tcp [12962.539646] Lustre: 298655:0:(ldlm_lib.c:562:client_obd_setup()) lustre-MDT0000-mdc-ffff90fd06c5b000: config has no valid NIDs, force dynamic NIDs [12963.584677] Lustre: Mounted lustre-client [12963.707077] LustreError: 298691:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd06c5b000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [12963.735097] Lustre: Unmounted lustre-client [12983.235036] Key type lgssc unregistered [12983.381702] LNet: 299531:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [12983.383937] LNetError: 299531:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [12983.392663] LNet: Removed LNI 192.168.203.34@tcp50 [12983.615257] Key type .llcrypt unregistered [12983.616677] Key type ._llcrypt unregistered [12987.744159] Key type ._llcrypt registered [12987.745804] Key type .llcrypt registered [12988.331397] Lustre: DEBUG MARKER: == conf-sanity test 74: Test per-device adaptive timeout parameters ========================================================== 20:07:40 (1773619660) [12989.109346] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [12989.116776] alg: No test for adler32 (adler32-zlib) [12989.987309] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [12990.084253] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [12991.671208] Key type lgssc registered [12992.160833] Lustre: Echo OBD driver; http://www.lustre.org/ [13011.844035] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [13013.238126] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [13020.040142] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [13030.389090] Lustre: Mounted lustre-client [13053.477547] Lustre: Mounted fs15246-client [13059.096431] LustreError: 303659:0:(lov_obd.c:783:lov_cleanup()) fs15246-clilov-ffff90fd05579800: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [13059.122171] Lustre: Unmounted fs15246-client [13072.589876] LustreError: 303877:0:(lov_obd.c:783:lov_cleanup()) lustre-clilov-ffff90fd07f0d000: lov tgt 0 not cleaned! deathrow=0, lovrc=1 [13072.616617] Lustre: Unmounted lustre-client [13099.104402] Key type lgssc unregistered [13099.229379] LNet: 304281:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [13099.232254] LNetError: 304281:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [13099.242807] LNet: Removed LNI 192.168.203.34@tcp [13099.483701] Key type .llcrypt unregistered [13099.485141] Key type ._llcrypt unregistered [13103.443749] Key type ._llcrypt registered [13103.444993] Key type .llcrypt registered [13103.958335] Lustre: DEBUG MARKER: == conf-sanity test 75: The order of --index should be irrelevant ========================================================== 20:09:36 (1773619776) [13104.571664] libcfs: HW NUMA nodes: 1, HW CPU cores: 4, npartitions: 1 [13104.579948] alg: No test for adler32 (adler32-zlib) [13105.444448] Lustre: Lustre: Build Version: 2.17.51_2_gc98ff3f [13105.534310] LNet: Added LNI 192.168.203.34@tcp [8/256/0/180] [13107.119177] Key type lgssc registered [13107.533404] Lustre: Echo OBD driver; http://www.lustre.org/ [13156.727828] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0000-mdc-*.mds_server_uuid [13157.984787] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount FULL mdc.lustre-MDT0001-mdc-*.mds_server_uuid [13166.039392] Lustre: DEBUG MARKER: oleg334-client.virtnet: executing wait_import_state_mount (FULL|IDLE) osc.lustre-OST0000-osc-[-0-9a-f]*.ost_server_uuid [13208.326413] Lustre: DEBUG MARKER: == conf-sanity test complete, duration 12872 sec ========= 20:11:20 (1773619880) [13208.934288] Lustre: DEBUG MARKER: === conf-sanity: start cleanup 20:11:21 (1773619881) === [13210.102544] Lustre: DEBUG MARKER: === conf-sanity: finish cleanup 20:11:22 (1773619882) === [13221.948551] Key type lgssc unregistered [13222.060611] LNet: 313427:0:(lib-ptl.c:967:lnet_clear_lazy_portal()) Active lazy portal 0 on exit [13222.063148] LNetError: 313427:0:(acceptor.c:252:lnet_acceptor_remove_socket()) Interface ens2 not found [13222.070442] LNet: Removed LNI 192.168.203.34@tcp [13222.312786] Key type .llcrypt unregistered [13222.313942] Key type ._llcrypt unregistered