[33.818854] Initializing watchdogs [33.818913] /dev/watchdog0 [33.823221] [001/137] (960s left) kms_vblank (pipe-b-ts-continuation-suspend) [33.973557] Starting subtest: pipe-B-ts-continuation-suspend [50.882710] Subtest pipe-B-ts-continuation-suspend: SUCCESS (1.556s) [56.985150] [002/137] (958s left) kms_ccs (pipe-d-crc-sprite-planes-basic-y_tiled_ccs) [57.431080] Starting subtest: pipe-D-crc-sprite-planes-basic-y_tiled_ccs [57.433897] Subtest pipe-D-crc-sprite-planes-basic-y_tiled_ccs: SKIP (0.002s) [57.510922] [003/137] (958s left) kms_big_fb (x-tiled-64bpp-rotate-180) [57.612640] Starting subtest: x-tiled-64bpp-rotate-180 [59.124288] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.512s) [59.240786] [004/137] (956s left) kms_big_fb (y-tiled-32bpp-rotate-180) [59.341276] Starting subtest: y-tiled-32bpp-rotate-180 [60.566233] Subtest y-tiled-32bpp-rotate-180: SUCCESS (1.225s) [60.649753] [005/137] (955s left) gem_exec_capture (capture-invisible) [60.700522] Starting subtest: capture-invisible [60.701304] Starting dynamic subtest: smem0 [60.702696] Dynamic subtest smem0: SKIP (0.000s) [60.704043] Subtest capture-invisible: SKIP (0.000s) [60.759095] [006/137] (954s left) gem_exec_fence (syncobj-channel) [61.096857] Starting subtest: syncobj-channel [62.114504] Subtest syncobj-channel: SUCCESS (1.017s) [62.391748] [007/137] (953s left) drm_fdinfo (virtual-busy) [62.452322] Starting subtest: virtual-busy [65.088801] Subtest virtual-busy: SUCCESS (2.636s) [65.129103] [008/137] (950s left) i915_hangman (engine-error-state-capture) [65.187751] Starting subtest: engine-error-state-capture [65.188489] Starting dynamic subtest: rcs0 [69.064538] Dynamic subtest rcs0: SUCCESS (3.877s) [69.071640] Starting dynamic subtest: bcs0 [73.099664] Dynamic subtest bcs0: SUCCESS (4.035s) [73.107122] Starting dynamic subtest: vcs0 [77.061748] Dynamic subtest vcs0: SUCCESS (3.962s) [77.068781] Starting dynamic subtest: vcs1 [81.100842] Dynamic subtest vcs1: SUCCESS (4.039s) [81.110598] Starting dynamic subtest: vecs0 [85.066547] Dynamic subtest vecs0: SUCCESS (3.966s) [85.067834] Subtest engine-error-state-capture: SUCCESS (19.879s) [85.112426] [009/137] (930s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-cpu) [85.218911] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-cpu [86.303807] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (1.087s) [86.393884] [010/137] (929s left) syncobj_timeline (multi-wait-for-submit-available-signaled) [86.445770] Starting subtest: multi-wait-for-submit-available-signaled [86.446522] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.000s) [86.489035] [011/137] (929s left) kms_async_flips (test-cursor) [86.592983] Starting subtest: test-cursor [86.593760] Starting dynamic subtest: pipe-A-HDMI-A-1 [86.790238] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.196s) [86.794205] Starting dynamic subtest: pipe-B-HDMI-A-1 [87.023198] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.232s) [87.028055] Starting dynamic subtest: pipe-C-HDMI-A-1 [87.181158] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.157s) [87.185516] Starting dynamic subtest: pipe-D-HDMI-A-1 [87.352283] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.169s) [87.353064] Subtest test-cursor: SUCCESS (0.759s) [87.544643] [012/137] (928s left) syncobj_timeline (device-signal-unordered) [87.593609] Starting subtest: device-signal-unordered [87.594406] Subtest device-signal-unordered: SUCCESS (0.001s) [87.628209] [013/137] (928s left) kms_psr2_sf (cursor-plane-move-continuous-sf) [87.674662] Subtest cursor-plane-move-continuous-sf: SKIP (0.000s) [87.696273] [014/137] (928s left) api_intel_bb (render) [87.743495] Starting subtest: render [87.744276] Starting dynamic subtest: render-none-512 [87.824047] Dynamic subtest render-none-512: SUCCESS (0.080s) [87.828067] Starting dynamic subtest: render-none-1024 [88.158743] Dynamic subtest render-none-1024: SUCCESS (0.334s) [88.162825] Starting dynamic subtest: render-x-512 [88.231321] Dynamic subtest render-x-512: SUCCESS (0.073s) [88.235454] Starting dynamic subtest: render-x-1024 [88.514967] Dynamic subtest render-x-1024: SUCCESS (0.283s) [88.519382] Starting dynamic subtest: render-y-512 [88.586843] Dynamic subtest render-y-512: SUCCESS (0.072s) [88.591282] Starting dynamic subtest: render-y-1024 [88.871409] Dynamic subtest render-y-1024: SUCCESS (0.281s) [88.875094] Subtest render: SUCCESS (1.124s) [88.933824] [015/137] (926s left) kms_plane_multiple (tiling-y) [89.032598] Starting subtest: tiling-y [89.033375] Starting dynamic subtest: pipe-A-HDMI-A-1 [89.613140] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.580s) [89.618801] Starting dynamic subtest: pipe-B-HDMI-A-1 [90.168480] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.554s) [90.172934] Starting dynamic subtest: pipe-C-HDMI-A-1 [90.762773] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.593s) [90.767483] Starting dynamic subtest: pipe-D-HDMI-A-1 [91.349045] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.585s) [91.349772] Subtest tiling-y: SUCCESS (2.317s) [91.462494] [016/137] (924s left) gem_render_copy (y-tiled-ccs-to-yf-tiled) [91.514130] Starting subtest: y-tiled-ccs-to-yf-tiled [91.514933] Starting dynamic subtest: smem [91.590315] Dynamic subtest smem: SUCCESS (0.076s) [91.591185] Subtest y-tiled-ccs-to-yf-tiled: SUCCESS (0.076s) [91.729499] [017/137] (924s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-msflip-blt) [91.829722] Starting subtest: psr-2p-primscrn-indfb-msflip-blt [91.831154] Subtest psr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s) [91.871008] [018/137] (924s left) kms_ccs (pipe-b-ccs-on-another-bo-y_tiled_gen12_rc_ccs) [92.124303] Starting subtest: pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs [92.125036] Subtest pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SUCCESS (0.000s) [92.376244] [019/137] (923s left) gem_exec_params (no-blt) [92.424800] Starting subtest: no-blt [92.425533] Subtest no-blt: SUCCESS (0.000s) [92.492975] [020/137] (923s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs) [92.845704] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs [92.848675] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.002s) [93.011197] [021/137] (922s left) gem_exec_params (rs-invalid) [93.060603] Starting subtest: rs-invalid [93.062485] Subtest rs-invalid: SUCCESS (0.001s) [93.127912] [022/137] (922s left) kms_vblank (pipe-d-wait-forked-busy) [93.225527] Starting subtest: pipe-D-wait-forked-busy [94.563230] Subtest pipe-D-wait-forked-busy: SUCCESS (1.338s) [94.663080] [023/137] (921s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [94.764704] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [94.766286] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [94.804657] [024/137] (921s left) kms_ccs (pipe-b-crc-primary-rotation-180-y_tiled_ccs) [95.031474] Starting subtest: pipe-B-crc-primary-rotation-180-y_tiled_ccs [95.033062] Subtest pipe-B-crc-primary-rotation-180-y_tiled_ccs: SKIP (0.000s) [95.313116] [025/137] (920s left) prime_mmap (test_aperture_limit) [95.358198] Starting subtest: test_aperture_limit [95.358930] Starting dynamic subtest: test_aperture_limit-smem [95.365301] Dynamic subtest test_aperture_limit-smem: SUCCESS (0.007s) [95.366085] Subtest test_aperture_limit: SUCCESS (0.007s) [95.420473] [026/137] (920s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff) [95.521472] Starting subtest: psr-2p-primscrn-spr-indfb-onoff [95.522860] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s) [95.571256] [027/137] (920s left) kms_cursor_legacy (torture-bo) [95.665439] Starting subtest: torture-bo [95.666169] Starting dynamic subtest: pipe-A [117.225456] Dynamic subtest pipe-A: SUCCESS (21.559s) [117.229908] Starting dynamic subtest: pipe-B [138.810477] Dynamic subtest pipe-B: SUCCESS (21.585s) [138.815606] Starting dynamic subtest: pipe-C [160.644613] Dynamic subtest pipe-C: SUCCESS (21.833s) [160.651150] Starting dynamic subtest: pipe-D [182.320530] Dynamic subtest pipe-D: SUCCESS (21.676s) [182.324849] Starting dynamic subtest: all-pipes [203.897223] Dynamic subtest all-pipes: SUCCESS (21.576s) [203.898064] Subtest torture-bo: SUCCESS (108.231s) [203.929420] [028/137] (812s left) gem_mmap_wc (bad-offset) [203.998552] Starting subtest: bad-offset [203.999342] Subtest bad-offset: SUCCESS (0.000s) [204.051010] [029/137] (811s left) perf (gen12-mi-rpc) [204.143584] Starting subtest: gen12-mi-rpc [204.144279] Starting dynamic subtest: rcs0 [204.155687] Dynamic subtest rcs0: SUCCESS (0.011s) [204.156512] Subtest gen12-mi-rpc: SUCCESS (0.012s) [204.168073] [030/137] (811s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180) [204.268725] Starting subtest: linear-max-hw-stride-64bpp-rotate-180 [204.833918] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (0.565s) [204.912058] [031/137] (811s left) kms_big_fb (yf-tiled-16bpp-rotate-180) [205.020363] Starting subtest: yf-tiled-16bpp-rotate-180 [205.021811] Subtest yf-tiled-16bpp-rotate-180: SKIP (0.000s) [205.062435] [032/137] (810s left) api_intel_bb (object-noreloc-keep-cache-simple) [205.109630] Starting subtest: object-noreloc-keep-cache-simple [205.111170] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.002s) [205.176722] [033/137] (810s left) gem_ctx_shared (create-shared-gtt) [205.240307] Starting subtest: create-shared-gtt [207.389364] Subtest create-shared-gtt: SUCCESS (2.149s) [207.546390] [034/137] (808s left) syncobj_timeline (etime-single-wait-all-submitted) [207.605252] Starting subtest: etime-single-wait-all-submitted [207.707814] Subtest etime-single-wait-all-submitted: SUCCESS (0.103s) [207.756852] [035/137] (808s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt) [207.864786] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt [207.866235] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s) [207.921318] [036/137] (808s left) kms_flip (2x-busy-flip) [208.003521] Starting subtest: 2x-busy-flip [208.023616] Subtest 2x-busy-flip: SKIP (0.020s) [208.071788] [037/137] (808s left) gem_ringfill (basic-all) [208.297717] Starting subtest: basic-all [209.417149] Subtest basic-all: SUCCESS (1.120s) [209.493901] [038/137] (806s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [209.616165] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [209.616877] Starting dynamic subtest: pipe-A-valid-mode [210.285558] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.669s) [210.286420] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SUCCESS (0.670s) [210.405210] [039/137] (805s left) kms_atomic (crtc-invalid-params-fence) [210.549691] Starting subtest: crtc-invalid-params-fence [210.626081] Subtest crtc-invalid-params-fence: SUCCESS (0.076s) [210.784821] [040/137] (805s left) kms_hdr (static-toggle-suspend) [210.881779] Starting subtest: static-toggle-suspend [210.883195] Subtest static-toggle-suspend: SKIP (0.000s) [210.918143] [041/137] (805s left) kms_lease (empty_lease) [211.013113] Starting subtest: empty_lease [211.013903] Starting dynamic subtest: pipe-A-HDMI-A-1 [211.014681] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.001s) [211.020437] Starting dynamic subtest: pipe-B-HDMI-A-1 [211.021225] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.000s) [211.025315] Starting dynamic subtest: pipe-C-HDMI-A-1 [211.026058] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.001s) [211.030070] Starting dynamic subtest: pipe-D-HDMI-A-1 [211.030849] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.000s) [211.031597] Subtest empty_lease: SUCCESS (0.007s) [211.051387] [042/137] (805s left) kms_frontbuffer_tracking (psr-rgb101010-draw-blt) [211.151985] Starting subtest: psr-rgb101010-draw-blt [211.153461] Subtest psr-rgb101010-draw-blt: SKIP (0.000s) [211.201146] [043/137] (804s left) syncobj_timeline (single-wait-all-for-submit-available-submitted) [211.248045] Starting subtest: single-wait-all-for-submit-available-submitted [211.248817] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s) [211.284946] [044/137] (804s left) kms_addfb_basic (bad-pitch-65536) [211.331561] Starting subtest: bad-pitch-65536 [211.332350] Subtest bad-pitch-65536: SUCCESS (0.000s) [211.443067] [045/137] (804s left) kms_chamelium_color (ctm-max) [211.540768] Subtest ctm-max: SKIP (0.000s) [211.560955] [046/137] (804s left) kms_big_fb (4-tiled-addfb) [211.661756] Starting subtest: 4-tiled-addfb [211.663265] Subtest 4-tiled-addfb: SKIP (0.000s) [211.717857] [047/137] (804s left) gem_exec_schedule (submit-late-slice) [211.775215] Starting subtest: submit-late-slice [211.776031] Starting dynamic subtest: rcs0 [211.797899] Dynamic subtest rcs0: SUCCESS (0.022s) [211.803469] Starting dynamic subtest: bcs0 [211.820905] Dynamic subtest bcs0: SUCCESS (0.023s) [211.825664] Starting dynamic subtest: vcs0 [211.842796] Dynamic subtest vcs0: SUCCESS (0.022s) [211.847538] Starting dynamic subtest: vcs1 [211.863857] Dynamic subtest vcs1: SUCCESS (0.021s) [211.869420] Starting dynamic subtest: vecs0 [211.886939] Dynamic subtest vecs0: SUCCESS (0.023s) [211.887683] Subtest submit-late-slice: SUCCESS (0.112s) [212.135030] [048/137] (804s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt) [212.233331] Starting subtest: fbc-rgb565-draw-mmap-gtt [213.281402] Subtest fbc-rgb565-draw-mmap-gtt: SUCCESS (1.049s) [213.375217] [049/137] (802s left) gem_exec_reloc (basic-wc-read) [213.429284] Starting subtest: basic-wc-read [213.433993] Subtest basic-wc-read: SUCCESS (0.005s) [213.518316] [050/137] (802s left) kms_cursor_legacy (short-flip-after-cursor-toggle) [213.613292] Starting subtest: short-flip-after-cursor-toggle [214.130926] Subtest short-flip-after-cursor-toggle: SUCCESS (0.518s) [214.222820] [051/137] (802s left) gem_exec_reloc (basic-cpu-gtt-noreloc) [214.273502] Starting subtest: basic-cpu-gtt-noreloc [214.276554] Subtest basic-cpu-gtt-noreloc: SUCCESS (0.003s) [214.364050] [052/137] (801s left) fbdev (read) [214.418119] Starting subtest: read [215.075761] Subtest read: SUCCESS (0.657s) [215.105634] [053/137] (801s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt) [215.212674] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt [215.214190] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [215.272633] [054/137] (801s left) kms_addfb_basic (bad-pitch-32) [215.319387] Starting subtest: bad-pitch-32 [215.320092] Subtest bad-pitch-32: SUCCESS (0.000s) [215.422357] [055/137] (800s left) gem_exec_balancer (bonded-sync) [215.474233] Starting subtest: bonded-sync [229.706742] Subtest bonded-sync: SUCCESS (14.232s) [229.932984] [056/137] (786s left) kms_ccs (pipe-b-random-ccs-data-y_tiled_gen12_mc_ccs) [230.179558] Starting subtest: pipe-B-random-ccs-data-y_tiled_gen12_mc_ccs [230.183071] Subtest pipe-B-random-ccs-data-y_tiled_gen12_mc_ccs: SKIP (0.000s) [230.451319] [057/137] (785s left) kms_vblank (pipe-c-wait-forked-hang) [230.546095] Starting subtest: pipe-C-wait-forked-hang [244.187528] Subtest pipe-C-wait-forked-hang: SUCCESS (13.642s) [244.288117] [058/137] (772s left) kms_prime (basic-modeset-hybrid) [244.804498] Subtest basic-modeset-hybrid: SKIP (0.000s) [244.869674] [059/137] (771s left) sw_sync (sync_random_merge) [244.927307] Starting subtest: sync_random_merge [244.959432] Subtest sync_random_merge: SUCCESS (0.032s) [244.988822] [060/137] (771s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [245.085766] Starting subtest: basic-busy-flip-before-cursor-atomic [245.087337] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [245.120887] [061/137] (771s left) gem_partial_pwrite_pread (reads-uncached) [245.168479] Starting subtest: reads-uncached [246.651790] Subtest reads-uncached: SUCCESS (1.483s) [246.730661] [062/137] (769s left) vgem_basic (sysfs) [246.792306] Starting subtest: sysfs [246.793112] Subtest sysfs: SUCCESS (0.000s) [246.821713] [063/137] (769s left) v3d/v3d_submit_csd (job-perfmon) [246.900767] Subtest job-perfmon: SKIP (0.000s) [246.932054] [064/137] (769s left) i915_selftest (mock) [247.969053] Starting subtest: mock [247.970242] Starting dynamic subtest: sanitycheck [248.136002] Dynamic subtest sanitycheck: SUCCESS (0.167s) [248.143521] Starting dynamic subtest: shmem [248.304093] Dynamic subtest shmem: SUCCESS (0.167s) [248.311684] Starting dynamic subtest: fence [255.616113] Dynamic subtest fence: SUCCESS (7.311s) [255.623064] Starting dynamic subtest: scatterlist [256.776897] Dynamic subtest scatterlist: SUCCESS (1.160s) [256.783472] Starting dynamic subtest: syncmap [259.133308] Dynamic subtest syncmap: SUCCESS (2.355s) [259.139993] Starting dynamic subtest: uncore [259.282826] Dynamic subtest uncore: SUCCESS (0.149s) [259.291029] Starting dynamic subtest: ring [259.451927] Dynamic subtest ring: SUCCESS (0.168s) [259.459926] Starting dynamic subtest: engine [259.625899] Dynamic subtest engine: SUCCESS (0.173s) [259.633997] Starting dynamic subtest: timelines [263.129429] Dynamic subtest timelines: SUCCESS (3.502s) [263.136273] Starting dynamic subtest: requests [265.205415] Dynamic subtest requests: SUCCESS (2.075s) [265.212719] Starting dynamic subtest: objects [265.448508] Dynamic subtest objects: SUCCESS (0.242s) [265.456079] Starting dynamic subtest: phys [265.694512] Dynamic subtest phys: SUCCESS (0.245s) [265.701999] Starting dynamic subtest: dmabuf [265.936443] Dynamic subtest dmabuf: SUCCESS (0.241s) [265.943087] Starting dynamic subtest: vma [273.276436] Dynamic subtest vma: SUCCESS (7.339s) [273.283410] Starting dynamic subtest: evict [274.111067] Dynamic subtest evict: FAIL (0.822s) [274.112297] Subtest mock: FAIL (26.130s) [274.243268] Aborting: Lockdep not active /proc/lockdep_stats contents: lock-classes: 1665 [max: 8192] direct dependencies: 15816 [max: 32768] indirect dependencies: 90721 all direct dependencies: 316515 dependency chains: 21315 [max: 131072] dependency chain hlocks used: 85348 [max: 655360] dependency chain hlocks lost: 0 in-hardirq chains: 179 in-softirq chains: 635 in-process chains: 20501 stack-trace entries: 178248 [max: 1048576] number of stack traces: 9298 number of stack hash chains: 7098 combined max dependencies: 2347068960 hardirq-safe locks: 94 hardirq-unsafe locks: 999 softirq-safe locks: 182 softirq-unsafe locks: 911 irq-safe locks: 207 irq-unsafe locks: 999 hardirq-read-safe locks: 3 hardirq-read-unsafe locks: 292 softirq-read-safe locks: 7 softirq-read-unsafe locks: 287 irq-read-safe locks: 7 irq-read-unsafe locks: 292 uncategorized locks: 278 unused locks: 1 max locking depth: 15 max bfs queue depth: 411 max lock class index: 1829 chain lookup misses: 27618 chain lookup hits: 237922265 cyclic checks: 27178 redundant checks: 0 redundant links: 0 find-mask forwards checks: 4481 find-mask backwards checks: 3059 hardirq on events: 138434571 hardirq off events: 138434563 redundant hardirq ons: 56 redundant hardirq offs: 17 softirq on events: 1330811 softirq off events: 1330811 redundant softirq ons: 0 redundant softirq offs: 0 debug_locks: 0 zapped classes: 454 zapped lock chains: 6135 large chain blocks: 1 [274.244379] Closing watchdogs Done.