[63.161495] Initializing watchdogs
[63.161562]   /dev/watchdog0
[63.181963] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[63.193761] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[63.197576] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[63.200417] [001/133] (960s left) kms_psr (fbc-pr-basic)
[64.721463] Subtest fbc-pr-basic: SKIP (0.000s)
[64.777276] [002/133] (958s left) gem_ctx_persistence (engines-mixed-process)
[64.881464] Starting subtest: engines-mixed-process
[64.882459] Starting dynamic subtest: rcs0
[67.158262] Dynamic subtest rcs0: SUCCESS (2.271s)
[67.166035] Starting dynamic subtest: bcs0
[68.925049] Dynamic subtest bcs0: SUCCESS (1.764s)
[68.933207] Starting dynamic subtest: vcs0
[70.909176] Dynamic subtest vcs0: SUCCESS (1.981s)
[70.917815] Starting dynamic subtest: vcs1
[72.900735] Dynamic subtest vcs1: SUCCESS (1.989s)
[72.910051] Starting dynamic subtest: vecs0
[74.899271] Dynamic subtest vecs0: SUCCESS (1.995s)
[74.907256] Starting dynamic subtest: vecs1
[76.875968] Dynamic subtest vecs1: SUCCESS (1.976s)
[76.885245] Starting dynamic subtest: ccs0
[78.910774] Dynamic subtest ccs0: SUCCESS (2.033s)
[78.912148] Subtest engines-mixed-process: SUCCESS (14.013s)
[79.019571] [003/133] (944s left) gem_watchdog (default-physical)
[79.102534] Starting subtest: default-physical
[80.157064] Subtest default-physical: SUCCESS (1.053s)
[80.261651] [004/133] (943s left) syncobj_timeline (32bits-limit)
[80.333258] Starting subtest: 32bits-limit
[80.334212] Subtest 32bits-limit: SUCCESS (0.001s)
[80.518555] [005/133] (943s left) kms_colorop (plane-xr30-xr30-pq_125_eotf)
[83.477038] Subtest plane-XR30-XR30-pq_125_eotf: SKIP (0.000s)
[83.624855] [006/133] (940s left) gem_mmap_wc (bad-size)
[83.729167] Subtest bad-size: SKIP (0.000s)
[83.799956] [007/133] (940s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[85.327767] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[85.329559] Subtest fbcpsr-rgb565-draw-mmap-wc: SKIP (0.000s)
[85.547311] [008/133] (938s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling)
[87.063297] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling
[87.064214] Starting dynamic subtest: pipe-A-valid-mode
[87.122992] Dynamic subtest pipe-A-valid-mode: SKIP (0.058s)
[87.124672] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.059s)
[87.304660] [009/133] (936s left) tools_test (tools_test)
[87.358140] Starting subtest: tools_test
[87.432978] Subtest tools_test: SUCCESS (0.082s)
[87.565418] [010/133] (936s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[89.084981] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[89.085974] Starting dynamic subtest: pipe-A
[91.006721] Dynamic subtest pipe-A: SUCCESS (1.920s)
[91.021851] Starting dynamic subtest: pipe-B
[93.000854] Dynamic subtest pipe-B: SUCCESS (1.992s)
[93.010167] Starting dynamic subtest: pipe-C
[93.227206] Dynamic subtest pipe-C: SUCCESS (0.226s)
[93.244295] Starting dynamic subtest: pipe-D
[93.470899] Dynamic subtest pipe-D: SUCCESS (0.243s)
[93.472280] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (4.383s)
[93.766498] [011/133] (930s left) syncobj_basic (illegal-fd-to-handle)
[93.848993] Starting subtest: illegal-fd-to-handle
[93.850081] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[93.996246] [012/133] (930s left) api_intel_bb (simple-bb)
[94.075270] Starting subtest: simple-bb
[94.106688] Subtest simple-bb: SUCCESS (0.031s)
[94.297724] [013/133] (930s left) gem_pipe_control_store_loop (reused-buffer)
[94.374130] Starting subtest: reused-buffer
[96.554256] Subtest reused-buffer: SUCCESS (2.179s)
[96.726703] [014/133] (927s left) kms_joiner (basic-force-ultra-joiner)
[98.240184] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[98.437614] [015/133] (926s left) kms_psr (fbc-psr2-sprite-plane-move)
[99.953289] Subtest fbc-psr2-sprite-plane-move: SKIP (0.000s)
[100.004131] [016/133] (924s left) kms_chamelium_audio (hdmi-audio-edid)
[101.575248] Subtest hdmi-audio-edid: SKIP (0.000s)
[101.671756] [017/133] (923s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90)
[103.182015] Starting subtest: primary-yf-tiled-reflect-x-90
[103.183835] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s)
[103.362265] [018/133] (921s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180)
[104.901212] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180
[106.179832] Subtest x-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.278s)
[106.421450] [019/133] (918s left) kms_big_fb (linear-8bpp-rotate-270)
[107.942199] Starting subtest: linear-8bpp-rotate-270
[107.998381] Subtest linear-8bpp-rotate-270: SKIP (0.054s)
[108.216729] [020/133] (916s left) kms_vrr (flip-basic-fastset)
[109.724343] Starting subtest: flip-basic-fastset
[109.727135] Subtest flip-basic-fastset: SKIP (0.000s)
[109.889960] [021/133] (915s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs-cc)
[111.418199] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs-cc
[111.419207] Starting dynamic subtest: pipe-A-HDMI-A-1
[111.427997] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[111.436539] Starting dynamic subtest: pipe-B-HDMI-A-1
[111.445380] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[111.453393] Starting dynamic subtest: pipe-C-HDMI-A-1
[111.461934] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[111.470116] Starting dynamic subtest: pipe-D-HDMI-A-1
[111.480514] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[111.482230] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[111.727051] [022/133] (913s left) gem_exec_suspend (basic-s3-devices)
[111.808077] Starting subtest: basic-S3-devices
[111.809057] Starting dynamic subtest: smem
[121.912074] Dynamic subtest smem: SUCCESS (10.101s)
[121.921481] Starting dynamic subtest: lmem0
[131.974687] Dynamic subtest lmem0: SUCCESS (10.060s)
[131.975770] Subtest basic-S3-devices: SUCCESS (20.162s)
[142.259775] [023/133] (893s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-onoff)
[143.772944] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-onoff
[143.774922] Subtest fbcpsr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[143.990307] [024/133] (891s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[145.516048] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[145.517952] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[145.736168] [025/133] (889s left) gem_busy (semaphore)
[145.986333] Subtest semaphore: SKIP (0.000s)
[146.304711] [026/133] (889s left) perf_pmu (module-unload)
[146.416383] Starting subtest: module-unload
[155.122309] Subtest module-unload: FAIL (8.684s)
[155.157479] [FACT perf_pmu (module-unload)] deleted: kernel.kmod_is_loaded.i915: true
[155.159333] [027/133] (880s left) syncobj_timeline (transfer-timeline-point)
[157.987015] Starting subtest: transfer-timeline-point
[157.987851] Subtest transfer-timeline-point: SUCCESS (0.001s)
[158.768331] [FACT syncobj_timeline (transfer-timeline-point)] new: kernel.kmod_is_loaded.i915: true
[158.771635] [028/133] (876s left) syncobj_wait (wait-any-interrupted)
[158.861014] Starting subtest: wait-any-interrupted
[158.963229] Subtest wait-any-interrupted: SUCCESS (0.101s)
[159.123533] [029/133] (876s left) api_intel_allocator (default-alignment)
[159.193173] Starting subtest: default-alignment
[159.205610] Subtest default-alignment: SUCCESS (0.013s)
[159.424198] [030/133] (876s left) gem_exec_gttfill (all-engines)
[159.517496] Starting subtest: all-engines
[185.712941] Subtest all-engines: SUCCESS (26.198s)
[185.980419] [031/133] (849s left) syncobj_timeline (invalid-signal-one-illegal-handle)
[186.102731] Starting subtest: invalid-signal-one-illegal-handle
[186.103634] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[186.340362] [032/133] (849s left) gem_lmem_evict (dontneed-evict-race)
[191.107800] Starting subtest: dontneed-evict-race
[193.199703] Subtest dontneed-evict-race: SUCCESS (2.092s)
[195.118422] [FACT gem_lmem_evict (dontneed-evict-race)] deleted: kernel.kmod_is_loaded.i915: true
[195.120297] [033/133] (840s left) kms_draw_crc (draw-method-blt)
[200.138084] Starting subtest: draw-method-blt
[200.139057] Starting dynamic subtest: xrgb8888-untiled
[200.542901] Dynamic subtest xrgb8888-untiled: SUCCESS (0.404s)
[200.579500] Starting dynamic subtest: rgb565-untiled
[200.842840] Dynamic subtest rgb565-untiled: SUCCESS (0.298s)
[200.879930] Starting dynamic subtest: xrgb2101010-untiled
[201.176271] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.331s)
[201.208539] Starting dynamic subtest: xbgr16161616f-untiled
[201.492816] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.314s)
[201.527169] Starting dynamic subtest: xrgb8888-xtiled
[201.660184] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.165s)
[201.696378] Starting dynamic subtest: rgb565-xtiled
[201.826450] Dynamic subtest rgb565-xtiled: SUCCESS (0.164s)
[201.862311] Starting dynamic subtest: xrgb2101010-xtiled
[201.976310] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.148s)
[202.013923] Starting dynamic subtest: xbgr16161616f-xtiled
[202.126293] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.148s)
[202.163624] Starting dynamic subtest: xrgb8888-4tiled
[202.293278] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.165s)
[202.331064] Starting dynamic subtest: rgb565-4tiled
[202.476678] Dynamic subtest rgb565-4tiled: SUCCESS (0.181s)
[202.513886] Starting dynamic subtest: xrgb2101010-4tiled
[202.642927] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.164s)
[202.677043] Starting dynamic subtest: xbgr16161616f-4tiled
[202.792984] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.148s)
[202.794951] Subtest draw-method-blt: SUCCESS (2.656s)
[203.034575] [FACT kms_draw_crc (draw-method-blt)] new: kernel.kmod_is_loaded.i915: true
[203.036994] [034/133] (833s left) kms_content_protection (dp-mst-type-1)
[204.629183] Starting subtest: dp-mst-type-1
[204.631070] Subtest dp-mst-type-1: SKIP (0.000s)
[204.852925] [035/133] (831s left) i915_drm_fdinfo (isolation)
[204.922666] Starting subtest: isolation
[204.923570] Starting dynamic subtest: rcs0
[204.945306] Dynamic subtest rcs0: SKIP (0.022s)
[204.955688] Starting dynamic subtest: bcs0
[204.957477] Dynamic subtest bcs0: SKIP (0.000s)
[204.967919] Starting dynamic subtest: vcs0
[204.970418] Dynamic subtest vcs0: SKIP (0.000s)
[204.980734] Starting dynamic subtest: vcs1
[204.982989] Dynamic subtest vcs1: SKIP (0.000s)
[204.993200] Starting dynamic subtest: vecs0
[204.995581] Dynamic subtest vecs0: SKIP (0.000s)
[205.005729] Starting dynamic subtest: vecs1
[205.007632] Dynamic subtest vecs1: SKIP (0.000s)
[205.017918] Starting dynamic subtest: ccs0
[205.020365] Dynamic subtest ccs0: SKIP (0.000s)
[205.022739] Subtest isolation: SKIP (0.027s)
[205.065299] [036/133] (831s left) syncobj_timeline (invalid-transfer-non-existent-point)
[205.141164] Starting subtest: invalid-transfer-non-existent-point
[205.142167] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[205.295258] [037/133] (831s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[206.809857] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu
[206.811964] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[207.042645] [038/133] (829s left) kms_pm_dc (dc6-psr)
[209.556198] Starting subtest: dc6-psr
[209.558040] Subtest dc6-psr: SKIP (0.000s)
[209.757978] [039/133] (826s left) gem_exec_reloc (basic-gtt-cpu-noreloc)
[209.843079] Subtest basic-gtt-cpu-noreloc: SKIP (0.000s)
[209.918282] [040/133] (826s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[211.430655] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[211.432423] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[211.705578] [041/133] (825s left) kms_selftest (drm_dp_mst_helper)
[211.756445] Starting subtest: drm_dp_mst_helper
[211.765200] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[211.860100] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.092s)
[211.897073] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[211.962945] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.100s)
[211.997119] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[212.067425] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.104s)
[212.068931] Subtest drm_dp_mst_helper: SUCCESS (0.310s)
[212.314476] [042/133] (824s left) kms_legacy_colorkey (basic)
[213.825551] Starting subtest: basic
[213.826469] Starting dynamic subtest: pipe-A
[213.885408] Dynamic subtest pipe-A: SUCCESS (0.060s)
[213.899912] Starting dynamic subtest: pipe-B
[213.901018] Dynamic subtest pipe-B: SUCCESS (0.001s)
[213.917902] Starting dynamic subtest: pipe-C
[213.919141] Dynamic subtest pipe-C: SUCCESS (0.001s)
[213.939544] Starting dynamic subtest: pipe-D
[213.940909] Dynamic subtest pipe-D: SUCCESS (0.001s)
[213.942193] Subtest basic: SUCCESS (0.064s)
[214.070407] [043/133] (822s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[214.142296] Starting subtest: etime-multi-wait-for-submit-submitted
[214.246231] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.103s)
[214.429618] [044/133] (822s left) kms_flip (flip-vs-absolute-wf_vblank)
[215.940999] Starting subtest: flip-vs-absolute-wf_vblank
[215.943949] Starting dynamic subtest: A-HDMI-A1
[224.012210] Dynamic subtest A-HDMI-A1: SUCCESS (8.068s)
[224.024132] Starting dynamic subtest: B-HDMI-A1
[231.984378] Dynamic subtest B-HDMI-A1: SUCCESS (7.971s)
[231.995455] Starting dynamic subtest: C-HDMI-A1
[239.955979] Dynamic subtest C-HDMI-A1: SUCCESS (7.970s)
[239.966834] Starting dynamic subtest: D-HDMI-A1
[247.926493] Dynamic subtest D-HDMI-A1: SUCCESS (7.969s)
[247.928809] Subtest flip-vs-absolute-wf_vblank: SUCCESS (31.988s)
[248.228398] [045/133] (788s left) gem_eio (execbuf)
[248.511194] Starting subtest: execbuf
[248.959426] Subtest execbuf: SUCCESS (0.448s)
[250.608030] [046/133] (786s left) gem_ctx_persistence (saturated-hostile)
[250.693211] Starting subtest: saturated-hostile
[250.694328] Starting dynamic subtest: rcs0
[251.577617] Dynamic subtest rcs0: SUCCESS (0.885s)
[251.590163] Starting dynamic subtest: bcs0
[252.362830] Dynamic subtest bcs0: SUCCESS (0.784s)
[252.375238] Starting dynamic subtest: vcs0
[253.154594] Dynamic subtest vcs0: SUCCESS (0.791s)
[253.165633] Starting dynamic subtest: vcs1
[253.939616] Dynamic subtest vcs1: SUCCESS (0.784s)
[253.950600] Starting dynamic subtest: vecs0
[254.732653] Dynamic subtest vecs0: SUCCESS (0.792s)
[254.743658] Starting dynamic subtest: vecs1
[255.523711] Dynamic subtest vecs1: SUCCESS (0.790s)
[255.535837] Starting dynamic subtest: ccs0
[256.372654] Dynamic subtest ccs0: SUCCESS (0.848s)
[256.373885] Subtest saturated-hostile: SUCCESS (5.681s)
[256.540204] [047/133] (780s left) gem_ctx_bad_destroy (invalid-pad)
[256.606938] Starting subtest: invalid-pad
[256.607878] Subtest invalid-pad: SUCCESS (0.000s)
[256.813716] [048/133] (780s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-onoff)
[258.334942] Starting subtest: psr-2p-primscrn-cur-indfb-onoff
[258.336829] Subtest psr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[258.565720] [049/133] (778s left) kms_flip (flip-vs-panning-interruptible)
[260.078308] Starting subtest: flip-vs-panning-interruptible
[260.082808] Starting dynamic subtest: A-HDMI-A1
[267.842194] Dynamic subtest A-HDMI-A1: SUCCESS (7.758s)
[267.882291] Starting dynamic subtest: B-HDMI-A1
[275.563718] Dynamic subtest B-HDMI-A1: SUCCESS (7.716s)
[275.604505] Starting dynamic subtest: C-HDMI-A1
[283.285188] Dynamic subtest C-HDMI-A1: SUCCESS (7.716s)
[283.322820] Starting dynamic subtest: D-HDMI-A1
[291.006220] Dynamic subtest D-HDMI-A1: SUCCESS (7.715s)
[291.016858] Subtest flip-vs-panning-interruptible: SUCCESS (30.935s)
[291.334898] [050/133] (746s left) syncobj_wait (reset-signaled)
[291.405485] Starting subtest: reset-signaled
[291.406485] Subtest reset-signaled: SUCCESS (0.000s)
[291.619062] [051/133] (746s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[293.135190] Starting subtest: fbc-rgb101010-draw-mmap-wc
[293.137111] Subtest fbc-rgb101010-draw-mmap-wc: SKIP (0.000s)
[293.367152] [052/133] (744s left) gem_mmap_offset (partial-mmap)
[293.438504] Starting subtest: partial-mmap
[293.439396] Starting dynamic subtest: lmem0
[293.442596] Dynamic subtest lmem0: SUCCESS (0.005s)
[293.454012] Starting dynamic subtest: smem0
[293.455180] Dynamic subtest smem0: SUCCESS (0.005s)
[293.456215] Subtest partial-mmap: SUCCESS (0.011s)
[293.675500] [053/133] (744s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[295.205450] Starting subtest: x-tiled-addfb-size-offset-overflow
[295.206369] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.001s)
[295.410149] [054/133] (742s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[296.927423] Subtest pr-cursor-plane-update-sf: SKIP (0.000s)
[296.992141] [055/133] (741s left) gem_render_copy (linear-to-vebox-yf-tiled)
[297.074931] Starting subtest: linear-to-vebox-yf-tiled
[297.077310] Subtest linear-to-vebox-yf-tiled: SKIP (0.000s)
[297.370466] [056/133] (740s left) kms_chamelium_frames (vga-frame-dump)
[298.924600] Subtest vga-frame-dump: SKIP (0.000s)
[299.031781] [057/133] (739s left) kms_plane_alpha_blend (constant-alpha-mid)
[300.547304] Starting subtest: constant-alpha-mid
[300.815286] Starting dynamic subtest: pipe-A-HDMI-A-1
[301.502679] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.687s)
[301.514772] Starting dynamic subtest: pipe-D-HDMI-A-1
[302.177309] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.673s)
[302.178180] Subtest constant-alpha-mid: SUCCESS (1.631s)
[302.434660] [058/133] (735s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[303.946352] Starting subtest: addfb25-yf-tiled-legacy
[303.947272] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[304.175360] [059/133] (734s left) gem_exec_reloc (basic-wc-read-noreloc)
[304.253458] Subtest basic-wc-read-noreloc: SKIP (0.000s)
[304.339321] [060/133] (734s left) gem_render_copy (yf-tiled-to-vebox-x-tiled)
[304.420543] Starting subtest: yf-tiled-to-vebox-x-tiled
[304.422408] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s)
[304.662734] [061/133] (733s left) gem_ctx_shared (single-timeline)
[304.754428] Starting subtest: single-timeline
[304.793273] Subtest single-timeline: SUCCESS (0.036s)
[305.063150] [062/133] (733s left) gen9_exec_parse (bb-start-cmd)
[305.144448] Subtest bb-start-cmd: SKIP (0.000s)
[305.244453] [063/133] (733s left) gem_exec_schedule (u-semaphore-resolve)
[305.330874] Starting subtest: u-semaphore-resolve
[305.417417] Subtest u-semaphore-resolve: SUCCESS (0.087s)
[305.844714] [064/133] (732s left) i915_pm_rps (min-max-config-loaded)
[305.931309] Starting subtest: min-max-config-loaded
[305.933164] Subtest min-max-config-loaded: SKIP (0.001s)
[306.099390] [065/133] (732s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[307.615215] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[310.610899] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (2.996s)
[310.873977] [066/133] (727s left) gem_render_copy_redux (normal)
[310.952108] Starting subtest: normal
[311.723485] Subtest normal: SUCCESS (0.771s)
[311.928964] [067/133] (727s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-onoff)
[313.441167] Starting subtest: psr-1p-primscrn-cur-indfb-onoff
[313.443145] Subtest psr-1p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[313.683961] [068/133] (725s left) kms_plane (plane-position-hole-dpms)
[315.194305] Starting subtest: plane-position-hole-dpms
[315.602561] Starting dynamic subtest: pipe-A-plane-1
[316.100717] Dynamic subtest pipe-A-plane-1: SUCCESS (0.499s)
[316.112179] Starting dynamic subtest: pipe-A-plane-2
[316.618618] Dynamic subtest pipe-A-plane-2: SUCCESS (0.517s)
[316.630137] Starting dynamic subtest: pipe-A-plane-3
[317.091973] Dynamic subtest pipe-A-plane-3: SUCCESS (0.472s)
[317.103574] Starting dynamic subtest: pipe-A-plane-4
[317.610877] Dynamic subtest pipe-A-plane-4: SUCCESS (0.518s)
[317.622503] Starting dynamic subtest: pipe-A-plane-5
[317.630321] Dynamic subtest pipe-A-plane-5: SUCCESS (0.018s)
[317.907933] Starting dynamic subtest: pipe-B-plane-1
[318.378955] Dynamic subtest pipe-B-plane-1: SUCCESS (0.482s)
[318.390533] Starting dynamic subtest: pipe-B-plane-2
[318.863007] Dynamic subtest pipe-B-plane-2: SUCCESS (0.483s)
[318.875134] Starting dynamic subtest: pipe-B-plane-3
[319.349028] Dynamic subtest pipe-B-plane-3: SUCCESS (0.485s)
[319.360694] Starting dynamic subtest: pipe-B-plane-4
[319.801182] Dynamic subtest pipe-B-plane-4: SUCCESS (0.451s)
[319.813233] Starting dynamic subtest: pipe-B-plane-5
[319.822065] Dynamic subtest pipe-B-plane-5: SUCCESS (0.019s)
[319.823099] Subtest plane-position-hole-dpms: SUCCESS (4.628s)
[320.077530] [069/133] (719s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[321.597189] Starting subtest: 4-tiled-32bpp-rotate-0
[323.498846] Subtest 4-tiled-32bpp-rotate-0: SUCCESS (1.901s)
[323.684737] [070/133] (715s left) kms_colorop (plane-xr24-xr24-ctm_3x4_50_desat)
[326.632585] Subtest plane-XR24-XR24-ctm_3x4_50_desat: SKIP (0.000s)
[326.798144] [071/133] (712s left) syncobj_wait (multi-wait-all-submitted-signaled)
[326.893469] Starting subtest: multi-wait-all-submitted-signaled
[326.997617] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[327.161081] [072/133] (712s left) kms_invalid_mode (bad-hsync-start)
[328.666966] Starting subtest: bad-hsync-start
[328.667945] Starting dynamic subtest: pipe-A-HDMI-A-1
[328.722471] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.054s)
[328.736604] Starting dynamic subtest: pipe-B-HDMI-A-1
[328.737774] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[328.750308] Starting dynamic subtest: pipe-C-HDMI-A-1
[328.751588] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.001s)
[328.765569] Starting dynamic subtest: pipe-D-HDMI-A-1
[328.766787] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.001s)
[328.768026] Subtest bad-hsync-start: SUCCESS (0.065s)
[328.984907] [073/133] (710s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[329.060489] Starting subtest: multi-wait-for-submit-submitted-signaled
[329.061434] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[329.255241] [074/133] (710s left) gem_exec_suspend (basic-s0)
[329.342535] Starting subtest: basic-S0
[329.343431] Starting dynamic subtest: smem
[350.724658] Dynamic subtest smem: SUCCESS (7.305s)
[350.737888] Starting dynamic subtest: lmem0
[371.672442] Dynamic subtest lmem0: SUCCESS (7.086s)
[371.673608] Subtest basic-S0: SUCCESS (14.393s)
[376.954381] [075/133] (667s left) syncobj_wait (single-wait-signaled)
[377.027015] Starting subtest: single-wait-signaled
[377.027975] Subtest single-wait-signaled: SUCCESS (0.000s)
[377.180404] [076/133] (667s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[377.871774] Starting subtest: syncobj-timeline-multiple-ext-nodes
[377.874204] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.002s)
[378.254508] [FACT gem_exec_fence (syncobj-timeline-multiple-ext-nodes)] new: kernel.kmod_is_loaded.vgem: true
[378.256890] [077/133] (666s left) gem_create (create-ext-placement-sanity-check)
[378.451271] Starting subtest: create-ext-placement-sanity-check
[378.456177] Subtest create-ext-placement-sanity-check: SUCCESS (0.006s)
[378.654429] [078/133] (666s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[380.205659] Starting subtest: 2x-long-flip-vs-cursor-atomic
[380.208851] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.002s)
[380.400604] [079/133] (664s left) kms_colorop (plane-xr24-xr24-srgb_inv_eotf_lut)
[383.416834] Subtest plane-XR24-XR24-srgb_inv_eotf_lut: SKIP (0.000s)
[383.614003] [080/133] (661s left) gem_sync (basic-store-all)
[383.714980] Starting subtest: basic-store-all
[388.244017] Subtest basic-store-all: SUCCESS (4.483s)
[388.565163] [081/133] (656s left) perf (invalid-open-flags)
[389.039863] Starting subtest: invalid-open-flags
[389.040754] Subtest invalid-open-flags: SUCCESS (0.000s)
[389.094930] [082/133] (656s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[390.633108] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[390.634857] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[390.895651] [083/133] (654s left) gem_userptr_blits (create-destroy-sync)
[390.991986] Starting subtest: create-destroy-sync
[395.999228] Subtest create-destroy-sync: SUCCESS (4.988s)
[396.182110] [084/133] (649s left) kms_addfb_basic (bad-pitch-0)
[396.261675] Starting subtest: bad-pitch-0
[396.262574] Subtest bad-pitch-0: SUCCESS (0.000s)
[397.963046] [085/133] (647s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[399.508867] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[399.510657] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[399.735360] [086/133] (646s left) gem_madvise (dontneed-before-mmap)
[399.785095] Starting subtest: dontneed-before-mmap
[399.834890] Subtest dontneed-before-mmap: SUCCESS (0.051s)
[400.006544] [087/133] (645s left) kms_atomic (plane-invalid-params)
[401.532854] Starting subtest: plane-invalid-params
[401.533810] Starting dynamic subtest: pipe-A-HDMI-A-1
[402.381023] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.845s)
[402.381886] Subtest plane-invalid-params: SUCCESS (0.848s)
[402.645637] [088/133] (643s left) kms_flip (flip-vs-rmfb-interruptible)
[404.168036] Starting subtest: flip-vs-rmfb-interruptible
[404.172812] Starting dynamic subtest: A-HDMI-A1
[411.907910] Dynamic subtest A-HDMI-A1: SUCCESS (7.730s)
[411.947067] Starting dynamic subtest: B-HDMI-A1
[419.580715] Dynamic subtest B-HDMI-A1: SUCCESS (7.665s)
[419.623911] Starting dynamic subtest: C-HDMI-A1
[427.272263] Dynamic subtest C-HDMI-A1: SUCCESS (7.683s)
[427.308691] Starting dynamic subtest: D-HDMI-A1
[434.947664] Dynamic subtest D-HDMI-A1: SUCCESS (7.667s)
[434.959092] Subtest flip-vs-rmfb-interruptible: SUCCESS (30.777s)
[435.279445] [089/133] (610s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[436.795980] Starting subtest: cursorB-vs-flipB-toggle
[436.797984] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[436.982987] [090/133] (609s left) gem_exec_reloc (basic-cpu-read-active)
[437.077964] Subtest basic-cpu-read-active: SKIP (0.000s)
[437.175204] [091/133] (609s left) kms_psr (fbc-psr-sprite-blt)
[438.695043] Subtest fbc-psr-sprite-blt: SKIP (0.000s)
[438.754794] [092/133] (607s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[440.279615] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[440.281373] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[440.529250] [093/133] (605s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[442.045008] Starting subtest: basic-busy-flip-before-cursor-varying-size
[442.047016] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[442.240092] [094/133] (604s left) kms_prop_blob (invalid-set-prop-any)
[442.323568] Starting subtest: invalid-set-prop-any
[442.324538] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[442.510254] [095/133] (604s left) dmabuf_sync_file (export-wait-after-attach)
[442.575243] Starting subtest: export-wait-after-attach
[442.576122] Subtest export-wait-after-attach: SUCCESS (0.001s)
[442.705995] [096/133] (603s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[444.228004] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[447.110836] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (2.882s)
[447.361089] [097/133] (599s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render)
[448.887083] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render
[448.888791] Subtest psr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s)
[449.102615] [098/133] (597s left) kms_vblank (query-forked-busy)
[450.619978] Starting subtest: query-forked-busy
[450.620938] Starting dynamic subtest: pipe-A-HDMI-A-1
[453.120767] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.498s)
[453.181753] Starting dynamic subtest: pipe-D-HDMI-A-1
[455.614908] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (2.477s)
[455.616657] Subtest query-forked-busy: SUCCESS (4.995s)
[455.890016] [099/133] (591s left) i915_selftest (mock)
[457.016914] Starting subtest: mock
[457.018011] Starting dynamic subtest: sanitycheck
[458.003541] Dynamic subtest sanitycheck: SUCCESS (0.985s)
[458.021098] Starting dynamic subtest: shmem
[459.029587] Dynamic subtest shmem: SUCCESS (1.021s)
[459.038898] Starting dynamic subtest: fence
[467.046797] Dynamic subtest fence: SUCCESS (8.012s)
[467.064084] Starting dynamic subtest: scatterlist
[469.058738] Dynamic subtest scatterlist: SUCCESS (2.007s)
[469.071249] Starting dynamic subtest: syncmap
[472.103640] Dynamic subtest syncmap: SUCCESS (3.040s)
[472.119332] Starting dynamic subtest: uncore
[473.154028] Dynamic subtest uncore: SUCCESS (1.048s)
[473.166790] Starting dynamic subtest: ring
[474.191919] Dynamic subtest ring: SUCCESS (1.034s)
[474.204095] Starting dynamic subtest: engine
[475.194604] Dynamic subtest engine: SUCCESS (1.000s)
[475.207092] Starting dynamic subtest: timelines
[480.092947] Dynamic subtest timelines: SUCCESS (4.898s)
[480.102950] Starting dynamic subtest: requests
[483.042469] Dynamic subtest requests: SUCCESS (2.949s)
[483.052405] Starting dynamic subtest: objects
[484.161492] Dynamic subtest objects: SUCCESS (1.118s)
[484.171107] Starting dynamic subtest: phys
[485.307626] Dynamic subtest phys: SUCCESS (1.145s)
[485.319628] Starting dynamic subtest: dmabuf
[486.436871] Dynamic subtest dmabuf: SUCCESS (1.128s)
[486.455435] Starting dynamic subtest: vma
[494.926666] Dynamic subtest vma: SUCCESS (8.489s)
[494.941114] Starting dynamic subtest: evict
[497.029833] Dynamic subtest evict: SUCCESS (2.102s)
[497.044127] Starting dynamic subtest: gtt
[501.267527] Dynamic subtest gtt: SUCCESS (4.236s)
[501.278702] Starting dynamic subtest: hugepages
[502.568675] Dynamic subtest hugepages: SUCCESS (1.300s)
[502.579833] Starting dynamic subtest: memory_region
[506.340553] Dynamic subtest memory_region: SUCCESS (3.770s)
[506.341651] Subtest mock: SUCCESS (49.325s)
[506.379193] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[506.380195] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[506.382334] [100/133] (540s left) kms_cursor_crc (cursor-sliding-64x64)
[511.538048] Starting subtest: cursor-sliding-64x64
[511.553913] Starting dynamic subtest: pipe-A-HDMI-A-1
[515.951628] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (4.397s)
[515.992198] Starting dynamic subtest: pipe-D-HDMI-A-1
[520.320971] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (4.338s)
[520.321881] Subtest cursor-sliding-64x64: SUCCESS (8.782s)
[520.831142] [FACT kms_cursor_crc (cursor-sliding-64x64)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[520.833967] [FACT kms_cursor_crc (cursor-sliding-64x64)] new: kernel.kmod_is_loaded.i915: true
[520.837126] [101/133] (526s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-blt)
[522.360536] Starting subtest: psr-2p-primscrn-cur-indfb-draw-blt
[522.362439] Subtest psr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[522.588567] [102/133] (524s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-render)
[524.110729] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-render
[524.112715] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[524.337119] [103/133] (522s left) kms_ccs (crc-sprite-planes-basic-4-tiled-lnl-ccs)
[525.858001] Starting subtest: crc-sprite-planes-basic-4-tiled-lnl-ccs
[525.859847] Subtest crc-sprite-planes-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[526.094991] [104/133] (521s left) perf_pmu (busy-accuracy-98)
[526.174317] Starting subtest: busy-accuracy-98
[526.175225] Starting dynamic subtest: rcs0
[529.233047] Dynamic subtest rcs0: SUCCESS (3.057s)
[529.244273] Starting dynamic subtest: bcs0
[532.291888] Dynamic subtest bcs0: SUCCESS (3.057s)
[532.303433] Starting dynamic subtest: vcs0
[535.349564] Dynamic subtest vcs0: SUCCESS (3.056s)
[535.360923] Starting dynamic subtest: vcs1
[538.407134] Dynamic subtest vcs1: SUCCESS (3.056s)
[538.418738] Starting dynamic subtest: vecs0
[541.463012] Dynamic subtest vecs0: SUCCESS (3.054s)
[541.474477] Starting dynamic subtest: vecs1
[544.518773] Dynamic subtest vecs1: SUCCESS (3.054s)
[544.530382] Starting dynamic subtest: ccs0
[547.577744] Dynamic subtest ccs0: SUCCESS (3.057s)
[547.578709] Subtest busy-accuracy-98: SUCCESS (21.398s)
[547.813189] [105/133] (499s left) gem_exec_flush (basic-batch-kernel-default-uc)
[547.913228] Subtest basic-batch-kernel-default-uc: SKIP (0.000s)
[548.015791] [106/133] (499s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[549.537548] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[549.541033] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.002s)
[549.753690] [107/133] (497s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[549.834021] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[549.835047] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[550.035114] [108/133] (497s left) sysfs_timeslice_duration (idempotent)
[550.126657] Starting subtest: idempotent
[550.127594] Starting dynamic subtest: vecs0
[550.128510] Dynamic subtest vecs0: SUCCESS (0.000s)
[550.139688] Starting dynamic subtest: ccs0
[550.140702] Dynamic subtest ccs0: SUCCESS (0.001s)
[550.151824] Starting dynamic subtest: vcs0
[550.152901] Dynamic subtest vcs0: SUCCESS (0.000s)
[550.164096] Starting dynamic subtest: bcs0
[550.165215] Dynamic subtest bcs0: SUCCESS (0.001s)
[550.176329] Starting dynamic subtest: vecs1
[550.177494] Dynamic subtest vecs1: SUCCESS (0.000s)
[550.188011] Starting dynamic subtest: rcs0
[550.189169] Dynamic subtest rcs0: SUCCESS (0.000s)
[550.199756] Starting dynamic subtest: vcs1
[550.201001] Dynamic subtest vcs1: SUCCESS (0.001s)
[550.202093] Subtest idempotent: SUCCESS (0.012s)
[550.271528] [109/133] (497s left) perf (disabled-read-error)
[550.702771] Starting subtest: disabled-read-error
[550.738421] Subtest disabled-read-error: SUCCESS (0.036s)
[550.806002] [110/133] (497s left) kms_feature_discovery (dp-mst)
[552.324204] Starting subtest: dp-mst
[552.325984] Subtest dp-mst: SKIP (0.000s)
[552.539368] [111/133] (495s left) gem_spin_batch (legacy)
[552.630970] Starting subtest: legacy
[552.631944] Starting dynamic subtest: default
[555.899545] Dynamic subtest default: SUCCESS (3.264s)
[555.913586] Starting dynamic subtest: render
[559.141800] Dynamic subtest render: SUCCESS (3.232s)
[559.152927] Starting dynamic subtest: bsd
[562.376477] Dynamic subtest bsd: SUCCESS (3.232s)
[562.392108] Starting dynamic subtest: bsd1
[565.616669] Dynamic subtest bsd1: SUCCESS (3.233s)
[565.632208] Starting dynamic subtest: bsd2
[568.856272] Dynamic subtest bsd2: SUCCESS (3.233s)
[568.872111] Starting dynamic subtest: blt
[572.096535] Dynamic subtest blt: SUCCESS (3.233s)
[572.116117] Starting dynamic subtest: vebox
[575.339647] Dynamic subtest vebox: SUCCESS (3.236s)
[575.341650] Subtest legacy: SUCCESS (22.702s)
[575.617258] [112/133] (472s left) gem_lmem_swapping (verify-random)
[580.336083] Starting subtest: verify-random
[580.336971] Starting dynamic subtest: lmem0
[588.898935] Dynamic subtest lmem0: SUCCESS (8.559s)
[588.899939] Subtest verify-random: SUCCESS (8.560s)
[590.049601] [FACT gem_lmem_swapping (verify-random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[590.050617] [FACT gem_lmem_swapping (verify-random)] deleted: kernel.kmod_is_loaded.i915: true
[590.052901] [113/133] (458s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc)
[595.103507] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc
[595.105902] Starting dynamic subtest: pipe-A-HDMI-A-1
[603.426260] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (8.316s)
[603.444992] Starting dynamic subtest: pipe-B-HDMI-A-1
[604.136847] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.704s)
[604.174582] Starting dynamic subtest: pipe-C-HDMI-A-1
[604.862915] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.718s)
[604.900096] Starting dynamic subtest: pipe-D-HDMI-A-1
[605.589621] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.719s)
[605.591481] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc: SUCCESS (10.484s)
[605.918394] [FACT kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[605.921093] [FACT kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc)] new: kernel.kmod_is_loaded.i915: true
[605.923830] [114/133] (442s left) kms_psr (fbc-psr2-no-drrs)
[607.457446] Subtest fbc-psr2-no-drrs: SKIP (0.000s)
[607.520270] [115/133] (440s left) kms_psr (psr-sprite-render)
[609.038617] Subtest psr-sprite-render: SKIP (0.000s)
[609.102322] [116/133] (439s left) gem_exec_balancer (bonded-semaphore)
[609.206592] Starting subtest: bonded-semaphore
[609.208811] Subtest bonded-semaphore: SKIP (0.000s)
[609.662140] [117/133] (438s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[611.180763] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[611.182725] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[611.416445] [118/133] (437s left) kms_frontbuffer_tracking (fbc-2p-indfb-fliptrack-mmap-gtt)
[612.940896] Starting subtest: fbc-2p-indfb-fliptrack-mmap-gtt
[612.942780] Subtest fbc-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[613.164954] [119/133] (435s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[613.255591] Subtest basic-wc-cpu-noreloc: SKIP (0.000s)
[613.335967] [120/133] (435s left) gem_partial_pwrite_pread (reads)
[613.429291] Subtest reads: SKIP (0.000s)
[613.530193] [121/133] (435s left) gem_exec_schedule (in-order)
[613.625324] Starting subtest: in-order
[613.626274] Starting dynamic subtest: rcs0
[613.911867] Dynamic subtest rcs0: SUCCESS (0.286s)
[613.922819] Starting dynamic subtest: bcs0
[614.121852] Dynamic subtest bcs0: SUCCESS (0.209s)
[614.133039] Starting dynamic subtest: vcs0
[614.339087] Dynamic subtest vcs0: SUCCESS (0.216s)
[614.350346] Starting dynamic subtest: vcs1
[614.556044] Dynamic subtest vcs1: SUCCESS (0.216s)
[614.567109] Starting dynamic subtest: vecs0
[614.775755] Dynamic subtest vecs0: SUCCESS (0.215s)
[614.788974] Starting dynamic subtest: vecs1
[614.993029] Dynamic subtest vecs1: SUCCESS (0.219s)
[615.006442] Starting dynamic subtest: ccs0
[615.205142] Dynamic subtest ccs0: SUCCESS (0.211s)
[615.205967] Subtest in-order: SUCCESS (1.581s)
[615.688193] [122/133] (433s left) gem_workarounds (suspend-resume-context)
[615.786959] Starting subtest: suspend-resume-context
[634.620135] Subtest suspend-resume-context: SUCCESS (3.842s)
[644.780345] [123/133] (414s left) kms_pm_rpm (system-suspend-modeset)
[648.994539] Starting subtest: system-suspend-modeset
[670.654310] Subtest system-suspend-modeset: SUCCESS (6.421s)
[675.694810] [124/133] (387s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt)
[677.228063] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt
[677.229852] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[677.465467] [125/133] (385s left) kms_cursor_crc (cursor-onscreen-512x170)
[679.288500] Starting subtest: cursor-onscreen-512x170
[679.292215] Subtest cursor-onscreen-512x170: SKIP (0.001s)
[679.558444] [126/133] (383s left) kms_psr (psr2-sprite-blt)
[681.085174] Subtest psr2-sprite-blt: SKIP (0.000s)
[681.159359] [127/133] (382s left) kms_busy (extended-modeset-hang-newfb)
[682.689143] Starting subtest: extended-modeset-hang-newfb
[682.690060] Starting dynamic subtest: pipe-A
[698.280894] Dynamic subtest pipe-A: SUCCESS (15.586s)
[698.295665] Starting dynamic subtest: pipe-D
[713.863923] Dynamic subtest pipe-D: SUCCESS (15.580s)
[713.864909] Subtest extended-modeset-hang-newfb: SUCCESS (31.173s)
[714.139819] [128/133] (349s left) i915_drm_fdinfo (virtual-busy-idle)
[714.213106] Starting subtest: virtual-busy-idle
[714.214971] Subtest virtual-busy-idle: SKIP (0.000s)
[714.355096] [129/133] (349s left) gem_exec_fence (basic-wait)
[714.574004] Starting subtest: basic-wait
[714.575494] Starting dynamic subtest: rcs0
[714.708928] Dynamic subtest rcs0: SUCCESS (0.133s)
[714.727310] Starting dynamic subtest: bcs0
[714.765751] Dynamic subtest bcs0: SUCCESS (0.052s)
[714.792569] Starting dynamic subtest: vcs0
[714.819475] Dynamic subtest vcs0: SUCCESS (0.052s)
[714.850052] Starting dynamic subtest: vcs1
[714.878382] Dynamic subtest vcs1: SUCCESS (0.056s)
[714.900236] Starting dynamic subtest: vecs0
[714.932262] Dynamic subtest vecs0: SUCCESS (0.052s)
[714.959782] Starting dynamic subtest: vecs1
[714.988488] Dynamic subtest vecs1: SUCCESS (0.054s)
[715.015289] Starting dynamic subtest: ccs0
[715.044527] Dynamic subtest ccs0: SUCCESS (0.054s)
[715.045650] Subtest basic-wait: SUCCESS (0.472s)
[715.769899] [130/133] (347s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-blt)
[717.292020] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-blt
[719.644003] Subtest fbc-1p-offscreen-pri-indfb-draw-blt: SUCCESS (2.352s)
[719.896115] [131/133] (343s left) kms_chamelium_hpd (hdmi-hpd-fast)
[721.469119] Subtest hdmi-hpd-fast: SKIP (0.000s)
[721.578983] [132/133] (342s left) gem_eio (in-flight-contexts-1us)
[721.890916] Starting subtest: in-flight-contexts-1us
[735.067269] Subtest in-flight-contexts-1us: SUCCESS (13.176s)
[736.711634] [133/133] (327s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[738.242702] Starting subtest: y-tiled-8bpp-rotate-0
[738.244577] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s)
[738.474422] Closing watchdogs
results: parsing output: 0/ for test: kms_psr
results: parsing output: 1/ for test: gem_ctx_persistence
results: parsing output: 2/ for test: gem_watchdog
results: parsing output: 3/ for test: syncobj_timeline
results: parsing output: 4/ for test: kms_colorop
results: parsing output: 5/ for test: gem_mmap_wc
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_flip_scaled_crc
results: parsing output: 8/ for test: tools_test
results: parsing output: 9/ for test: kms_plane_scaling
results: parsing output: 10/ for test: syncobj_basic
results: parsing output: 11/ for test: api_intel_bb
results: parsing output: 12/ for test: gem_pipe_control_store_loop
results: parsing output: 13/ for test: kms_joiner
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: kms_chamelium_audio
results: parsing output: 16/ for test: kms_rotation_crc
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: kms_vrr
results: parsing output: 20/ for test: kms_ccs
results: parsing output: 21/ for test: gem_exec_suspend
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: gem_busy
results: parsing output: 25/ for test: perf_pmu
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: syncobj_wait
results: parsing output: 28/ for test: api_intel_allocator
results: parsing output: 29/ for test: gem_exec_gttfill
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: gem_lmem_evict
results: parsing output: 32/ for test: kms_draw_crc
results: parsing output: 33/ for test: kms_content_protection
results: parsing output: 34/ for test: i915_drm_fdinfo
results: parsing output: 35/ for test: syncobj_timeline
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_pm_dc
results: parsing output: 38/ for test: gem_exec_reloc
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: kms_selftest
results: parsing output: 41/ for test: kms_legacy_colorkey
results: parsing output: 42/ for test: syncobj_timeline
results: parsing output: 43/ for test: kms_flip
results: parsing output: 44/ for test: gem_eio
results: parsing output: 45/ for test: gem_ctx_persistence
results: parsing output: 46/ for test: gem_ctx_bad_destroy
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_flip
results: parsing output: 49/ for test: syncobj_wait
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: gem_mmap_offset
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_psr2_sf
results: parsing output: 54/ for test: gem_render_copy
results: parsing output: 55/ for test: kms_chamelium_frames
results: parsing output: 56/ for test: kms_plane_alpha_blend
results: parsing output: 57/ for test: kms_addfb_basic
results: parsing output: 58/ for test: gem_exec_reloc
results: parsing output: 59/ for test: gem_render_copy
results: parsing output: 60/ for test: gem_ctx_shared
results: parsing output: 61/ for test: gen9_exec_parse
results: parsing output: 62/ for test: gem_exec_schedule
results: parsing output: 63/ for test: i915_pm_rps
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: gem_render_copy_redux
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_plane
results: parsing output: 68/ for test: kms_big_fb
results: parsing output: 69/ for test: kms_colorop
results: parsing output: 70/ for test: syncobj_wait
results: parsing output: 71/ for test: kms_invalid_mode
results: parsing output: 72/ for test: syncobj_timeline
results: parsing output: 73/ for test: gem_exec_suspend
results: parsing output: 74/ for test: syncobj_wait
results: parsing output: 75/ for test: gem_exec_fence
results: parsing output: 76/ for test: gem_create
results: parsing output: 77/ for test: kms_cursor_legacy
results: parsing output: 78/ for test: kms_colorop
results: parsing output: 79/ for test: gem_sync
results: parsing output: 80/ for test: perf
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: gem_userptr_blits
results: parsing output: 83/ for test: kms_addfb_basic
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: gem_madvise
results: parsing output: 86/ for test: kms_atomic
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: kms_cursor_legacy
results: parsing output: 89/ for test: gem_exec_reloc
results: parsing output: 90/ for test: kms_psr
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_cursor_legacy
results: parsing output: 93/ for test: kms_prop_blob
results: parsing output: 94/ for test: dmabuf_sync_file
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_vblank
results: parsing output: 98/ for test: i915_selftest
results: parsing output: 99/ for test: kms_cursor_crc
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: perf_pmu
results: parsing output: 104/ for test: gem_exec_flush
results: parsing output: 105/ for test: kms_cursor_legacy
results: parsing output: 106/ for test: syncobj_wait
results: parsing output: 107/ for test: sysfs_timeslice_duration
results: parsing output: 108/ for test: perf
results: parsing output: 109/ for test: kms_feature_discovery
results: parsing output: 110/ for test: gem_spin_batch
results: parsing output: 111/ for test: gem_lmem_swapping
results: parsing output: 112/ for test: kms_ccs
results: parsing output: 113/ for test: kms_psr
results: parsing output: 114/ for test: kms_psr
results: parsing output: 115/ for test: gem_exec_balancer
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: gem_exec_reloc
results: parsing output: 119/ for test: gem_partial_pwrite_pread
results: parsing output: 120/ for test: gem_exec_schedule
results: parsing output: 121/ for test: gem_workarounds
results: parsing output: 122/ for test: kms_pm_rpm
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_cursor_crc
results: parsing output: 125/ for test: kms_psr
results: parsing output: 126/ for test: kms_busy
results: parsing output: 127/ for test: i915_drm_fdinfo
results: parsing output: 128/ for test: gem_exec_fence
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_chamelium_hpd
results: parsing output: 131/ for test: gem_eio
results: parsing output: 132/ for test: kms_big_fb
Done.