2025-04-15T11:46:39.970001 [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x000f0510]
2025-04-15T11:46:39.970517 [ 0.000000] Linux version 6.14.0 (tuxmake@tuxmake) (Debian clang version 21.0.0 (++20250401110258+749535ba2808-1~exp1~20250401230337.1361), Debian LLD 21.0.0) #1 SMP PREEMPT @1743678930
2025-04-15T11:46:39.970633 [ 0.000000] KASLR enabled
2025-04-15T11:46:39.970718 [ 0.000000] random: crng init done
2025-04-15T11:46:39.970793 [ 0.000000] Machine model: linux,dummy-virt
2025-04-15T11:46:39.970859 [ 0.000000] efi: UEFI not found.
2025-04-15T11:46:39.971030 [ 0.000000] earlycon: pl11 at MMIO 0x0000000009000000 (options '')
2025-04-15T11:46:39.971177 [ 0.000000] printk: legacy bootconsole [pl11] enabled
2025-04-15T11:46:39.972297 [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT
2025-04-15T11:46:39.975194 [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000013fffffff]
2025-04-15T11:46:39.975969 [ 0.000000] NODE_DATA(0) allocated [mem 0x13f5fc000-0x13f5fe77f]
2025-04-15T11:46:39.978430 [ 0.000000] Zone ranges:
2025-04-15T11:46:39.978887 [ 0.000000] DMA [mem 0x0000000040000000-0x00000000ffffffff]
2025-04-15T11:46:39.978967 [ 0.000000] DMA32 empty
2025-04-15T11:46:39.979097 [ 0.000000] Normal [mem 0x0000000100000000-0x000000013fffffff]
2025-04-15T11:46:39.979256 [ 0.000000] Movable zone start for each node
2025-04-15T11:46:39.979432 [ 0.000000] Early memory node ranges
2025-04-15T11:46:39.979615 [ 0.000000] node 0: [mem 0x0000000040000000-0x000000013fffffff]
2025-04-15T11:46:39.980149 [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000013fffffff]
2025-04-15T11:46:40.005684 [ 0.000000] cma: Reserved 32 MiB at 0x0000000000000000
2025-04-15T11:46:40.006665 [ 0.000000] psci: probing for conduit method from DT.
2025-04-15T11:46:40.006825 [ 0.000000] psci: PSCIv1.1 detected in firmware.
2025-04-15T11:46:40.006987 [ 0.000000] psci: Using standard PSCI v0.2 function IDs
2025-04-15T11:46:40.007253 [ 0.000000] psci: Trusted OS migration not required
2025-04-15T11:46:40.007347 [ 0.000000] psci: SMC Calling Convention v1.0
2025-04-15T11:46:40.009613 [ 0.000000] percpu: Embedded 34 pages/cpu s101464 r8192 d29608 u139264
2025-04-15T11:46:40.010055 [ 0.000000] pcpu-alloc: s101464 r8192 d29608 u139264 alloc=34*4096
2025-04-15T11:46:40.010339 [ 0.000000] pcpu-alloc: [0] 0 [0] 1
2025-04-15T11:46:40.011410 [ 0.000000] Detected PIPT I-cache on CPU0
2025-04-15T11:46:40.012799 [ 0.000000] CPU features: detected: Branch Target Identification
2025-04-15T11:46:40.013024 [ 0.000000] CPU features: detected: Address authentication (IMP DEF algorithm)
2025-04-15T11:46:40.013246 [ 0.000000] CPU features: detected: GIC system register CPU interface
2025-04-15T11:46:40.013400 [ 0.000000] CPU features: detected: HCRX_EL2 register
2025-04-15T11:46:40.013586 [ 0.000000] CPU features: detected: 52-bit Virtual Addressing (LPA2)
2025-04-15T11:46:40.013743 [ 0.000000] CPU features: detected: Virtualization Host Extensions
2025-04-15T11:46:40.013933 [ 0.000000] CPU features: detected: Memory Tagging Extension
2025-04-15T11:46:40.014127 [ 0.000000] CPU features: detected: Asymmetric MTE Tag Check Fault
2025-04-15T11:46:40.014395 [ 0.000000] CPU features: detected: Spectre-v4
2025-04-15T11:46:40.017571 [ 0.000000] alternatives: applying boot alternatives
2025-04-15T11:46:40.020540 [ 0.000000] Kernel command line: console=ttyAMA0,115200 rootwait root=/dev/vda debug verbose console_msg_format=syslog systemd.log_level=warning rw earlycon
2025-04-15T11:46:40.022541 <5>[ 0.000000] Unknown kernel command line parameters "verbose", will be passed to user space.
2025-04-15T11:46:40.024532 <6>[ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes
2025-04-15T11:46:40.026617 <6>[ 0.000000] Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear)
2025-04-15T11:46:40.027791 <6>[ 0.000000] Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear)
2025-04-15T11:46:40.028065 <6>[ 0.000000] software IO TLB: area num 2.
2025-04-15T11:46:40.075578 <6>[ 0.000000] software IO TLB: mapped [mem 0x00000000fa000000-0x00000000fe000000] (64MB)
2025-04-15T11:46:40.076949 <6>[ 0.000000] Fallback order for Node 0: 0
2025-04-15T11:46:40.077027 <6>[ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 1048576
2025-04-15T11:46:40.077087 <6>[ 0.000000] Policy zone: Normal
2025-04-15T11:46:40.077705 <6>[ 0.000000] mem auto-init: stack:all(zero), heap alloc:off, heap free:off
2025-04-15T11:46:40.100746 <6>[ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1
2025-04-15T11:46:40.440073 <6>[ 0.000000] ftrace: allocating 71913 entries in 282 pages
2025-04-15T11:46:40.440427 <6>[ 0.000000] ftrace: allocated 282 pages with 4 groups
2025-04-15T11:46:40.447481 <6>[ 0.000000] rcu: Preemptible hierarchical RCU implementation.
2025-04-15T11:46:40.447560 <6>[ 0.000000] rcu: RCU event tracing is enabled.
2025-04-15T11:46:40.447659 <6>[ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2.
2025-04-15T11:46:40.448032 <6>[ 0.000000] Trampoline variant of Tasks RCU enabled.
2025-04-15T11:46:40.448111 <6>[ 0.000000] Rude variant of Tasks RCU enabled.
2025-04-15T11:46:40.448186 <6>[ 0.000000] Tracing variant of Tasks RCU enabled.
2025-04-15T11:46:40.448431 <6>[ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.
2025-04-15T11:46:40.448635 <6>[ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2
2025-04-15T11:46:40.449889 <6>[ 0.000000] RCU Tasks: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2.
2025-04-15T11:46:40.450197 <6>[ 0.000000] RCU Tasks Rude: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2.
2025-04-15T11:46:40.450478 <6>[ 0.000000] RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2.
2025-04-15T11:46:40.475805 <6>[ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0
2025-04-15T11:46:40.481371 <6>[ 0.000000] GICv3: GIC: Using split EOI/Deactivate mode
2025-04-15T11:46:40.481555 <6>[ 0.000000] GICv3: 256 SPIs implemented
2025-04-15T11:46:40.481693 <6>[ 0.000000] GICv3: 0 Extended SPIs implemented
2025-04-15T11:46:40.483285 <6>[ 0.000000] Root IRQ handler: gic_handle_irq
2025-04-15T11:46:40.483472 <6>[ 0.000000] GICv3: GICv3 features: 16 PPIs
2025-04-15T11:46:40.483738 <6>[ 0.000000] GICv3: GICD_CTRL.DS=1, SCR_EL3.FIQ=0
2025-04-15T11:46:40.484340 <6>[ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000
2025-04-15T11:46:40.489202 <6>[ 0.000000] ITS [mem 0x08080000-0x0809ffff]
2025-04-15T11:46:40.489975 <6>[ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @100210000 (indirect, esz 8, psz 64K, shr 1)
2025-04-15T11:46:40.490297 <6>[ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @100220000 (flat, esz 8, psz 64K, shr 1)
2025-04-15T11:46:40.490991 <6>[ 0.000000] GICv3: using LPI property table @0x0000000100230000
2025-04-15T11:46:40.491698 <6>[ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000100240000
2025-04-15T11:46:40.493576 <6>[ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.
2025-04-15T11:46:40.500310 <6>[ 0.000000] arch_timer: cp15 timer(s) running at 1000.00MHz (phys).
2025-04-15T11:46:40.500716 <6>[ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
2025-04-15T11:46:40.501266 <6>[ 0.000044] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns
2025-04-15T11:46:40.504674 <6>[ 0.003218] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)
2025-04-15T11:46:40.518438 <6>[ 0.015459] Console: colour dummy device 80x25
2025-04-15T11:46:40.522147 <6>[ 0.020294] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000)
2025-04-15T11:46:40.522465 <6>[ 0.021295] pid_max: default: 32768 minimum: 301
2025-04-15T11:46:40.524868 <6>[ 0.023574] LSM: initializing lsm=capability
2025-04-15T11:46:40.528323 <6>[ 0.027123] Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear)
2025-04-15T11:46:40.528637 <6>[ 0.027462] Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear)
2025-04-15T11:46:40.558196 <4>[ 0.056967] cacheinfo: Unable to detect cache hierarchy for CPU 0
2025-04-15T11:46:40.572884 <6>[ 0.071652] rcu: Hierarchical SRCU implementation.
2025-04-15T11:46:40.572974 <6>[ 0.071842] rcu: Max phase no-delay instances is 1000.
2025-04-15T11:46:40.576195 <6>[ 0.074421] Timer migration: 1 hierarchy levels; 8 children per group; 1 crossnode level
2025-04-15T11:46:40.586737 <6>[ 0.085519] fsl-mc MSI: its@8080000 domain created
2025-04-15T11:46:40.589431 <6>[ 0.088219] EFI services will not be available.
2025-04-15T11:46:40.592980 <6>[ 0.091753] smp: Bringing up secondary CPUs ...
2025-04-15T11:46:40.611952 <6>[ 0.103513] Detected PIPT I-cache on CPU1
2025-04-15T11:46:40.612066 <6>[ 0.104827] GICv3: CPU1: found redistributor 1 region 0:0x00000000080c0000
2025-04-15T11:46:40.612254 <6>[ 0.105492] GICv3: CPU1: using allocated LPI pending table @0x0000000100250000
2025-04-15T11:46:40.612430 <6>[ 0.107089] CPU1: Booted secondary processor 0x0000000001 [0x000f0510]
2025-04-15T11:46:40.612538 <6>[ 0.110687] smp: Brought up 1 node, 2 CPUs
2025-04-15T11:46:40.612745 <6>[ 0.111654] SMP: Total of 2 processors activated.
2025-04-15T11:46:40.613042 <6>[ 0.111976] CPU: All CPU(s) started at EL2
2025-04-15T11:46:40.613346 <6>[ 0.112241] CPU features: detected: 32-bit EL0 Support
2025-04-15T11:46:40.613604 <6>[ 0.112466] CPU features: detected: 32-bit EL1 Support
2025-04-15T11:46:40.613783 <6>[ 0.112658] CPU features: detected: ARMv8.4 Translation Table Level
2025-04-15T11:46:40.614094 <6>[ 0.112895] CPU features: detected: Instruction cache invalidation not required for I/D coherence
2025-04-15T11:46:40.614387 <6>[ 0.113210] CPU features: detected: Data cache clean to the PoU not required for I/D coherence
2025-04-15T11:46:40.614648 <6>[ 0.113510] CPU features: detected: Common not Private translations
2025-04-15T11:46:40.614834 <6>[ 0.113748] CPU features: detected: CRC32 instructions
2025-04-15T11:46:40.615007 <6>[ 0.113918] CPU features: detected: Data independent timing control (DIT)
2025-04-15T11:46:40.615161 <6>[ 0.114105] CPU features: detected: E0PD
2025-04-15T11:46:40.615383 <6>[ 0.114262] CPU features: detected: Enhanced Counter Virtualization
2025-04-15T11:46:40.615786 <6>[ 0.114482] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF)
2025-04-15T11:46:40.615884 <6>[ 0.114794] CPU features: detected: Enhanced Privileged Access Never
2025-04-15T11:46:40.616087 <6>[ 0.114980] CPU features: detected: Enhanced Virtualization Traps
2025-04-15T11:46:40.616269 <6>[ 0.115188] CPU features: detected: Fine Grained Traps
2025-04-15T11:46:40.616595 <6>[ 0.115431] CPU features: detected: Generic authentication (IMP DEF algorithm)
2025-04-15T11:46:40.616891 <6>[ 0.115759] CPU features: detected: RCpc load-acquire (LDAPR)
2025-04-15T11:46:40.617833 <6>[ 0.116654] CPU features: detected: 52-bit Virtual Addressing for KVM (LPA2)
2025-04-15T11:46:40.618032 <6>[ 0.116935] CPU features: detected: LSE atomic instructions
2025-04-15T11:46:40.618264 <6>[ 0.117135] CPU features: detected: Memory Copy and Memory Set instructions
2025-04-15T11:46:40.618463 <6>[ 0.117366] CPU features: detected: Privileged Access Never
2025-04-15T11:46:40.618714 <6>[ 0.117598] CPU features: detected: PMUv3
2025-04-15T11:46:40.618864 <6>[ 0.117763] CPU features: detected: RAS Extension Support
2025-04-15T11:46:40.619069 <6>[ 0.117966] CPU features: detected: Random Number Generator
2025-04-15T11:46:40.619275 <6>[ 0.118169] CPU features: detected: Speculation barrier (SB)
2025-04-15T11:46:40.619481 <6>[ 0.118377] CPU features: detected: Stage-2 Force Write-Back
2025-04-15T11:46:40.619904 <6>[ 0.118580] CPU features: detected: Trap EL0 IMPLEMENTATION DEFINED functionality
2025-04-15T11:46:40.620012 <6>[ 0.118873] CPU features: detected: TLB range maintenance instructions
2025-04-15T11:46:40.620197 <6>[ 0.119110] CPU features: detected: WFx with timeout
2025-04-15T11:46:40.620524 <6>[ 0.119362] CPU features: detected: Speculative Store Bypassing Safe (SSBS)
2025-04-15T11:46:40.620736 <6>[ 0.119625] CPU features: detected: Scalable Vector Extension
2025-04-15T11:46:40.631281 <6>[ 0.127803] alternatives: applying system-wide alternatives
2025-04-15T11:46:40.641593 <6>[ 0.139980] CPU features: detected: Hardware dirty bit management on CPU0-1
2025-04-15T11:46:40.641909 <6>[ 0.140794] SVE: maximum available vector length 256 bytes per vector
2025-04-15T11:46:40.642102 <6>[ 0.141014] SVE: default vector length 64 bytes per vector
2025-04-15T11:46:40.652245 <6>[ 0.150941] Memory: 3955692K/4194304K available (22976K kernel code, 6952K rwdata, 14412K rodata, 3584K init, 801K bss, 199832K reserved, 32768K cma-reserved)
2025-04-15T11:46:40.676281 <6>[ 0.175019] devtmpfs: initialized
2025-04-15T11:46:40.715914 <6>[ 0.214635] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns
2025-04-15T11:46:40.716512 <6>[ 0.215307] posixtimers hash table entries: 1024 (order: 2, 16384 bytes, linear)
2025-04-15T11:46:40.716808 <6>[ 0.215688] futex hash table entries: 512 (order: 3, 32768 bytes, linear)
2025-04-15T11:46:40.719622 <6>[ 0.218419] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL
2025-04-15T11:46:40.719932 <6>[ 0.218665] 0 pages in range for non-PLT usage
2025-04-15T11:46:40.723209 <6>[ 0.218747] 512032 pages in range for PLT usage
2025-04-15T11:46:40.723286 <6>[ 0.222011] pinctrl core: initialized pinctrl subsystem
2025-04-15T11:46:40.737938 <6>[ 0.236712] DMI not present or invalid.
2025-04-15T11:46:40.754800 <6>[ 0.253540] NET: Registered PF_NETLINK/PF_ROUTE protocol family
2025-04-15T11:46:40.767373 <6>[ 0.266083] DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations
2025-04-15T11:46:40.768429 <6>[ 0.267218] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
2025-04-15T11:46:40.770284 <6>[ 0.269088] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
2025-04-15T11:46:40.770853 <6>[ 0.269655] audit: initializing netlink subsys (disabled)
2025-04-15T11:46:40.773275 <5>[ 0.272071] audit: type=2000 audit(0.248:1): state=initialized audit_enabled=0 res=1
2025-04-15T11:46:40.779749 <6>[ 0.278494] thermal_sys: Registered thermal governor 'step_wise'
2025-04-15T11:46:40.780658 <6>[ 0.278556] thermal_sys: Registered thermal governor 'power_allocator'
2025-04-15T11:46:40.780723 <6>[ 0.279461] cpuidle: using governor menu
2025-04-15T11:46:40.782596 <6>[ 0.281396] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.
2025-04-15T11:46:40.783373 <6>[ 0.282206] ASID allocator initialised with 65536 entries
2025-04-15T11:46:40.798070 <6>[ 0.296843] Serial: AMBA PL011 UART driver
2025-04-15T11:46:41.003303 <6>[ 0.501984] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 15, base_baud = 0) is a PL011 rev1
2025-04-15T11:46:41.005509 <6>[ 0.503869] printk: console [ttyAMA0] enabled
2025-04-15T11:46:41.005860 <6>[ 0.503869] printk: console [ttyAMA0] enabled
2025-04-15T11:46:41.005987 <6>[ 0.504909] printk: legacy bootconsole [pl11] disabled
2025-04-15T11:46:41.006121 <6>[ 0.504909] printk: legacy bootconsole [pl11] disabled
2025-04-15T11:46:41.039266 <6>[ 0.537388] HugeTLB: allocation took 0ms with hugepage_allocation_threads=1
2025-04-15T11:46:41.039353 <6>[ 0.537739] HugeTLB: allocation took 0ms with hugepage_allocation_threads=1
2025-04-15T11:46:41.039667 <6>[ 0.538055] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
2025-04-15T11:46:41.039732 <6>[ 0.538078] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page
2025-04-15T11:46:41.039800 <6>[ 0.538115] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages
2025-04-15T11:46:41.040049 <6>[ 0.538128] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page
2025-04-15T11:46:41.040261 <6>[ 0.538143] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
2025-04-15T11:46:41.040568 <6>[ 0.538165] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page
2025-04-15T11:46:41.041112 <6>[ 0.538193] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages
2025-04-15T11:46:41.041285 <6>[ 0.538205] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page
2025-04-15T11:46:41.057579 <6>[ 0.556302] cryptd: max_cpu_qlen set to 1000
2025-04-15T11:46:41.078111 <6>[ 0.576853] ACPI: Interpreter disabled.
2025-04-15T11:46:41.114481 <6>[ 0.613099] iommu: Default domain type: Translated
2025-04-15T11:46:41.114568 <6>[ 0.613237] iommu: DMA domain TLB invalidation policy: strict mode
2025-04-15T11:46:41.116535 <5>[ 0.615277] SCSI subsystem initialized
2025-04-15T11:46:41.118653 <7>[ 0.617398] libata version 3.00 loaded.
2025-04-15T11:46:41.120350 <6>[ 0.619128] usbcore: registered new interface driver usbfs
2025-04-15T11:46:41.120612 <6>[ 0.619416] usbcore: registered new interface driver hub
2025-04-15T11:46:41.120871 <6>[ 0.619672] usbcore: registered new device driver usb
2025-04-15T11:46:41.128544 <6>[ 0.627279] mc: Linux media interface: v0.10
2025-04-15T11:46:41.128887 <6>[ 0.627672] videodev: Linux video capture interface: v2.00
2025-04-15T11:46:41.129281 <6>[ 0.627955] pps_core: LinuxPPS API ver. 1 registered
2025-04-15T11:46:41.129458 <6>[ 0.628011] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
2025-04-15T11:46:41.129592 <6>[ 0.628213] PTP clock support registered
2025-04-15T11:46:41.130733 <6>[ 0.629517] EDAC MC: Ver: 3.0.0
2025-04-15T11:46:41.135129 <6>[ 0.633875] scmi_core: SCMI protocol bus registered
2025-04-15T11:46:41.149701 <6>[ 0.648392] FPGA manager framework
2025-04-15T11:46:41.150602 <6>[ 0.649291] Advanced Linux Sound Architecture Driver Initialized.
2025-04-15T11:46:41.162522 <6>[ 0.661242] vgaarb: loaded
2025-04-15T11:46:41.165853 <6>[ 0.664576] clocksource: Switched to clocksource arch_sys_counter
2025-04-15T11:46:41.171502 <5>[ 0.670140] VFS: Disk quotas dquot_6.6.0
2025-04-15T11:46:41.171825 <6>[ 0.670625] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
2025-04-15T11:46:41.175056 <6>[ 0.673793] pnp: PnP ACPI: disabled
2025-04-15T11:46:41.214952 <6>[ 0.713662] NET: Registered PF_INET protocol family
2025-04-15T11:46:41.216441 <6>[ 0.715153] IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear)
2025-04-15T11:46:41.221748 <6>[ 0.720458] tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear)
2025-04-15T11:46:41.222182 <6>[ 0.720940] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
2025-04-15T11:46:41.222598 <6>[ 0.721377] TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear)
2025-04-15T11:46:41.223283 <6>[ 0.722058] TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear)
2025-04-15T11:46:41.224249 <6>[ 0.723026] TCP: Hash tables configured (established 32768 bind 32768)
2025-04-15T11:46:41.227177 <6>[ 0.725913] MPTCP token hash table entries: 4096 (order: 4, 98304 bytes, linear)
2025-04-15T11:46:41.227849 <6>[ 0.726598] UDP hash table entries: 2048 (order: 5, 131072 bytes, linear)
2025-04-15T11:46:41.228455 <6>[ 0.727221] UDP-Lite hash table entries: 2048 (order: 5, 131072 bytes, linear)
2025-04-15T11:46:41.229872 <6>[ 0.728651] NET: Registered PF_UNIX/PF_LOCAL protocol family
2025-04-15T11:46:41.241356 <6>[ 0.740093] RPC: Registered named UNIX socket transport module.
2025-04-15T11:46:41.241765 <6>[ 0.740613] RPC: Registered udp transport module.
2025-04-15T11:46:41.242078 <6>[ 0.740895] RPC: Registered tcp transport module.
2025-04-15T11:46:41.242315 <6>[ 0.741158] RPC: Registered tcp-with-tls transport module.
2025-04-15T11:46:41.242639 <6>[ 0.741446] RPC: Registered tcp NFSv4.1 backchannel transport module.
2025-04-15T11:46:41.243005 <6>[ 0.741883] PCI: CLS 0 bytes, default 64
2025-04-15T11:46:41.270535 <6>[ 0.769224] kvm [1]: nv: 566 coarse grained trap handlers
2025-04-15T11:46:41.273322 <6>[ 0.772028] kvm [1]: nv: 669 fine grained trap handlers
2025-04-15T11:46:41.276336 <6>[ 0.775073] kvm [1]: IPA Size Limit: 52 bits
2025-04-15T11:46:41.277104 <6>[ 0.775842] kvm [1]: GICv3: no GICV resource entry
2025-04-15T11:46:41.277416 <6>[ 0.775981] kvm [1]: disabling GICv2 emulation
2025-04-15T11:46:41.277886 <6>[ 0.776657] kvm [1]: GIC system register CPU interface enabled
2025-04-15T11:46:41.278664 <6>[ 0.777451] kvm [1]: vgic interrupt IRQ9
2025-04-15T11:46:41.279395 <6>[ 0.778165] kvm [1]: VHE mode initialized successfully
2025-04-15T11:46:41.288438 <5>[ 0.787171] Initialise system trusted keyrings
2025-04-15T11:46:41.290382 <6>[ 0.789128] workingset: timestamp_bits=42 max_order=20 bucket_order=0
2025-04-15T11:46:41.294662 <6>[ 0.793403] squashfs: version 4.0 (2009/01/31) Phillip Lougher
2025-04-15T11:46:41.300952 <5>[ 0.799693] NFS: Registering the id_resolver key type
2025-04-15T11:46:41.301136 <5>[ 0.800006] Key type id_resolver registered
2025-04-15T11:46:41.301458 <5>[ 0.800078] Key type id_legacy registered
2025-04-15T11:46:41.301833 <6>[ 0.800603] nfs4filelayout_init: NFSv4 File Layout Driver Registering...
2025-04-15T11:46:41.302096 <6>[ 0.800746] nfs4flexfilelayout_init: NFSv4 Flexfile Layout Driver Registering...
2025-04-15T11:46:41.302968 <6>[ 0.801754] 9p: Installing v9fs 9p2000 file system support
2025-04-15T11:46:41.338904 <6>[ 0.837602] NET: Registered PF_ALG protocol family
2025-04-15T11:46:41.339005 <5>[ 0.837882] Key type asymmetric registered
2025-04-15T11:46:41.339182 <5>[ 0.837990] Asymmetric key parser 'x509' registered
2025-04-15T11:46:41.339612 <6>[ 0.838298] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 244)
2025-04-15T11:46:41.339805 <6>[ 0.838466] io scheduler mq-deadline registered
2025-04-15T11:46:41.340141 <6>[ 0.838556] io scheduler kyber registered
2025-04-15T11:46:41.461124 <6>[ 0.959760] pl061_gpio 9030000.pl061: PL061 GPIO chip registered
2025-04-15T11:46:41.479309 <6>[ 0.978060] ledtrig-cpu: registered to indicate activity on CPUs
2025-04-15T11:46:41.487742 <6>[ 0.986419] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:
2025-04-15T11:46:41.488915 <6>[ 0.987522] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000
2025-04-15T11:46:41.489946 <6>[ 0.988652] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000
2025-04-15T11:46:41.490508 <6>[ 0.989229] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000
2025-04-15T11:46:41.491400 <4>[ 0.990140] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits
2025-04-15T11:46:41.492693 <6>[ 0.991163] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]
2025-04-15T11:46:41.494523 <6>[ 0.993292] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00
2025-04-15T11:46:41.495192 <6>[ 0.993938] pci_bus 0000:00: root bus resource [bus 00-ff]
2025-04-15T11:46:41.495542 <6>[ 0.994283] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]
2025-04-15T11:46:41.495826 <6>[ 0.994624] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]
2025-04-15T11:46:41.496168 <6>[ 0.994952] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]
2025-04-15T11:46:41.497862 <6>[ 0.996537] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint
2025-04-15T11:46:41.502433 <6>[ 1.001153] pci 0000:00:01.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint
2025-04-15T11:46:41.503276 <6>[ 1.002028] pci 0000:00:01.0: BAR 0 [io 0x0000-0x007f]
2025-04-15T11:46:41.503593 <6>[ 1.002369] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]
2025-04-15T11:46:41.504002 <6>[ 1.002723] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]
2025-04-15T11:46:41.508836 <6>[ 1.007561] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned
2025-04-15T11:46:41.509494 <6>[ 1.008176] pci 0000:00:01.0: BAR 1 [mem 0x10000000-0x10000fff]: assigned
2025-04-15T11:46:41.509870 <6>[ 1.008671] pci 0000:00:01.0: BAR 0 [io 0x1000-0x107f]: assigned
2025-04-15T11:46:41.510499 <6>[ 1.009278] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]
2025-04-15T11:46:41.510785 <6>[ 1.009591] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]
2025-04-15T11:46:41.511095 <6>[ 1.009899] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]
2025-04-15T11:46:41.804915 <6>[ 1.303534] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)
2025-04-15T11:46:41.851764 <6>[ 1.350449] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
2025-04-15T11:46:41.882697 <6>[ 1.381415] msm_serial: driver initialized
2025-04-15T11:46:41.886147 <6>[ 1.384880] SuperH (H)SCI(F) driver initialized
2025-04-15T11:46:41.887530 <6>[ 1.386315] STM32 USART driver initialized
2025-04-15T11:46:41.941437 <6>[ 1.440062] loop: module loaded
2025-04-15T11:46:41.942482 <6>[ 1.441177] virtio_blk virtio0: 2/0/0 default/read/poll queues
2025-04-15T11:46:41.952300 <5>[ 1.450994] virtio_blk virtio0: [vda] 5388544 512-byte logical blocks (2.76 GB/2.57 GiB)
2025-04-15T11:46:41.971666 <6>[ 1.470401] megasas: 07.727.03.00-rc1
2025-04-15T11:46:41.986030 <5>[ 1.484720] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]
2025-04-15T11:46:41.987862 <6>[ 1.486490] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000
2025-04-15T11:46:41.988521 <6>[ 1.487245] Intel/Sharp Extended Query Table at 0x0031
2025-04-15T11:46:41.989596 <6>[ 1.488280] Using buffer write method
2025-04-15T11:46:41.990140 <7>[ 1.488882] erase region 0: offset=0x0,size=0x40000,blocks=256
2025-04-15T11:46:41.990724 <5>[ 1.489453] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]
2025-04-15T11:46:41.991726 <6>[ 1.490394] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000
2025-04-15T11:46:41.992013 <6>[ 1.490866] Intel/Sharp Extended Query Table at 0x0031
2025-04-15T11:46:41.992888 <6>[ 1.491644] Using buffer write method
2025-04-15T11:46:41.993096 <7>[ 1.491926] erase region 0: offset=0x0,size=0x40000,blocks=256
2025-04-15T11:46:41.993462 <5>[ 1.492276] Concatenating MTD devices:
2025-04-15T11:46:41.993724 <5>[ 1.492608] (0): "0.flash"
2025-04-15T11:46:41.993989 <5>[ 1.492825] (1): "0.flash"
2025-04-15T11:46:41.994134 <5>[ 1.493045] into device "0.flash"
2025-04-15T11:46:42.066337 <6>[ 1.564975] thunder_xcv, ver 1.0
2025-04-15T11:46:42.066678 <6>[ 1.565369] thunder_bgx, ver 1.0
2025-04-15T11:46:42.066975 <6>[ 1.565775] nicpf, ver 1.0
2025-04-15T11:46:42.078492 <6>[ 1.577203] hns3: Hisilicon Ethernet Network Driver for Hip08 Family - version
2025-04-15T11:46:42.078706 <6>[ 1.577554] hns3: Copyright (c) 2017 Huawei Corporation.
2025-04-15T11:46:42.079446 <6>[ 1.578202] hclge is initializing
2025-04-15T11:46:42.079767 <6>[ 1.578552] e1000: Intel(R) PRO/1000 Network Driver
2025-04-15T11:46:42.079998 <6>[ 1.578831] e1000: Copyright (c) 1999-2006 Intel Corporation.
2025-04-15T11:46:42.080543 <6>[ 1.579329] e1000e: Intel(R) PRO/1000 Network Driver
2025-04-15T11:46:42.080815 <6>[ 1.579618] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.
2025-04-15T11:46:42.081336 <6>[ 1.580130] igb: Intel(R) Gigabit Ethernet Network Driver
2025-04-15T11:46:42.081660 <6>[ 1.580497] igb: Copyright (c) 2007-2014 Intel Corporation.
2025-04-15T11:46:42.082195 <6>[ 1.580983] igbvf: Intel(R) Gigabit Virtual Function Network Driver
2025-04-15T11:46:42.082469 <6>[ 1.581306] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.
2025-04-15T11:46:42.085857 <6>[ 1.584580] sky2: driver version 1.30
2025-04-15T11:46:42.100036 <6>[ 1.598785] VFIO - User Level meta-driver version: 0.3
2025-04-15T11:46:42.127330 <6>[ 1.625758] usbcore: registered new interface driver usb-storage
2025-04-15T11:46:42.157484 <6>[ 1.656112] rtc-pl031 9010000.pl031: registered as rtc0
2025-04-15T11:46:42.158548 <6>[ 1.657071] rtc-pl031 9010000.pl031: setting system clock to 2025-04-15T11:46:42 UTC (1744717602)
2025-04-15T11:46:42.165269 <6>[ 1.663891] i2c_dev: i2c /dev entries driver
2025-04-15T11:46:42.236679 <6>[ 1.735263] sdhci: Secure Digital Host Controller Interface driver
2025-04-15T11:46:42.237017 <6>[ 1.735312] sdhci: Copyright(c) Pierre Ossman
2025-04-15T11:46:42.242802 <6>[ 1.741444] Synopsys Designware Multimedia Card Interface Driver
2025-04-15T11:46:42.251793 <6>[ 1.750381] sdhci-pltfm: SDHCI platform and OF driver helper
2025-04-15T11:46:42.294166 <6>[ 1.792658] usbcore: registered new interface driver usbhid
2025-04-15T11:46:42.294250 <6>[ 1.792727] usbhid: USB HID core driver
2025-04-15T11:46:42.320557 <6>[ 1.819136] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available
2025-04-15T11:46:42.329512 <6>[ 1.827955] cs_system_cfg: CoreSight Configuration manager initialised
2025-04-15T11:46:42.364772 <6>[ 1.863346] NET: Registered PF_INET6 protocol family
2025-04-15T11:46:42.371721 <6>[ 1.870399] Segment Routing with IPv6
2025-04-15T11:46:42.371827 <6>[ 1.870648] In-situ OAM (IOAM) with IPv6
2025-04-15T11:46:42.372535 <6>[ 1.871242] NET: Registered PF_PACKET protocol family
2025-04-15T11:46:42.373922 <6>[ 1.872666] 9pnet: Installing 9P2000 support
2025-04-15T11:46:42.374280 <5>[ 1.873048] Key type dns_resolver registered
2025-04-15T11:46:42.448991 <6>[ 1.947590] registered taskstats version 1
2025-04-15T11:46:42.450269 <5>[ 1.948985] Loading compiled-in X.509 certificates
2025-04-15T11:46:42.508160 <6>[ 2.006452] Demotion targets for Node 0: null
2025-04-15T11:46:42.518510 <6>[ 2.016998] input: gpio-keys as /devices/platform/gpio-keys/input/input0
2025-04-15T11:46:42.525600 <6>[ 2.024121] clk: Disabling unused clocks
2025-04-15T11:46:42.525938 <6>[ 2.024408] PM: genpd: Disabling unused power domains
2025-04-15T11:46:42.526129 <6>[ 2.024837] ALSA device list:
2025-04-15T11:46:42.526348 <6>[ 2.024950] No soundcards found.
2025-04-15T11:46:42.560091 <6>[ 2.058449] EXT4-fs (vda): mounted filesystem 2ea66019-2eda-4da4-821a-b9ba5736bba0 r/w with ordered data mode. Quota mode: none.
2025-04-15T11:46:42.560542 <6>[ 2.058874] VFS: Mounted root (ext4 filesystem) on device 254:0.
2025-04-15T11:46:42.562145 <6>[ 2.060881] devtmpfs: mounted
2025-04-15T11:46:42.898982 <6>[ 2.397407] Freeing unused kernel memory: 3584K
2025-04-15T11:46:42.899846 <6>[ 2.398446] Run /sbin/init as init process
2025-04-15T11:46:42.899919 <7>[ 2.398569] with arguments:
2025-04-15T11:46:42.899983 <7>[ 2.398628] /sbin/init
2025-04-15T11:46:42.900377 <7>[ 2.398669] verbose
2025-04-15T11:46:42.900729 <7>[ 2.398720] with environment:
2025-04-15T11:46:42.901025 <7>[ 2.398748] HOME=/
2025-04-15T11:46:42.901091 <7>[ 2.398784] TERM=linux
2025-04-15T11:46:43.352086 [!p]104[?7h
2025-04-15T11:46:43.352177 [0;1;39mWelcome to [0m[1mDebian GNU/Linux trixie/sid[0m[0;1;39m![0m
2025-04-15T11:46:43.352236
2025-04-15T11:46:45.438339 [[0;32m OK [0m] Created slice [0;1;39msystem-getty.slice[0m - Slice /system/getty.
2025-04-15T11:46:45.448550 [[0;32m OK [0m] Created slice [0;1;39msystem-modprobe.slice[0m - Slice /system/modprobe.
2025-04-15T11:46:45.458278 [[0;32m OK [0m] Created slice [0;1;39msystem-serial\x2dget…slice[0m - Slice /system/serial-getty.
2025-04-15T11:46:45.469186 [[0;32m OK [0m] Created slice [0;1;39msystem-xfs_scrub.sli…[0mxfs_scrub background service slice.
2025-04-15T11:46:45.478069 [[0;32m OK [0m] Created slice [0;1;39muser.slice[0m - User and Session Slice.
2025-04-15T11:46:45.481689 [[0;32m OK [0m] Started [0;1;39msystemd-ask-password-conso…[0mequests to Console Directory Watch.
2025-04-15T11:46:45.483997 [[0;32m OK [0m] Started [0;1;39msystemd-ask-password-wall.…[0md Requests to Wall Directory Watch.
2025-04-15T11:46:45.487060 Expecting device [0;1;39mdev-ttyAMA0.device[0m - /dev/ttyAMA0...
2025-04-15T11:46:45.488496 [[0;32m OK [0m] Reached target [0;1;39mpaths.target[0m - Path Units.
2025-04-15T11:46:45.490139 [[0;32m OK [0m] Reached target [0;1;39mremote-fs.target[0m - Remote File Systems.
2025-04-15T11:46:45.491285 [[0;32m OK [0m] Reached target [0;1;39mslices.target[0m - Slice Units.
2025-04-15T11:46:45.492535 [[0;32m OK [0m] Reached target [0;1;39mswap.target[0m - Swaps.
2025-04-15T11:46:45.506584 [[0;32m OK [0m] Listening on [0;1;39msystemd-creds.socket[0m - Credential Encryption/Decryption.
2025-04-15T11:46:45.510252 [[0;32m OK [0m] Listening on [0;1;39msystemd-initctl.socke…[0m- initctl Compatibility Named Pipe.
2025-04-15T11:46:45.514108 [[0;32m OK [0m] Listening on [0;1;39msystemd-journald-dev-…socket[0m - Journal Socket (/dev/log).
2025-04-15T11:46:45.517579 [[0;32m OK [0m] Listening on [0;1;39msystemd-journald.socket[0m - Journal Sockets.
2025-04-15T11:46:45.521464 [[0;32m OK [0m] Listening on [0;1;39msystemd-udevd-control.socket[0m - udev Control Socket.
2025-04-15T11:46:45.523919 [[0;32m OK [0m] Listening on [0;1;39msystemd-udevd-kernel.socket[0m - udev Kernel Socket.
2025-04-15T11:46:45.556116 Mounting [0;1;39mdev-hugepages.mount[0m - Huge Pages File System...
2025-04-15T11:46:45.576955 Mounting [0;1;39mdev-mqueue.mount[0m - POSIX Message Queue File System...
2025-04-15T11:46:45.618194 Mounting [0;1;39mrun-lock.mount[0m - Legacy Locks Directory /run/lock...
2025-04-15T11:46:45.657114 Mounting [0;1;39msys-kernel-debug.mount[0m - Kernel Debug File System...
2025-04-15T11:46:45.715628 Mounting [0;1;39msys-kernel-tracing.mount[0m - Kernel Trace File System...
2025-04-15T11:46:45.786472 Mounting [0;1;39mtmp.mount[0m - Temporary Directory /tmp...
2025-04-15T11:46:45.881670 Starting [0;1;39mkmod-static-nodes.service[0m…eate List of Static Device Nodes...
2025-04-15T11:46:45.960768 Starting [0;1;39mmodprobe@configfs.service[0m - Load Kernel Module configfs...
2025-04-15T11:46:45.999670 Starting [0;1;39mmodprobe@drm.service[0m - Load Kernel Module drm...
2025-04-15T11:46:46.028836 Starting [0;1;39mmodprobe@efi_pstore.servi…[0m - Load Kernel Module efi_pstore...
2025-04-15T11:46:46.070551 Starting [0;1;39mmodprobe@fuse.service[0m - Load Kernel Module fuse...
2025-04-15T11:46:46.130296 Starting [0;1;39msystemd-journald.service[0m - Journal Service...
2025-04-15T11:46:46.159721 Starting [0;1;39msystemd-modules-load.service[0m - Load Kernel Modules...
2025-04-15T11:46:46.190052 Starting [0;1;39msystemd-remount-fs.servic…[0munt Root and Kernel File Systems...
2025-04-15T11:46:46.213876 Starting [0;1;39msystemd-udev-load-credent…[0mLoad udev Rules from Credentials...
2025-04-15T11:46:46.254240 Starting [0;1;39msystemd-udev-trigger.service[0m - Coldplug All udev Devices...
2025-04-15T11:46:46.308239 [[0;32m OK [0m] Mounted [0;1;39mdev-hugepages.mount[0m - Huge Pages File System.
2025-04-15T11:46:46.312710 [[0;32m OK [0m] Mounted [0;1;39mdev-mqueue.mount[0m - POSIX Message Queue File System.
2025-04-15T11:46:46.320807 [[0;32m OK [0m] Mounted [0;1;39mrun-lock.mount[0m - Legacy Locks Directory /run/lock.
2025-04-15T11:46:46.325160 [[0;32m OK [0m] Mounted [0;1;39msys-kernel-debug.mount[0m - Kernel Debug File System.
2025-04-15T11:46:46.329266 [[0;32m OK [0m] Mounted [0;1;39msys-kernel-tracing.mount[0m - Kernel Trace File System.
2025-04-15T11:46:46.333618 [[0;32m OK [0m] Mounted [0;1;39mtmp.mount[0m - Temporary Directory /tmp.
2025-04-15T11:46:46.346514 [[0;32m OK [0m] Finished [0;1;39mkmod-static-nodes.service[0m…Create List of Static Device Nodes.
2025-04-15T11:46:46.385768 Starting [0;1;39msystemd-tmpfiles-setup-de…[0m Device Nodes in /dev gracefully...
2025-04-15T11:46:46.898494 [[0;32m OK [0m] Finished [0;1;39msystemd-remount-fs.servic…[0mmount Root and Kernel File Systems.
2025-04-15T11:46:46.915791 [[0;32m OK [0m] Finished [0;1;39msystemd-modules-load.service[0m - Load Kernel Modules.
2025-04-15T11:46:46.952758 Starting [0;1;39msystemd-random-seed.service[0m - Load/Save OS Random Seed...
2025-04-15T11:46:47.049944 Starting [0;1;39msystemd-sysctl.service[0m - Apply Kernel Variables...
2025-04-15T11:46:47.132088 [[0;32m OK [0m] Finished [0;1;39msystemd-udev-load-credent…[0m- Load udev Rules from Credentials.
2025-04-15T11:46:47.172008 [[0;32m OK [0m] Finished [0;1;39msystemd-tmpfiles-setup-de…[0mic Device Nodes in /dev gracefully.
2025-04-15T11:46:47.201067 Starting [0;1;39msystemd-sysusers.service[0m - Create System Users...
2025-04-15T11:46:47.417818 <6>[ 6.913806] fuse: init (API version 7.43)
2025-04-15T11:46:47.499535 [[0;32m OK [0m] Finished [0;1;39mmodprobe@configfs.service[0m - Load Kernel Module configfs.
2025-04-15T11:46:47.538253 Mounting [0;1;39msys-kernel-config.mount[0m - Kernel Configuration File System...
2025-04-15T11:46:47.564935 [[0;32m OK [0m] Finished [0;1;39mmodprobe@efi_pstore.service[0m - Load Kernel Module efi_pstore.
2025-04-15T11:46:47.599031 [[0;32m OK [0m] Finished [0;1;39mmodprobe@fuse.service[0m - Load Kernel Module fuse.
2025-04-15T11:46:47.638261 Mounting [0;1;39msys-fs-fuse-connections.mount[0m - FUSE Control File System...
2025-04-15T11:46:47.790488 [[0;32m OK [0m] Mounted [0;1;39msys-fs-fuse-connections.mount[0m - FUSE Control File System.
2025-04-15T11:46:47.796408 [[0;32m OK [0m] Mounted [0;1;39msys-kernel-config.mount[0m - Kernel Configuration File System.
2025-04-15T11:46:47.826412 [[0;32m OK [0m] Finished [0;1;39msystemd-random-seed.service[0m - Load/Save OS Random Seed.
2025-04-15T11:46:47.874499 [[0;32m OK [0m] Finished [0;1;39msystemd-sysusers.service[0m - Create System Users.
2025-04-15T11:46:47.908644 Starting [0;1;39msystemd-tmpfiles-setup-de…[0meate Static Device Nodes in /dev...
2025-04-15T11:46:47.948422 [[0;32m OK [0m] Finished [0;1;39mmodprobe@drm.service[0m - Load Kernel Module drm.
2025-04-15T11:46:47.960451 [[0;32m OK [0m] Finished [0;1;39msystemd-sysctl.service[0m - Apply Kernel Variables.
2025-04-15T11:46:48.376222 [[0;32m OK [0m] Finished [0;1;39msystemd-tmpfiles-setup-de…[0mCreate Static Device Nodes in /dev.
2025-04-15T11:46:48.389338 [[0;32m OK [0m] Reached target [0;1;39mlocal-fs-pre.target[0m…Preparation for Local File Systems.
2025-04-15T11:46:48.391898 [[0;32m OK [0m] Reached target [0;1;39mlocal-fs.target[0m - Local File Systems.
2025-04-15T11:46:48.411433 [[0;32m OK [0m] Listening on [0;1;39msystemd-sysext.socket[0m… System Extension Image Management.
2025-04-15T11:46:48.454302 Starting [0;1;39msystemd-udevd.service[0m - R…ager for Device Events and Files...
2025-04-15T11:46:48.511281 [[0;32m OK [0m] Started [0;1;39msystemd-journald.service[0m - Journal Service.
2025-04-15T11:46:48.548817 Starting [0;1;39msystemd-journal-flush.ser…[0msh Journal to Persistent Storage...
2025-04-15T11:46:49.390635 [[0;32m OK [0m] Finished [0;1;39msystemd-journal-flush.ser…[0mlush Journal to Persistent Storage.
2025-04-15T11:46:49.424672 Starting [0;1;39msystemd-tmpfiles-setup.se…[0mate System Files and Directories...
2025-04-15T11:46:49.773210 [[0;32m OK [0m] Started [0;1;39msystemd-udevd.service[0m - Ru…anager for Device Events and Files.
2025-04-15T11:46:50.075674 [[0;32m OK [0m] Finished [0;1;39msystemd-tmpfiles-setup.se…[0mreate System Files and Directories.
2025-04-15T11:46:50.116961 Starting [0;1;39mldconfig.service[0m - Rebuild Dynamic Linker Cache...
2025-04-15T11:46:50.150380 Starting [0;1;39msystemd-journal-catalog-u…ervice[0m - Rebuild Journal Catalog...
2025-04-15T11:46:51.049318 [[0;32m OK [0m] Finished [0;1;39msystemd-journal-catalog-u….service[0m - Rebuild Journal Catalog.
2025-04-15T11:46:51.287603 [[0;32m OK [0m] Finished [0;1;39mldconfig.service[0m - Rebuild Dynamic Linker Cache.
2025-04-15T11:46:51.320658 Starting [0;1;39msystemd-update-done.service[0m - Update is Completed...
2025-04-15T11:46:51.507482 [[0;32m OK [0m] Finished [0;1;39msystemd-update-done.service[0m - Update is Completed.
2025-04-15T11:46:53.761004 [[0m[0;31m* [0m] (1 of 2) Job systemd-udev-trigger.s…vice/start running (8s / no limit)
2025-04-15T11:46:54.345636 M
[K[[0;1;31m*[0m[0;31m* [0m] (1 of 2) Job systemd-udev-trigger.s…vice/start running (8s / no limit)
2025-04-15T11:46:54.928961 M
[K[[0;31m*[0;1;31m*[0m[0;31m* [0m] (1 of 2) Job systemd-udev-trigger.s…vice/start running (9s / no limit)
2025-04-15T11:46:55.035077 M
[K[[0;32m OK [0m] Finished [0;1;39msystemd-udev-trigger.service[0m - Coldplug All udev Devices.
2025-04-15T11:46:55.067918 [K[[0;32m OK [0m] Reached target [0;1;39msysinit.target[0m - System Initialization.
2025-04-15T11:46:55.076359 [[0;32m OK [0m] Started [0;1;39mapt-daily.timer[0m - Daily apt download activities.
2025-04-15T11:46:55.079239 [[0;32m OK [0m] Started [0;1;39mapt-daily-upgrade.timer[0m - …y apt upgrade and clean activities.
2025-04-15T11:46:55.081829 [[0;32m OK [0m] Started [0;1;39mdpkg-db-backup.timer[0m - Daily dpkg database backup timer.
2025-04-15T11:46:55.085227 [[0;32m OK [0m] Started [0;1;39me2scrub_all.timer[0m - Period…Metadata Check for All Filesystems.
2025-04-15T11:46:55.088586 [[0;32m OK [0m] Started [0;1;39mfstrim.timer[0m - Discard unused filesystem blocks once a week.
2025-04-15T11:46:55.092934 [[0;32m OK [0m] Started [0;1;39mlogrotate.timer[0m - Daily rotation of log files.
2025-04-15T11:46:55.094697 [[0;32m OK [0m] Started [0;1;39msystemd-tmpfiles-clean.tim…[0my Cleanup of Temporary Directories.
2025-04-15T11:46:55.098561 [[0;32m OK [0m] Started [0;1;39mxfs_scrub_all.timer[0m - Peri…Metadata Check for All Filesystems.
2025-04-15T11:46:55.099713 [[0;32m OK [0m] Reached target [0;1;39mtimers.target[0m - Timer Units.
2025-04-15T11:46:55.114836 [[0;32m OK [0m] Listening on [0;1;39mdbus.socket[0m - D-Bus System Message Bus Socket.
2025-04-15T11:46:55.117258 [[0;32m OK [0m] Listening on [0;1;39msystemd-hostnamed.socket[0m - Hostname Service Socket.
2025-04-15T11:46:55.118653 [[0;32m OK [0m] Reached target [0;1;39msockets.target[0m - Socket Units.
2025-04-15T11:46:55.120235 [[0;32m OK [0m] Reached target [0;1;39mbasic.target[0m - Basic System.
2025-04-15T11:46:55.153065 [[0;32m OK [0m] Started [0;1;39mcron.service[0m - Regular background program processing daemon.
2025-04-15T11:46:55.184723 Starting [0;1;39mdbus.service[0m - D-Bus System Message Bus...
2025-04-15T11:46:55.229216 Starting [0;1;39me2scrub_reap.service[0m - Re…ne ext4 Metadata Check Snapshots...
2025-04-15T11:46:55.322208 Starting [0;1;39msystemd-logind.service[0m - User Login Management...
2025-04-15T11:46:55.353149 Starting [0;1;39msystemd-user-sessions.service[0m - Permit User Sessions...
2025-04-15T11:46:55.735219 [[0;32m OK [0m] Found device [0;1;39mdev-ttyAMA0.device[0m - /dev/ttyAMA0.
2025-04-15T11:46:55.833958 [[0;32m OK [0m] Started [0;1;39mdbus.service[0m - D-Bus System Message Bus.
2025-04-15T11:46:55.898799 [[0;32m OK [0m] Finished [0;1;39msystemd-user-sessions.service[0m - Permit User Sessions.
2025-04-15T11:46:55.943095 [[0;32m OK [0m] Started [0;1;39mgetty@tty1.service[0m - Getty on tty1.
2025-04-15T11:46:55.975585 [[0;32m OK [0m] Started [0;1;39mserial-getty@ttyAMA0.service[0m - Serial Getty on ttyAMA0.
2025-04-15T11:46:55.977269 [[0;32m OK [0m] Reached target [0;1;39mgetty.target[0m - Login Prompts.
2025-04-15T11:46:56.224401 [[0;32m OK [0m] Finished [0;1;39me2scrub_reap.service[0m - Re…line ext4 Metadata Check Snapshots.
2025-04-15T11:46:56.835468 [[0;32m OK [0m] Started [0;1;39msystemd-logind.service[0m - User Login Management.
2025-04-15T11:46:57.018786 [[0;32m OK [0m] Reached target [0;1;39mmulti-user.target[0m - Multi-User System.
2025-04-15T11:46:57.023206 [[0;32m OK [0m] Reached target [0;1;39mgraphical.target[0m - Graphical Interface.
2025-04-15T11:46:58.848194 [!p]104[?7h[6n[32766;32766H[6n[!p]104[?7h[6n[32766;32766H[6n
2025-04-15T11:46:58.848591 Debian GNU/Linux trixie/sid runner-xxurkrix-project-40964107-concurrent-0 ttyAMA0
2025-04-15T11:46:58.848658
2025-04-15T11:46:58.951038 runner-xxurkrix-project-40964107-concurrent-0 login: root
2025-04-15T11:46:59.320083 Linux runner-xxurkrix-project-40964107-concurrent-0 6.14.0 #1 SMP PREEMPT @1743678930 aarch64
2025-04-15T11:46:59.323032
2025-04-15T11:46:59.323307 The programs included with the Debian GNU/Linux system are free software;
2025-04-15T11:46:59.323632 the exact distribution terms for each program are described in the
2025-04-15T11:46:59.323725 individual files in /usr/share/doc/*/copyright.
2025-04-15T11:46:59.323801
2025-04-15T11:46:59.324171 Debian GNU/Linux comes with ABSOLUTELY NO WARRANTY, to the extent
2025-04-15T11:46:59.324250 permitted by applicable law.
2025-04-15T11:47:02.284631 [?2004hroot@runner-xxurkrix-project-40964107-concurrent-0:~#
2025-04-15T11:47:02.389820 [?2004l
[?2004hroot@runner-xxurkrix-project-40964107-concurrent-0:~# #
2025-04-15T11:47:02.493901 [?2004l
[?2004hroot@runner-xxurkrix-project-40964107-concurrent-0:~# export SHELL=/bin/sh
2025-04-15T11:47:02.598115 [?2004l
[?2004hroot@runner-xxurkrix-project-40964107-concurrent-0:~# . /lava-1/environment
2025-04-15T11:47:02.704024 [?2004l
[?2004hroot@runner-xxurkrix-project-40964107-concurrent-0:~# /lava-1/bin/lava-test-runne
er /lava-1/0
2025-04-15T11:47:03.088344 [?2004l
+ export TESTRUN_ID=0_ltp-syscalls
2025-04-15T11:47:03.088899 + cd /lava-1/0/tests/0_ltp-syscalls
2025-04-15T11:47:03.094585 + cat uuid
2025-04-15T11:47:03.107647 + UUID=1_1.1.3.1
2025-04-15T11:47:03.108099 + set +x
2025-04-15T11:47:03.109156 <8>[ 22.607838] <LAVA_SIGNAL_STARTRUN 0_ltp-syscalls 1_1.1.3.1>
2025-04-15T11:47:03.111843 + cd ./automated/linux/ltp/
2025-04-15T11:47:03.120922 + ./ltp.sh -T syscalls -s true -v -M 5 -R root -r kirk -b -d /scratch -g -e production -i /opt/ltp/ -S skipfile-lkft.yaml -p -u -t false -n 25 -c 4
2025-04-15T11:47:03.144459 + . ../../lib/sh-test-lib
2025-04-15T11:47:03.147126 ++ LANG=C
2025-04-15T11:47:03.147549 ++ export LANG
2025-04-15T11:47:03.168115 ++ export PATH=/lava-1/0/../bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/sbin:/usr/sbin:/usr/local/sbin
2025-04-15T11:47:03.168573 ++ PATH=/lava-1/0/../bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/sbin:/usr/sbin:/usr/local/sbin
2025-04-15T11:47:03.175506 ++ kernel_config=
2025-04-15T11:47:03.185881 ++ pwd
2025-04-15T11:47:03.191089 + OUTPUT=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output
2025-04-15T11:47:03.192362 + RESULT_FILE=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output/result.txt
2025-04-15T11:47:03.200729 ++ readlink -f ./ltp.sh
2025-04-15T11:47:03.215061 + SCRIPT=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/ltp.sh
2025-04-15T11:47:03.224451 ++ dirname /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/ltp.sh
2025-04-15T11:47:03.242712 + SCRIPTPATH=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp
2025-04-15T11:47:03.243681 + echo 'Script path is: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp'
2025-04-15T11:47:03.244472 Script path is: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp
2025-04-15T11:47:03.244725 + TST_CMDFILES=
2025-04-15T11:47:03.244951 + SKIPFILE=
2025-04-15T11:47:03.245177 + SKIPFILE_YAML=
2025-04-15T11:47:03.245806 + BOARD=
2025-04-15T11:47:03.245909 + BRANCH=
2025-04-15T11:47:03.246168 + ENVIRONMENT=
2025-04-15T11:47:03.246416 + LTP_VERSION=20180926
2025-04-15T11:47:03.246659 + TEST_PROGRAM=ltp
2025-04-15T11:47:03.246901 + TEST_GIT_URL=
2025-04-15T11:47:03.257906 ++ pwd
2025-04-15T11:47:03.262527 + TEST_DIR=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/ltp
2025-04-15T11:47:03.263238 + BUILD_FROM_TAR=false
2025-04-15T11:47:03.263455 + SHARD_NUMBER=1
2025-04-15T11:47:03.263670 + SHARD_INDEX=1
2025-04-15T11:47:03.263895 + RUNNER=
2025-04-15T11:47:03.264299 + LTP_TMPDIR=/ltp-tmp
2025-04-15T11:47:03.264535 + LTP_INSTALL_PATH=/opt/ltp
2025-04-15T11:47:03.267706 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.268261 + case "$arg" in
2025-04-15T11:47:03.268504 + TST_CMDFILES=syscalls
2025-04-15T11:47:03.291114 ++ echo syscalls
2025-04-15T11:47:03.292967 ++ sed 's,\/,_,'
2025-04-15T11:47:03.345240 + LOG_FILE=syscalls
2025-04-15T11:47:03.346255 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.346721 + case "$arg" in
2025-04-15T11:47:03.347140 + SKIP_INSTALL=true
2025-04-15T11:47:03.347552 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.347783 + case "$arg" in
2025-04-15T11:47:03.348005 + LTP_VERSION=
2025-04-15T11:47:03.348391 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.348606 + case "$arg" in
2025-04-15T11:47:03.349035 + export LTP_TIMEOUT_MUL=5
2025-04-15T11:47:03.349254 + LTP_TIMEOUT_MUL=5
2025-04-15T11:47:03.349810 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.350091 + case "$arg" in
2025-04-15T11:47:03.350493 + export PASSWD=root
2025-04-15T11:47:03.350555 + PASSWD=root
2025-04-15T11:47:03.351025 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.351124 + case "$arg" in
2025-04-15T11:47:03.351517 + export RUNNER=kirk
2025-04-15T11:47:03.351572 + RUNNER=kirk
2025-04-15T11:47:03.352009 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.352243 + case "$arg" in
2025-04-15T11:47:03.352463 + export BOARD=
2025-04-15T11:47:03.352685 + BOARD=
2025-04-15T11:47:03.353082 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.353145 + case "$arg" in
2025-04-15T11:47:03.353908 + export LTP_TMPDIR=/scratch
2025-04-15T11:47:03.354130 + LTP_TMPDIR=/scratch
2025-04-15T11:47:03.354359 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.354742 + case "$arg" in
2025-04-15T11:47:03.354984 + export BRANCH=
2025-04-15T11:47:03.355041 + BRANCH=
2025-04-15T11:47:03.355449 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.355668 + case "$arg" in
2025-04-15T11:47:03.356088 + export ENVIRONMENT=production
2025-04-15T11:47:03.356147 + ENVIRONMENT=production
2025-04-15T11:47:03.356553 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.356770 + case "$arg" in
2025-04-15T11:47:03.357152 + export LTP_INSTALL_PATH=/opt/ltp/
2025-04-15T11:47:03.358266 + LTP_INSTALL_PATH=/opt/ltp/
2025-04-15T11:47:03.358724 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.358803 + case "$arg" in
2025-04-15T11:47:03.359774 + '[' -z skipfile-lkft.yaml ']'
2025-04-15T11:47:03.360211 + '[' yaml = yaml ']'
2025-04-15T11:47:03.360611 + SKIPFILE_YAML=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml
2025-04-15T11:47:03.361093 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.361316 + case "$arg" in
2025-04-15T11:47:03.362743 + [[ '' != '' ]]
2025-04-15T11:47:03.363144 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.363394 + case "$arg" in
2025-04-15T11:47:03.363638 + [[ '' != '' ]]
2025-04-15T11:47:03.364081 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.364158 + case "$arg" in
2025-04-15T11:47:03.364541 + BUILD_FROM_TAR=false
2025-04-15T11:47:03.364802 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.365019 + case "$arg" in
2025-04-15T11:47:03.366368 + SHARD_NUMBER=25
2025-04-15T11:47:03.366757 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.366980 + case "$arg" in
2025-04-15T11:47:03.367222 + SHARD_INDEX=4
2025-04-15T11:47:03.367461 + getopts M:T:S:b:d:g:e:i:s:v:R:r:u:p:t:c:n: arg
2025-04-15T11:47:03.368571 + TEST_TARFILE=https://github.com/linux-test-project/ltp/releases/download//ltp-full-.tar.xz
2025-04-15T11:47:03.369161 + '[' -n /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml ']'
2025-04-15T11:47:03.371164 + export SKIPFILE_PATH=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile
2025-04-15T11:47:03.371483 + SKIPFILE_PATH=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile
2025-04-15T11:47:03.371732 + generate_skipfile
2025-04-15T11:47:03.372612 + info_msg 'Generating a skipfile based on /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml'
2025-04-15T11:47:03.373697 + local 'msg=Generating a skipfile based on /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml'
2025-04-15T11:47:03.375758 + '[' -z 'Generating a skipfile based on /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml' ']'
2025-04-15T11:47:03.376482 + printf 'INFO: %s\n' 'Generating a skipfile based on /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml'
2025-04-15T11:47:03.377485 INFO: Generating a skipfile based on /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml
2025-04-15T11:47:03.378431 + detect_abi
2025-04-15T11:47:03.388588 ++ uname -m
2025-04-15T11:47:03.402594 + abi=aarch64
2025-04-15T11:47:03.403221 + case "${abi}" in
2025-04-15T11:47:03.403443 + abi=arm64
2025-04-15T11:47:03.404353 + local SKIPGEN_ARGS=
2025-04-15T11:47:03.404758 + test -n ''
2025-04-15T11:47:03.404979 + test -n ''
2025-04-15T11:47:03.406832 + test -n production
2025-04-15T11:47:03.407336 + SKIPGEN_ARGS=' --environment production'
2025-04-15T11:47:03.408033 + ../../bin/arm64/skipgen --environment production /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/skipfile-lkft.yaml
2025-04-15T11:47:03.666742 + res=0
2025-04-15T11:47:03.667287 + test 0 -eq 0
2025-04-15T11:47:03.667754 + info_msg 'Using the following generated skipfile contents (until EOF):'
2025-04-15T11:47:03.668221 + local 'msg=Using the following generated skipfile contents (until EOF):'
2025-04-15T11:47:03.668753 + '[' -z 'Using the following generated skipfile contents (until EOF):' ']'
2025-04-15T11:47:03.669184 + printf 'INFO: %s\n' 'Using the following generated skipfile contents (until EOF):'
2025-04-15T11:47:03.669617 INFO: Using the following generated skipfile contents (until EOF):
2025-04-15T11:47:03.670289 + cat /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile
2025-04-15T11:47:03.684679 bind06
2025-04-15T11:47:03.684748 cve-2018-18559
2025-04-15T11:47:03.684823 dio10
2025-04-15T11:47:03.684886 dio12
2025-04-15T11:47:03.684949 dio13
2025-04-15T11:47:03.685030 dio14
2025-04-15T11:47:03.685089 dio15
2025-04-15T11:47:03.685152 dio16
2025-04-15T11:47:03.685218 dio17
2025-04-15T11:47:03.685284 dio18
2025-04-15T11:47:03.685341 dio19
2025-04-15T11:47:03.685621 dio20
2025-04-15T11:47:03.685891 dio21
2025-04-15T11:47:03.685967 dio22
2025-04-15T11:47:03.686038 dio23
2025-04-15T11:47:03.686107 dio24
2025-04-15T11:47:03.686192 dio25
2025-04-15T11:47:03.686263 dio26
2025-04-15T11:47:03.686333 dio27
2025-04-15T11:47:03.686415 dio28
2025-04-15T11:47:03.686485 dio29
2025-04-15T11:47:03.686555 dio30
2025-04-15T11:47:03.686637 fanotify07
2025-04-15T11:47:03.686708 fanotify08
2025-04-15T11:47:03.686815 fanotify09
2025-04-15T11:47:03.686945 fork13
2025-04-15T11:47:03.687039 ftrace_stress_test.sh
2025-04-15T11:47:03.687123 futex_wake04
2025-04-15T11:47:03.687182 gf01
2025-04-15T11:47:03.687248 gf14
2025-04-15T11:47:03.687325 gf15
2025-04-15T11:47:03.687389 gf18
2025-04-15T11:47:03.687431 hackbench01
2025-04-15T11:47:03.687469 hackbench02
2025-04-15T11:47:03.687516 hugemmap06
2025-04-15T11:47:03.687557 inotify07
2025-04-15T11:47:03.687593 inotify08
2025-04-15T11:47:03.687628 ksm01
2025-04-15T11:47:03.687672 memcg_stress
2025-04-15T11:47:03.687708 msgctl10
2025-04-15T11:47:03.687752 msgctl11
2025-04-15T11:47:03.687797 msgstress03
2025-04-15T11:47:03.688027 msgstress04
2025-04-15T11:47:03.688084 mtest06
2025-04-15T11:47:03.688128 perf_event_open02
2025-04-15T11:47:03.688210 ping01
2025-04-15T11:47:03.688258 ping602
2025-04-15T11:47:03.688351 pth_str01
2025-04-15T11:47:03.688457 pth_str02
2025-04-15T11:47:03.688544 pth_str03
2025-04-15T11:47:03.688608 sendfile09
2025-04-15T11:47:03.688666 sendfile09_64
2025-04-15T11:47:03.688733 setsockopt06
2025-04-15T11:47:03.688780 time-schedule01
2025-04-15T11:47:03.691969 + info_msg EOF
2025-04-15T11:47:03.692729 + local msg=EOF
2025-04-15T11:47:03.693002 + '[' -z EOF ']'
2025-04-15T11:47:03.693623 + printf 'INFO: %s\n' EOF
2025-04-15T11:47:03.693900 INFO: EOF
2025-04-15T11:47:03.695037 + '[' '!' -f /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile ']'
2025-04-15T11:47:03.695771 + SKIPFILE='-S /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile'
2025-04-15T11:47:03.701015 + check_root
2025-04-15T11:47:03.709207 ++ id -ru
2025-04-15T11:47:03.728325 + '[' 0 -eq 0 ']'
2025-04-15T11:47:03.728927 + return 0
2025-04-15T11:47:03.730452 + create_out_dir /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output
2025-04-15T11:47:03.731138 + '[' -z /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output ']'
2025-04-15T11:47:03.731613 + local OUTPUT=/lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output
2025-04-15T11:47:03.732069 + '[' -d /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output ']'
2025-04-15T11:47:03.732578 + mkdir -p /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output
2025-04-15T11:47:03.754918 + '[' -d /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output ']'
2025-04-15T11:47:03.755943 + info_msg 'About to run ltp test...'
2025-04-15T11:47:03.756396 + local 'msg=About to run ltp test...'
2025-04-15T11:47:03.756635 + '[' -z 'About to run ltp test...' ']'
2025-04-15T11:47:03.757071 + printf 'INFO: %s\n' 'About to run ltp test...'
2025-04-15T11:47:03.757316 INFO: About to run ltp test...
2025-04-15T11:47:03.758329 + info_msg 'Output directory: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output'
2025-04-15T11:47:03.758799 + local 'msg=Output directory: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output'
2025-04-15T11:47:03.759213 + '[' -z 'Output directory: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output' ']'
2025-04-15T11:47:03.759646 + printf 'INFO: %s\n' 'Output directory: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output'
2025-04-15T11:47:03.759967 INFO: Output directory: /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output
2025-04-15T11:47:03.760388 + '[' true = true ']'
2025-04-15T11:47:03.760710 + info_msg 'ltp installation skipped altogether'
2025-04-15T11:47:03.761030 + local 'msg=ltp installation skipped altogether'
2025-04-15T11:47:03.761424 + '[' -z 'ltp installation skipped altogether' ']'
2025-04-15T11:47:03.761891 + printf 'INFO: %s\n' 'ltp installation skipped altogether'
2025-04-15T11:47:03.762125 INFO: ltp installation skipped altogether
2025-04-15T11:47:03.762667 + '[' '!' -d /opt/ltp/ ']'
2025-04-15T11:47:03.763955 + info_msg 'Running prep_system'
2025-04-15T11:47:03.764198 + local 'msg=Running prep_system'
2025-04-15T11:47:03.764635 + '[' -z 'Running prep_system' ']'
2025-04-15T11:47:03.764956 + printf 'INFO: %s\n' 'Running prep_system'
2025-04-15T11:47:03.765007 INFO: Running prep_system
2025-04-15T11:47:03.765450 + prep_system
2025-04-15T11:47:03.765845 + systemctl is-active systemd-timesyncd
2025-04-15T11:47:03.853072 inactive
2025-04-15T11:47:03.863247 + '[' -f /proc/sys/kernel/unprivileged_userns_clone ']'
2025-04-15T11:47:03.863782 + info_msg 'Kernel has no support of unprivileged_userns_clone'
2025-04-15T11:47:03.864337 + local 'msg=Kernel has no support of unprivileged_userns_clone'
2025-04-15T11:47:03.864765 + '[' -z 'Kernel has no support of unprivileged_userns_clone' ']'
2025-04-15T11:47:03.865310 + printf 'INFO: %s\n' 'Kernel has no support of unprivileged_userns_clone'
2025-04-15T11:47:03.865779 INFO: Kernel has no support of unprivileged_userns_clone
2025-04-15T11:47:03.866425 + info_msg 'Running run_ltp'
2025-04-15T11:47:03.866649 + local 'msg=Running run_ltp'
2025-04-15T11:47:03.867064 + '[' -z 'Running run_ltp' ']'
2025-04-15T11:47:03.867374 + printf 'INFO: %s\n' 'Running run_ltp'
2025-04-15T11:47:03.867426 INFO: Running run_ltp
2025-04-15T11:47:03.867812 + run_ltp
2025-04-15T11:47:03.868298 + cd /opt/ltp/
2025-04-15T11:47:03.869198 + mkdir -m 777 -p /scratch
2025-04-15T11:47:03.891823 + for file in ${TST_CMDFILES//,/ }
2025-04-15T11:47:03.892110 + cat runtest/syscalls
2025-04-15T11:47:03.914139 + sed -i 's/#.*$//;/^$/d' alltests
2025-04-15T11:47:03.953142 + split --verbose --numeric-suffixes=1 -n l/4/25 alltests
2025-04-15T11:47:03.975695 + echo '============== Tests to run ==============='
2025-04-15T11:47:03.976039 ============== Tests to run ===============
2025-04-15T11:47:03.976299 + cat runtest/shardfile
2025-04-15T11:47:03.989795 faccessat02 faccessat02
2025-04-15T11:47:03.989873 faccessat201 faccessat201
2025-04-15T11:47:03.989944 faccessat202 faccessat202
2025-04-15T11:47:03.990016 fallocate01 fallocate01
2025-04-15T11:47:03.990077 fallocate02 fallocate02
2025-04-15T11:47:03.990332 fallocate03 fallocate03
2025-04-15T11:47:03.990381 fallocate04 fallocate04
2025-04-15T11:47:03.990429 fallocate05 fallocate05
2025-04-15T11:47:03.990485 fallocate06 fallocate06
2025-04-15T11:47:03.990729 fsetxattr01 fsetxattr01
2025-04-15T11:47:03.990772 fsetxattr02 fsetxattr02
2025-04-15T11:47:03.991002 posix_fadvise01 posix_fadvise01
2025-04-15T11:47:03.991062 posix_fadvise01_64 posix_fadvise01_64
2025-04-15T11:47:03.991310 posix_fadvise02 posix_fadvise02
2025-04-15T11:47:03.991365 posix_fadvise02_64 posix_fadvise02_64
2025-04-15T11:47:03.991656 posix_fadvise03 posix_fadvise03
2025-04-15T11:47:03.991706 posix_fadvise03_64 posix_fadvise03_64
2025-04-15T11:47:03.991988 posix_fadvise04 posix_fadvise04
2025-04-15T11:47:03.992037 posix_fadvise04_64 posix_fadvise04_64
2025-04-15T11:47:03.992257 fchdir01 fchdir01
2025-04-15T11:47:03.992299 fchdir02 fchdir02
2025-04-15T11:47:03.992342 fchdir03 fchdir03
2025-04-15T11:47:03.992385 fchmod01 fchmod01
2025-04-15T11:47:03.992603 fchmod02 fchmod02
2025-04-15T11:47:03.992644 fchmod03 fchmod03
2025-04-15T11:47:03.992686 fchmod04 fchmod04
2025-04-15T11:47:03.992728 fchmod05 fchmod05
2025-04-15T11:47:03.992957 fchmod06 fchmod06
2025-04-15T11:47:03.993018 fchmodat01 fchmodat01
2025-04-15T11:47:03.993075 fchmodat02 fchmodat02
2025-04-15T11:47:03.993118 fchmodat2_01 fchmodat2_01
2025-04-15T11:47:03.993166 fchmodat2_02 fchmodat2_02
2025-04-15T11:47:03.993805 fchown01 fchown01
2025-04-15T11:47:03.994050 fchown01_16 fchown01_16
2025-04-15T11:47:03.994102 fchown02 fchown02
2025-04-15T11:47:03.994152 fchown02_16 fchown02_16
2025-04-15T11:47:03.994200 fchown03 fchown03
2025-04-15T11:47:03.994427 fchown03_16 fchown03_16
2025-04-15T11:47:03.994472 fchown04 fchown04
2025-04-15T11:47:03.994520 fchown04_16 fchown04_16
2025-04-15T11:47:03.994566 fchown05 fchown05
2025-04-15T11:47:03.994786 fchown05_16 fchown05_16
2025-04-15T11:47:03.994830 fchownat01 fchownat01
2025-04-15T11:47:03.994877 fchownat02 fchownat02
2025-04-15T11:47:03.994923 fcntl01 fcntl01
2025-04-15T11:47:03.995153 fcntl01_64 fcntl01_64
2025-04-15T11:47:03.995199 fcntl02 fcntl02
2025-04-15T11:47:03.995245 fcntl02_64 fcntl02_64
2025-04-15T11:47:03.998638 + echo '===========End Tests to run ==============='
2025-04-15T11:47:03.999110 ===========End Tests to run ===============
2025-04-15T11:47:03.999393 + '[' -n kirk ']'
2025-04-15T11:47:03.999853 + eval kirk --version
2025-04-15T11:47:04.000470 ++ kirk --version
2025-04-15T11:47:06.195993 kirk, 1.4
2025-04-15T11:47:06.310769 + '[' 0 -ne 0 ']'
2025-04-15T11:47:06.312659 + pipe0_status 'kirk --framework ltp --run-suite shardfile -d /scratch --env LTP_COLORIZE_OUTPUT=0 --skip-file /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile --json-report /tmp/kirk-report.json' 'tee /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output/LTP_syscalls.out'
2025-04-15T11:47:06.313206 + '[' 2 -ne 2 ']'
2025-04-15T11:47:06.314467 + local 'cmd1=kirk --framework ltp --run-suite shardfile -d /scratch --env LTP_COLORIZE_OUTPUT=0 --skip-file /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile --json-report /tmp/kirk-report.json'
2025-04-15T11:47:06.314928 + local 'cmd2=tee /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output/LTP_syscalls.out'
2025-04-15T11:47:06.315167 + exec
2025-04-15T11:47:06.315582 + local ret_val
2025-04-15T11:47:06.331966 ++ eval 'kirk --framework ltp --run-suite shardfile -d /scratch --env LTP_COLORIZE_OUTPUT=0 --skip-file /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile --json-report /tmp/kirk-report.json'
2025-04-15T11:47:06.334133 +++ kirk --framework ltp --run-suite shardfile -d /scratch --env LTP_COLORIZE_OUTPUT=0 --skip-file /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/generated_skipfile --json-report /tmp/kirk-report.json
2025-04-15T11:47:06.335887 ++ eval 'tee /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output/LTP_syscalls.out'
2025-04-15T11:47:06.336857 +++ tee /lava-1/0/tests/0_ltp-syscalls/automated/linux/ltp/output/LTP_syscalls.out
2025-04-15T11:47:07.338812 Host information
2025-04-15T11:47:07.338965
2025-04-15T11:47:07.339234 System: Linux
2025-04-15T11:47:07.339314 Node: runner-xxurkrix-project-40964107-concurrent-0
2025-04-15T11:47:07.339571 Kernel Release: 6.14.0
2025-04-15T11:47:07.339644 Kernel Version: #1 SMP PREEMPT @1743678930
2025-04-15T11:47:07.339915 Machine Architecture: aarch64
2025-04-15T11:47:07.339965 Processor:
2025-04-15T11:47:07.340010
2025-04-15T11:47:07.340264 Temporary directory: /scratch/kirk.root/tmp60g8whmg
2025-04-15T11:47:07.340309
2025-04-15T11:47:07.347113 Connecting to SUT: host
2025-04-15T11:47:07.683995 Starting suite: shardfile
2025-04-15T11:47:07.791033 faccessat02: <12>[ 27.289672] /usr/local/bin/kirk[265]: starting test faccessat02 (faccessat02)
2025-04-15T11:47:08.001174 [1;32mpass[0m (0.105s)
2025-04-15T11:47:08.026605 faccessat201: <12>[ 27.525293] /usr/local/bin/kirk[265]: starting test faccessat201 (faccessat201)
2025-04-15T11:47:08.218413 [1;32mpass[0m (0.101s)
2025-04-15T11:47:08.249369 fallocate03: <12>[ 27.747793] /usr/local/bin/kirk[265]: starting test fallocate03 (fallocate03)
2025-04-15T11:47:08.431422 [1;32mpass[0m (0.095s)
2025-04-15T11:47:08.460436 posix_fadvise01: <12>[ 27.958963] /usr/local/bin/kirk[265]: starting test posix_fadvise01 (posix_fadvise01)
2025-04-15T11:47:08.642126 [1;32mpass[0m (0.090s)
2025-04-15T11:47:08.672281 posix_fadvise02: <12>[ 28.170812] /usr/local/bin/kirk[265]: starting test posix_fadvise02 (posix_fadvise02)
2025-04-15T11:47:08.845459 [1;32mpass[0m (0.085s)
2025-04-15T11:47:08.875317 posix_fadvise03: <12>[ 28.373812] /usr/local/bin/kirk[265]: starting test posix_fadvise03 (posix_fadvise03)
2025-04-15T11:47:09.057397 [1;32mpass[0m (0.093s)
2025-04-15T11:47:09.090617 posix_fadvise04: <12>[ 28.589183] /usr/local/bin/kirk[265]: starting test posix_fadvise04 (posix_fadvise04)
2025-04-15T11:47:09.265824 [1;32mpass[0m (0.086s)
2025-04-15T11:47:09.296068 fchdir01: <12>[ 28.794658] /usr/local/bin/kirk[265]: starting test fchdir01 (fchdir01)
2025-04-15T11:47:09.480196 [1;32mpass[0m (0.095s)
2025-04-15T11:47:09.509869 fchdir02: <12>[ 29.008192] /usr/local/bin/kirk[265]: starting test fchdir02 (fchdir02)
2025-04-15T11:47:09.684906 [1;32mpass[0m (0.085s)
2025-04-15T11:47:09.712870 fchmod01: <12>[ 29.211382] /usr/local/bin/kirk[265]: starting test fchmod01 (fchmod01)
2025-04-15T11:47:09.891544 [1;32mpass[0m (0.090s)
2025-04-15T11:47:09.923082 fchmodat01: <12>[ 29.421607] /usr/local/bin/kirk[265]: starting test fchmodat01 (fchmodat01)
2025-04-15T11:47:10.106763 [1;32mpass[0m (0.093s)
2025-04-15T11:47:10.134415 fchmodat02: <12>[ 29.633088] /usr/local/bin/kirk[265]: starting test fchmodat02 (fchmodat02)
2025-04-15T11:47:10.315763 [1;32mpass[0m (0.093s)
2025-04-15T11:47:10.343350 fchmodat2_02: <12>[ 29.842007] /usr/local/bin/kirk[265]: starting test fchmodat2_02 (fchmodat2_02)
2025-04-15T11:47:10.523721 [1;32mpass[0m (0.090s)
2025-04-15T11:47:10.551405 fchown01: <12>[ 30.050066] /usr/local/bin/kirk[265]: starting test fchown01 (fchown01)
2025-04-15T11:47:10.728732 [1;32mpass[0m (0.087s)
2025-04-15T11:47:10.758963 fcntl02: <12>[ 30.257627] /usr/local/bin/kirk[265]: starting test fcntl02 (fcntl02)
2025-04-15T11:47:10.939735 [1;32mpass[0m (0.090s)
2025-04-15T11:47:10.971826 faccessat202: <12>[ 30.470355] /usr/local/bin/kirk[265]: starting test faccessat202 (faccessat202)
2025-04-15T11:47:11.156418 [1;32mpass[0m (0.095s)
2025-04-15T11:47:11.187796 fallocate01: <12>[ 30.686367] /usr/local/bin/kirk[265]: starting test fallocate01 (fallocate01)
2025-04-15T11:47:11.317088 [1;32mpass[0m (0.032s)
2025-04-15T11:47:11.347969 fallocate02: <12>[ 30.846523] /usr/local/bin/kirk[265]: starting test fallocate02 (fallocate02)
2025-04-15T11:47:11.468545 [1;32mpass[0m (0.031s)
2025-04-15T11:47:11.498116 fallocate04: <12>[ 30.996690] /usr/local/bin/kirk[265]: starting test fallocate04 (fallocate04)
2025-04-15T11:47:14.173225 <6>[ 33.671311] loop0: detected capacity change from 0 to 614400
2025-04-15T11:47:14.251963 <3>[ 33.749497] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:14.300317 <3>[ 33.799003] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:14.335353 <3>[ 33.834041] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:14.545910 <6>[ 34.044433] raid6: neonx8 gen() 1865 MB/s
2025-04-15T11:47:14.614131 <6>[ 34.112712] raid6: neonx4 gen() 2200 MB/s
2025-04-15T11:47:14.682026 <6>[ 34.180352] raid6: neonx2 gen() 1824 MB/s
2025-04-15T11:47:14.749728 <6>[ 34.248346] raid6: neonx1 gen() 1252 MB/s
2025-04-15T11:47:14.817879 <6>[ 34.316358] raid6: int64x8 gen() 1922 MB/s
2025-04-15T11:47:14.885993 <6>[ 34.384345] raid6: int64x4 gen() 2688 MB/s
2025-04-15T11:47:14.953811 <6>[ 34.452344] raid6: int64x2 gen() 2322 MB/s
2025-04-15T11:47:15.022065 <6>[ 34.520366] raid6: int64x1 gen() 1869 MB/s
2025-04-15T11:47:15.022263 <6>[ 34.520429] raid6: using algorithm int64x4 gen() 2688 MB/s
2025-04-15T11:47:15.089835 <6>[ 34.588380] raid6: .... xor() 1671 MB/s, rmw enabled
2025-04-15T11:47:15.091084 <6>[ 34.588462] raid6: using neon recovery algorithm
2025-04-15T11:47:15.099403 <6>[ 34.597868] xor: measuring software checksum speed
2025-04-15T11:47:15.099830 <6>[ 34.598637] 8regs : 5353 MB/sec
2025-04-15T11:47:15.100575 <6>[ 34.599321] 32regs : 5762 MB/sec
2025-04-15T11:47:15.108491 <6>[ 34.607220] arm64_neon : 577 MB/sec
2025-04-15T11:47:15.108642 <6>[ 34.607337] xor: using function: 32regs (5762 MB/sec)
2025-04-15T11:47:15.259525 <6>[ 34.758251] Btrfs loaded, zoned=no, fsverity=no
2025-04-15T11:47:15.365004 <3>[ 34.863634] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:16.567532 <3>[ 36.065971] operation not supported error, dev loop0, sector 614272 op 0x9:(WRITE_ZEROES) flags 0x10000800 phys_seg 0 prio class 0
2025-04-15T11:47:16.871474 <6>[ 36.368618] EXT4-fs (loop0): mounting ext2 file system using the ext4 subsystem
2025-04-15T11:47:16.881633 <6>[ 36.377500] EXT4-fs (loop0): mounted filesystem 2d656659-80e4-4b2b-9396-9272e39a7170 r/w without journal. Quota mode: none.
2025-04-15T11:47:16.925073 <6>[ 36.422880] EXT4-fs (loop0): unmounting filesystem 2d656659-80e4-4b2b-9396-9272e39a7170.
2025-04-15T11:47:18.154171 <6>[ 37.652704] EXT4-fs (loop0): mounting ext3 file system using the ext4 subsystem
2025-04-15T11:47:18.188565 <6>[ 37.686943] EXT4-fs (loop0): mounted filesystem 5ac19621-3688-49f9-924c-4bc278f0b4ce r/w with ordered data mode. Quota mode: none.
2025-04-15T11:47:18.246210 <6>[ 37.744809] EXT4-fs (loop0): unmounting filesystem 5ac19621-3688-49f9-924c-4bc278f0b4ce.
2025-04-15T11:47:18.680506 <6>[ 38.178790] EXT4-fs (loop0): mounted filesystem f0bffc0c-635f-44c6-9e7d-6e67fc4266de r/w with ordered data mode. Quota mode: none.
2025-04-15T11:47:18.783000 <6>[ 38.281215] EXT4-fs (loop0): unmounting filesystem f0bffc0c-635f-44c6-9e7d-6e67fc4266de.
2025-04-15T11:47:19.298913 <6>[ 38.797183] BTRFS: device fsid d17e14ae-5df1-4726-a495-7b89252076c8 devid 1 transid 8 /dev/loop0 (7:0) scanned by fallocate04 (500)
2025-04-15T11:47:19.305841 <6>[ 38.804467] BTRFS info (device loop0): first mount of filesystem d17e14ae-5df1-4726-a495-7b89252076c8
2025-04-15T11:47:19.306674 <6>[ 38.805207] BTRFS info (device loop0): using crc32c (crc32c-arm64) checksum algorithm
2025-04-15T11:47:19.310433 <6>[ 38.809147] BTRFS info (device loop0): using free-space-tree
2025-04-15T11:47:19.376579 <6>[ 38.875251] BTRFS info (device loop0): checking UUID tree
2025-04-15T11:47:19.640533 <6>[ 39.138967] BTRFS info (device loop0): last unmount of filesystem d17e14ae-5df1-4726-a495-7b89252076c8
2025-04-15T11:47:19.956048 [1;33mskip[0m (8.337s)
2025-04-15T11:47:19.988760 fallocate05: <12>[ 39.487256] /usr/local/bin/kirk[265]: starting test fallocate05 (fallocate05)
2025-04-15T11:47:22.657363 <6>[ 42.155850] loop0: detected capacity change from 0 to 614400
2025-04-15T11:47:22.729387 <3>[ 42.227954] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:22.767023 <3>[ 42.265646] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:22.806338 <3>[ 42.304958] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:22.992086 <3>[ 42.490721] /dev/zero: Can't lookup blockdev
2025-04-15T11:47:24.170453 <3>[ 43.668920] operation not supported error, dev loop0, sector 614272 op 0x9:(WRITE_ZEROES) flags 0x10000800 phys_seg 0 prio class 0
2025-04-15T11:47:24.463292 <6>[ 43.961774] EXT4-fs (loop0): mounting ext2 file system using the ext4 subsystem
2025-04-15T11:47:24.479653 <6>[ 43.978017] EXT4-fs (loop0): mounted filesystem d34ea4a7-7f14-4e08-af7c-dc50ac279ae1 r/w without journal. Quota mode: none.
2025-04-15T11:47:24.510505 <6>[ 44.009159] EXT4-fs (loop0): unmounting filesystem d34ea4a7-7f14-4e08-af7c-dc50ac279ae1.
2025-04-15T11:47:25.718869 <6>[ 45.217491] EXT4-fs (loop0): mounting ext3 file system using the ext4 subsystem
2025-04-15T11:47:25.746920 <6>[ 45.245402] EXT4-fs (loop0): mounted filesystem a4becef9-2a98-4305-9e7e-a544c9bd3bbf r/w with ordered data mode. Quota mode: none.
2025-04-15T11:47:25.811505 <6>[ 45.310130] EXT4-fs (loop0): unmounting filesystem a4becef9-2a98-4305-9e7e-a544c9bd3bbf.
2025-04-15T11:47:26.195054 <6>[ 45.693538] EXT4-fs (loop0): mounted filesystem f8be2752-c4ef-4efc-aad3-79052706eb8c r/w with ordered data mode. Quota mode: none.
2025-04-15T11:47:46.296532 <6>[ 65.795136] EXT4-fs (loop0): unmounting filesystem f8be2752-c4ef-4efc-aad3-79052706eb8c.
2025-04-15T11:47:47.632601 <6>[ 67.131090] BTRFS: device fsid bde7ab08-cb51-4eb6-824b-b303437884b4 devid 1 transid 8 /dev/loop0 (7:0) scanned by fallocate05 (565)
2025-04-15T11:47:47.636169 <6>[ 67.134774] BTRFS info (device loop0): first mount of filesystem bde7ab08-cb51-4eb6-824b-b303437884b4
2025-04-15T11:47:47.636859 <6>[ 67.135393] BTRFS info (device loop0): using crc32c (crc32c-arm64) checksum algorithm
2025-04-15T11:47:47.637455 <6>[ 67.135950] BTRFS info (device loop0): using free-space-tree
2025-04-15T11:47:47.687640 <6>[ 67.186125] BTRFS info (device loop0): checking UUID tree
2025-04-15T11:48:00.114109 <6>[ 79.612738] BTRFS info (device loop0): last unmount of filesystem bde7ab08-cb51-4eb6-824b-b303437884b4
2025-04-15T11:48:01.830331 [1;33mskip[0m (41.743s)
2025-04-15T11:48:01.862888 fallocate06: <12>[ 81.361556] /usr/local/bin/kirk[265]: starting test fallocate06 (fallocate06)
2025-04-15T11:48:11.997407 <6>[ 91.495859] loop0: detected capacity change from 0 to 2097152
2025-04-15T11:48:12.091566 <3>[ 91.590092] /dev/zero: Can't lookup blockdev
2025-04-15T11:48:12.128028 <3>[ 91.625614] /dev/zero: Can't lookup blockdev
2025-04-15T11:48:12.162451 <3>[ 91.660995] /dev/zero: Can't lookup blockdev
2025-04-15T11:48:12.346679 <3>[ 91.845208] /dev/zero: Can't lookup blockdev
2025-04-15T11:48:15.736093 <3>[ 95.234510] operation not supported error, dev loop0, sector 2097024 op 0x9:(WRITE_ZEROES) flags 0x10000800 phys_seg 0 prio class 0
2025-04-15T11:48:15.930852 <6>[ 95.429441] EXT4-fs (loop0): mounting ext2 file system using the ext4 subsystem
2025-04-15T11:48:15.939510 <6>[ 95.438051] EXT4-fs (loop0): mounted filesystem a9701224-40d0-4a93-b889-fd1bce7e81c1 r/w without journal. Quota mode: none.
2025-04-15T11:48:16.010837 <6>[ 95.508985] EXT4-fs (loop0): unmounting filesystem a9701224-40d0-4a93-b889-fd1bce7e81c1.
2025-04-15T11:48:17.687672 <6>[ 97.186264] EXT4-fs (loop0): mounting ext3 file system using the ext4 subsystem
2025-04-15T11:48:17.711861 <6>[ 97.210353] EXT4-fs (loop0): mounted filesystem 69bdcd6a-5efd-411c-91e5-cbdb2e54e1e4 r/w with ordered data mode. Quota mode: none.
2025-04-15T11:48:17.738610 <6>[ 97.236612] EXT4-fs (loop0): unmounting filesystem 69bdcd6a-5efd-411c-91e5-cbdb2e54e1e4.
2025-04-15T11:48:18.409551 <6>[ 97.907974] EXT4-fs (loop0): mounted filesystem 41dabe65-8228-48fb-b9a4-b45dc41501fd r/w with ordered data mode. Quota mode: none.
2025-04-15T11:48:57.062166 <6>[ 136.560779] EXT4-fs (loop0): unmounting filesystem 41dabe65-8228-48fb-b9a4-b45dc41501fd.
2025-04-15T11:49:00.692450 <6>[ 140.190752] BTRFS: device fsid 06c6f695-b038-4373-9eb8-21efc8730038 devid 1 transid 8 /dev/loop0 (7:0) scanned by fallocate06 (630)
2025-04-15T11:49:00.696369 <6>[ 140.194937] BTRFS info (device loop0): first mount of filesystem 06c6f695-b038-4373-9eb8-21efc8730038
2025-04-15T11:49:00.696718 <6>[ 140.195120] BTRFS info (device loop0): using crc32c (crc32c-arm64) checksum algorithm
2025-04-15T11:49:00.696885 <6>[ 140.195216] BTRFS info (device loop0): using free-space-tree
2025-04-15T11:49:00.775041 <6>[ 140.273703] BTRFS info (device loop0): checking UUID tree
2025-04-15T11:50:17.627064 <6>[ 217.125479] BTRFS info (device loop0): last unmount of filesystem 06c6f695-b038-4373-9eb8-21efc8730038
2025-04-15T11:50:40.736261 [1;33mskip[0m (2m 39s)
2025-04-15T11:50:40.766446 fsetxattr01: <12>[ 240.265023] /usr/local/bin/kirk[265]: starting test fsetxattr01 (fsetxattr01)
2025-04-15T11:50:43.308539 <6>[ 242.807066] loop0: detected capacity change from 0 to 614400
2025-04-15T11:50:43.385961 <3>[ 242.884245] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:43.423311 <3>[ 242.921964] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:43.459575 <3>[ 242.958290] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:43.627039 <3>[ 243.125689] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:44.801411 <3>[ 244.299654] operation not supported error, dev loop0, sector 614272 op 0x9:(WRITE_ZEROES) flags 0x10000800 phys_seg 0 prio class 0
2025-04-15T11:50:45.095959 <6>[ 244.592660] EXT4-fs (loop0): mounting ext2 file system using the ext4 subsystem
2025-04-15T11:50:45.103602 <6>[ 244.601999] EXT4-fs (loop0): mounted filesystem 24a755f2-e717-482d-aca9-9dfe45292590 r/w without journal. Quota mode: none.
2025-04-15T11:50:45.149629 <6>[ 244.648077] EXT4-fs (loop0): unmounting filesystem 24a755f2-e717-482d-aca9-9dfe45292590.
2025-04-15T11:50:46.376442 <6>[ 245.874731] EXT4-fs (loop0): mounting ext3 file system using the ext4 subsystem
2025-04-15T11:50:46.407726 <6>[ 245.905961] EXT4-fs (loop0): mounted filesystem a4f01756-7a36-4fa8-9daf-00f5e2727329 r/w with ordered data mode. Quota mode: none.
2025-04-15T11:50:46.461717 <6>[ 245.957586] EXT4-fs (loop0): unmounting filesystem a4f01756-7a36-4fa8-9daf-00f5e2727329.
2025-04-15T11:50:46.864603 <6>[ 246.363098] EXT4-fs (loop0): mounted filesystem 9040e30b-e420-478e-b668-f80d39f4143a r/w with ordered data mode. Quota mode: none.
2025-04-15T11:50:46.892625 <6>[ 246.391182] EXT4-fs (loop0): unmounting filesystem 9040e30b-e420-478e-b668-f80d39f4143a.
2025-04-15T11:50:47.361653 <6>[ 246.859996] BTRFS: device fsid 51963044-0752-4ebb-b505-c7ab73fbfa96 devid 1 transid 8 /dev/loop0 (7:0) scanned by fsetxattr01 (697)
2025-04-15T11:50:47.367581 <6>[ 246.866205] BTRFS info (device loop0): first mount of filesystem 51963044-0752-4ebb-b505-c7ab73fbfa96
2025-04-15T11:50:47.367873 <6>[ 246.866352] BTRFS info (device loop0): using crc32c (crc32c-arm64) checksum algorithm
2025-04-15T11:50:47.368079 <6>[ 246.866414] BTRFS info (device loop0): using free-space-tree
2025-04-15T11:50:47.424755 <6>[ 246.923278] BTRFS info (device loop0): checking UUID tree
2025-04-15T11:50:47.514400 <6>[ 247.012915] BTRFS info (device loop0): last unmount of filesystem 51963044-0752-4ebb-b505-c7ab73fbfa96
2025-04-15T11:50:48.109368 [1;32mpass[0m (7.226s)
2025-04-15T11:50:48.135805 fsetxattr02: <12>[ 247.634356] /usr/local/bin/kirk[265]: starting test fsetxattr02 (fsetxattr02)
2025-04-15T11:50:48.259848 [1;33mskip[0m (0.034s)
2025-04-15T11:50:48.290344 posix_fadvise01_64: <12>[ 247.788879] /usr/local/bin/kirk[265]: starting test posix_fadvise01_64 (posix_fadvise01_64)
2025-04-15T11:50:48.470881 [1;32mpass[0m (0.086s)
2025-04-15T11:50:48.500584 posix_fadvise02_64: <12>[ 247.999025] /usr/local/bin/kirk[265]: starting test posix_fadvise02_64 (posix_fadvise02_64)
2025-04-15T11:50:48.677775 [1;32mpass[0m (0.088s)
2025-04-15T11:50:48.706935 posix_fadvise03_64: <12>[ 248.205215] /usr/local/bin/kirk[265]: starting test posix_fadvise03_64 (posix_fadvise03_64)
2025-04-15T11:50:48.889232 [1;32mpass[0m (0.091s)
2025-04-15T11:50:48.923097 posix_fadvise04_64: <12>[ 248.421655] /usr/local/bin/kirk[265]: starting test posix_fadvise04_64 (posix_fadvise04_64)
2025-04-15T11:50:49.095845 [1;32mpass[0m (0.085s)
2025-04-15T11:50:49.124723 fchdir03: <12>[ 248.623264] /usr/local/bin/kirk[265]: starting test fchdir03 (fchdir03)
2025-04-15T11:50:49.308007 [1;32mpass[0m (0.091s)
2025-04-15T11:50:49.334006 fchmod02: <12>[ 248.832214] /usr/local/bin/kirk[265]: starting test fchmod02 (fchmod02)
2025-04-15T11:50:49.512785 [1;32mpass[0m (0.089s)
2025-04-15T11:50:49.540482 fchmod03: <12>[ 249.039003] /usr/local/bin/kirk[265]: starting test fchmod03 (fchmod03)
2025-04-15T11:50:49.718797 [1;32mpass[0m (0.088s)
2025-04-15T11:50:49.747021 fchmod04: <12>[ 249.245680] /usr/local/bin/kirk[265]: starting test fchmod04 (fchmod04)
2025-04-15T11:50:49.928469 [1;32mpass[0m (0.091s)
2025-04-15T11:50:49.956910 fchmod05: <12>[ 249.455430] /usr/local/bin/kirk[265]: starting test fchmod05 (fchmod05)
2025-04-15T11:50:50.138584 [1;32mpass[0m (0.091s)
2025-04-15T11:50:50.167322 fchmod06: <12>[ 249.666010] /usr/local/bin/kirk[265]: starting test fchmod06 (fchmod06)
2025-04-15T11:50:50.395569 [1;32mpass[0m (0.136s)
2025-04-15T11:50:50.429626 fchmodat2_01: <12>[ 249.927972] /usr/local/bin/kirk[265]: starting test fchmodat2_01 (fchmodat2_01)
2025-04-15T11:50:53.000580 <6>[ 252.499190] loop0: detected capacity change from 0 to 614400
2025-04-15T11:50:53.088293 <3>[ 252.586959] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:53.126257 <3>[ 252.624743] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:53.160646 <3>[ 252.659217] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:53.340579 <3>[ 252.839231] /dev/zero: Can't lookup blockdev
2025-04-15T11:50:54.520710 <3>[ 254.019127] operation not supported error, dev loop0, sector 614272 op 0x9:(WRITE_ZEROES) flags 0x10000800 phys_seg 0 prio class 0
2025-04-15T11:50:58.091094 [1;32mpass[0m (7.544s)
2025-04-15T11:50:58.118502 fchown01_16: <12>[ 257.617146] /usr/local/bin/kirk[265]: starting test fchown01_16 (fchown01_16)
2025-04-15T11:50:58.296320 [1;33mskip[0m (0.090s)
2025-04-15T11:50:58.324553 fchown02: <12>[ 257.823155] /usr/local/bin/kirk[265]: starting test fchown02 (fchown02)
2025-04-15T11:50:58.503273 [1;32mpass[0m (0.090s)
2025-04-15T11:50:58.532441 fchown02_16: <12>[ 258.031007] /usr/local/bin/kirk[265]: starting test fchown02_16 (fchown02_16)
2025-04-15T11:50:58.705748 [1;33mskip[0m (0.087s)
2025-04-15T11:50:58.737873 fchown03: <12>[ 258.236258] /usr/local/bin/kirk[265]: starting test fchown03 (fchown03)
2025-04-15T11:50:58.916070 [1;32mpass[0m (0.089s)
2025-04-15T11:50:58.945409 fchown03_16: <12>[ 258.443845] /usr/local/bin/kirk[265]: starting test fchown03_16 (fchown03_16)
2025-04-15T11:50:59.127624 [1;33mskip[0m (0.094s)
2025-04-15T11:50:59.156343 fchown04: <12>[ 258.654852] /usr/local/bin/kirk[265]: starting test fchown04 (fchown04)
2025-04-15T11:50:59.390079 [1;32mpass[0m (0.135s)
2025-04-15T11:50:59.414736 fchown04_16: <12>[ 258.913339] /usr/local/bin/kirk[265]: starting test fchown04_16 (fchown04_16)
2025-04-15T11:50:59.625805 [1;33mskip[0m (0.119s)
2025-04-15T11:50:59.655684 fchown05: <12>[ 259.154290] /usr/local/bin/kirk[265]: starting test fchown05 (fchown05)
2025-04-15T11:50:59.838504 [1;32mpass[0m (0.091s)
2025-04-15T11:50:59.864519 fchown05_16: <12>[ 259.362987] /usr/local/bin/kirk[265]: starting test fchown05_16 (fchown05_16)
2025-04-15T11:51:00.042613 [1;33mskip[0m (0.088s)
2025-04-15T11:51:00.071102 fchownat01: <12>[ 259.569746] /usr/local/bin/kirk[265]: starting test fchownat01 (fchownat01)
2025-04-15T11:51:00.192603 [1;32mpass[0m (0.032s)
2025-04-15T11:51:00.220814 fchownat02: <12>[ 259.717983] /usr/local/bin/kirk[265]: starting test fchownat02 (fchownat02)
2025-04-15T11:51:00.341808 [1;32mpass[0m (0.029s)
2025-04-15T11:51:00.371273 fcntl01: <12>[ 259.869923] /usr/local/bin/kirk[265]: starting test fcntl01 (fcntl01)
2025-04-15T11:51:00.492968 [1;32mpass[0m (0.029s)
2025-04-15T11:51:00.522647 fcntl01_64: <12>[ 260.021303] /usr/local/bin/kirk[265]: starting test fcntl01_64 (fcntl01_64)
2025-04-15T11:51:00.640732 [1;32mpass[0m (0.029s)
2025-04-15T11:51:00.668440 fcntl02_64: <12>[ 260.166804] /usr/local/bin/kirk[265]: starting test fcntl02_64 (fcntl02_64)
2025-04-15T11:51:00.884203 [1;32mpass[0m (0.089s)
2025-04-15T11:51:00.888644
2025-04-15T11:51:00.889143
2025-04-15T11:51:00.889234 Execution time: 3m 53s
2025-04-15T11:51:00.889318
2025-04-15T11:51:00.889413 Suite Name: shardfile
2025-04-15T11:51:00.889498 Total Run: 48
2025-04-15T11:51:00.889560 Total Runtime: 3m 47s
2025-04-15T11:51:00.889798 Passed Tests: 335
2025-04-15T11:51:00.889850 Failed Tests: 0
2025-04-15T11:51:00.889922 Skipped Tests: 16
2025-04-15T11:51:00.889970 Broken Tests: 0
2025-04-15T11:51:00.890031 Warnings: 0
2025-04-15T11:51:00.890343 Kernel Version: Linux 6.14.0 #1 SMP PREEMPT @1743678930
2025-04-15T11:51:00.890392 CPU: unknown
2025-04-15T11:51:00.890453 Machine Architecture: aarch64
2025-04-15T11:51:00.890511 RAM: 3998056 kB
2025-04-15T11:51:00.890568 Swap memory: 0 kB
2025-04-15T11:51:00.890801 Distro: debian
2025-04-15T11:51:00.890847 Distro Version:
2025-04-15T11:51:00.890898
2025-04-15T11:51:00.894219
2025-04-15T11:51:00.894504 Disconnecting from SUT: host
2025-04-15T11:51:01.003861 ++ echo 0
2025-04-15T11:51:01.019158 + ret_val=0
2025-04-15T11:51:01.019446 + exec
2025-04-15T11:51:01.019962 + return 0
2025-04-15T11:51:01.020786 + parse_ltp_json_results /tmp/kirk-report.json
2025-04-15T11:51:01.021026 + local result
2025-04-15T11:51:01.028595 + jq -r '.results| .[]| "\(.test_fqn) \(.test.result)"' /tmp/kirk-report.json
2025-04-15T11:51:01.034062 + sed 's/brok/fail/; s/conf/skip/'
2025-04-15T11:51:01.131082 ++ jq -r '.results| .[]| .test_fqn' /tmp/kirk-report.json
2025-04-15T11:51:01.201021 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.208776 ++ jq -r '.results | .[] | select(.test_fqn == "faccessat02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.278531 + result=pass
2025-04-15T11:51:01.278816 + '[' pass = pass ']'
2025-04-15T11:51:01.279082 + continue
2025-04-15T11:51:01.279681 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.287237 ++ jq -r '.results | .[] | select(.test_fqn == "faccessat201") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.355902 + result=pass
2025-04-15T11:51:01.356184 + '[' pass = pass ']'
2025-04-15T11:51:01.356268 + continue
2025-04-15T11:51:01.356759 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.364480 ++ jq -r '.results | .[] | select(.test_fqn == "fallocate03") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.433040 + result=pass
2025-04-15T11:51:01.433323 + '[' pass = pass ']'
2025-04-15T11:51:01.433586 + continue
2025-04-15T11:51:01.433857 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.441553 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.510208 + result=pass
2025-04-15T11:51:01.510791 + '[' pass = pass ']'
2025-04-15T11:51:01.510899 + continue
2025-04-15T11:51:01.511408 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.518949 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.588274 + result=pass
2025-04-15T11:51:01.588555 + '[' pass = pass ']'
2025-04-15T11:51:01.588637 + continue
2025-04-15T11:51:01.589108 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.596860 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise03") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.664953 + result=pass
2025-04-15T11:51:01.665234 + '[' pass = pass ']'
2025-04-15T11:51:01.665498 + continue
2025-04-15T11:51:01.665954 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.673645 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise04") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.742401 + result=pass
2025-04-15T11:51:01.742498 + '[' pass = pass ']'
2025-04-15T11:51:01.742755 + continue
2025-04-15T11:51:01.743012 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.750624 ++ jq -r '.results | .[] | select(.test_fqn == "fchdir01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.819099 + result=pass
2025-04-15T11:51:01.819777 + '[' pass = pass ']'
2025-04-15T11:51:01.819878 + continue
2025-04-15T11:51:01.820347 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.827892 ++ jq -r '.results | .[] | select(.test_fqn == "fchdir02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.896661 + result=pass
2025-04-15T11:51:01.897167 + '[' pass = pass ']'
2025-04-15T11:51:01.897613 + continue
2025-04-15T11:51:01.898006 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.905616 ++ jq -r '.results | .[] | select(.test_fqn == "fchmod01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:01.974170 + result=pass
2025-04-15T11:51:01.974632 + '[' pass = pass ']'
2025-04-15T11:51:01.974715 + continue
2025-04-15T11:51:01.975140 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:01.982846 ++ jq -r '.results | .[] | select(.test_fqn == "fchmodat01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.050544 + result=pass
2025-04-15T11:51:02.051035 + '[' pass = pass ']'
2025-04-15T11:51:02.051306 + continue
2025-04-15T11:51:02.051698 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.059400 ++ jq -r '.results | .[] | select(.test_fqn == "fchmodat02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.128102 + result=pass
2025-04-15T11:51:02.128594 + '[' pass = pass ']'
2025-04-15T11:51:02.128865 + continue
2025-04-15T11:51:02.129258 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.136741 ++ jq -r '.results | .[] | select(.test_fqn == "fchmodat2_02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.205090 + result=pass
2025-04-15T11:51:02.205179 + '[' pass = pass ']'
2025-04-15T11:51:02.205645 + continue
2025-04-15T11:51:02.206085 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.213786 ++ jq -r '.results | .[] | select(.test_fqn == "fchown01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.282239 + result=pass
2025-04-15T11:51:02.282521 + '[' pass = pass ']'
2025-04-15T11:51:02.282629 + continue
2025-04-15T11:51:02.283101 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.290599 ++ jq -r '.results | .[] | select(.test_fqn == "fcntl02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.359030 + result=pass
2025-04-15T11:51:02.359513 + '[' pass = pass ']'
2025-04-15T11:51:02.359745 + continue
2025-04-15T11:51:02.360171 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.368233 ++ jq -r '.results | .[] | select(.test_fqn == "faccessat202") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.438106 + result=pass
2025-04-15T11:51:02.438714 + '[' pass = pass ']'
2025-04-15T11:51:02.438945 + continue
2025-04-15T11:51:02.439183 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.447134 ++ jq -r '.results | .[] | select(.test_fqn == "fallocate01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.515259 + result=pass
2025-04-15T11:51:02.515746 + '[' pass = pass ']'
2025-04-15T11:51:02.515987 + continue
2025-04-15T11:51:02.516417 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.524129 ++ jq -r '.results | .[] | select(.test_fqn == "fallocate02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.593385 + result=pass
2025-04-15T11:51:02.594153 + '[' pass = pass ']'
2025-04-15T11:51:02.594425 + continue
2025-04-15T11:51:02.594668 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.602472 ++ jq -r '.results | .[] | select(.test_fqn == "fallocate04") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.673394 + result=pass
2025-04-15T11:51:02.674118 + '[' pass = pass ']'
2025-04-15T11:51:02.674371 + continue
2025-04-15T11:51:02.674846 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.683278 ++ jq -r '.results | .[] | select(.test_fqn == "fallocate05") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.752495 + result=pass
2025-04-15T11:51:02.753243 + '[' pass = pass ']'
2025-04-15T11:51:02.753673 + continue
2025-04-15T11:51:02.754039 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.762089 ++ jq -r '.results | .[] | select(.test_fqn == "fallocate06") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.831082 + result=pass
2025-04-15T11:51:02.831583 + '[' pass = pass ']'
2025-04-15T11:51:02.831867 + continue
2025-04-15T11:51:02.832192 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.839806 ++ jq -r '.results | .[] | select(.test_fqn == "fsetxattr01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.907691 + result=pass
2025-04-15T11:51:02.907931 + '[' pass = pass ']'
2025-04-15T11:51:02.908164 + continue
2025-04-15T11:51:02.908645 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:02.916248 ++ jq -r '.results | .[] | select(.test_fqn == "fsetxattr02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:02.984837 + result=conf
2025-04-15T11:51:02.985629 + '[' conf = pass ']'
2025-04-15T11:51:02.986290 + jq -r '.results | .[] | select(.test_fqn == "fsetxattr02") | .test.log' /tmp/kirk-report.json
2025-04-15T11:51:03.061008 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.068533 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise01_64") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.136555 + result=pass
2025-04-15T11:51:03.137158 + '[' pass = pass ']'
2025-04-15T11:51:03.137624 + continue
2025-04-15T11:51:03.138142 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.145687 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise02_64") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.214294 + result=pass
2025-04-15T11:51:03.214797 + '[' pass = pass ']'
2025-04-15T11:51:03.215043 + continue
2025-04-15T11:51:03.215450 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.222736 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise03_64") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.290880 + result=pass
2025-04-15T11:51:03.291162 + '[' pass = pass ']'
2025-04-15T11:51:03.291698 + continue
2025-04-15T11:51:03.292008 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.299564 ++ jq -r '.results | .[] | select(.test_fqn == "posix_fadvise04_64") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.368404 + result=pass
2025-04-15T11:51:03.368982 + '[' pass = pass ']'
2025-04-15T11:51:03.369238 + continue
2025-04-15T11:51:03.370230 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.378123 ++ jq -r '.results | .[] | select(.test_fqn == "fchdir03") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.446120 + result=pass
2025-04-15T11:51:03.446580 + '[' pass = pass ']'
2025-04-15T11:51:03.446821 + continue
2025-04-15T11:51:03.447238 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.454546 ++ jq -r '.results | .[] | select(.test_fqn == "fchmod02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.522277 + result=pass
2025-04-15T11:51:03.522800 + '[' pass = pass ']'
2025-04-15T11:51:03.523047 + continue
2025-04-15T11:51:03.523458 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.531146 ++ jq -r '.results | .[] | select(.test_fqn == "fchmod03") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.600006 + result=pass
2025-04-15T11:51:03.600477 + '[' pass = pass ']'
2025-04-15T11:51:03.600776 + continue
2025-04-15T11:51:03.601026 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.608473 ++ jq -r '.results | .[] | select(.test_fqn == "fchmod04") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.677304 + result=pass
2025-04-15T11:51:03.677606 + '[' pass = pass ']'
2025-04-15T11:51:03.677705 + continue
2025-04-15T11:51:03.678023 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.685492 ++ jq -r '.results | .[] | select(.test_fqn == "fchmod05") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.753735 + result=pass
2025-04-15T11:51:03.754395 + '[' pass = pass ']'
2025-04-15T11:51:03.754692 + continue
2025-04-15T11:51:03.755143 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.762391 ++ jq -r '.results | .[] | select(.test_fqn == "fchmod06") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.830423 + result=pass
2025-04-15T11:51:03.830925 + '[' pass = pass ']'
2025-04-15T11:51:03.831182 + continue
2025-04-15T11:51:03.831702 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.838750 ++ jq -r '.results | .[] | select(.test_fqn == "fchmodat2_01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.906628 + result=pass
2025-04-15T11:51:03.907198 + '[' pass = pass ']'
2025-04-15T11:51:03.907447 + continue
2025-04-15T11:51:03.907892 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:03.916460 ++ jq -r '.results | .[] | select(.test_fqn == "fchown01_16") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:03.984870 + result=conf
2025-04-15T11:51:03.985345 + '[' conf = pass ']'
2025-04-15T11:51:03.986075 + jq -r '.results | .[] | select(.test_fqn == "fchown01_16") | .test.log' /tmp/kirk-report.json
2025-04-15T11:51:04.060067 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.067927 ++ jq -r '.results | .[] | select(.test_fqn == "fchown02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.135386 + result=pass
2025-04-15T11:51:04.135876 + '[' pass = pass ']'
2025-04-15T11:51:04.136148 + continue
2025-04-15T11:51:04.136600 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.144311 ++ jq -r '.results | .[] | select(.test_fqn == "fchown02_16") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.211506 + result=conf
2025-04-15T11:51:04.212001 + '[' conf = pass ']'
2025-04-15T11:51:04.212595 + jq -r '.results | .[] | select(.test_fqn == "fchown02_16") | .test.log' /tmp/kirk-report.json
2025-04-15T11:51:04.286791 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.293770 ++ jq -r '.results | .[] | select(.test_fqn == "fchown03") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.362606 + result=pass
2025-04-15T11:51:04.363102 + '[' pass = pass ']'
2025-04-15T11:51:04.363328 + continue
2025-04-15T11:51:04.363854 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.371955 ++ jq -r '.results | .[] | select(.test_fqn == "fchown03_16") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.439942 + result=conf
2025-04-15T11:51:04.440418 + '[' conf = pass ']'
2025-04-15T11:51:04.440978 + jq -r '.results | .[] | select(.test_fqn == "fchown03_16") | .test.log' /tmp/kirk-report.json
2025-04-15T11:51:04.514109 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.522044 ++ jq -r '.results | .[] | select(.test_fqn == "fchown04") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.590476 + result=pass
2025-04-15T11:51:04.590981 + '[' pass = pass ']'
2025-04-15T11:51:04.591252 + continue
2025-04-15T11:51:04.591505 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.599142 ++ jq -r '.results | .[] | select(.test_fqn == "fchown04_16") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.667437 + result=conf
2025-04-15T11:51:04.667947 + '[' conf = pass ']'
2025-04-15T11:51:04.668577 + jq -r '.results | .[] | select(.test_fqn == "fchown04_16") | .test.log' /tmp/kirk-report.json
2025-04-15T11:51:04.742922 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.750525 ++ jq -r '.results | .[] | select(.test_fqn == "fchown05") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.819955 + result=pass
2025-04-15T11:51:04.820048 + '[' pass = pass ']'
2025-04-15T11:51:04.820326 + continue
2025-04-15T11:51:04.820614 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.827976 ++ jq -r '.results | .[] | select(.test_fqn == "fchown05_16") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:04.896497 + result=conf
2025-04-15T11:51:04.896793 + '[' conf = pass ']'
2025-04-15T11:51:04.897389 + jq -r '.results | .[] | select(.test_fqn == "fchown05_16") | .test.log' /tmp/kirk-report.json
2025-04-15T11:51:04.973057 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:04.980683 ++ jq -r '.results | .[] | select(.test_fqn == "fchownat01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:05.049650 + result=pass
2025-04-15T11:51:05.049955 + '[' pass = pass ']'
2025-04-15T11:51:05.050236 + continue
2025-04-15T11:51:05.050710 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:05.058273 ++ jq -r '.results | .[] | select(.test_fqn == "fchownat02") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:05.126313 + result=pass
2025-04-15T11:51:05.126791 + '[' pass = pass ']'
2025-04-15T11:51:05.127066 + continue
2025-04-15T11:51:05.127374 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:05.136797 ++ jq -r '.results | .[] | select(.test_fqn == "fcntl01") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:05.204098 + result=pass
2025-04-15T11:51:05.204393 + '[' pass = pass ']'
2025-04-15T11:51:05.204663 + continue
2025-04-15T11:51:05.205072 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:05.212568 ++ jq -r '.results | .[] | select(.test_fqn == "fcntl01_64") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:05.280417 + result=pass
2025-04-15T11:51:05.280714 + '[' pass = pass ']'
2025-04-15T11:51:05.280990 + continue
2025-04-15T11:51:05.281673 + for test_fqn in $(jq -r '.results| .[]| .test_fqn' "$1")
2025-04-15T11:51:05.289222 ++ jq -r '.results | .[] | select(.test_fqn == "fcntl02_64") | .test.result' /tmp/kirk-report.json
2025-04-15T11:51:05.357902 + result=pass
2025-04-15T11:51:05.358209 + '[' pass = pass ']'
2025-04-15T11:51:05.358500 + continue
2025-04-15T11:51:05.359325 + rm /tmp/kirk-report.json
2025-04-15T11:51:05.380939 + rm -rf /scratch
2025-04-15T11:51:05.408860 + rm -rf alltests
2025-04-15T11:51:05.430710 + ../../utils/send-to-lava.sh ./output/result.txt
2025-04-15T11:51:05.512888 <8>[ 265.011355] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=faccessat02 RESULT=pass>
2025-04-15T11:51:05.562390 <8>[ 265.060954] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=faccessat201 RESULT=pass>
2025-04-15T11:51:05.612528 <8>[ 265.111105] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fallocate03 RESULT=pass>
2025-04-15T11:51:05.663209 <8>[ 265.161770] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise01 RESULT=pass>
2025-04-15T11:51:05.712590 <8>[ 265.211013] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise02 RESULT=pass>
2025-04-15T11:51:05.761397 <8>[ 265.259890] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise03 RESULT=pass>
2025-04-15T11:51:05.809881 <8>[ 265.308258] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise04 RESULT=pass>
2025-04-15T11:51:05.859917 <8>[ 265.358464] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchdir01 RESULT=pass>
2025-04-15T11:51:05.908563 <8>[ 265.407054] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchdir02 RESULT=pass>
2025-04-15T11:51:05.956138 <8>[ 265.454828] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmod01 RESULT=pass>
2025-04-15T11:51:06.004341 <8>[ 265.502831] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmodat01 RESULT=pass>
2025-04-15T11:51:06.056306 <8>[ 265.554796] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmodat02 RESULT=pass>
2025-04-15T11:51:06.104867 <8>[ 265.603148] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmodat2_02 RESULT=pass>
2025-04-15T11:51:06.157111 <8>[ 265.655610] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown01 RESULT=pass>
2025-04-15T11:51:06.213467 <8>[ 265.711963] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fcntl02 RESULT=pass>
2025-04-15T11:51:06.265573 <8>[ 265.764044] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=faccessat202 RESULT=pass>
2025-04-15T11:51:06.315807 <8>[ 265.814487] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fallocate01 RESULT=pass>
2025-04-15T11:51:06.363812 <8>[ 265.862519] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fallocate02 RESULT=pass>
2025-04-15T11:51:06.414668 <8>[ 265.913219] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fallocate04 RESULT=pass>
2025-04-15T11:51:06.463873 <8>[ 265.962443] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fallocate05 RESULT=pass>
2025-04-15T11:51:06.511830 <8>[ 266.010407] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fallocate06 RESULT=pass>
2025-04-15T11:51:06.560953 <8>[ 266.059520] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fsetxattr01 RESULT=pass>
2025-04-15T11:51:06.585468 <LAVA_SIGNAL_STARTTC fsetxattr02>
2025-04-15T11:51:06.592884 tst_test.c:1335: TCONF: brd driver not available
2025-04-15T11:51:06.592974
2025-04-15T11:51:06.595254 <LAVA_SIGNAL_ENDTC fsetxattr02>
2025-04-15T11:51:06.620621 <8>[ 266.119242] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fsetxattr02 RESULT=skip>
2025-04-15T11:51:06.668847 <8>[ 266.167316] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise01_64 RESULT=pass>
2025-04-15T11:51:06.718968 <8>[ 266.217682] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise02_64 RESULT=pass>
2025-04-15T11:51:06.768424 <8>[ 266.266930] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise03_64 RESULT=pass>
2025-04-15T11:51:06.816599 <8>[ 266.315294] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=posix_fadvise04_64 RESULT=pass>
2025-04-15T11:51:06.867469 <8>[ 266.366078] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchdir03 RESULT=pass>
2025-04-15T11:51:06.919010 <8>[ 266.417566] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmod02 RESULT=pass>
2025-04-15T11:51:06.967957 <8>[ 266.466403] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmod03 RESULT=pass>
2025-04-15T11:51:07.018660 <8>[ 266.517213] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmod04 RESULT=pass>
2025-04-15T11:51:07.069192 <8>[ 266.567666] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmod05 RESULT=pass>
2025-04-15T11:51:07.118904 <8>[ 266.617615] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmod06 RESULT=pass>
2025-04-15T11:51:07.168085 <8>[ 266.666665] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchmodat2_01 RESULT=pass>
2025-04-15T11:51:07.192348 <LAVA_SIGNAL_STARTTC fchown01_16>
2025-04-15T11:51:07.199874 tst_tmpdir.c:316: TINFO: Using /tmp/LTP_fchKiZ6xu as tmpdir (tmpfs filesystem)
2025-04-15T11:51:07.200156 tst_test.c:1900: TINFO: LTP version: 20250130
2025-04-15T11:51:07.200246 tst_test.c:1904: TINFO: Tested kernel: 6.14.0 #1 SMP PREEMPT @1743678930 aarch64
2025-04-15T11:51:07.200499 tst_kconfig.c:88: TINFO: Parsing kernel config '/proc/config.gz'
2025-04-15T11:51:07.200744 tst_kconfig.c:676: TINFO: CONFIG_TRACE_IRQFLAGS kernel option detected which might slow the execution
2025-04-15T11:51:07.200799 tst_test.c:1722: TINFO: Overall timeout per run is 0h 21m 36s
2025-04-15T11:51:07.201258 /all/src/ltp_ltp-20250130/testcases/kernel/syscalls/fchown/../utils/compat_tst_16.h:143: TCONF: 16-bit version of fchown() is not supported on your platform
2025-04-15T11:51:07.201309
2025-04-15T11:51:07.201357 Summary:
2025-04-15T11:51:07.201403 passed 0
2025-04-15T11:51:07.201472 failed 0
2025-04-15T11:51:07.201557 broken 0
2025-04-15T11:51:07.201782 skipped 1
2025-04-15T11:51:07.201826 warnings 0
2025-04-15T11:51:07.201866
2025-04-15T11:51:07.204318 <LAVA_SIGNAL_ENDTC fchown01_16>
2025-04-15T11:51:07.230996 <8>[ 266.729732] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown01_16 RESULT=skip>
2025-04-15T11:51:07.281453 <8>[ 266.779887] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown02 RESULT=pass>
2025-04-15T11:51:07.306462 <LAVA_SIGNAL_STARTTC fchown02_16>
2025-04-15T11:51:07.314442 tst_tmpdir.c:316: TINFO: Using /tmp/LTP_fch5qiGvf as tmpdir (tmpfs filesystem)
2025-04-15T11:51:07.314545 tst_test.c:1900: TINFO: LTP version: 20250130
2025-04-15T11:51:07.314919 tst_test.c:1904: TINFO: Tested kernel: 6.14.0 #1 SMP PREEMPT @1743678930 aarch64
2025-04-15T11:51:07.315009 tst_kconfig.c:88: TINFO: Parsing kernel config '/proc/config.gz'
2025-04-15T11:51:07.315460 tst_kconfig.c:676: TINFO: CONFIG_TRACE_IRQFLAGS kernel option detected which might slow the execution
2025-04-15T11:51:07.315568 tst_test.c:1722: TINFO: Overall timeout per run is 0h 21m 36s
2025-04-15T11:51:07.315995 /all/src/ltp_ltp-20250130/testcases/kernel/syscalls/fchown/../utils/compat_tst_16.h:143: TCONF: 16-bit version of fchown() is not supported on your platform
2025-04-15T11:51:07.316069
2025-04-15T11:51:07.316142 Summary:
2025-04-15T11:51:07.316230 passed 0
2025-04-15T11:51:07.316294 failed 0
2025-04-15T11:51:07.316360 broken 0
2025-04-15T11:51:07.316442 skipped 1
2025-04-15T11:51:07.316505 warnings 0
2025-04-15T11:51:07.316606
2025-04-15T11:51:07.318891 <LAVA_SIGNAL_ENDTC fchown02_16>
2025-04-15T11:51:07.344273 <8>[ 266.842827] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown02_16 RESULT=skip>
2025-04-15T11:51:07.392894 <8>[ 266.891432] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown03 RESULT=pass>
2025-04-15T11:51:07.418668 <LAVA_SIGNAL_STARTTC fchown03_16>
2025-04-15T11:51:07.427077 tst_tmpdir.c:316: TINFO: Using /tmp/LTP_fchR7YgJx as tmpdir (tmpfs filesystem)
2025-04-15T11:51:07.427358 tst_test.c:1900: TINFO: LTP version: 20250130
2025-04-15T11:51:07.427605 tst_test.c:1904: TINFO: Tested kernel: 6.14.0 #1 SMP PREEMPT @1743678930 aarch64
2025-04-15T11:51:07.427681 tst_kconfig.c:88: TINFO: Parsing kernel config '/proc/config.gz'
2025-04-15T11:51:07.428055 tst_kconfig.c:676: TINFO: CONFIG_TRACE_IRQFLAGS kernel option detected which might slow the execution
2025-04-15T11:51:07.428118 tst_test.c:1722: TINFO: Overall timeout per run is 0h 21m 36s
2025-04-15T11:51:07.428659 /all/src/ltp_ltp-20250130/testcases/kernel/syscalls/fchown/../utils/compat_tst_16.h:143: TCONF: 16-bit version of fchown() is not supported on your platform
2025-04-15T11:51:07.428705
2025-04-15T11:51:07.428743 Summary:
2025-04-15T11:51:07.428786 passed 0
2025-04-15T11:51:07.428831 failed 0
2025-04-15T11:51:07.428875 broken 0
2025-04-15T11:51:07.429039 skipped 1
2025-04-15T11:51:07.429147 warnings 0
2025-04-15T11:51:07.429238
2025-04-15T11:51:07.431790 <LAVA_SIGNAL_ENDTC fchown03_16>
2025-04-15T11:51:07.457979 <8>[ 266.956590] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown03_16 RESULT=skip>
2025-04-15T11:51:07.507665 <8>[ 267.006286] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown04 RESULT=pass>
2025-04-15T11:51:07.533167 <LAVA_SIGNAL_STARTTC fchown04_16>
2025-04-15T11:51:07.541794 tst_tmpdir.c:316: TINFO: Using /tmp/LTP_fchn0VCtr as tmpdir (tmpfs filesystem)
2025-04-15T11:51:07.542154 tst_test.c:1076: TINFO: Mounting (null) to /tmp/LTP_fchn0VCtr/mntpoint fstyp=tmpfs flags=21
2025-04-15T11:51:07.542245 tst_test.c:1900: TINFO: LTP version: 20250130
2025-04-15T11:51:07.542558 tst_test.c:1904: TINFO: Tested kernel: 6.14.0 #1 SMP PREEMPT @1743678930 aarch64
2025-04-15T11:51:07.542665 tst_kconfig.c:88: TINFO: Parsing kernel config '/proc/config.gz'
2025-04-15T11:51:07.543062 tst_kconfig.c:676: TINFO: CONFIG_TRACE_IRQFLAGS kernel option detected which might slow the execution
2025-04-15T11:51:07.543133 tst_test.c:1722: TINFO: Overall timeout per run is 0h 21m 36s
2025-04-15T11:51:07.543710 /all/src/ltp_ltp-20250130/testcases/kernel/syscalls/fchown/../utils/compat_tst_16.h:143: TCONF: 16-bit version of fchown() is not supported on your platform
2025-04-15T11:51:07.543760
2025-04-15T11:51:07.543806 Summary:
2025-04-15T11:51:07.543857 passed 0
2025-04-15T11:51:07.543902 failed 0
2025-04-15T11:51:07.543954 broken 0
2025-04-15T11:51:07.544179 skipped 1
2025-04-15T11:51:07.544223 warnings 0
2025-04-15T11:51:07.544276
2025-04-15T11:51:07.546735 <LAVA_SIGNAL_ENDTC fchown04_16>
2025-04-15T11:51:07.574095 <8>[ 267.072687] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown04_16 RESULT=skip>
2025-04-15T11:51:07.626838 <8>[ 267.125553] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown05 RESULT=pass>
2025-04-15T11:51:07.651377 <LAVA_SIGNAL_STARTTC fchown05_16>
2025-04-15T11:51:07.659373 tst_tmpdir.c:316: TINFO: Using /tmp/LTP_fch9u03lN as tmpdir (tmpfs filesystem)
2025-04-15T11:51:07.659637 tst_test.c:1900: TINFO: LTP version: 20250130
2025-04-15T11:51:07.659723 tst_test.c:1904: TINFO: Tested kernel: 6.14.0 #1 SMP PREEMPT @1743678930 aarch64
2025-04-15T11:51:07.660086 tst_kconfig.c:88: TINFO: Parsing kernel config '/proc/config.gz'
2025-04-15T11:51:07.660246 tst_kconfig.c:676: TINFO: CONFIG_TRACE_IRQFLAGS kernel option detected which might slow the execution
2025-04-15T11:51:07.660504 tst_test.c:1722: TINFO: Overall timeout per run is 0h 21m 36s
2025-04-15T11:51:07.660868 /all/src/ltp_ltp-20250130/testcases/kernel/syscalls/fchown/../utils/compat_tst_16.h:143: TCONF: 16-bit version of fchown() is not supported on your platform
2025-04-15T11:51:07.660937
2025-04-15T11:51:07.661005 Summary:
2025-04-15T11:51:07.661069 passed 0
2025-04-15T11:51:07.661132 failed 0
2025-04-15T11:51:07.661186 broken 0
2025-04-15T11:51:07.661247 skipped 1
2025-04-15T11:51:07.661472 warnings 0
2025-04-15T11:51:07.661520
2025-04-15T11:51:07.664094 <LAVA_SIGNAL_ENDTC fchown05_16>
2025-04-15T11:51:07.689879 <8>[ 267.188594] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchown05_16 RESULT=skip>
2025-04-15T11:51:07.746303 <8>[ 267.244831] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchownat01 RESULT=pass>
2025-04-15T11:51:07.802534 <8>[ 267.301160] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fchownat02 RESULT=pass>
2025-04-15T11:51:07.855786 <8>[ 267.354349] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fcntl01 RESULT=pass>
2025-04-15T11:51:07.906610 <8>[ 267.405306] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fcntl01_64 RESULT=pass>
2025-04-15T11:51:07.956632 <8>[ 267.455189] <LAVA_SIGNAL_TESTCASE TEST_CASE_ID=fcntl02_64 RESULT=pass>
2025-04-15T11:51:07.961639 + set +x
2025-04-15T11:51:07.962409 <8>[ 267.461150] <LAVA_SIGNAL_ENDRUN 0_ltp-syscalls 1_1.1.3.1>
2025-04-15T11:51:07.968051 <LAVA_TEST_RUNNER EXIT>
2025-04-15T11:51:09.071158 [?2004hroot@runner-xxurkrix-project-40964107-concurrent-0:~# poweroff