[38.857565] Initializing watchdogs [38.857712] /dev/watchdog0 [38.871882] [001/143] (960s left) kms_plane_scaling (planes-downscale-factor-0-25-unity-scaling) [38.958255] Starting subtest: planes-downscale-factor-0-25-unity-scaling [38.960799] Starting dynamic subtest: pipe-A-eDP-1 [38.969472] Dynamic subtest pipe-A-eDP-1: SKIP (0.008s) [38.980594] Starting dynamic subtest: pipe-B-eDP-1 [38.985485] Dynamic subtest pipe-B-eDP-1: SKIP (0.015s) [38.996248] Starting dynamic subtest: pipe-C-eDP-1 [39.001144] Dynamic subtest pipe-C-eDP-1: SKIP (0.015s) [39.011348] Starting dynamic subtest: pipe-D-eDP-1 [39.016264] Dynamic subtest pipe-D-eDP-1: SKIP (0.015s) [39.020225] Subtest planes-downscale-factor-0-25-unity-scaling: SKIP (0.056s) [39.095324] [002/143] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc) [39.192645] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc [43.815847] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (4.632s) [43.923283] [003/143] (955s left) syncobj_wait (signal) [43.992459] Starting subtest: signal [43.995209] Subtest signal: SUCCESS (0.000s) [44.070556] [004/143] (955s left) kms_addfb_basic (bad-pitch-128) [44.137847] Starting subtest: bad-pitch-128 [44.139799] Subtest bad-pitch-128: SUCCESS (0.000s) [44.228488] [005/143] (955s left) gem_exec_schedule (implicit-read-write) [44.309108] Starting subtest: implicit-read-write [44.311624] Starting dynamic subtest: rcs0 [44.433122] Dynamic subtest rcs0: SUCCESS (0.123s) [44.446485] Starting dynamic subtest: vcs0 [44.520868] Dynamic subtest vcs0: SUCCESS (0.088s) [44.532969] Starting dynamic subtest: vcs1 [44.598343] Dynamic subtest vcs1: SUCCESS (0.077s) [44.611246] Starting dynamic subtest: vecs0 [44.672566] Dynamic subtest vecs0: SUCCESS (0.075s) [44.686305] Starting dynamic subtest: ccs0 [44.755831] Dynamic subtest ccs0: SUCCESS (0.083s) [44.758577] Subtest implicit-read-write: SUCCESS (0.447s) [46.564609] [006/143] (952s left) kms_chamelium_edid (hdmi-edid-change-during-suspend) [46.965027] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s) [47.830395] [007/143] (951s left) gem_eio (in-flight-immediate) [48.101535] Starting subtest: in-flight-immediate [56.096807] Subtest in-flight-immediate: SUCCESS (7.998s) [56.215804] [008/143] (943s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling) [56.339386] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling [56.341821] Starting dynamic subtest: pipe-A-default-mode [56.631958] Dynamic subtest pipe-A-default-mode: SKIP (0.288s) [56.637719] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.289s) [57.522695] [009/143] (942s left) gem_exec_fence (syncobj-signal) [58.033083] Starting subtest: syncobj-signal [58.042911] Subtest syncobj-signal: SUCCESS (0.010s) [59.518548] [010/143] (940s left) kms_ccs (pipe-c-bad-pixel-format-4-tiled-dg2-mc-ccs) [59.962106] Starting subtest: pipe-C-bad-pixel-format-4-tiled-dg2-mc-ccs [59.967994] Subtest pipe-C-bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.000s) [60.852343] [011/143] (938s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt) [60.929351] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt [60.933603] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [60.998392] [012/143] (938s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt) [61.077286] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt [61.082146] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s) [61.140224] [013/143] (938s left) kms_pm_rpm (fences) [62.748953] Starting subtest: fences [62.754751] Subtest fences: SKIP (0.000s) [63.544065] [014/143] (936s left) gem_mmap_gtt (basic-small-bo) [63.611342] Subtest basic-small-bo: SKIP (0.000s) [63.645699] [015/143] (936s left) kms_cursor_crc (cursor-sliding-32x32) [63.828956] Starting subtest: cursor-sliding-32x32 [63.862677] Subtest cursor-sliding-32x32: SKIP (0.027s) [64.159497] [016/143] (935s left) sriov_basic (enable-vfs-autoprobe-on) [64.232531] Subtest enable-vfs-autoprobe-on: SKIP (0.000s) [64.276449] [017/143] (935s left) kms_plane_scaling (invalid-parameters) [64.347537] Starting subtest: invalid-parameters [64.349956] Starting dynamic subtest: less-than-1-height-src [64.355515] Dynamic subtest less-than-1-height-src: SUCCESS (0.007s) [64.371494] Starting dynamic subtest: less-than-1-width-src [64.374100] Dynamic subtest less-than-1-width-src: SUCCESS (0.007s) [64.376503] Subtest invalid-parameters: SUCCESS (0.014s) [64.439722] [018/143] (935s left) kms_ccs (pipe-b-crc-primary-rotation-180-4-tiled-mtl-rc-ccs) [64.838232] Starting subtest: pipe-B-crc-primary-rotation-180-4-tiled-mtl-rc-ccs [65.877134] Subtest pipe-B-crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SUCCESS (1.040s) [67.065850] [019/143] (932s left) gem_ccs (block-copy-compressed) [67.137269] Starting subtest: block-copy-compressed [67.142612] Subtest block-copy-compressed: SKIP (0.000s) [67.220328] [020/143] (932s left) kms_draw_crc (fill-fb) [67.329776] Starting subtest: fill-fb [67.877293] Subtest fill-fb: SUCCESS (0.547s) [67.957068] [021/143] (931s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions-varying-size) [68.082774] Starting subtest: flip-vs-cursor-atomic-transitions-varying-size [75.478906] Subtest flip-vs-cursor-atomic-transitions-varying-size: SUCCESS (7.395s) [76.419578] [022/143] (923s left) kms_ccs (pipe-a-bad-rotation-90-4-tiled-mtl-rc-ccs-cc) [76.794384] Starting subtest: pipe-A-bad-rotation-90-4-tiled-mtl-rc-ccs-cc [77.632842] Subtest pipe-A-bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.839s) [78.809836] [023/143] (921s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt) [78.905579] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt [78.910035] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s) [78.984149] [024/143] (921s left) core_hotunplug (unbind-rebind) [79.109532] Starting subtest: unbind-rebind [84.637395] Subtest unbind-rebind: SUCCESS (5.527s) [84.672062] [025/143] (915s left) syncobj_wait (invalid-reset-one-illegal-handle) [86.423995] Starting subtest: invalid-reset-one-illegal-handle [86.426702] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s) [86.527043] [026/143] (913s left) kms_hdmi_inject (inject-audio) [86.893619] Starting subtest: inject-audio [87.132879] Subtest inject-audio: SUCCESS (0.239s) [88.079476] [027/143] (912s left) kms_flip (2x-flip-vs-wf_vblank) [88.186312] Starting subtest: 2x-flip-vs-wf_vblank [88.197628] Subtest 2x-flip-vs-wf_vblank: SKIP (0.013s) [88.274117] [028/143] (911s left) gem_mmap_gtt (pf-nonblock) [88.356282] Subtest pf-nonblock: SKIP (0.000s) [88.405595] [029/143] (911s left) gem_lmem_swapping (verify-random-ccs) [88.458837] Subtest verify-random-ccs: SKIP (0.000s) [88.471751] [030/143] (911s left) kms_vblank (wait-busy-hang) [88.561694] Starting subtest: wait-busy-hang [88.564195] Starting dynamic subtest: pipe-A-eDP-1 [102.358124] Dynamic subtest pipe-A-eDP-1: SUCCESS (13.794s) [102.376022] Starting dynamic subtest: pipe-D-eDP-1 [117.335520] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.973s) [117.338886] Subtest wait-busy-hang: SUCCESS (28.774s) [118.260166] [031/143] (881s left) kms_big_fb (y-tiled-32bpp-rotate-90) [118.395131] Starting subtest: y-tiled-32bpp-rotate-90 [118.399845] Subtest y-tiled-32bpp-rotate-90: SKIP (0.000s) [118.472615] [032/143] (881s left) kms_chamelium_hpd (hdmi-hpd-after-suspend) [118.843920] Subtest hdmi-hpd-after-suspend: SKIP (0.000s) [119.707288] [033/143] (880s left) kms_big_fb (4-tiled-64bpp-rotate-180) [119.795136] Starting subtest: 4-tiled-64bpp-rotate-180 [121.439151] Subtest 4-tiled-64bpp-rotate-180: SUCCESS (1.646s) [121.618883] [034/143] (878s left) gem_eio (in-flight-internal-immediate) [121.848738] Starting subtest: in-flight-internal-immediate [123.559127] Subtest in-flight-internal-immediate: SUCCESS (1.710s) [123.677342] [035/143] (876s left) gem_reg_read (bad-register) [123.762526] Starting subtest: bad-register [123.765138] Subtest bad-register: SUCCESS (0.000s) [123.833236] [036/143] (876s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt) [123.932230] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt [123.936281] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [124.019269] [037/143] (876s left) i915_suspend (fence-restore-tiled2untiled) [124.098432] Starting subtest: fence-restore-tiled2untiled [124.102834] Subtest fence-restore-tiled2untiled: SKIP (0.000s) [124.175617] [038/143] (876s left) kms_getfb (getfb2-handle-not-fb) [124.241732] Starting subtest: getfb2-handle-not-fb [124.254964] Subtest getfb2-handle-not-fb: SUCCESS (0.013s) [124.333469] [039/143] (876s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [124.449227] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip [124.453343] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s) [124.539251] [040/143] (875s left) kms_force_connector_basic (force-load-detect) [124.614524] Starting subtest: force-load-detect [124.619238] Subtest force-load-detect: SKIP (0.000s) [124.721839] [041/143] (875s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-shrfb-draw-mmap-wc) [124.831731] Starting subtest: psr-1p-offscren-pri-shrfb-draw-mmap-wc [129.392407] Subtest psr-1p-offscren-pri-shrfb-draw-mmap-wc: SUCCESS (4.565s) [129.517096] [042/143] (871s left) kms_cursor_crc (cursor-onscreen-512x512) [129.842612] Starting subtest: cursor-onscreen-512x512 [129.847957] Subtest cursor-onscreen-512x512: SKIP (0.001s) [129.985326] [043/143] (870s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite) [130.078720] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite [130.084735] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [130.152170] [044/143] (870s left) gem_softpin (allocator-basic-reserve) [130.234678] Starting subtest: allocator-basic-reserve [130.317191] Subtest allocator-basic-reserve: SUCCESS (0.082s) [130.423503] [045/143] (870s left) kms_atomic (crtc-invalid-params-fence) [130.535214] Starting subtest: crtc-invalid-params-fence [130.537371] Starting dynamic subtest: pipe-A-eDP-1 [130.923564] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.387s) [130.926962] Subtest crtc-invalid-params-fence: SUCCESS (0.389s) [131.844437] [046/143] (868s left) kms_cursor_legacy (forked-move) [131.965377] Starting subtest: forked-move [131.967920] Starting dynamic subtest: pipe-A [137.431105] Dynamic subtest pipe-A: SUCCESS (5.463s) [137.449426] Starting dynamic subtest: pipe-B [143.027751] Dynamic subtest pipe-B: SUCCESS (5.592s) [143.045708] Starting dynamic subtest: pipe-C [148.603298] Dynamic subtest pipe-C: SUCCESS (5.576s) [148.620205] Starting dynamic subtest: pipe-D [154.177964] Dynamic subtest pipe-D: SUCCESS (5.571s) [154.195494] Starting dynamic subtest: all-pipes [159.738375] Dynamic subtest all-pipes: SUCCESS (5.563s) [159.741581] Subtest forked-move: SUCCESS (27.769s) [159.893303] [047/143] (840s left) gem_mmap_wc (write-read-distinct) [159.971050] Subtest write-read-distinct: SKIP (0.000s) [160.023187] [048/143] (840s left) kms_ccs (pipe-c-ccs-on-another-bo-y-tiled-gen12-mc-ccs) [160.441033] Starting subtest: pipe-C-ccs-on-another-bo-y-tiled-gen12-mc-ccs [160.449879] Subtest pipe-C-ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.000s) [161.340729] [049/143] (839s left) prime_mmap (test_dup) [161.398043] Starting subtest: test_dup [161.402644] Starting dynamic subtest: test_dup-smem [161.431870] Dynamic subtest test_dup-smem: SUCCESS (0.034s) [161.434297] Subtest test_dup: SUCCESS (0.035s) [161.490838] [050/143] (839s left) kms_addfb_basic (addfb25-bad-modifier) [161.548418] Starting subtest: addfb25-bad-modifier [161.550779] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [161.674253] [051/143] (839s left) kms_fb_coherency (memset-crc) [161.746787] Starting subtest: memset-crc [161.749288] Starting dynamic subtest: mmap-offset-wc [162.166149] Dynamic subtest mmap-offset-wc: SUCCESS (0.422s) [162.476881] Starting dynamic subtest: mmap-offset-uc [168.813405] Dynamic subtest mmap-offset-uc: SUCCESS (6.355s) [169.107428] Subtest memset-crc: SUCCESS (7.363s) [170.049822] [052/143] (830s left) kms_ccs (pipe-a-crc-primary-rotation-180-4-tiled-mtl-mc-ccs) [170.444646] Starting subtest: pipe-A-crc-primary-rotation-180-4-tiled-mtl-mc-ccs [173.088373] Subtest pipe-A-crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (2.644s) [174.277220] [053/143] (826s left) kms_busy (extended-pageflip-hang-newfb) [174.391607] Starting subtest: extended-pageflip-hang-newfb [174.394057] Starting dynamic subtest: pipe-A [188.409313] Dynamic subtest pipe-A: SUCCESS (14.017s) [188.428858] Starting dynamic subtest: pipe-D [203.380581] Dynamic subtest pipe-D: SUCCESS (14.959s) [203.383339] Subtest extended-pageflip-hang-newfb: SUCCESS (28.985s) [204.277446] [054/143] (796s left) perf_pmu (gt-awake) [204.355976] Starting subtest: gt-awake [213.430066] Subtest gt-awake: SUCCESS (9.072s) [213.527353] [055/143] (787s left) kms_ccs (pipe-d-bad-rotation-90-4-tiled-dg2-rc-ccs-cc) [214.012393] Starting subtest: pipe-D-bad-rotation-90-4-tiled-dg2-rc-ccs-cc [214.018474] Subtest pipe-D-bad-rotation-90-4-tiled-dg2-rc-ccs-cc: SKIP (0.000s) [214.903546] [056/143] (786s left) kms_ccs (pipe-a-missing-ccs-buffer-4-tiled-mtl-rc-ccs) [215.294212] Starting subtest: pipe-A-missing-ccs-buffer-4-tiled-mtl-rc-ccs [215.296961] Subtest pipe-A-missing-ccs-buffer-4-tiled-mtl-rc-ccs: SUCCESS (0.000s) [216.188728] [057/143] (784s left) kms_ccs (pipe-d-missing-ccs-buffer-y-tiled-gen12-rc-ccs-cc) [216.626402] Starting subtest: pipe-D-missing-ccs-buffer-y-tiled-gen12-rc-ccs-cc [216.631609] Subtest pipe-D-missing-ccs-buffer-y-tiled-gen12-rc-ccs-cc: SKIP (0.000s) [217.479633] [058/143] (783s left) kms_big_fb (x-tiled-64bpp-rotate-270) [217.584418] Starting subtest: x-tiled-64bpp-rotate-270 [217.600512] Subtest x-tiled-64bpp-rotate-270: SKIP (0.019s) [217.703858] [059/143] (783s left) api_intel_allocator (fork-simple-once) [217.767052] Starting subtest: fork-simple-once [217.794301] Subtest fork-simple-once: SUCCESS (0.030s) [217.897923] [060/143] (783s left) gem_exec_reloc (basic-cpu-gtt) [217.997499] Subtest basic-cpu-gtt: SKIP (0.000s) [218.046782] [061/143] (783s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic) [218.184032] Starting subtest: 2x-long-flip-vs-cursor-atomic [218.188557] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.002s) [218.324857] [062/143] (782s left) kms_psr (fbc-pr-cursor-blt) [218.403750] Starting subtest: fbc-pr-cursor-blt [218.408281] Subtest fbc-pr-cursor-blt: SKIP (0.000s) [218.501833] [063/143] (782s left) sw_sync (sync_merge_same) [218.571827] Starting subtest: sync_merge_same [218.574202] Subtest sync_merge_same: SUCCESS (0.000s) [218.635778] [064/143] (782s left) vc4/vc4_purgeable_bo (mark-unpurgeable-twice) [218.736273] Subtest mark-unpurgeable-twice: SKIP (0.000s) [218.781767] [065/143] (782s left) kms_feature_discovery (display-2x) [218.878881] Starting subtest: display-2x [218.883145] Subtest display-2x: SKIP (0.000s) [218.947992] [066/143] (782s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt) [219.065076] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt [222.426327] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (3.363s) [222.550390] [067/143] (778s left) gem_ctx_param (invalid-get-no-zeromap) [222.610345] Starting subtest: invalid-get-no-zeromap [222.612370] Subtest invalid-get-no-zeromap: SUCCESS (0.001s) [222.696367] [068/143] (778s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt) [222.767225] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt [222.771296] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s) [222.860602] [069/143] (778s left) core_getversion [222.981414] [070/143] (778s left) gem_eio (kms) [223.218706] Starting subtest: kms [244.762528] Subtest kms: SUCCESS (21.545s) [246.023287] [071/143] (755s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25) [246.122809] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25 [246.125440] Starting dynamic subtest: pipe-A-eDP-1 [246.186909] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.065s) [246.207976] Starting dynamic subtest: pipe-B-eDP-1 [247.410160] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.220s) [247.423076] Starting dynamic subtest: pipe-C-eDP-1 [248.613079] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.199s) [248.630737] Starting dynamic subtest: pipe-D-eDP-1 [249.832480] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.216s) [249.835125] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.713s) [251.144472] [072/143] (750s left) gem_exec_gttfill (all-engines) [251.224835] Starting subtest: all-engines [274.063815] Subtest all-engines: SUCCESS (22.837s) [274.251945] [073/143] (727s left) i915_hangman (gt-engine-error) [274.388040] Starting subtest: gt-engine-error [274.390878] Starting dynamic subtest: rcs0 [276.435689] Dynamic subtest rcs0: SUCCESS (2.046s) [276.455554] Starting dynamic subtest: bcs0 [278.418822] Dynamic subtest bcs0: SUCCESS (1.981s) [278.438727] Starting dynamic subtest: vcs0 [280.403603] Dynamic subtest vcs0: SUCCESS (1.983s) [280.424250] Starting dynamic subtest: vcs1 [282.386271] Dynamic subtest vcs1: SUCCESS (1.982s) [282.409437] Starting dynamic subtest: vecs0 [284.434862] Dynamic subtest vecs0: SUCCESS (2.046s) [284.456905] Starting dynamic subtest: ccs0 [286.419506] Dynamic subtest ccs0: SUCCESS (1.982s) [286.422826] Subtest gt-engine-error: SUCCESS (12.031s) [286.510390] [074/143] (715s left) kms_ccs (pipe-b-bad-rotation-90-yf-tiled-ccs) [286.961965] Starting subtest: pipe-B-bad-rotation-90-yf-tiled-ccs [286.968209] Subtest pipe-B-bad-rotation-90-yf-tiled-ccs: SKIP (0.000s) [287.866608] [075/143] (713s left) gem_madvise (dontneed-before-pwrite) [287.909449] Starting subtest: dontneed-before-pwrite [287.930618] Subtest dontneed-before-pwrite: SKIP (0.017s) [287.988965] [076/143] (713s left) kms_psr (psr-cursor-blt) [288.074707] Starting subtest: psr-cursor-blt [288.077102] Starting dynamic subtest: eDP-1 [289.880524] Dynamic subtest eDP-1: SUCCESS (1.808s) [289.883124] Subtest psr-cursor-blt: SUCCESS (1.809s) [290.810937] [077/143] (710s left) kms_content_protection (legacy) [290.933922] Starting subtest: legacy [295.133640] Subtest legacy: SKIP (4.195s) [296.384565] [078/143] (705s left) gem_render_copy_redux (flink-interruptible) [296.496616] Starting subtest: flink-interruptible [297.645834] Subtest flink-interruptible: SUCCESS (1.149s) [297.742625] [079/143] (703s left) gem_exec_suspend (basic-s3-devices) [297.828521] Starting subtest: basic-S3-devices [297.831098] Starting dynamic subtest: smem [309.429198] Dynamic subtest smem: SUCCESS (11.598s) [309.433069] Subtest basic-S3-devices: SUCCESS (11.600s) [309.620125] [080/143] (692s left) gem_exec_schedule (submit-late-slice) [309.719085] Starting subtest: submit-late-slice [309.721172] Starting dynamic subtest: rcs0 [309.756111] Dynamic subtest rcs0: SUCCESS (0.043s) [309.775373] Starting dynamic subtest: bcs0 [309.824916] Dynamic subtest bcs0: SUCCESS (0.068s) [309.845851] Starting dynamic subtest: vcs0 [309.863297] Dynamic subtest vcs0: SUCCESS (0.036s) [309.882106] Starting dynamic subtest: vcs1 [309.894583] Dynamic subtest vcs1: SUCCESS (0.034s) [309.903109] Starting dynamic subtest: vecs0 [309.929178] Dynamic subtest vecs0: SUCCESS (0.033s) [309.950470] Starting dynamic subtest: ccs0 [309.990789] Dynamic subtest ccs0: SUCCESS (0.061s) [309.993757] Subtest submit-late-slice: SUCCESS (0.278s) [311.553414] [081/143] (690s left) kms_atomic_transition (plane-all-transition-nonblocking) [311.658645] Starting subtest: plane-all-transition-nonblocking [311.661372] Starting dynamic subtest: pipe-A-eDP-1 [314.157324] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.500s) [314.490296] Starting dynamic subtest: pipe-B-eDP-1 [317.844284] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.371s) [318.151371] Subtest plane-all-transition-nonblocking: SUCCESS (6.495s) [319.096631] [082/143] (682s left) kms_ccs (pipe-d-bad-rotation-90-4-tiled-dg2-mc-ccs) [319.530246] Starting subtest: pipe-D-bad-rotation-90-4-tiled-dg2-mc-ccs [319.535937] Subtest pipe-D-bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.000s) [320.376032] [083/143] (681s left) gem_userptr_blits (sd-probe) [320.464593] Starting subtest: sd-probe [320.466658] Subtest sd-probe: SUCCESS (0.001s) [320.600334] [084/143] (681s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary) [320.707186] Starting subtest: fbc-shrfb-scaledprimary [324.796557] Subtest fbc-shrfb-scaledprimary: SUCCESS (4.090s) [324.937551] [085/143] (676s left) kms_psr (pr-cursor-mmap-cpu) [325.041163] Starting subtest: pr-cursor-mmap-cpu [325.046320] Subtest pr-cursor-mmap-cpu: SKIP (0.000s) [325.144469] [086/143] (676s left) gem_exec_whisper (basic-contexts-priority-all) [325.230552] Starting subtest: basic-contexts-priority-all [355.194512] Subtest basic-contexts-priority-all: SUCCESS (29.959s) [355.374863] [087/143] (646s left) gem_ctx_exec (basic-invalid-context) [355.449144] Starting subtest: basic-invalid-context [355.467865] Subtest basic-invalid-context: SUCCESS (0.019s) [355.561919] [088/143] (646s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled) [355.637993] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [355.640753] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [355.735551] [089/143] (646s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary) [355.844982] Starting subtest: psr-indfb-scaledprimary [359.656417] Subtest psr-indfb-scaledprimary: SUCCESS (3.816s) [359.774568] [090/143] (642s left) kms_cursor_legacy (cursor-vs-flip-toggle) [359.891188] Starting subtest: cursor-vs-flip-toggle [389.655935] Subtest cursor-vs-flip-toggle: SUCCESS (29.762s) [390.585436] [091/143] (611s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite) [390.726084] Starting subtest: fbc-rgb565-draw-pwrite [394.118999] Subtest fbc-rgb565-draw-pwrite: SUCCESS (3.397s) [394.249561] [092/143] (607s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-fullscreen) [394.358622] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-fullscreen [394.363677] Subtest fbcpsr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s) [394.443659] [093/143] (607s left) syncobj_timeline (invalid-transfer-non-existent-point) [394.521823] Starting subtest: invalid-transfer-non-existent-point [394.524581] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s) [394.594186] [094/143] (607s left) kms_lease (possible-crtcs-filtering) [394.679836] Starting subtest: possible-crtcs-filtering [394.682985] Subtest possible-crtcs-filtering: SUCCESS (0.004s) [394.785532] [095/143] (607s left) vc4/vc4_dmabuf_poll (poll-read-waits-until-write-done) [394.876527] Subtest poll-read-waits-until-write-done: SKIP (0.000s) [394.923938] [096/143] (607s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-render) [395.039912] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-render [398.095791] Subtest fbc-1p-offscren-pri-shrfb-draw-render: SUCCESS (3.059s) [398.219518] [097/143] (604s left) gem_exec_fair (basic-none-rrul) [398.345144] Subtest basic-none-rrul: SKIP (0.000s) [398.407602] [098/143] (603s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling) [398.529494] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling [398.531583] Starting dynamic subtest: pipe-A-default-mode [401.422978] Dynamic subtest pipe-A-default-mode: SUCCESS (2.892s) [401.425757] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (2.895s) [402.358764] [099/143] (599s left) gem_reg_read (timestamp-moving) [402.436049] Starting subtest: timestamp-moving [403.435879] Subtest timestamp-moving: SUCCESS (1.001s) [403.517164] [100/143] (598s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs) [403.585849] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs [403.590835] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s) [403.778225] [101/143] (598s left) kms_cursor_legacy (cursorb-vs-flipb-toggle) [403.909044] Starting subtest: cursorB-vs-flipB-toggle [403.914154] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s) [404.048651] [102/143] (598s left) dumb_buffer (create-clear) [404.108136] Starting subtest: create-clear [438.560298] Subtest create-clear: SUCCESS (34.451s) [438.668392] [103/143] (563s left) kms_atomic_transition (plane-use-after-nonblocking-unbind) [438.792685] Starting subtest: plane-use-after-nonblocking-unbind [438.795712] Starting dynamic subtest: pipe-A-eDP-1 [438.864412] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.077s) [439.183593] Starting dynamic subtest: pipe-B-eDP-1 [440.037454] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.868s) [440.347864] Subtest plane-use-after-nonblocking-unbind: SUCCESS (1.560s) [441.271888] [104/143] (561s left) kms_vblank (query-idle-hang) [441.344224] Starting subtest: query-idle-hang [441.346960] Starting dynamic subtest: pipe-A-eDP-1 [455.382126] Dynamic subtest pipe-A-eDP-1: SUCCESS (14.037s) [455.407687] Starting dynamic subtest: pipe-D-eDP-1 [470.365348] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.976s) [470.367896] Subtest query-idle-hang: SUCCESS (29.023s) [471.286760] [105/143] (531s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [471.393583] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip [472.024722] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.636s) [472.198818] [106/143] (530s left) kms_psr2_sf (overlay-plane-update-sf-dmg-area) [477.502337] Starting subtest: overlay-plane-update-sf-dmg-area [477.505183] Starting dynamic subtest: pipe-A-eDP-1 [484.320855] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.817s) [484.339775] Starting dynamic subtest: pipe-B-eDP-1 [491.174643] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.850s) [491.177348] Subtest overlay-plane-update-sf-dmg-area: SUCCESS (13.674s) [492.094132] [107/143] (510s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [492.205039] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip [492.210034] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s) [492.289517] [108/143] (510s left) kms_pm_rpm (system-suspend-modeset) [493.840185] Starting subtest: system-suspend-modeset [518.306674] Subtest system-suspend-modeset: SUCCESS (9.469s) [519.110258] [109/143] (498s left) syncobj_timeline (wait-for-submit-delayed-submit) [519.185049] Starting subtest: wait-for-submit-delayed-submit [519.286993] Subtest wait-for-submit-delayed-submit: SUCCESS (0.103s) [519.373905] [110/143] (498s left) gem_ctx_persistence (legacy-engines-hostile-preempt) [519.453351] Starting subtest: legacy-engines-hostile-preempt [519.456400] Starting dynamic subtest: render [519.532351] Dynamic subtest render: SUCCESS (0.078s) [519.557722] Starting dynamic subtest: bsd1 [521.473108] Dynamic subtest bsd1: SUCCESS (1.936s) [521.498708] Starting dynamic subtest: bsd2 [523.458063] Dynamic subtest bsd2: SUCCESS (1.982s) [523.482614] Starting dynamic subtest: blt [523.724053] Dynamic subtest blt: SUCCESS (0.265s) [523.749962] Starting dynamic subtest: vebox [525.425045] Dynamic subtest vebox: SUCCESS (1.697s) [525.428251] Subtest legacy-engines-hostile-preempt: SUCCESS (5.970s) [525.538457] [111/143] (492s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen) [525.643513] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen [530.251988] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (4.615s) [530.376286] [112/143] (487s left) kms_psr (psr2-cursor-render) [530.493826] Starting subtest: psr2-cursor-render [530.496389] Starting dynamic subtest: eDP-1 [532.338837] Dynamic subtest eDP-1: SUCCESS (1.847s) [532.341675] Subtest psr2-cursor-render: SUCCESS (1.849s) [533.260491] [113/143] (484s left) v3d/v3d_submit_csd (bad-bo) [533.351054] Subtest bad-bo: SKIP (0.000s) [533.412687] [114/143] (484s left) gem_exec_balancer (parallel-contexts) [533.685493] Starting subtest: parallel-contexts [537.571000] Subtest parallel-contexts: SUCCESS (3.885s) [537.729681] [115/143] (480s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move) [537.824552] Starting subtest: psr-1p-primscrn-spr-indfb-move [543.451212] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (5.630s) [543.575378] [116/143] (474s left) i915_pm_rpm (gem-idle) [545.532296] Starting subtest: gem-idle [554.009246] Subtest gem-idle: SUCCESS (8.478s) [554.573247] [117/143] (463s left) gem_mmap_offset (ptrace) [555.437214] Starting subtest: ptrace [555.444221] Starting dynamic subtest: smem0-wb [555.500126] Dynamic subtest smem0-wb: SUCCESS (0.054s) [555.526298] Starting dynamic subtest: smem0-wc [555.558489] Dynamic subtest smem0-wc: SUCCESS (0.058s) [555.581388] Starting dynamic subtest: smem0-uc [555.607067] Dynamic subtest smem0-uc: SUCCESS (0.046s) [555.610411] Subtest ptrace: SUCCESS (0.173s) [555.700426] [118/143] (462s left) kms_ccs (pipe-c-bad-rotation-90-4-tiled-mtl-rc-ccs) [556.093262] Starting subtest: pipe-C-bad-rotation-90-4-tiled-mtl-rc-ccs [556.898425] Subtest pipe-C-bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.802s) [558.103411] [119/143] (459s left) kms_force_connector_basic (force-connector-state) [558.187201] Starting subtest: force-connector-state [558.759670] Subtest force-connector-state: SUCCESS (0.571s) [559.725711] [120/143] (458s left) kms_color (ctm-blue-to-red) [559.786598] Starting subtest: ctm-blue-to-red [559.789265] Starting dynamic subtest: pipe-A [560.524204] Dynamic subtest pipe-A: SUCCESS (0.737s) [560.538252] Starting dynamic subtest: pipe-B [562.004288] Dynamic subtest pipe-B: SUCCESS (1.478s) [562.018530] Starting dynamic subtest: pipe-C [563.448216] Dynamic subtest pipe-C: SUCCESS (1.443s) [563.469317] Starting dynamic subtest: pipe-D [564.921906] Dynamic subtest pipe-D: SUCCESS (1.469s) [564.925063] Subtest ctm-blue-to-red: SUCCESS (5.133s) [565.806413] [121/143] (452s left) kms_rotation_crc (primary-x-tiled-reflect-x-180) [565.956605] Starting subtest: primary-x-tiled-reflect-x-180 [574.439357] Subtest primary-x-tiled-reflect-x-180: SUCCESS (8.486s) [575.777525] [122/143] (442s left) syncobj_wait (invalid-single-wait-unsubmitted) [575.859218] Starting subtest: invalid-single-wait-unsubmitted [575.861978] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s) [575.949154] [123/143] (442s left) gen9_exec_parse (bb-chained) [576.036507] Subtest bb-chained: SKIP (0.000s) [576.069128] [124/143] (442s left) kms_sequence (get-busy) [576.176489] Starting subtest: get-busy [576.178985] Starting dynamic subtest: pipe-A-eDP-1 [578.127180] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.951s) [578.151514] Starting dynamic subtest: pipe-B-eDP-1 [580.801016] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.670s) [580.822747] Starting dynamic subtest: pipe-C-eDP-1 [583.480900] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.676s) [583.498288] Starting dynamic subtest: pipe-D-eDP-1 [586.151149] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.666s) [586.153866] Subtest get-busy: SUCCESS (9.975s) [587.090926] [125/143] (431s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled) [587.147124] Starting subtest: multi-wait-for-submit-available-submitted-signaled [587.149382] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s) [587.238041] [126/143] (431s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt) [587.351089] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt [587.355988] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s) [587.435073] [127/143] (430s left) kms_ccs (pipe-c-crc-sprite-planes-basic-y-tiled-gen12-mc-ccs) [587.831997] Starting subtest: pipe-C-crc-sprite-planes-basic-y-tiled-gen12-mc-ccs [587.838144] Subtest pipe-C-crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.001s) [588.699804] [128/143] (429s left) kms_flip (dpms-off-confusion) [588.777921] Starting subtest: dpms-off-confusion [588.780449] Starting dynamic subtest: A-eDP1 [597.575856] Dynamic subtest A-eDP1: SUCCESS (8.799s) [597.600475] Starting dynamic subtest: B-eDP1 [606.346612] Dynamic subtest B-eDP1: SUCCESS (8.769s) [606.368505] Starting dynamic subtest: C-eDP1 [615.104388] Dynamic subtest C-eDP1: SUCCESS (8.753s) [615.123880] Starting dynamic subtest: D-eDP1 [623.935164] Dynamic subtest D-eDP1: SUCCESS (8.831s) [623.943577] Subtest dpms-off-confusion: SUCCESS (35.170s) [625.248153] [129/143] (393s left) kms_ccs (pipe-d-crc-primary-basic-y-tiled-ccs) [625.665476] Starting subtest: pipe-D-crc-primary-basic-y-tiled-ccs [625.671375] Subtest pipe-D-crc-primary-basic-y-tiled-ccs: SKIP (0.000s) [626.518465] [130/143] (391s left) drm_fdinfo (basics) [626.567983] Starting subtest: basics [626.570154] Subtest basics: SUCCESS (0.000s) [626.637092] [131/143] (391s left) kms_psr (fbc-psr2-primary-render) [626.749394] Starting subtest: fbc-psr2-primary-render [626.752272] Starting dynamic subtest: eDP-1 [626.757753] Dynamic subtest eDP-1: SKIP (0.000s) [626.763088] Subtest fbc-psr2-primary-render: SKIP (0.002s) [626.862714] [132/143] (391s left) kms_invalid_mode (zero-vdisplay) [626.952062] Starting subtest: zero-vdisplay [626.954461] Starting dynamic subtest: pipe-A-eDP-1 [627.236016] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s) [627.258191] Starting dynamic subtest: pipe-B-eDP-1 [627.261184] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [627.276230] Starting dynamic subtest: pipe-C-eDP-1 [627.278806] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [627.299990] Starting dynamic subtest: pipe-D-eDP-1 [627.302623] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [627.305128] Subtest zero-vdisplay: SUCCESS (0.296s) [628.177361] [133/143] (390s left) v3d/v3d_get_bo_offset (create-get-offsets) [628.295780] Subtest create-get-offsets: SKIP (0.000s) [628.355327] [134/143] (390s left) kms_ccs (pipe-b-bad-pixel-format-4-tiled-dg2-rc-ccs) [628.753683] Starting subtest: pipe-B-bad-pixel-format-4-tiled-dg2-rc-ccs [628.759082] Subtest pipe-B-bad-pixel-format-4-tiled-dg2-rc-ccs: SKIP (0.000s) [629.624234] [135/143] (388s left) gem_exec_whisper (basic-queues-forked) [629.692525] Starting subtest: basic-queues-forked [654.726010] Subtest basic-queues-forked: SUCCESS (25.031s) [654.917691] [136/143] (363s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted-signaled) [654.983540] Starting subtest: etime-multi-wait-all-for-submit-submitted-signaled [655.084889] Subtest etime-multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.101s) [655.157159] [137/143] (363s left) gem_render_copy (linear-to-vebox-y-tiled) [655.254082] Starting subtest: linear-to-vebox-y-tiled [655.258650] Subtest linear-to-vebox-y-tiled: SKIP (0.000s) [655.453013] [138/143] (363s left) kms_atomic_interruptible (atomic-setmode) [655.538924] Starting subtest: atomic-setmode [655.541502] Starting dynamic subtest: pipe-A-eDP-1 [662.469372] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.930s) [662.472434] Subtest atomic-setmode: SUCCESS (6.932s) [663.373697] [139/143] (355s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted) [663.464953] Starting subtest: etime-single-wait-for-submit-unsubmitted [663.565766] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.101s) [663.648542] [140/143] (355s left) kms_flip (plain-flip-fb-recreate) [663.758022] Starting subtest: plain-flip-fb-recreate [663.760609] Starting dynamic subtest: A-eDP1 [672.709458] Dynamic subtest A-eDP1: SUCCESS (8.953s) [672.733589] Starting dynamic subtest: B-eDP1 [681.670429] Dynamic subtest B-eDP1: SUCCESS (8.959s) [681.694460] Starting dynamic subtest: C-eDP1 [690.617456] Dynamic subtest C-eDP1: SUCCESS (8.944s) [690.638388] Starting dynamic subtest: D-eDP1 [699.577713] Dynamic subtest D-eDP1: SUCCESS (8.958s) [699.585791] Subtest plain-flip-fb-recreate: SUCCESS (35.832s) [700.897461] [141/143] (317s left) perf (global-sseu-config-invalid) [701.047214] Subtest global-sseu-config-invalid: SKIP (0.000s) [701.078452] [142/143] (317s left) kms_big_fb (linear-64bpp-rotate-0) [701.159391] Starting subtest: linear-64bpp-rotate-0 [703.138796] Subtest linear-64bpp-rotate-0: SUCCESS (1.981s) [703.308472] [143/143] (315s left) v3d/v3d_perfmon (get-values-invalid-perfmon) [703.401986] Subtest get-values-invalid-perfmon: SKIP (0.000s) [703.457458] Closing watchdogs Done.