[61.637767] Initializing watchdogs [61.637816] /dev/watchdog0 [61.652046] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [61.656401] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [61.658704] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [61.662160] [001/133] (960s left) gen3_render_linear_blits [61.787925] [002/133] (960s left) kms_getfb (getfb-handle-valid) [61.885099] Starting subtest: getfb-handle-valid [61.887393] Subtest getfb-handle-valid: SUCCESS (0.000s) [61.965693] [003/133] (960s left) kms_psr (fbc-psr-no-drrs) [62.058772] Starting subtest: fbc-psr-no-drrs [62.061031] Starting dynamic subtest: eDP-1 [62.064991] Dynamic subtest eDP-1: SKIP (0.000s) [62.069082] Subtest fbc-psr-no-drrs: SKIP (0.000s) [62.126441] [004/133] (960s left) i915_hangman (gt-engine-hang) [62.196116] Starting subtest: gt-engine-hang [62.198467] Starting dynamic subtest: rcs0 [63.861576] Dynamic subtest rcs0: SUCCESS (1.673s) [63.870752] Starting dynamic subtest: bcs0 [65.842991] Dynamic subtest bcs0: SUCCESS (1.988s) [65.856363] Starting dynamic subtest: vcs0 [67.891700] Dynamic subtest vcs0: SUCCESS (2.054s) [67.899704] Starting dynamic subtest: vcs1 [69.875339] Dynamic subtest vcs1: SUCCESS (1.986s) [69.885679] Starting dynamic subtest: vecs0 [71.859744] Dynamic subtest vecs0: SUCCESS (1.987s) [71.869335] Starting dynamic subtest: ccs0 [73.906830] Dynamic subtest ccs0: SUCCESS (2.049s) [73.938314] Subtest gt-engine-hang: SUCCESS (11.744s) [74.042204] [005/133] (948s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-downscaling) [74.146709] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-downscaling [74.151075] Subtest flip-32bpp-ytile-to-64bpp-ytile-downscaling: SKIP (0.000s) [74.227961] [006/133] (948s left) gem_exec_fence (syncobj-timeline-export) [74.787921] Starting subtest: syncobj-timeline-export [74.793774] Subtest syncobj-timeline-export: SUCCESS (0.007s) [76.014667] [FACT gem_exec_fence (syncobj-timeline-export)] new: kernel.kmod_is_loaded.vgem: true [76.017554] [007/133] (946s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite) [76.106690] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite [76.111043] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [76.211626] [008/133] (946s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu) [76.319744] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu [80.361029] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.047s) [81.563770] [009/133] (940s left) kms_psr (psr2-primary-mmap-gtt) [81.665084] Starting subtest: psr2-primary-mmap-gtt [81.667381] Starting dynamic subtest: eDP-1 [83.147256] Dynamic subtest eDP-1: SKIP (1.479s) [83.152124] Subtest psr2-primary-mmap-gtt: SKIP (1.480s) [83.291653] [010/133] (939s left) kms_cursor_legacy (cursor-vs-flip-atomic) [83.411438] Starting subtest: cursor-vs-flip-atomic [113.187319] Subtest cursor-vs-flip-atomic: SUCCESS (29.770s) [114.007454] [011/133] (908s left) drm_buddy (drm_buddy) [114.054351] Starting subtest: drm_buddy [114.058948] Subtest drm_buddy: SKIP (0.000s) [114.112269] [012/133] (908s left) kms_vblank (invalid) [114.199253] Starting subtest: invalid [114.201582] Starting dynamic subtest: pipe-A-eDP-1 [114.609660] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.407s) [114.611683] Subtest invalid: SUCCESS (0.408s) [115.441903] [013/133] (907s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy) [115.566670] Starting subtest: flip-vs-cursor-crc-legacy [116.270528] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.704s) [117.077376] [014/133] (905s left) gem_partial_pwrite_pread (writes-after-reads-uncached) [117.143316] Subtest writes-after-reads-uncached: SKIP (0.000s) [117.208348] [015/133] (905s left) kms_psr (pr-sprite-mmap-gtt) [117.299976] Starting subtest: pr-sprite-mmap-gtt [117.304021] Subtest pr-sprite-mmap-gtt: SKIP (0.000s) [117.370255] [016/133] (905s left) kms_atomic (crtc-invalid-params) [117.475092] Starting subtest: crtc-invalid-params [117.477623] Starting dynamic subtest: pipe-A-eDP-1 [117.827418] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.353s) [117.829841] Subtest crtc-invalid-params: SUCCESS (0.354s) [118.697851] [017/133] (904s left) gem_lmem_swapping (massive-random) [118.745878] Subtest massive-random: SKIP (0.000s) [118.791920] [018/133] (904s left) gem_request_retire (retire-vma-not-inactive) [118.841355] Starting subtest: retire-vma-not-inactive [118.908611] Subtest retire-vma-not-inactive: SUCCESS (0.062s) [119.028334] [019/133] (903s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-wc) [119.129421] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-wc [119.133427] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [119.230155] [020/133] (903s left) kms_plane_multiple (2x-tiling-4) [119.323975] Starting subtest: 2x-tiling-4 [119.328618] Subtest 2x-tiling-4: SKIP (0.000s) [119.410473] [021/133] (903s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc) [119.500318] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc [119.503415] Starting dynamic subtest: pipe-A-eDP-1 [119.521737] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [119.534245] Starting dynamic subtest: pipe-B-eDP-1 [119.552367] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [119.559501] Starting dynamic subtest: pipe-C-eDP-1 [119.576542] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [119.583535] Starting dynamic subtest: pipe-D-eDP-1 [119.601245] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [119.604568] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.003s) [121.743204] [022/133] (901s left) gem_ctx_persistence (engines-queued) [121.814852] Starting subtest: engines-queued [121.817266] Starting dynamic subtest: rcs0 [121.887269] Dynamic subtest rcs0: SUCCESS (0.073s) [121.897825] Starting dynamic subtest: bcs0 [121.915545] Dynamic subtest bcs0: SUCCESS (0.027s) [121.923043] Starting dynamic subtest: vcs0 [123.892063] Dynamic subtest vcs0: SUCCESS (1.974s) [123.902977] Starting dynamic subtest: vcs1 [125.875667] Dynamic subtest vcs1: SUCCESS (1.982s) [125.886038] Starting dynamic subtest: vecs0 [127.859816] Dynamic subtest vecs0: SUCCESS (1.982s) [127.870194] Starting dynamic subtest: ccs0 [128.035053] Dynamic subtest ccs0: SUCCESS (0.175s) [128.037950] Subtest engines-queued: SUCCESS (6.219s) [128.152007] [023/133] (894s left) gem_ctx_shared (q-in-order) [128.212276] Starting subtest: Q-in-order [128.214707] Starting dynamic subtest: rcs0 [128.395996] Dynamic subtest rcs0: SUCCESS (0.182s) [128.412037] Starting dynamic subtest: vcs0 [128.506432] Dynamic subtest vcs0: SUCCESS (0.111s) [128.523628] Starting dynamic subtest: vcs1 [128.617297] Dynamic subtest vcs1: SUCCESS (0.110s) [128.633622] Starting dynamic subtest: vecs0 [128.721889] Dynamic subtest vecs0: SUCCESS (0.106s) [128.738862] Starting dynamic subtest: ccs0 [128.846261] Dynamic subtest ccs0: SUCCESS (0.123s) [128.848525] Subtest Q-in-order: SUCCESS (0.633s) [130.039943] [024/133] (893s left) kms_frontbuffer_tracking (fbcpsr-tiling-4) [130.144589] Starting subtest: fbcpsr-tiling-4 [137.271359] Subtest fbcpsr-tiling-4: SUCCESS (7.132s) [137.392779] [025/133] (885s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa [137.440600] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled [137.442723] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.001s) [137.530707] [026/133] (885s left) gem_userptr_blits (process-exit) [137.594585] Starting subtest: process-exit [137.601454] Subtest process-exit: SUCCESS (0.010s) [137.733204] [027/133] (885s left) gem_exec_reloc (basic-write-read-noreloc) [137.789998] Subtest basic-write-read-noreloc: SKIP (0.000s) [137.868247] [028/133] (885s left) kms_psr2_sf (fbc-psr2-primary-plane-update-sf-dmg-area) [137.975793] Starting subtest: fbc-psr2-primary-plane-update-sf-dmg-area [137.978166] Starting dynamic subtest: pipe-A-eDP-1 [138.071792] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s) [138.082229] Starting dynamic subtest: pipe-B-eDP-1 [139.251646] Dynamic subtest pipe-B-eDP-1: SKIP (1.178s) [139.256518] Subtest fbc-psr2-primary-plane-update-sf-dmg-area: SKIP (1.281s) [140.471460] [029/133] (882s left) syncobj_wait (invalid-reset-zero-handles) [140.522647] Starting subtest: invalid-reset-zero-handles [140.524548] Subtest invalid-reset-zero-handles: SUCCESS (0.000s) [140.602440] [030/133] (882s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs) [140.698204] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs [140.700576] Starting dynamic subtest: pipe-A-eDP-1 [140.721374] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.021s) [140.731416] Starting dynamic subtest: pipe-B-eDP-1 [140.751673] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s) [140.759544] Starting dynamic subtest: pipe-C-eDP-1 [140.779254] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s) [140.786949] Starting dynamic subtest: pipe-D-eDP-1 [140.807627] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.020s) [140.809919] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.085s) [143.015251] [031/133] (880s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling) [143.103123] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling [143.107219] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s) [143.173211] [032/133] (880s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-onoff) [143.277601] Starting subtest: fbc-2p-primscrn-spr-indfb-onoff [143.281784] Subtest fbc-2p-primscrn-spr-indfb-onoff: SKIP (0.000s) [143.371675] [033/133] (880s left) gem_pxp (hw-rejects-pxp-buffer) [143.498560] Starting subtest: hw-rejects-pxp-buffer [143.503070] Subtest hw-rejects-pxp-buffer: SKIP (0.000s) [143.602393] [034/133] (879s left) kms_chamelium_hpd (dp-hpd-fast) [143.976483] Subtest dp-hpd-fast: SKIP (0.000s) [144.814584] [035/133] (878s left) i915_pm_rps (min-max-config-loaded) [144.883500] Starting subtest: min-max-config-loaded [144.888329] Subtest min-max-config-loaded: SKIP (0.000s) [144.978881] [036/133] (878s left) api_intel_bb (crc32) [145.028044] Starting subtest: crc32 [145.030301] Starting dynamic subtest: rcs0-smem0 [145.339883] Dynamic subtest rcs0-smem0: SUCCESS (0.312s) [145.351113] Starting dynamic subtest: bcs0-smem0 [145.668528] Dynamic subtest bcs0-smem0: SUCCESS (0.327s) [145.678867] Starting dynamic subtest: vcs0-smem0 [146.059575] Dynamic subtest vcs0-smem0: SUCCESS (0.389s) [146.068499] Starting dynamic subtest: vcs1-smem0 [146.425849] Dynamic subtest vcs1-smem0: SUCCESS (0.365s) [146.435039] Starting dynamic subtest: vecs0-smem0 [146.805527] Dynamic subtest vecs0-smem0: SUCCESS (0.378s) [146.814052] Starting dynamic subtest: ccs0-smem0 [147.137476] Dynamic subtest ccs0-smem0: SUCCESS (0.330s) [147.140050] Subtest crc32: SUCCESS (2.111s) [147.247249] [037/133] (876s left) kms_psr (fbc-pr-sprite-plane-move) [147.343874] Starting subtest: fbc-pr-sprite-plane-move [147.348039] Subtest fbc-pr-sprite-plane-move: SKIP (0.000s) [147.414234] [038/133] (876s left) kms_pm_dc (dc5-psr) [148.511075] Starting subtest: dc5-psr [151.491983] Subtest dc5-psr: SUCCESS (2.981s) [152.359992] [039/133] (871s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-cpu) [152.473318] Starting subtest: fbcpsr-rgb565-draw-mmap-cpu [159.247030] Subtest fbcpsr-rgb565-draw-mmap-cpu: SUCCESS (6.776s) [159.373647] [040/133] (864s left) gem_create (create-ext-set-pat) [159.549021] Starting subtest: create-ext-set-pat [159.551443] Subtest create-ext-set-pat: SUCCESS (0.001s) [159.661275] [041/133] (864s left) gem_exec_fence (basic-busy-all) [159.726973] Starting subtest: basic-busy-all [159.832377] Subtest basic-busy-all: SUCCESS (0.106s) [161.963358] [042/133] (861s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180) [162.074968] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180 [162.079231] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [162.176874] [043/133] (861s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs) [162.286796] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs [162.289060] Starting dynamic subtest: pipe-A-eDP-1 [162.310711] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [162.319068] Starting dynamic subtest: pipe-B-eDP-1 [162.339585] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [162.347064] Starting dynamic subtest: pipe-C-eDP-1 [162.367605] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [162.374739] Starting dynamic subtest: pipe-D-eDP-1 [162.396313] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [162.400318] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.005s) [164.546218] [044/133] (859s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping) [164.637187] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping [164.641153] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping: SKIP (0.000s) [164.711986] [045/133] (859s left) kms_pm_rpm (modeset-stress-extra-wait) [166.234758] Starting subtest: modeset-stress-extra-wait [220.598895] Subtest modeset-stress-extra-wait: SUCCESS (54.313s) [220.662706] [046/133] (803s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted) [220.708697] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted [220.817473] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.108s) [220.895652] [047/133] (803s left) perf (polling) [221.015186] Starting subtest: polling [221.017545] Starting dynamic subtest: 0-rcs0 [231.029174] Dynamic subtest 0-rcs0: SUCCESS (10.012s) [231.041874] Starting dynamic subtest: 1-vcs1 [241.103132] Dynamic subtest 1-vcs1: SUCCESS (10.021s) [241.105926] Subtest polling: SUCCESS (20.035s) [241.149293] [048/133] (782s left) gem_close (basic) [241.219469] Starting subtest: basic [241.221910] Subtest basic: SUCCESS (0.000s) [241.311324] [049/133] (782s left) kms_cursor_legacy (cursor-vs-flip-legacy) [241.428287] Starting subtest: cursor-vs-flip-legacy [271.156751] Subtest cursor-vs-flip-legacy: SUCCESS (29.725s) [272.037867] [050/133] (752s left) gem_sync (basic-store-all) [272.117052] Starting subtest: basic-store-all [275.199522] Subtest basic-store-all: SUCCESS (3.093s) [275.381108] [051/133] (748s left) gem_readwrite (read-bad-handle) [275.430133] Subtest read-bad-handle: SKIP (0.000s) [275.485511] [052/133] (748s left) gem_mmap_offset (ptrace) [275.537313] Starting subtest: ptrace [275.539608] Starting dynamic subtest: smem0-wb [275.548395] Dynamic subtest smem0-wb: SUCCESS (0.012s) [275.557930] Starting dynamic subtest: smem0-wc [275.566161] Dynamic subtest smem0-wc: SUCCESS (0.017s) [275.573244] Starting dynamic subtest: smem0-uc [275.583151] Dynamic subtest smem0-uc: SUCCESS (0.016s) [275.585663] Subtest ptrace: SUCCESS (0.051s) [275.710995] [053/133] (748s left) kms_plane (pixel-format-yf-tiled-ccs-modifier) [275.797805] Starting subtest: pixel-format-yf-tiled-ccs-modifier [275.802019] Subtest pixel-format-yf-tiled-ccs-modifier: SKIP (0.000s) [275.907782] [054/133] (748s left) kms_big_fb (linear-16bpp-rotate-90) [276.003397] Starting subtest: linear-16bpp-rotate-90 [276.022740] Subtest linear-16bpp-rotate-90: SKIP (0.019s) [276.129364] [055/133] (748s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled) [276.175724] Starting subtest: invalid-multi-wait-unsubmitted-signaled [276.177993] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s) [276.269366] [056/133] (748s left) i915_drm_fdinfo (most-busy-check-all) [276.304814] Starting subtest: most-busy-check-all [276.307152] Starting dynamic subtest: rcs0 [276.311664] Dynamic subtest rcs0: SKIP (0.004s) [276.320078] Starting dynamic subtest: bcs0 [276.324475] Dynamic subtest bcs0: SKIP (0.000s) [276.332594] Starting dynamic subtest: vcs0 [276.335871] Dynamic subtest vcs0: SKIP (0.000s) [276.342959] Starting dynamic subtest: vcs1 [276.346274] Dynamic subtest vcs1: SKIP (0.000s) [276.352987] Starting dynamic subtest: vecs0 [276.356383] Dynamic subtest vecs0: SKIP (0.000s) [276.362963] Starting dynamic subtest: ccs0 [276.366479] Dynamic subtest ccs0: SKIP (0.000s) [276.369809] Subtest most-busy-check-all: SKIP (0.007s) [276.405126] [057/133] (748s left) kms_cursor_crc (cursor-random-64x21) [276.609648] Starting subtest: cursor-random-64x21 [276.663045] Subtest cursor-random-64x21: SKIP (0.049s) [276.901702] [058/133] (747s left) gem_exec_balancer (hang) [277.154069] Starting subtest: hang [278.932050] Subtest hang: SUCCESS (1.781s) [279.055517] [059/133] (745s left) gem_shrink (reclaim) [279.118912] Starting subtest: reclaim [281.536051] Subtest reclaim: SUCCESS (2.366s) [281.640285] [060/133] (742s left) gem_ctx_persistence (smoketest) [281.694569] Starting subtest: smoketest [321.844340] Subtest smoketest: SUCCESS (40.146s) [321.947542] [061/133] (702s left) gem_unfence_active_buffers [322.101998] [062/133] (702s left) gem_watchdog (default-physical) [322.166401] Starting subtest: default-physical [323.928235] Subtest default-physical: SUCCESS (1.774s) [324.017243] [063/133] (700s left) kms_psr (psr-primary-blt) [324.108042] Starting subtest: psr-primary-blt [324.110416] Starting dynamic subtest: eDP-1 [325.819071] Dynamic subtest eDP-1: SUCCESS (1.711s) [325.821303] Subtest psr-primary-blt: SUCCESS (1.712s) [326.694952] [064/133] (698s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [326.790884] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [326.795140] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [326.881218] [065/133] (697s left) gen7_exec_parse (cmd-crossing-page) [326.928058] Subtest cmd-crossing-page: SKIP (0.000s) [326.999541] [066/133] (697s left) gem_exec_schedule (smoketest) [327.175542] Starting subtest: smoketest [327.178058] Starting dynamic subtest: rcs0 [332.724373] Dynamic subtest rcs0: SUCCESS (5.498s) [332.734491] Starting dynamic subtest: bcs0 [338.266200] Dynamic subtest bcs0: SUCCESS (5.493s) [338.275108] Starting dynamic subtest: vcs0 [343.757704] Dynamic subtest vcs0: SUCCESS (5.490s) [343.768713] Starting dynamic subtest: vcs1 [349.255738] Dynamic subtest vcs1: SUCCESS (5.497s) [349.267044] Starting dynamic subtest: vecs0 [354.754523] Dynamic subtest vecs0: SUCCESS (5.497s) [354.767746] Starting dynamic subtest: ccs0 [360.189646] Dynamic subtest ccs0: SUCCESS (5.487s) [360.191878] Subtest smoketest: SUCCESS (32.968s) [360.342299] [067/133] (664s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite) [360.444618] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite [360.448728] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [360.542808] [068/133] (664s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc) [360.646063] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc [360.648369] Starting dynamic subtest: pipe-A-eDP-1 [360.670544] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [360.680470] Starting dynamic subtest: pipe-B-eDP-1 [360.700245] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [360.707657] Starting dynamic subtest: pipe-C-eDP-1 [360.728094] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [360.735060] Starting dynamic subtest: pipe-D-eDP-1 [360.755807] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [360.760031] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s) [362.922166] [069/133] (662s left) vgem_basic (bad-fence) [362.976236] Starting subtest: bad-fence [362.978457] Subtest bad-fence: SUCCESS (0.000s) [363.069432] [070/133] (661s left) gem_mmap_gtt (basic-wc) [363.124047] Subtest basic-wc: SKIP (0.000s) [363.185551] [071/133] (661s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip) [363.295748] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip [364.343091] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.046s) [364.467852] [072/133] (660s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt) [364.560063] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt [364.563230] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [364.683321] [073/133] (660s left) kms_big_fb (x-tiled-16bpp-rotate-270) [364.779752] Starting subtest: x-tiled-16bpp-rotate-270 [364.799446] Subtest x-tiled-16bpp-rotate-270: SKIP (0.019s) [364.923618] [074/133] (660s left) kms_async_flips (async-flip-dpms) [365.020667] Starting subtest: async-flip-dpms [365.407092] Starting dynamic subtest: pipe-A-eDP-1 [369.248224] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.840s) [369.630269] Starting dynamic subtest: pipe-B-eDP-1 [372.408892] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.785s) [372.788233] Starting dynamic subtest: pipe-C-eDP-1 [375.566147] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.784s) [375.942797] Starting dynamic subtest: pipe-D-eDP-1 [378.740066] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.806s) [378.742350] Subtest async-flip-dpms: SUCCESS (13.721s) [379.918354] [075/133] (645s left) kms_plane_alpha_blend (alpha-transparent-fb) [380.026465] Starting subtest: alpha-transparent-fb [380.320701] Starting dynamic subtest: pipe-A-eDP-1 [380.922599] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.600s) [380.930618] Starting dynamic subtest: pipe-D-eDP-1 [382.303258] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.378s) [382.305473] Subtest alpha-transparent-fb: SUCCESS (2.275s) [383.178477] [076/133] (642s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-plflip-blt) [383.279451] Starting subtest: psr-2p-scndscrn-shrfb-plflip-blt [383.283484] Subtest psr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s) [383.372226] [077/133] (641s left) gem_mmap_offset (blt-coherency) [383.427977] Starting subtest: blt-coherency [383.432741] Subtest blt-coherency: SUCCESS (0.006s) [383.553789] [078/133] (641s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-signaled) [383.609980] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled [383.612236] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.001s) [383.702282] [079/133] (641s left) api_intel_bb (intel-bb-blit-x) [383.757996] Starting subtest: intel-bb-blit-x [387.481267] Subtest intel-bb-blit-x: SUCCESS (3.724s) [387.595996] [080/133] (637s left) kms_psr2_su (page_flip-nv12) [387.645500] Subtest page_flip-NV12: SKIP (0.000s) [387.710283] [081/133] (637s left) kms_frontbuffer_tracking (fbcpsr-1p-pri-indfb-multidraw) [387.825668] Starting subtest: fbcpsr-1p-pri-indfb-multidraw [410.979341] Subtest fbcpsr-1p-pri-indfb-multidraw: SUCCESS (23.157s) [411.125085] [082/133] (614s left) drm_read (empty-nonblock) [411.269100] Starting subtest: empty-nonblock [411.271295] Subtest empty-nonblock: SUCCESS (0.000s) [411.396334] [083/133] (614s left) kms_dp_link_training (non-uhbr-sst) [411.498705] Starting subtest: non-uhbr-sst [411.505918] Subtest non-uhbr-sst: SKIP (0.000s) [411.588488] [084/133] (614s left) gem_exec_whisper (basic-contexts) [411.654708] Starting subtest: basic-contexts [417.206550] Subtest basic-contexts: SUCCESS (5.550s) [417.391347] [085/133] (608s left) gem_spin_batch (engines) [417.457607] Starting subtest: engines [417.459880] Starting dynamic subtest: rcs0 [420.701101] Dynamic subtest rcs0: SUCCESS (3.238s) [420.711815] Starting dynamic subtest: bcs0 [423.991956] Dynamic subtest bcs0: SUCCESS (3.236s) [424.003580] Starting dynamic subtest: vcs0 [427.229841] Dynamic subtest vcs0: SUCCESS (3.235s) [427.240272] Starting dynamic subtest: vcs1 [430.468384] Dynamic subtest vcs1: SUCCESS (3.235s) [430.479568] Starting dynamic subtest: vecs0 [433.706937] Dynamic subtest vecs0: SUCCESS (3.236s) [433.717734] Starting dynamic subtest: ccs0 [436.946224] Dynamic subtest ccs0: SUCCESS (3.236s) [436.948741] Subtest engines: SUCCESS (19.434s) [437.118507] [086/133] (588s left) gem_exec_schedule (independent) [437.189219] Starting subtest: independent [437.191427] Starting dynamic subtest: rcs0 [438.868734] Dynamic subtest rcs0: SUCCESS (1.686s) [438.879853] Starting dynamic subtest: vcs0 [440.926361] Dynamic subtest vcs0: SUCCESS (2.055s) [440.935279] Starting dynamic subtest: vcs1 [442.911388] Dynamic subtest vcs1: SUCCESS (1.983s) [442.921693] Starting dynamic subtest: vecs0 [444.896309] Dynamic subtest vecs0: SUCCESS (1.983s) [444.906650] Starting dynamic subtest: ccs0 [446.868857] Dynamic subtest ccs0: SUCCESS (1.969s) [446.871877] Subtest independent: SUCCESS (9.688s) [447.169819] [087/133] (578s left) kms_invalid_mode (bad-hsync-start) [447.267308] Starting subtest: bad-hsync-start [447.269603] Starting dynamic subtest: pipe-A-eDP-1 [447.569244] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.302s) [447.578137] Starting dynamic subtest: pipe-B-eDP-1 [447.580372] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [447.587969] Starting dynamic subtest: pipe-C-eDP-1 [447.590302] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [447.598142] Starting dynamic subtest: pipe-D-eDP-1 [447.600333] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [447.602308] Subtest bad-hsync-start: SUCCESS (0.308s) [448.366226] [088/133] (577s left) perf_pmu (busy-accuracy-2) [448.415538] Starting subtest: busy-accuracy-2 [448.417465] Starting dynamic subtest: rcs0 [451.456071] Dynamic subtest rcs0: SUCCESS (3.039s) [451.466849] Starting dynamic subtest: bcs0 [454.562049] Dynamic subtest bcs0: SUCCESS (3.055s) [454.571131] Starting dynamic subtest: vcs0 [457.611413] Dynamic subtest vcs0: SUCCESS (3.044s) [457.621274] Starting dynamic subtest: vcs1 [460.657620] Dynamic subtest vcs1: SUCCESS (3.042s) [460.668039] Starting dynamic subtest: vecs0 [463.701307] Dynamic subtest vecs0: SUCCESS (3.042s) [463.710557] Starting dynamic subtest: ccs0 [466.757063] Dynamic subtest ccs0: SUCCESS (3.054s) [466.759514] Subtest busy-accuracy-2: SUCCESS (18.292s) [466.823571] [089/133] (558s left) gem_render_copy (y-tiled-to-vebox-yf-tiled) [466.890040] Starting subtest: y-tiled-to-vebox-yf-tiled [466.894395] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s) [467.073585] [090/133] (558s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move) [467.176695] Starting subtest: psr-1p-primscrn-cur-indfb-move [474.569702] Subtest psr-1p-primscrn-cur-indfb-move: SUCCESS (7.396s) [474.708451] [091/133] (551s left) kms_cursor_crc (cursor-onscreen-32x32) [474.854076] Starting subtest: cursor-onscreen-32x32 [474.900233] Subtest cursor-onscreen-32x32: SKIP (0.043s) [475.183456] [092/133] (550s left) kms_ccs (random-ccs-data-4-tiled-mtl-mc-ccs) [475.274251] Starting subtest: random-ccs-data-4-tiled-mtl-mc-ccs [475.276191] Starting dynamic subtest: pipe-A-eDP-1 [476.635123] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.362s) [476.644765] Starting dynamic subtest: pipe-B-eDP-1 [478.941769] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.302s) [478.950365] Starting dynamic subtest: pipe-C-eDP-1 [481.247766] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.308s) [481.257264] Starting dynamic subtest: pipe-D-eDP-1 [483.562057] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.313s) [483.564361] Subtest random-ccs-data-4-tiled-mtl-mc-ccs: SUCCESS (8.290s) [484.698297] [093/133] (541s left) syncobj_wait (single-wait-all-for-submit-submitted) [484.755819] Starting subtest: single-wait-all-for-submit-submitted [484.865041] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.107s) [484.940045] [094/133] (541s left) kms_vblank (query-forked-hang) [485.038046] Starting subtest: query-forked-hang [485.040187] Starting dynamic subtest: pipe-A-eDP-1 [511.700559] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.659s) [511.714917] Starting dynamic subtest: pipe-D-eDP-1 [536.671548] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.969s) [536.673848] Subtest query-forked-hang: SUCCESS (51.633s) [537.472632] [095/133] (488s left) kms_flip (2x-flip-vs-blocking-wf-vblank) [537.565571] Starting subtest: 2x-flip-vs-blocking-wf-vblank [537.575870] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.011s) [537.662760] [096/133] (488s left) gem_mmap_gtt (cpuset-medium-copy) [537.715589] Subtest cpuset-medium-copy: SKIP (0.000s) [537.774421] [097/133] (488s left) perf_pmu (init-sema) [537.822095] Starting subtest: init-sema [537.824275] Starting dynamic subtest: rcs0 [537.826606] Dynamic subtest rcs0: SUCCESS (0.002s) [537.835568] Starting dynamic subtest: bcs0 [537.837430] Dynamic subtest bcs0: SUCCESS (0.000s) [537.845025] Starting dynamic subtest: vcs0 [537.846834] Dynamic subtest vcs0: SUCCESS (0.001s) [537.854369] Starting dynamic subtest: vcs1 [537.856250] Dynamic subtest vcs1: SUCCESS (0.001s) [537.864384] Starting dynamic subtest: vecs0 [537.866546] Dynamic subtest vecs0: SUCCESS (0.001s) [537.874077] Starting dynamic subtest: ccs0 [537.876330] Dynamic subtest ccs0: SUCCESS (0.000s) [537.878502] Subtest init-sema: SUCCESS (0.008s) [537.923795] [098/133] (488s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [538.014841] Starting subtest: plane-upscale-factor-0-25-with-modifiers [538.017154] Starting dynamic subtest: pipe-A [538.351475] Dynamic subtest pipe-A: SUCCESS (0.338s) [538.362977] Starting dynamic subtest: pipe-B [539.759842] Dynamic subtest pipe-B: SUCCESS (1.407s) [539.768431] Starting dynamic subtest: pipe-C [541.198964] Dynamic subtest pipe-C: SUCCESS (1.438s) [541.208365] Starting dynamic subtest: pipe-D [542.623842] Dynamic subtest pipe-D: SUCCESS (1.424s) [542.626128] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.612s) [543.793137] [099/133] (482s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-pgflip-blt) [543.893845] Starting subtest: fbcpsr-2p-scndscrn-indfb-pgflip-blt [543.897946] Subtest fbcpsr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s) [543.996837] [100/133] (482s left) kms_fb_coherency (memset-crc) [544.102354] Starting subtest: memset-crc [544.104520] Starting dynamic subtest: mmap-offset-wc [544.514574] Dynamic subtest mmap-offset-wc: SUCCESS (0.413s) [544.818962] Starting dynamic subtest: mmap-offset-uc [550.953908] Dynamic subtest mmap-offset-uc: SUCCESS (6.143s) [551.241043] Subtest memset-crc: SUCCESS (7.140s) [552.034607] [101/133] (474s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt) [552.131373] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt [552.135383] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s) [552.255158] [102/133] (474s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-atomic) [552.364304] Starting subtest: flip-vs-cursor-busy-crc-atomic [553.207454] Subtest flip-vs-cursor-busy-crc-atomic: SUCCESS (0.842s) [554.061845] [103/133] (472s left) kms_color (ctm-0-75) [554.156517] Starting subtest: ctm-0-75 [554.158788] Starting dynamic subtest: pipe-A-eDP-1 [559.017591] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.862s) [559.032910] Starting dynamic subtest: pipe-B-eDP-1 [564.752829] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.734s) [564.762114] Starting dynamic subtest: pipe-C-eDP-1 [570.125438] Dynamic subtest pipe-C-eDP-1: SUCCESS (5.372s) [570.134868] Starting dynamic subtest: pipe-D-eDP-1 [575.549959] Dynamic subtest pipe-D-eDP-1: SUCCESS (5.422s) [575.552565] Subtest ctm-0-75: SUCCESS (21.394s) [576.374585] [104/133] (450s left) gem_exec_params (invalid-batch-start-offset) [576.449174] Starting subtest: invalid-batch-start-offset [576.451563] Subtest invalid-batch-start-offset: SUCCESS (0.003s) [576.576559] [105/133] (449s left) kms_big_fb (y-tiled-32bpp-rotate-0) [576.680540] Starting subtest: y-tiled-32bpp-rotate-0 [576.684693] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s) [576.783616] [106/133] (449s left) gem_softpin (noreloc) [576.838854] Starting subtest: noreloc [582.301781] Subtest noreloc: SUCCESS (5.407s) [582.362518] [107/133] (444s left) kms_atomic_transition (plane-all-transition-fencing) [582.454123] Starting subtest: plane-all-transition-fencing [582.456398] Starting dynamic subtest: pipe-A-eDP-1 [584.949961] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.497s) [585.268831] Starting dynamic subtest: pipe-B-eDP-1 [588.512024] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.251s) [588.810768] Subtest plane-all-transition-fencing: SUCCESS (6.356s) [589.643293] [108/133] (436s left) i915_pm_rps (waitboost) [589.692345] Starting subtest: waitboost [596.031870] Subtest waitboost: SUCCESS (6.337s) [596.110601] [109/133] (430s left) gem_ccs (block-copy-uncompressed) [596.166530] Starting subtest: block-copy-uncompressed [596.168786] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-smem [596.193435] Dynamic subtest linear-uncompressed-compfmt0-smem-smem: SUCCESS (0.026s) [596.202429] Starting dynamic subtest: xmajor-uncompressed-compfmt0-smem-smem [596.213232] Dynamic subtest xmajor-uncompressed-compfmt0-smem-smem: SUCCESS (0.019s) [596.221332] Starting dynamic subtest: tile4-uncompressed-compfmt0-smem-smem [596.232127] Dynamic subtest tile4-uncompressed-compfmt0-smem-smem: SUCCESS (0.018s) [596.240283] Starting dynamic subtest: tile64-uncompressed-compfmt0-smem-smem [596.250617] Dynamic subtest tile64-uncompressed-compfmt0-smem-smem: SUCCESS (0.018s) [596.253357] Subtest block-copy-uncompressed: SUCCESS (0.084s) [596.372574] [110/133] (430s left) gem_exec_reloc (basic-write-read) [596.434067] Subtest basic-write-read: SKIP (0.000s) [596.511204] [111/133] (430s left) gem_fenced_exec_thrash (too-many-fences) [596.574979] Subtest too-many-fences: SKIP (0.000s) [596.649069] [112/133] (430s left) gem_userptr_blits (create-destroy-unsync) [596.717853] Subtest create-destroy-unsync: SKIP (0.000s) [596.858573] [113/133] (429s left) kms_lease (lease-unleased-crtc) [596.954845] Starting subtest: lease-unleased-crtc [596.957071] Starting dynamic subtest: pipe-A-eDP-1 [597.247953] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.293s) [597.257300] Starting dynamic subtest: pipe-B-eDP-1 [597.991914] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.740s) [598.006756] Starting dynamic subtest: pipe-C-eDP-1 [598.009184] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.005s) [598.019854] Starting dynamic subtest: pipe-D-eDP-1 [598.022141] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s) [598.024431] Subtest lease-unleased-crtc: SUCCESS (1.048s) [598.369094] [114/133] (428s left) syncobj_timeline (single-wait-all-signaled) [598.427101] Starting subtest: single-wait-all-signaled [598.429417] Subtest single-wait-all-signaled: SUCCESS (0.000s) [598.525472] [115/133] (428s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-pwrite) [598.627616] Starting subtest: psr-1p-offscreen-pri-indfb-draw-pwrite [605.903418] Subtest psr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.277s) [606.044655] [116/133] (420s left) gem_exec_reloc (basic-range) [606.116206] Subtest basic-range: SKIP (0.000s) [606.187944] [117/133] (420s left) syncobj_wait (single-wait-all-submitted) [606.238044] Starting subtest: single-wait-all-submitted [606.345111] Subtest single-wait-all-submitted: SUCCESS (0.107s) [606.425057] [118/133] (420s left) kms_flip (plain-flip-interruptible) [606.510278] Starting subtest: plain-flip-interruptible [606.512557] Starting dynamic subtest: A-eDP1 [608.191880] Dynamic subtest A-eDP1: SUCCESS (1.680s) [608.201884] Starting dynamic subtest: B-eDP1 [609.823086] Dynamic subtest B-eDP1: SUCCESS (1.630s) [609.834152] Starting dynamic subtest: C-eDP1 [611.449149] Dynamic subtest C-eDP1: SUCCESS (1.625s) [611.461443] Starting dynamic subtest: D-eDP1 [613.082875] Dynamic subtest D-eDP1: SUCCESS (1.631s) [613.087571] Subtest plain-flip-interruptible: SUCCESS (6.578s) [614.256793] [119/133] (412s left) kms_content_protection (dp-mst-type-0-suspend-resume) [614.395375] Starting subtest: dp-mst-type-0-suspend-resume [614.400154] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s) [614.520681] [120/133] (412s left) gem_eio (banned) [614.754971] Starting subtest: banned [615.376135] Subtest banned: SUCCESS (0.622s) [615.536828] [121/133] (411s left) kms_chamelium_frames (dp-crc-multiple) [615.916894] Subtest dp-crc-multiple: SKIP (0.000s) [616.768766] [122/133] (410s left) kms_big_fb (4-tiled-64bpp-rotate-0) [616.867086] Starting subtest: 4-tiled-64bpp-rotate-0 [618.412787] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.546s) [618.587235] [123/133] (408s left) syncobj_wait (multi-wait-all-for-submit-signaled) [618.648483] Starting subtest: multi-wait-all-for-submit-signaled [618.650825] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s) [618.768485] [124/133] (408s left) gem_exec_capture (capture-invisible) [618.822724] Starting subtest: capture-invisible [618.824663] Starting dynamic subtest: smem0 [618.828452] Dynamic subtest smem0: SKIP (0.000s) [618.832098] Subtest capture-invisible: SKIP (0.001s) [618.925989] [125/133] (408s left) sw_sync (alloc_merge_fence) [618.961203] Starting subtest: alloc_merge_fence [618.962900] Subtest alloc_merge_fence: SUCCESS (0.000s) [619.026233] [126/133] (408s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf) [619.143230] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-sf [619.145144] Starting dynamic subtest: pipe-A-eDP-1 [619.221191] Dynamic subtest pipe-A-eDP-1: SKIP (0.080s) [619.230482] Starting dynamic subtest: pipe-B-eDP-1 [620.377417] Dynamic subtest pipe-B-eDP-1: SKIP (1.151s) [620.382091] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (1.234s) [621.569484] [127/133] (405s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt) [621.665241] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt [621.669493] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [621.759903] [128/133] (405s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-move) [621.859808] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-move [629.468385] Subtest fbcpsr-1p-primscrn-spr-indfb-move: SUCCESS (7.612s) [629.615783] [129/133] (397s left) perf_pmu (semaphore-wait-idle) [629.661927] Starting subtest: semaphore-wait-idle [629.664154] Starting dynamic subtest: rcs0 [630.176504] Dynamic subtest rcs0: SUCCESS (0.513s) [630.188562] Starting dynamic subtest: bcs0 [630.691394] Dynamic subtest bcs0: SUCCESS (0.512s) [630.707065] Starting dynamic subtest: vcs0 [631.205240] Dynamic subtest vcs0: SUCCESS (0.511s) [631.217161] Starting dynamic subtest: vcs1 [631.718731] Dynamic subtest vcs1: SUCCESS (0.510s) [631.730380] Starting dynamic subtest: vecs0 [632.232071] Dynamic subtest vecs0: SUCCESS (0.510s) [632.245936] Starting dynamic subtest: ccs0 [632.750337] Dynamic subtest ccs0: SUCCESS (0.515s) [632.753258] Subtest semaphore-wait-idle: SUCCESS (3.090s) [633.964859] [130/133] (393s left) kms_panel_fitting (legacy) [634.061342] Starting subtest: legacy [634.063662] Starting dynamic subtest: pipe-A-eDP-1 [634.614718] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.555s) [634.642412] Starting dynamic subtest: pipe-B-eDP-1 [636.186832] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.552s) [636.213382] Starting dynamic subtest: pipe-C-eDP-1 [637.792430] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.586s) [637.821580] Starting dynamic subtest: pipe-D-eDP-1 [639.289898] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.479s) [639.292236] Subtest legacy: SUCCESS (5.230s) [640.522431] [131/133] (387s left) gem_exec_reloc (basic-write-gtt) [640.586064] Subtest basic-write-gtt: SKIP (0.000s) [640.672518] [132/133] (386s left) drm_read (empty-block) [640.834690] Starting subtest: empty-block [641.833634] Subtest empty-block: SUCCESS (1.001s) [641.961162] [133/133] (385s left) kms_cursor_crc (cursor-sliding-256x85) [642.255788] Starting subtest: cursor-sliding-256x85 [642.308490] Subtest cursor-sliding-256x85: SKIP (0.046s) [642.491699] Closing watchdogs results: parsing output: 0/ for test: gen3_render_linear_blits results: parsing output: 1/ for test: kms_getfb results: parsing output: 2/ for test: kms_psr results: parsing output: 3/ for test: i915_hangman results: parsing output: 4/ for test: kms_flip_scaled_crc results: parsing output: 5/ for test: gem_exec_fence results: parsing output: 6/ for test: kms_frontbuffer_tracking results: parsing output: 7/ for test: kms_frontbuffer_tracking results: parsing output: 8/ for test: kms_psr results: parsing output: 9/ for test: kms_cursor_legacy results: parsing output: 10/ for test: drm_buddy results: parsing output: 11/ for test: kms_vblank results: parsing output: 12/ for test: kms_cursor_legacy results: parsing output: 13/ for test: gem_partial_pwrite_pread results: parsing output: 14/ for test: kms_psr results: parsing output: 15/ for test: kms_atomic results: parsing output: 16/ for test: gem_lmem_swapping results: parsing output: 17/ for test: gem_request_retire results: parsing output: 18/ for test: kms_frontbuffer_tracking results: parsing output: 19/ for test: kms_plane_multiple results: parsing output: 20/ for test: kms_ccs results: parsing output: 21/ for test: gem_ctx_persistence results: parsing output: 22/ for test: gem_ctx_shared results: parsing output: 23/ for test: kms_frontbuffer_tracking results: parsing output: 24/ for test: syncobj_timeline results: parsing output: 25/ for test: gem_userptr_blits results: parsing output: 26/ for test: gem_exec_reloc results: parsing output: 27/ for test: kms_psr2_sf results: parsing output: 28/ for test: syncobj_wait results: parsing output: 29/ for test: kms_ccs results: parsing output: 30/ for test: kms_flip_scaled_crc results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: gem_pxp results: parsing output: 33/ for test: kms_chamelium_hpd results: parsing output: 34/ for test: i915_pm_rps results: parsing output: 35/ for test: api_intel_bb results: parsing output: 36/ for test: kms_psr results: parsing output: 37/ for test: kms_pm_dc results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: gem_create results: parsing output: 40/ for test: gem_exec_fence results: parsing output: 41/ for test: kms_big_fb results: parsing output: 42/ for test: kms_ccs results: parsing output: 43/ for test: kms_plane results: parsing output: 44/ for test: kms_pm_rpm results: parsing output: 45/ for test: syncobj_timeline results: parsing output: 46/ for test: perf results: parsing output: 47/ for test: gem_close results: parsing output: 48/ for test: kms_cursor_legacy results: parsing output: 49/ for test: gem_sync results: parsing output: 50/ for test: gem_readwrite results: parsing output: 51/ for test: gem_mmap_offset results: parsing output: 52/ for test: kms_plane results: parsing output: 53/ for test: kms_big_fb results: parsing output: 54/ for test: syncobj_timeline results: parsing output: 55/ for test: i915_drm_fdinfo results: parsing output: 56/ for test: kms_cursor_crc results: parsing output: 57/ for test: gem_exec_balancer results: parsing output: 58/ for test: gem_shrink results: parsing output: 59/ for test: gem_ctx_persistence results: parsing output: 60/ for test: gem_unfence_active_buffers results: parsing output: 61/ for test: gem_watchdog results: parsing output: 62/ for test: kms_psr results: parsing output: 63/ for test: kms_big_fb results: parsing output: 64/ for test: gen7_exec_parse results: parsing output: 65/ for test: gem_exec_schedule results: parsing output: 66/ for test: kms_frontbuffer_tracking results: parsing output: 67/ for test: kms_ccs results: parsing output: 68/ for test: vgem_basic results: parsing output: 69/ for test: gem_mmap_gtt results: parsing output: 70/ for test: kms_big_fb results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_big_fb results: parsing output: 73/ for test: kms_async_flips results: parsing output: 74/ for test: kms_plane_alpha_blend results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: gem_mmap_offset results: parsing output: 77/ for test: syncobj_timeline results: parsing output: 78/ for test: api_intel_bb results: parsing output: 79/ for test: kms_psr2_su results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: drm_read results: parsing output: 82/ for test: kms_dp_link_training results: parsing output: 83/ for test: gem_exec_whisper results: parsing output: 84/ for test: gem_spin_batch results: parsing output: 85/ for test: gem_exec_schedule results: parsing output: 86/ for test: kms_invalid_mode results: parsing output: 87/ for test: perf_pmu results: parsing output: 88/ for test: gem_render_copy results: parsing output: 89/ for test: kms_frontbuffer_tracking results: parsing output: 90/ for test: kms_cursor_crc results: parsing output: 91/ for test: kms_ccs results: parsing output: 92/ for test: syncobj_wait results: parsing output: 93/ for test: kms_vblank results: parsing output: 94/ for test: kms_flip results: parsing output: 95/ for test: gem_mmap_gtt results: parsing output: 96/ for test: perf_pmu results: parsing output: 97/ for test: kms_plane_scaling results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: kms_fb_coherency results: parsing output: 100/ for test: kms_frontbuffer_tracking results: parsing output: 101/ for test: kms_cursor_legacy results: parsing output: 102/ for test: kms_color results: parsing output: 103/ for test: gem_exec_params results: parsing output: 104/ for test: kms_big_fb results: parsing output: 105/ for test: gem_softpin results: parsing output: 106/ for test: kms_atomic_transition results: parsing output: 107/ for test: i915_pm_rps results: parsing output: 108/ for test: gem_ccs results: parsing output: 109/ for test: gem_exec_reloc results: parsing output: 110/ for test: gem_fenced_exec_thrash results: parsing output: 111/ for test: gem_userptr_blits results: parsing output: 112/ for test: kms_lease results: parsing output: 113/ for test: syncobj_timeline results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: gem_exec_reloc results: parsing output: 116/ for test: syncobj_wait results: parsing output: 117/ for test: kms_flip results: parsing output: 118/ for test: kms_content_protection results: parsing output: 119/ for test: gem_eio results: parsing output: 120/ for test: kms_chamelium_frames results: parsing output: 121/ for test: kms_big_fb results: parsing output: 122/ for test: syncobj_wait results: parsing output: 123/ for test: gem_exec_capture results: parsing output: 124/ for test: sw_sync results: parsing output: 125/ for test: kms_psr2_sf results: parsing output: 126/ for test: kms_frontbuffer_tracking results: parsing output: 127/ for test: kms_frontbuffer_tracking results: parsing output: 128/ for test: perf_pmu results: parsing output: 129/ for test: kms_panel_fitting results: parsing output: 130/ for test: gem_exec_reloc results: parsing output: 131/ for test: drm_read results: parsing output: 132/ for test: kms_cursor_crc Done.