[37.900616] Initializing watchdogs
[37.900797]   /dev/watchdog0
[37.915185] [001/142] (960s left) gem_ctx_isolation (nonpriv-switch)
[38.097172] Starting subtest: nonpriv-switch
[38.100850] Starting dynamic subtest: rcs0
[38.767900] Dynamic subtest rcs0: SUCCESS (0.670s)
[38.782024] Starting dynamic subtest: bcs0
[40.034212] Dynamic subtest bcs0: SUCCESS (1.262s)
[40.044591] Starting dynamic subtest: vcs0
[40.737181] Dynamic subtest vcs0: SUCCESS (0.705s)
[40.752106] Starting dynamic subtest: vecs0
[41.412739] Dynamic subtest vecs0: SUCCESS (0.677s)
[41.413813] Subtest nonpriv-switch: SUCCESS (3.316s)
[41.606974] [002/142] (956s left) kms_plane_cursor (viewport)
[41.840769] Starting subtest: viewport
[41.846155] Starting dynamic subtest: pipe-A-HDMI-A-1-size-64
[44.589944] Dynamic subtest pipe-A-HDMI-A-1-size-64: SUCCESS (2.742s)
[44.675138] Starting dynamic subtest: pipe-A-HDMI-A-1-size-128
[47.105061] Dynamic subtest pipe-A-HDMI-A-1-size-128: SUCCESS (2.442s)
[47.192909] Starting dynamic subtest: pipe-A-HDMI-A-1-size-256
[49.622158] Dynamic subtest pipe-A-HDMI-A-1-size-256: SUCCESS (2.448s)
[49.930714] Starting dynamic subtest: pipe-B-HDMI-A-2-size-64
[52.462232] Dynamic subtest pipe-B-HDMI-A-2-size-64: SUCCESS (2.538s)
[52.530887] Starting dynamic subtest: pipe-B-HDMI-A-2-size-128
[54.945816] Dynamic subtest pipe-B-HDMI-A-2-size-128: SUCCESS (2.424s)
[55.014928] Starting dynamic subtest: pipe-B-HDMI-A-2-size-256
[57.462572] Dynamic subtest pipe-B-HDMI-A-2-size-256: SUCCESS (2.458s)
[57.758866] Starting dynamic subtest: pipe-C-HDMI-A-1-size-64
[60.244076] Dynamic subtest pipe-C-HDMI-A-1-size-64: SUCCESS (2.501s)
[60.314124] Starting dynamic subtest: pipe-C-HDMI-A-1-size-128
[62.760749] Dynamic subtest pipe-C-HDMI-A-1-size-128: SUCCESS (2.456s)
[62.829910] Starting dynamic subtest: pipe-C-HDMI-A-1-size-256
[65.244117] Dynamic subtest pipe-C-HDMI-A-1-size-256: SUCCESS (2.424s)
[65.512253] Subtest viewport: SUCCESS (23.671s)
[65.815917] [003/142] (932s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move)
[66.079169] Starting subtest: fbc-2p-primscrn-spr-indfb-move
[69.305952] Subtest fbc-2p-primscrn-spr-indfb-move: SUCCESS (3.226s)
[69.471145] [004/142] (929s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-blt)
[69.713175] Starting subtest: psr-2p-primscrn-cur-indfb-draw-blt
[69.716536] Subtest psr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[69.799429] [005/142] (928s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[70.051411] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt
[72.106212] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SUCCESS (2.057s)
[72.277237] [006/142] (926s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[72.692295] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip
[72.995579] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.297s)
[73.280981] [007/142] (925s left) gem_ctx_persistence (engines-mixed-process)
[73.502410] Starting subtest: engines-mixed-process
[73.503637] Starting dynamic subtest: rcs0
[73.882795] Dynamic subtest rcs0: SUCCESS (0.367s)
[73.903907] Starting dynamic subtest: bcs0
[74.222915] Dynamic subtest bcs0: SUCCESS (0.352s)
[74.238933] Starting dynamic subtest: vcs0
[74.560215] Dynamic subtest vcs0: SUCCESS (0.335s)
[74.584901] Starting dynamic subtest: vecs0
[74.912403] Dynamic subtest vecs0: SUCCESS (0.348s)
[74.918224] Subtest engines-mixed-process: SUCCESS (1.415s)
[75.003913] [008/142] (923s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[75.255313] Starting subtest: psr-rgb565-draw-render
[75.257858] Subtest psr-rgb565-draw-render: SKIP (0.000s)
[75.336442] [009/142] (923s left) gem_exec_balancer (indices)
[75.503115] Starting subtest: indices
[78.355688] Subtest indices: SUCCESS (2.852s)
[81.388343] [010/142] (917s left) kms_flip (2x-wf_vblank-ts-check)
[81.597210] Starting subtest: 2x-wf_vblank-ts-check
[81.602365] Starting dynamic subtest: AB-HDMI-A1-HDMI-A2
[92.921295] Dynamic subtest AB-HDMI-A1-HDMI-A2: SUCCESS (11.312s)
[92.938811] Starting dynamic subtest: AC-HDMI-A1-HDMI-A2
[103.933831] Dynamic subtest AC-HDMI-A1-HDMI-A2: SUCCESS (11.008s)
[103.954832] Starting dynamic subtest: BC-HDMI-A1-HDMI-A2
[114.934601] Dynamic subtest BC-HDMI-A1-HDMI-A2: SUCCESS (11.004s)
[114.935830] Subtest 2x-wf_vblank-ts-check: SUCCESS (33.339s)
[115.486081] [011/142] (883s left) kms_ccs (pipe-c-bad-aux-stride-4_tiled_mtl_mc_ccs)
[116.304539] Starting subtest: pipe-C-bad-aux-stride-4_tiled_mtl_mc_ccs
[116.306916] Subtest pipe-C-bad-aux-stride-4_tiled_mtl_mc_ccs: SKIP (0.000s)
[116.559777] [012/142] (882s left) api_intel_bb (object-noreloc-purge-cache-simple)
[116.701429] Starting subtest: object-noreloc-purge-cache-simple
[116.707465] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.006s)
[116.792811] [013/142] (881s left) kms_cursor_edge_walk (64x64-left-edge)
[117.018702] Starting subtest: 64x64-left-edge
[117.022391] Starting dynamic subtest: pipe-A-HDMI-A-1
[120.988590] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.966s)
[121.009871] Starting dynamic subtest: pipe-C-HDMI-A-1
[124.445671] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (3.443s)
[124.448246] Subtest 64x64-left-edge: SUCCESS (7.428s)
[124.680164] [014/142] (874s left) i915_pm_backlight (fade-with-suspend)
[124.905954] Subtest fade-with-suspend: SKIP (0.000s)
[124.947977] [015/142] (873s left) kms_lease (lessee_list)
[125.168705] Starting subtest: lessee_list
[125.174628] Starting dynamic subtest: pipe-A-HDMI-A-1
[125.187065] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.004s)
[125.234853] Starting dynamic subtest: pipe-A-HDMI-A-2
[125.235932] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.003s)
[125.246798] Starting dynamic subtest: pipe-B-HDMI-A-1
[125.247876] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.004s)
[125.258216] Starting dynamic subtest: pipe-B-HDMI-A-2
[125.259303] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.001s)
[125.271399] Starting dynamic subtest: pipe-C-HDMI-A-1
[125.272448] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.004s)
[125.297737] Starting dynamic subtest: pipe-C-HDMI-A-2
[125.299361] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.004s)
[125.300430] Subtest lessee_list: SUCCESS (0.048s)
[125.318493] [016/142] (873s left) perf (oa-formats)
[125.581215] Starting subtest: oa-formats
[125.582304] Starting dynamic subtest: 0-rcs0
[125.677831] Dynamic subtest 0-rcs0: SUCCESS (0.095s)
[125.679192] Subtest oa-formats: SUCCESS (0.099s)
[125.728071] [017/142] (873s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[125.960081] Starting subtest: cursorB-vs-flipB-toggle
[137.292883] Subtest cursorB-vs-flipB-toggle: SUCCESS (11.333s)
[137.654841] [018/142] (861s left) gem_exec_nop (basic-parallel)
[137.830794] Starting subtest: basic-parallel
[140.961361] Subtest basic-parallel: SUCCESS (3.129s)
[141.160943] [019/142] (857s left) kms_ccs (pipe-a-crc-sprite-planes-basic-4_tiled_mtl_mc_ccs)
[141.860989] Starting subtest: pipe-A-crc-sprite-planes-basic-4_tiled_mtl_mc_ccs
[141.868742] Subtest pipe-A-crc-sprite-planes-basic-4_tiled_mtl_mc_ccs: SKIP (0.007s)
[142.260688] [020/142] (856s left) gem_tiled_wc
[145.854326] [021/142] (853s left) gem_exec_whisper (basic-normal)
[146.020519] Starting subtest: basic-normal
[149.759419] Subtest basic-normal: SUCCESS (3.739s)
[149.957995] [022/142] (849s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[150.573680] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[150.866431] [023/142] (848s left) prime_self_import (basic-with_two_bos)
[151.007943] Starting subtest: basic-with_two_bos
[151.020288] Subtest basic-with_two_bos: SUCCESS (0.013s)
[151.104800] [024/142] (847s left) gem_mmap_gtt (basic-small-copy-xy)
[151.250396] Starting subtest: basic-small-copy-XY
[154.898440] Subtest basic-small-copy-XY: SUCCESS (3.645s)
[154.994127] [025/142] (844s left) kms_plane_scaling (plane-downscale-with-pixel-format-factor-0-5)
[155.316685] Starting subtest: plane-downscale-with-pixel-format-factor-0-5
[155.321404] Starting dynamic subtest: pipe-A-HDMI-A-1
[158.820797] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.497s)
[158.848978] Starting dynamic subtest: pipe-B-HDMI-A-1
[162.280366] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.457s)
[162.310895] Starting dynamic subtest: pipe-C-HDMI-A-1
[162.785250] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.487s)
[162.787235] Subtest plane-downscale-with-pixel-format-factor-0-5: SUCCESS (7.470s)
[163.319140] [026/142] (835s left) i915_suspend (fence-restore-tiled2untiled)
[163.470198] Starting subtest: fence-restore-tiled2untiled
[183.345328] Subtest fence-restore-tiled2untiled: SUCCESS (4.009s)
[188.435848] [027/142] (831s left) kms_ccs (pipe-a-bad-pixel-format-y_tiled_gen12_rc_ccs_cc)
[188.682786] Starting subtest: pipe-A-bad-pixel-format-y_tiled_gen12_rc_ccs_cc
[188.685209] Subtest pipe-A-bad-pixel-format-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[189.586691] [028/142] (830s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[189.847710] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[189.849959] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[189.936528] [029/142] (830s left) kms_selftest (drm_format)
[190.076840] Starting subtest: drm_format
[190.092734] Subtest drm_format: SKIP (0.015s)
[190.169353] [030/142] (829s left) gem_mmap_offset (perf)
[190.315008] Starting subtest: perf
[190.316156] Starting dynamic subtest: smem0
[190.597473] Dynamic subtest smem0: SUCCESS (0.282s)
[190.598519] Subtest perf: SUCCESS (0.283s)
[190.686075] [031/142] (829s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[190.934180] Starting subtest: x-tiled-16bpp-rotate-180
[196.134933] Subtest x-tiled-16bpp-rotate-180: SUCCESS (5.199s)
[196.438153] [032/142] (823s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[196.691393] Starting subtest: cursor-rapid-movement-128x128
[196.771657] Starting dynamic subtest: pipe-A-HDMI-A-1
[197.715143] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.938s)
[197.841188] Starting dynamic subtest: pipe-C-HDMI-A-1
[199.082649] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.269s)
[199.087604] Subtest cursor-rapid-movement-128x128: SUCCESS (2.394s)
[199.431554] [033/142] (820s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[199.694252] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[199.696657] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[199.785661] [034/142] (820s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[199.937349] Starting subtest: multi-wait-all-for-submit-available-signaled
[199.940724] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.003s)
[200.028744] [035/142] (820s left) gem_softpin (overlap)
[200.202230] Starting subtest: overlap
[202.889339] Subtest overlap: SUCCESS (2.683s)
[202.986681] [036/142] (817s left) dumb_buffer (map-invalid-size)
[203.134547] Starting subtest: map-invalid-size
[203.135673] Subtest map-invalid-size: SUCCESS (0.000s)
[203.220707] [037/142] (817s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[203.459383] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[203.463622] Starting dynamic subtest: pipe-A-valid-mode
[203.944604] Dynamic subtest pipe-A-valid-mode: SKIP (0.478s)
[203.947694] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.486s)
[204.305207] [038/142] (816s left) syncobj_basic (bad-handle-to-fd)
[204.449406] Starting subtest: bad-handle-to-fd
[204.450484] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[204.528980] [039/142] (815s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[204.782808] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip
[204.785219] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[204.879063] [040/142] (815s left) gem_exec_suspend (basic-s3-devices)
[205.041558] Starting subtest: basic-S3-devices
[205.042680] Starting dynamic subtest: smem
[214.482561] Dynamic subtest smem: SUCCESS (9.440s)
[214.483675] Subtest basic-S3-devices: SUCCESS (9.442s)
[219.336707] [041/142] (805s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-plflip-blt)
[219.587596] Starting subtest: fbc-2p-scndscrn-indfb-plflip-blt
[221.931509] Subtest fbc-2p-scndscrn-indfb-plflip-blt: SUCCESS (2.345s)
[222.084489] [042/142] (803s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[222.336534] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[222.338796] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[222.433178] [043/142] (802s left) gen9_exec_parse (batch-invalid-length)
[222.603373] Starting subtest: batch-invalid-length
[222.613669] Subtest batch-invalid-length: SUCCESS (0.010s)
[222.817090] [044/142] (802s left) kms_atomic_transition (modeset-transition-nonblocking-fencing)
[223.052198] Starting subtest: modeset-transition-nonblocking-fencing
[223.055047] Starting dynamic subtest: 1x-outputs
[228.962692] Dynamic subtest 1x-outputs: SUCCESS (5.900s)
[229.334202] Starting dynamic subtest: 2x-outputs
[249.285725] Dynamic subtest 2x-outputs: SUCCESS (19.976s)
[249.793564] Subtest modeset-transition-nonblocking-fencing: SUCCESS (26.738s)
[250.134676] [045/142] (775s left) kms_psr2_sf (cursor-plane-move-continuous-sf)
[250.302614] Subtest cursor-plane-move-continuous-sf: SKIP (0.000s)
[250.358113] [046/142] (774s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[250.613618] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[251.781090] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (1.167s)
[252.087988] [047/142] (773s left) kms_chamelium_hpd (hdmi-hpd-fast)
[252.771894] Subtest hdmi-hpd-fast: SKIP (0.000s)
[253.081141] [048/142] (772s left) gem_softpin (zero)
[253.240648] Starting subtest: zero
[253.248997] Subtest zero: SUCCESS (0.008s)
[253.351886] [049/142] (772s left) kms_psr (psr2_primary_mmap_cpu)
[253.503530] Subtest psr2_primary_mmap_cpu: SKIP (0.000s)
[253.563445] [050/142] (771s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[253.728059] Starting subtest: x-tiled-to-vebox-yf-tiled
[253.730489] Subtest x-tiled-to-vebox-yf-tiled: SKIP (0.001s)
[253.935464] [051/142] (771s left) gem_render_copy (y-tiled-ccs-to-x-tiled)
[254.098152] Starting subtest: y-tiled-ccs-to-x-tiled
[254.101560] Starting dynamic subtest: smem
[254.339839] Dynamic subtest smem: SUCCESS (0.238s)
[254.340971] Subtest y-tiled-ccs-to-x-tiled: SUCCESS (0.242s)
[254.545820] [052/142] (770s left) gem_exec_params (invalid-bsd-ring)
[254.703245] Starting subtest: invalid-bsd-ring
[254.707403] Subtest invalid-bsd-ring: SUCCESS (0.004s)
[254.801601] [053/142] (770s left) perf_pmu (frequency)
[254.950604] Starting subtest: frequency
[254.954017] Starting dynamic subtest: gt0
[257.028467] Dynamic subtest gt0: SUCCESS (2.072s)
[257.047099] Starting dynamic subtest: idle-gt0
[257.551950] Dynamic subtest idle-gt0: SUCCESS (0.513s)
[257.552987] Subtest frequency: SUCCESS (2.593s)
[257.635084] [054/142] (767s left) prime_mmap (test_forked)
[257.787565] Starting subtest: test_forked
[257.792726] Starting dynamic subtest: test_forked-smem
[257.825485] Dynamic subtest test_forked-smem: SUCCESS (0.032s)
[257.827325] Subtest test_forked: SUCCESS (0.037s)
[257.919083] [055/142] (767s left) template (b)
[258.068226] Starting subtest: B
[258.069477] Subtest B: SUCCESS (0.000s)
[258.168306] [056/142] (767s left) kms_vblank (pipe-a-query-forked-hang)
[258.418043] Starting subtest: pipe-A-query-forked-hang
[272.357010] Subtest pipe-A-query-forked-hang: SUCCESS (13.939s)
[272.710722] [057/142] (752s left) v3d/v3d_submit_cl (single-out-sync)
[272.910034] Subtest single-out-sync: SKIP (0.000s)
[272.976163] [058/142] (752s left) perf_pmu (gt-awake)
[273.128630] Starting subtest: gt-awake
[275.676593] Subtest gt-awake: SUCCESS (2.548s)
[275.776248] [059/142] (749s left) syncobj_timeline (invalid-transfer-non-existent-point)
[275.933163] Starting subtest: invalid-transfer-non-existent-point
[275.934446] Subtest invalid-transfer-non-existent-point: SUCCESS (0.001s)
[276.035742] [060/142] (749s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[276.296484] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[278.476444] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SUCCESS (2.181s)
[278.631575] [061/142] (747s left) i915_pm_rpm (fences-dpms)
[280.792524] Starting subtest: fences-dpms
[284.231877] Subtest fences-dpms: SUCCESS (3.438s)
[284.645341] [062/142] (741s left) kms_universal_plane (universal-plane-pipe-d-sanity)
[284.893051] Subtest universal-plane-pipe-D-sanity: SKIP (0.000s)
[284.977651] [063/142] (740s left) perf (gen12-group-concurrent-oa-buffer-read)
[285.234614] Starting subtest: gen12-group-concurrent-oa-buffer-read
[295.296580] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.059s)
[295.346330] [064/142] (730s left) kms_big_fb (yf-tiled-addfb)
[295.598089] Starting subtest: yf-tiled-addfb
[295.601438] Subtest yf-tiled-addfb: SUCCESS (0.002s)
[295.694076] [065/142] (730s left) kms_ccs (pipe-d-bad-aux-stride-y_tiled_gen12_rc_ccs_cc)
[296.478470] Subtest pipe-D-bad-aux-stride-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[296.722830] [066/142] (729s left) kms_vblank (pipe-c-query-forked-busy)
[296.970909] Starting subtest: pipe-C-query-forked-busy
[303.974034] Subtest pipe-C-query-forked-busy: SUCCESS (6.999s)
[304.203225] [067/142] (721s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-plflip-blt)
[304.445792] Starting subtest: fbcpsr-2p-scndscrn-shrfb-plflip-blt
[304.448776] Subtest fbcpsr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[304.537075] [068/142] (721s left) gem_gtt_cpu_tlb
[304.794853] [069/142] (721s left) gem_mmap_wc (close)
[304.938857] Starting subtest: close
[304.947412] Subtest close: SUCCESS (0.010s)
[305.036161] [070/142] (721s left) gem_softpin (evict-prime-sanity-check)
[305.189785] Starting subtest: evict-prime-sanity-check
[305.193229] Starting dynamic subtest: rcs0
[306.306534] Dynamic subtest rcs0: SUCCESS (1.112s)
[306.331780] Starting dynamic subtest: bcs0
[307.410342] Dynamic subtest bcs0: SUCCESS (1.101s)
[307.442283] Starting dynamic subtest: vcs0
[308.505218] Dynamic subtest vcs0: SUCCESS (1.092s)
[308.527699] Starting dynamic subtest: vecs0
[309.614206] Dynamic subtest vecs0: SUCCESS (1.105s)
[309.639909] Starting dynamic subtest: all
[310.720218] Dynamic subtest all: SUCCESS (1.101s)
[310.721578] Subtest evict-prime-sanity-check: SUCCESS (5.532s)
[310.812782] [071/142] (715s left) kms_addfb_basic (clobberred-modifier)
[310.956618] Starting subtest: clobberred-modifier
[310.959037] Subtest clobberred-modifier: SUCCESS (0.000s)
[311.152676] [072/142] (714s left) gem_exec_params (larger-than-life-batch)
[311.310890] Starting subtest: larger-than-life-batch
[311.706500] Subtest larger-than-life-batch: SKIP (0.383s)
[311.822736] [073/142] (714s left) gem_linear_blits (normal)
[312.205956] Starting subtest: normal
[331.263609] Subtest normal: SUCCESS (19.057s)
[331.367134] [074/142] (694s left) kms_frontbuffer_tracking (fbc-tiling-y)
[331.736054] Starting subtest: fbc-tiling-y
[334.155419] Subtest fbc-tiling-y: SUCCESS (2.416s)
[334.426239] [075/142] (691s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[334.589031] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[334.696871] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.107s)
[334.792050] [076/142] (691s left) kms_psr (primary_page_flip)
[334.945059] Subtest primary_page_flip: SKIP (0.000s)
[334.998145] [077/142] (691s left) gem_ctx_param (invalid-param-get)
[335.145727] Starting subtest: invalid-param-get
[335.146888] Subtest invalid-param-get: SUCCESS (0.000s)
[335.227187] [078/142] (691s left) vc4/vc4_purgeable_bo (access-purgeable-bo-mem)
[335.427324] Subtest access-purgeable-bo-mem: SKIP (0.000s)
[335.493009] [079/142] (690s left) kms_ccs (pipe-d-crc-primary-rotation-180-4_tiled_mtl_mc_ccs)
[336.342410] Subtest pipe-D-crc-primary-rotation-180-4_tiled_mtl_mc_ccs: SKIP (0.000s)
[336.739386] [080/142] (689s left) sw_sync (sync_random_merge)
[336.883431] Starting subtest: sync_random_merge
[337.010915] Subtest sync_random_merge: SUCCESS (0.126s)
[337.081470] [081/142] (689s left) vc4/vc4_wait_bo (bad-pad)
[337.270772] Subtest bad-pad: SKIP (0.000s)
[337.337568] [082/142] (689s left) gem_exec_schedule (wide)
[337.640746] Starting subtest: wide
[337.643733] Starting dynamic subtest: rcs0
[354.612904] Dynamic subtest rcs0: SUCCESS (16.965s)
[354.692406] Starting dynamic subtest: bcs0
[372.353866] Dynamic subtest bcs0: SUCCESS (17.734s)
[372.398117] Starting dynamic subtest: vcs0
[389.503752] Dynamic subtest vcs0: SUCCESS (17.133s)
[389.602847] Starting dynamic subtest: vecs0
[407.812885] Dynamic subtest vecs0: SUCCESS (18.298s)
[407.814074] Subtest wide: SUCCESS (70.171s)
[408.655862] [083/142] (617s left) vgem_slow (nohang)
[408.816323] Starting subtest: nohang
[419.051818] Subtest nohang: SUCCESS (10.236s)
[419.123178] [084/142] (607s left) kms_content_protection (dp-mst-lic-type-0)
[419.379023] Starting subtest: dp-mst-lic-type-0
[419.383336] Subtest dp-mst-lic-type-0: SKIP (0.003s)
[419.490789] [085/142] (607s left) gem_caching (read-writes)
[419.652112] Starting subtest: read-writes
[444.803811] Subtest read-writes: SUCCESS (25.151s)
[444.932863] [086/142] (581s left) v3d/v3d_wait_bo (unused-bo-0ns)
[445.150226] Subtest unused-bo-0ns: SKIP (0.000s)
[445.224844] [087/142] (581s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-onoff)
[445.479135] Starting subtest: fbc-2p-primscrn-spr-indfb-onoff
[448.371187] Subtest fbc-2p-primscrn-spr-indfb-onoff: SUCCESS (2.890s)
[448.544173] [088/142] (578s left) kms_frontbuffer_tracking (fbc-rgb565-draw-blt)
[448.804559] Starting subtest: fbc-rgb565-draw-blt
[451.287700] Subtest fbc-rgb565-draw-blt: SUCCESS (2.482s)
[451.562796] [089/142] (575s left) kms_chamelium_audio (hdmi-audio)
[452.232653] Subtest hdmi-audio: SKIP (0.000s)
[452.529316] [090/142] (574s left) drm_fdinfo (basics)
[452.691169] Starting subtest: basics
[452.692533] Subtest basics: SUCCESS (0.000s)
[452.780673] [091/142] (574s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[453.025173] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[453.030122] Starting dynamic subtest: pipe-A-valid-mode
[454.227207] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.197s)
[454.229013] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SUCCESS (1.203s)
[454.575463] [092/142] (572s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-shrfb-draw-blt)
[454.834331] Starting subtest: psr-1p-offscren-pri-shrfb-draw-blt
[454.836542] Subtest psr-1p-offscren-pri-shrfb-draw-blt: SKIP (0.000s)
[454.935846] [093/142] (571s left) kms_ccs (pipe-b-bad-pixel-format-4_tiled_dg2_rc_ccs)
[455.648813] Starting subtest: pipe-B-bad-pixel-format-4_tiled_dg2_rc_ccs
[455.651129] Subtest pipe-B-bad-pixel-format-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[456.043444] [094/142] (570s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu)
[456.310104] Starting subtest: fbc-rgb565-draw-mmap-cpu
[458.718742] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (2.408s)
[458.994686] [095/142] (567s left) gem_exercise_blt (fast-copy)
[459.153396] Starting subtest: fast-copy
[459.156670] Starting dynamic subtest: linear-smem-smem
[459.212159] Dynamic subtest linear-smem-smem: SUCCESS (0.053s)
[459.247602] Starting dynamic subtest: ymajor-smem-smem
[459.282902] Dynamic subtest ymajor-smem-smem: SUCCESS (0.056s)
[459.319118] Starting dynamic subtest: yfmajor-smem-smem
[459.350912] Dynamic subtest yfmajor-smem-smem: SUCCESS (0.061s)
[459.386120] Starting dynamic subtest: tile64-smem-smem
[459.418901] Dynamic subtest tile64-smem-smem: SUCCESS (0.061s)
[459.420639] Subtest fast-copy: SUCCESS (0.267s)
[459.527334] [096/142] (567s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[459.789631] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[459.791771] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[459.889358] [097/142] (567s left) kms_cursor_crc (cursor-offscreen-512x170)
[460.173091] Starting subtest: cursor-offscreen-512x170
[460.179309] Subtest cursor-offscreen-512x170: SKIP (0.005s)
[460.277321] [098/142] (566s left) v3d/v3d_get_bo_offset (create-get-offsets)
[460.474746] Subtest create-get-offsets: SKIP (0.000s)
[460.543427] [099/142] (566s left) gem_set_tiling_vs_blt (tiled-to-tiled)
[460.703432] Starting subtest: tiled-to-tiled
[460.830317] Subtest tiled-to-tiled: SUCCESS (0.124s)
[460.927470] [100/142] (566s left) gem_exec_fair (basic-deadline)
[461.102015] Starting subtest: basic-deadline
[472.928339] Subtest basic-deadline: FAIL (11.468s)
[472.974941] [101/142] (554s left) gem_userptr_blits (input-checking)
[473.129161] Starting subtest: input-checking
[473.132124] Subtest input-checking: SUCCESS (0.000s)
[473.265533] [102/142] (553s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[473.517626] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc
[473.519842] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.001s)
[473.612425] [103/142] (553s left) gem_reg_read (bad-register)
[473.766042] Starting subtest: bad-register
[473.767166] Subtest bad-register: SUCCESS (0.000s)
[473.861322] [104/142] (553s left) gem_ctx_persistence (legacy-engines-queued)
[474.013676] Starting subtest: legacy-engines-queued
[474.017068] Starting dynamic subtest: render
[474.064926] Dynamic subtest render: SUCCESS (0.049s)
[474.094564] Starting dynamic subtest: bsd
[474.110835] Dynamic subtest bsd: SUCCESS (0.035s)
[474.134346] Starting dynamic subtest: blt
[474.214972] Dynamic subtest blt: SUCCESS (0.105s)
[474.241132] Starting dynamic subtest: vebox
[474.260161] Dynamic subtest vebox: SUCCESS (0.041s)
[474.264129] Subtest legacy-engines-queued: SUCCESS (0.248s)
[474.362822] [105/142] (552s left) kms_vblank (pipe-c-query-idle-hang)
[474.597036] Starting subtest: pipe-C-query-idle-hang
[490.294163] Subtest pipe-C-query-idle-hang: SUCCESS (15.694s)
[490.659889] [106/142] (536s left) gem_media_fill (media-fill)
[490.823611] Starting subtest: media-fill
[490.827127] Starting dynamic subtest: smem
[490.840090] Dynamic subtest smem: SUCCESS (0.012s)
[490.842534] Subtest media-fill: SUCCESS (0.018s)
[491.060297] [107/142] (536s left) kms_vrr (flip-suspend)
[491.297349] Starting subtest: flip-suspend
[491.299561] Subtest flip-suspend: SKIP (0.000s)
[491.393304] [108/142] (536s left) api_intel_allocator (open-vm)
[491.543892] Starting subtest: open-vm
[491.549871] Subtest open-vm: SUCCESS (0.006s)
[491.642700] [109/142] (535s left) kms_ccs (pipe-c-crc-primary-basic-4_tiled_dg2_mc_ccs)
[492.470588] Starting subtest: pipe-C-crc-primary-basic-4_tiled_dg2_mc_ccs
[492.472827] Subtest pipe-C-crc-primary-basic-4_tiled_dg2_mc_ccs: SKIP (0.001s)
[492.868539] [110/142] (534s left) kms_hdmi_inject (inject-4k)
[493.516352] Starting subtest: inject-4k
[493.933680] Subtest inject-4k: SUCCESS (0.412s)
[494.395169] [111/142] (533s left) kms_ccs (pipe-b-ccs-on-another-bo-y_tiled_gen12_rc_ccs)
[495.192498] Starting subtest: pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs
[495.194680] Subtest pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[495.575916] [112/142] (531s left) gem_exec_schedule (noreorder-priority)
[495.879382] Starting subtest: noreorder-priority
[495.882414] Starting dynamic subtest: rcs0
[496.995567] Dynamic subtest rcs0: SUCCESS (1.114s)
[497.030583] Starting dynamic subtest: bcs0
[498.132556] Dynamic subtest bcs0: SUCCESS (1.125s)
[498.170063] Starting dynamic subtest: vcs0
[499.264575] Dynamic subtest vcs0: SUCCESS (1.120s)
[499.300254] Starting dynamic subtest: vecs0
[500.407161] Dynamic subtest vecs0: SUCCESS (1.129s)
[500.408437] Subtest noreorder-priority: SUCCESS (4.529s)
[500.617317] [113/142] (526s left) i915_pm_rpm (system-suspend-modeset)
[502.899406] Starting subtest: system-suspend-modeset
[520.927558] Subtest system-suspend-modeset: SUCCESS (2.087s)
[527.473081] [114/142] (522s left) syncobj_wait (wait-any-interrupted)
[527.625235] Starting subtest: wait-any-interrupted
[527.727815] Subtest wait-any-interrupted: SUCCESS (0.104s)
[527.822215] [115/142] (521s left) kms_flip (2x-flip-vs-suspend-interruptible)
[528.057684] Starting subtest: 2x-flip-vs-suspend-interruptible
[528.063733] Starting dynamic subtest: AB-HDMI-A1-HDMI-A2
[581.845806] Dynamic subtest AB-HDMI-A1-HDMI-A2: SUCCESS (4.792s)
[581.904161] Starting dynamic subtest: AC-HDMI-A1-HDMI-A2
[633.616221] Dynamic subtest AC-HDMI-A1-HDMI-A2: SUCCESS (4.042s)
[633.684237] Starting dynamic subtest: BC-HDMI-A1-HDMI-A2
[702.601703] Dynamic subtest BC-HDMI-A1-HDMI-A2: SUCCESS (5.102s)
[702.602802] Subtest 2x-flip-vs-suspend-interruptible: SUCCESS (13.952s)
[707.057601] [116/142] (507s left) gem_exec_fence (submit3)
[707.357523] Starting subtest: submit3
[707.358897] Starting dynamic subtest: rcs0
[707.369360] Dynamic subtest rcs0: SUCCESS (0.011s)
[707.410721] Starting dynamic subtest: bcs0
[707.413089] Dynamic subtest bcs0: SUCCESS (0.019s)
[707.443082] Starting dynamic subtest: vcs0
[707.444150] Dynamic subtest vcs0: SUCCESS (0.015s)
[707.461073] Starting dynamic subtest: vecs0
[707.462134] Dynamic subtest vecs0: SUCCESS (0.010s)
[707.463229] Subtest submit3: SUCCESS (0.078s)
[708.077439] [117/142] (506s left) v3d/v3d_job_submission (array-job-submission)
[708.281493] Subtest array-job-submission: SKIP (0.000s)
[708.356240] [118/142] (505s left) kms_ccs (pipe-d-missing-ccs-buffer-y_tiled_ccs)
[709.123258] Subtest pipe-D-missing-ccs-buffer-y_tiled_ccs: SKIP (0.000s)
[709.383825] [119/142] (504s left) gen9_exec_parse (allowed-all)
[709.547952] Starting subtest: allowed-all
[709.552817] Subtest allowed-all: SUCCESS (0.003s)
[709.766304] [120/142] (504s left) gem_create (create-ext-set-pat)
[710.037330] Starting subtest: create-ext-set-pat
[710.039839] Subtest create-ext-set-pat: SKIP (0.000s)
[710.133095] [121/142] (504s left) syncobj_timeline (invalid-multi-wait-all-available-unsubmitted-signaled)
[710.285474] Starting subtest: invalid-multi-wait-all-available-unsubmitted-signaled
[710.288806] Subtest invalid-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.003s)
[710.389013] [122/142] (503s left) syncobj_timeline (wait-all-interrupted)
[710.541630] Starting subtest: wait-all-interrupted
[710.649454] Subtest wait-all-interrupted: SUCCESS (0.107s)
[710.748848] [123/142] (503s left) kms_lease (invalid-create-leases)
[711.001713] Starting subtest: invalid-create-leases
[711.020556] Subtest invalid-create-leases: SUCCESS (0.021s)
[711.121370] [124/142] (503s left) syncobj_wait (reset-unsignaled)
[711.278277] Starting subtest: reset-unsignaled
[711.281522] Subtest reset-unsignaled: SUCCESS (0.002s)
[711.381767] [125/142] (503s left) kms_busy (extended-pageflip-hang-oldfb)
[711.636765] Starting subtest: extended-pageflip-hang-oldfb
[711.642840] Starting dynamic subtest: pipe-A
[712.359813] Dynamic subtest pipe-A: SUCCESS (0.716s)
[712.401125] Starting dynamic subtest: pipe-C
[712.929863] Dynamic subtest pipe-C: SUCCESS (0.553s)
[712.931890] Subtest extended-pageflip-hang-oldfb: SUCCESS (1.295s)
[713.241569] [126/142] (501s left) kms_ccs (pipe-c-bad-rotation-90-4_tiled_dg2_mc_ccs)
[714.049399] Starting subtest: pipe-C-bad-rotation-90-4_tiled_dg2_mc_ccs
[714.051690] Subtest pipe-C-bad-rotation-90-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[714.368217] [127/142] (500s left) kms_ccs (pipe-c-crc-sprite-planes-basic-y_tiled_ccs)
[715.174874] Starting subtest: pipe-C-crc-sprite-planes-basic-y_tiled_ccs
[715.183800] Subtest pipe-C-crc-sprite-planes-basic-y_tiled_ccs: SKIP (0.008s)
[715.432989] [128/142] (499s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[715.679907] Starting subtest: cursor-vs-flip-atomic
[750.821904] Subtest cursor-vs-flip-atomic: SUCCESS (35.143s)
[751.154882] [129/142] (463s left) kms_ccs (pipe-b-crc-primary-rotation-180-4_tiled_mtl_rc_ccs_cc)
[751.946545] Starting subtest: pipe-B-crc-primary-rotation-180-4_tiled_mtl_rc_ccs_cc
[751.950920] Subtest pipe-B-crc-primary-rotation-180-4_tiled_mtl_rc_ccs_cc: SKIP (0.004s)
[752.367945] [130/142] (462s left) kms_plane_scaling (planes-scaler-unity-scaling)
[752.609707] Starting subtest: planes-scaler-unity-scaling
[752.615118] Starting dynamic subtest: pipe-A-HDMI-A-1
[752.974760] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.348s)
[753.011230] Starting dynamic subtest: pipe-B-HDMI-A-1
[753.389525] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.411s)
[753.428690] Starting dynamic subtest: pipe-C-HDMI-A-1
[753.767038] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.363s)
[753.768262] Subtest planes-scaler-unity-scaling: SUCCESS (1.151s)
[754.279033] [131/142] (460s left) gem_exec_reloc (basic-write-cpu-active)
[754.442089] Starting subtest: basic-write-cpu-active
[754.574500] Subtest basic-write-cpu-active: SUCCESS (0.132s)
[754.778697] [132/142] (459s left) core_setmaster (master-drop-set-root)
[756.337597] Starting subtest: master-drop-set-root
[756.355912] Subtest master-drop-set-root: SUCCESS (0.018s)
[756.395543] [133/142] (458s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-pwrite)
[756.653814] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-pwrite
[756.655999] Subtest psr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[756.754179] [134/142] (457s left) gem_pwrite (basic-self)
[756.902382] Starting subtest: basic-self
[757.106091] Subtest basic-self: SUCCESS (0.202s)
[757.197465] [135/142] (457s left) i915_pm_rpm (gem-execbuf)
[759.276726] Starting subtest: gem-execbuf
[759.278699] Starting dynamic subtest: smem0
[760.873747] Dynamic subtest smem0: SUCCESS (1.597s)
[760.875623] Subtest gem-execbuf: SUCCESS (1.599s)
[761.370477] [136/142] (453s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite)
[761.641146] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite
[761.643885] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[761.735268] [137/142] (453s left) kms_ccs (pipe-a-crc-primary-basic-4_tiled_mtl_rc_ccs_cc)
[762.416930] Starting subtest: pipe-A-crc-primary-basic-4_tiled_mtl_rc_ccs_cc
[762.419382] Subtest pipe-A-crc-primary-basic-4_tiled_mtl_rc_ccs_cc: SKIP (0.002s)
[762.817989] [138/142] (452s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[765.949885] Subtest parallel-dmabuf-import-out-fence: SKIP (0.000s)
[766.060866] [139/142] (448s left) gem_exec_parallel (fds)
[766.223790] Starting subtest: fds
[766.228690] Starting dynamic subtest: rcs0
[770.602243] Dynamic subtest rcs0: SUCCESS (4.377s)
[770.638822] Starting dynamic subtest: bcs0
[775.188415] Dynamic subtest bcs0: SUCCESS (4.582s)
[775.226691] Starting dynamic subtest: vcs0
[779.778193] Dynamic subtest vcs0: SUCCESS (4.586s)
[779.817598] Starting dynamic subtest: vecs0
[784.098116] Dynamic subtest vecs0: SUCCESS (4.316s)
[784.099431] Subtest fds: SUCCESS (17.875s)
[784.322299] [140/142] (430s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[784.582479] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[784.584794] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[784.684110] [141/142] (430s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset)
[784.910200] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset
[784.915975] Starting dynamic subtest: A-HDMI-A1
[786.604520] Dynamic subtest A-HDMI-A1: SUCCESS (1.688s)
[786.641688] Starting dynamic subtest: B-HDMI-A1
[787.798675] Dynamic subtest B-HDMI-A1: SUCCESS (1.188s)
[787.839635] Starting dynamic subtest: C-HDMI-A1
[788.988582] Dynamic subtest C-HDMI-A1: SUCCESS (1.184s)
[789.010548] Starting dynamic subtest: A-HDMI-A2
[790.150451] Dynamic subtest A-HDMI-A2: SUCCESS (1.156s)
[790.187572] Starting dynamic subtest: B-HDMI-A2
[791.349741] Dynamic subtest B-HDMI-A2: SUCCESS (1.194s)
[791.387601] Starting dynamic subtest: C-HDMI-A2
[792.589921] Dynamic subtest C-HDMI-A2: SUCCESS (1.235s)
[792.591147] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (7.679s)
[792.931198] [142/142] (422s left) kms_ccs (pipe-d-ccs-on-another-bo-4_tiled_mtl_rc_ccs)
[793.763492] Subtest pipe-D-ccs-on-another-bo-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[794.021486] Closing watchdogs
Done.