[56.529401] Initializing watchdogs
[56.529531]   /dev/watchdog0
[56.538342] [001/131] (960s left) gem_ctx_persistence (hostile)
[56.606191] Starting subtest: hostile
[66.669713] Subtest hostile: SUCCESS (10.154s)
[66.791163] [002/131] (950s left) gem_exec_whisper (basic-queues-forked)
[66.858197] Starting subtest: basic-queues-forked
[89.980326] Subtest basic-queues-forked: SUCCESS (23.146s)
[90.141383] [003/131] (926s left) kms_big_fb (x-tiled-32bpp-rotate-90)
[90.261376] Starting subtest: x-tiled-32bpp-rotate-90
[90.291075] Subtest x-tiled-32bpp-rotate-90: SKIP (0.029s)
[90.390254] [004/131] (926s left) syncobj_wait (wait-all-interrupted)
[90.445752] Starting subtest: wait-all-interrupted
[90.549439] Subtest wait-all-interrupted: SUCCESS (0.102s)
[90.600969] [005/131] (926s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy)
[90.718289] Starting subtest: 2x-long-flip-vs-cursor-legacy
[90.722874] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s)
[90.828923] [006/131] (926s left) gem_ctx_exec (basic-nohangcheck)
[90.886790] Starting subtest: basic-nohangcheck
[91.113119] Subtest basic-nohangcheck: SUCCESS (0.227s)
[91.211518] [007/131] (925s left) kms_cursor_crc (cursor-size-change)
[91.304931] Starting subtest: cursor-size-change
[91.307233] Starting dynamic subtest: pipe-A-eDP-1
[92.109410] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.803s)
[92.116940] Starting dynamic subtest: pipe-D-eDP-1
[93.569359] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.457s)
[93.571574] Subtest cursor-size-change: SUCCESS (2.262s)
[94.347368] [008/131] (922s left) gem_lmem_swapping (heavy-verify-random-ccs)
[94.389067] Subtest heavy-verify-random-ccs: SKIP (0.000s)
[94.411197] [009/131] (922s left) perf_pmu (pmu-read)
[94.448702] Starting subtest: pmu-read
[94.451081] Subtest pmu-read: SUCCESS (0.002s)
[94.542539] [010/131] (922s left) syncobj_timeline (wait-for-submit-delayed-submit)
[94.588624] Starting subtest: wait-for-submit-delayed-submit
[94.692622] Subtest wait-for-submit-delayed-submit: SUCCESS (0.103s)
[94.745660] [011/131] (922s left) gem_exec_params (invalid-batch-start-offset)
[94.798465] Starting subtest: invalid-batch-start-offset
[94.800798] Subtest invalid-batch-start-offset: SUCCESS (0.002s)
[94.897669] [012/131] (922s left) kms_atomic (atomic-plane-damage)
[94.997851] Starting subtest: atomic-plane-damage
[95.058572] Starting dynamic subtest: pipe-A-eDP-1
[95.587525] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.528s)
[95.589520] Subtest atomic-plane-damage: SUCCESS (0.588s)
[96.374472] [013/131] (920s left) gem_exec_balancer (invalid-balancer)
[96.433513] Starting subtest: invalid-balancer
[97.202761] Subtest invalid-balancer: SUCCESS (0.767s)
[97.453404] [014/131] (919s left) gem_userptr_blits (unsync-unmap)
[97.515825] Subtest unsync-unmap: SKIP (0.000s)
[97.614846] [015/131] (919s left) kms_big_fb (linear-32bpp-rotate-180)
[97.722053] Starting subtest: linear-32bpp-rotate-180
[99.122077] Subtest linear-32bpp-rotate-180: SUCCESS (1.400s)
[99.224226] [016/131] (917s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[99.314602] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[99.316614] Starting dynamic subtest: pipe-A-default-mode
[101.999820] Dynamic subtest pipe-A-default-mode: SUCCESS (2.681s)
[102.001690] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.682s)
[102.852576] [017/131] (914s left) kms_cursor_legacy (torture-bo)
[102.967943] Starting subtest: torture-bo
[102.970134] Starting dynamic subtest: pipe-A
[109.034444] Dynamic subtest pipe-A: SUCCESS (6.063s)
[109.051312] Starting dynamic subtest: pipe-B
[115.238932] Dynamic subtest pipe-B: SUCCESS (6.205s)
[115.246410] Starting dynamic subtest: pipe-C
[121.255045] Dynamic subtest pipe-C: SUCCESS (6.013s)
[121.263884] Starting dynamic subtest: pipe-D
[129.241327] Dynamic subtest pipe-D: SUCCESS (7.987s)
[129.250078] Starting dynamic subtest: all-pipes
[135.268276] Dynamic subtest all-pipes: SUCCESS (6.027s)
[135.270702] Subtest torture-bo: SUCCESS (32.296s)
[135.401063] [018/131] (881s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe)
[135.794071] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s)
[136.550839] [019/131] (880s left) kms_psr (fbc-psr2-dpms)
[136.660986] Starting subtest: fbc-psr2-dpms
[136.663327] Starting dynamic subtest: eDP-1
[136.667508] Dynamic subtest eDP-1: SKIP (0.000s)
[136.671718] Subtest fbc-psr2-dpms: SKIP (0.000s)
[136.712491] [020/131] (880s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[136.840113] Starting subtest: 2x-long-cursor-vs-flip-atomic
[136.844790] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.001s)
[136.964035] [021/131] (880s left) kms_vrr (seamless-rr-switch-vrr)
[137.056938] Starting subtest: seamless-rr-switch-vrr
[137.063307] Subtest seamless-rr-switch-vrr: SKIP (0.000s)
[137.114730] [022/131] (880s left) kms_pm_dc (dc5-dpms-negative)
[138.212994] Starting subtest: dc5-dpms-negative
[138.217198] Subtest dc5-dpms-negative: SKIP (0.000s)
[138.268785] [023/131] (879s left) kms_busy (extended-modeset-hang-newfb)
[138.385892] Starting subtest: extended-modeset-hang-newfb
[138.388333] Starting dynamic subtest: pipe-A
[172.801220] Dynamic subtest pipe-A: SUCCESS (34.409s)
[172.810258] Starting dynamic subtest: pipe-D
[195.777070] Dynamic subtest pipe-D: SUCCESS (22.974s)
[195.779565] Subtest extended-modeset-hang-newfb: SUCCESS (57.387s)
[196.544445] [024/131] (820s left) i915_pm_rps (basic-api)
[196.602223] Starting subtest: basic-api
[196.606461] Subtest basic-api: SKIP (0.000s)
[196.663415] [025/131] (820s left) kms_psr (psr-basic)
[196.760059] Starting subtest: psr-basic
[196.762365] Starting dynamic subtest: eDP-1
[198.336722] Dynamic subtest eDP-1: SUCCESS (1.574s)
[198.339091] Subtest psr-basic: SUCCESS (1.575s)
[199.189332] [026/131] (818s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[199.297231] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu
[199.301581] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[199.382703] [027/131] (818s left) sriov_basic (bind-unbind-vf)
[199.439730] Starting subtest: bind-unbind-vf
[199.442363] Starting dynamic subtest: vf-1
[199.517170] Dynamic subtest vf-1: FAIL (0.005s)
[199.526480] Starting dynamic subtest: vf-2
[199.600135] Dynamic subtest vf-2: FAIL (0.003s)
[199.608377] Starting dynamic subtest: vf-3
[199.681301] Dynamic subtest vf-3: FAIL (0.005s)
[199.689799] Starting dynamic subtest: vf-4
[199.763064] Dynamic subtest vf-4: FAIL (0.004s)
[199.772793] Starting dynamic subtest: vf-5
[199.845838] Dynamic subtest vf-5: FAIL (0.003s)
[199.854364] Starting dynamic subtest: vf-6
[199.928223] Dynamic subtest vf-6: FAIL (0.003s)
[199.937617] Starting dynamic subtest: vf-7
[200.011312] Dynamic subtest vf-7: FAIL (0.004s)
[200.020056] Starting dynamic subtest: vf-random
[200.093886] Dynamic subtest vf-random: FAIL (0.003s)
[200.103350] Starting dynamic subtest: vf-last
[200.172243] Dynamic subtest vf-last: FAIL (0.507s)
[200.173966] Subtest bind-unbind-vf: FAIL (0.540s)
[200.188887] [028/131] (817s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[200.296261] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip
[200.299995] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[200.375241] [029/131] (817s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[200.477071] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[200.480589] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[200.572913] [030/131] (816s left) syncobj_timeline (single-wait-available-submitted)
[200.631643] Starting subtest: single-wait-available-submitted
[200.633661] Subtest single-wait-available-submitted: SUCCESS (0.000s)
[200.718457] [031/131] (816s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[200.812230] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-wc
[200.815930] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[200.890868] [032/131] (816s left) gem_tiled_blits (normal)
[200.949562] Subtest normal: SKIP (0.000s)
[201.000133] [033/131] (816s left) gen7_exec_parse (basic-rejected)
[201.073056] Subtest basic-rejected: SKIP (0.000s)
[201.136291] [034/131] (816s left) gem_exec_fence (submit-chain)
[201.326624] Starting subtest: submit-chain
[201.345606] Subtest submit-chain: SUCCESS (0.019s)
[202.961633] [035/131] (814s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[203.018070] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[203.022577] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[203.179555] [036/131] (814s left) gem_close_race (multigpu-basic-threads)
[203.242478] Starting subtest: multigpu-basic-threads
[203.246964] Subtest multigpu-basic-threads: SKIP (0.000s)
[203.437255] [037/131] (814s left) kms_lease (lease-invalid-plane)
[203.545793] Starting subtest: lease-invalid-plane
[203.548098] Starting dynamic subtest: pipe-A-eDP-1
[203.550275] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[203.558535] Starting dynamic subtest: pipe-B-eDP-1
[203.560494] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[203.568070] Starting dynamic subtest: pipe-C-eDP-1
[203.570156] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[203.577320] Starting dynamic subtest: pipe-D-eDP-1
[203.579160] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[203.581028] Subtest lease-invalid-plane: SUCCESS (0.002s)
[203.597939] [038/131] (814s left) kms_draw_crc (draw-method-mmap-cpu)
[203.695103] Starting subtest: draw-method-mmap-cpu
[203.697040] Starting dynamic subtest: xrgb8888-untiled
[203.938934] Dynamic subtest xrgb8888-untiled: SUCCESS (0.246s)
[203.946587] Starting dynamic subtest: rgb565-untiled
[204.127738] Dynamic subtest rgb565-untiled: SUCCESS (0.189s)
[204.135288] Starting dynamic subtest: xrgb2101010-untiled
[204.305777] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.178s)
[204.313790] Starting dynamic subtest: xrgb8888-xtiled
[204.427580] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.122s)
[204.434867] Starting dynamic subtest: rgb565-xtiled
[204.538708] Dynamic subtest rgb565-xtiled: SUCCESS (0.111s)
[204.547399] Starting dynamic subtest: xrgb2101010-xtiled
[204.638700] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.100s)
[204.646079] Starting dynamic subtest: xrgb8888-4tiled
[204.760920] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.122s)
[204.768230] Starting dynamic subtest: rgb565-4tiled
[204.883111] Dynamic subtest rgb565-4tiled: SUCCESS (0.122s)
[204.890381] Starting dynamic subtest: xrgb2101010-4tiled
[204.995240] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.111s)
[204.997812] Subtest draw-method-mmap-cpu: SUCCESS (1.302s)
[205.066503] [039/131] (812s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[205.123408] Subtest writes-after-reads-snoop: SKIP (0.000s)
[205.185500] [040/131] (812s left) gem_exec_nop (basic-sequential)
[205.256029] Starting subtest: basic-sequential
[220.404085] Subtest basic-sequential: SUCCESS (15.154s)
[220.639828] [041/131] (797s left) drm_fdinfo (memory-info-shared)
[220.685739] Starting subtest: memory-info-shared
[220.688086] Starting dynamic subtest: smem0
[220.757748] Dynamic subtest smem0: SUCCESS (0.073s)
[220.760761] Subtest memory-info-shared: SUCCESS (0.074s)
[220.810456] [042/131] (796s left) perf (per-context-mode-unprivileged)
[220.934279] Starting subtest: per-context-mode-unprivileged
[220.938677] Subtest per-context-mode-unprivileged: SKIP (0.000s)
[220.953970] [043/131] (796s left) kms_psr (psr2-sprite-plane-onoff)
[221.050082] Starting subtest: psr2-sprite-plane-onoff
[221.052423] Starting dynamic subtest: eDP-1
[222.800456] Dynamic subtest eDP-1: SUCCESS (1.747s)
[222.802748] Subtest psr2-sprite-plane-onoff: SUCCESS (1.748s)
[223.632875] [044/131] (794s left) kms_tiled_display (basic-test-pattern)
[223.766594] Subtest basic-test-pattern: SKIP (0.000s)
[223.787734] [045/131] (793s left) kms_cursor_crc (cursor-sliding-256x85)
[224.014596] Starting subtest: cursor-sliding-256x85
[224.051486] Subtest cursor-sliding-256x85: SKIP (0.032s)
[224.224378] [046/131] (793s left) gem_mmap_gtt (basic-write-gtt)
[224.282116] Subtest basic-write-gtt: SKIP (0.000s)
[224.325024] [047/131] (793s left) gem_mmap_gtt (basic-small-bo-tiledy)
[224.371660] Subtest basic-small-bo-tiledY: SKIP (0.000s)
[224.414961] [048/131] (793s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[224.524279] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[224.528303] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[224.615715] [049/131] (793s left) kms_ccs (crc-primary-rotation-180-4-tiled-lnl-ccs)
[224.710824] Starting subtest: crc-primary-rotation-180-4-tiled-lnl-ccs
[224.714907] Subtest crc-primary-rotation-180-4-tiled-lnl-ccs: SKIP (0.000s)
[225.762382] [050/131] (792s left) gem_workarounds (reset)
[225.819613] Starting subtest: reset
[226.008592] Subtest reset: SUCCESS (0.189s)
[226.124830] [051/131] (791s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[226.227743] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[226.232237] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[226.314174] [052/131] (791s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[226.423135] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[226.425570] Starting dynamic subtest: pipe-A
[226.434894] Dynamic subtest pipe-A: SKIP (0.005s)
[226.443133] Starting dynamic subtest: pipe-B
[226.452109] Dynamic subtest pipe-B: SKIP (0.019s)
[226.461064] Starting dynamic subtest: pipe-C
[226.474241] Dynamic subtest pipe-C: SKIP (0.019s)
[226.482110] Starting dynamic subtest: pipe-D
[226.490498] Dynamic subtest pipe-D: SKIP (0.016s)
[226.494314] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.060s)
[226.575390] [053/131] (791s left) api_intel_bb (render-ccs)
[226.627780] Starting subtest: render-ccs
[226.984442] Subtest render-ccs: SUCCESS (0.356s)
[227.082349] [054/131] (790s left) gem_ctx_param (invalid-param-set)
[227.136627] Starting subtest: invalid-param-set
[227.138767] Subtest invalid-param-set: SUCCESS (0.000s)
[227.180072] [055/131] (790s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[227.288843] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[227.292821] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[227.361363] [056/131] (790s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[227.465193] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[227.467389] Starting dynamic subtest: pipe-A-eDP-1
[227.486894] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[227.495320] Starting dynamic subtest: pipe-B-eDP-1
[227.513098] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[227.520983] Starting dynamic subtest: pipe-C-eDP-1
[227.540080] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[227.547813] Starting dynamic subtest: pipe-D-eDP-1
[227.567277] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[227.569139] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.006s)
[229.624521] [057/131] (788s left) kms_chamelium_frames (dp-crc-multiple)
[230.011850] Subtest dp-crc-multiple: SKIP (0.000s)
[230.824512] [058/131] (787s left) core_auth (many-magics)
[230.883983] Starting subtest: many-magics
[231.723078] Subtest many-magics: SUCCESS (0.840s)
[231.920319] [059/131] (786s left) kms_plane_alpha_blend (constant-alpha-min)
[232.012098] Starting subtest: constant-alpha-min
[232.308242] Starting dynamic subtest: pipe-A-eDP-1
[233.010570] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.698s)
[233.021996] Starting dynamic subtest: pipe-D-eDP-1
[234.420215] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.412s)
[234.422650] Subtest constant-alpha-min: SUCCESS (2.407s)
[235.199466] [060/131] (782s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-fullscreen)
[235.301612] Starting subtest: fbc-1p-primscrn-spr-indfb-fullscreen
[238.306189] Subtest fbc-1p-primscrn-spr-indfb-fullscreen: SUCCESS (3.008s)
[238.446437] [061/131] (779s left) gem_ppgtt (shrink-vs-evict-pinned)
[238.510573] Starting subtest: shrink-vs-evict-pinned
[243.910349] Subtest shrink-vs-evict-pinned: SUCCESS (5.398s)
[243.993748] [062/131] (774s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs)
[244.051726] Starting subtest: mixed-tiled-to-y-tiled-ccs
[244.056216] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.000s)
[244.219049] [063/131] (773s left) kms_hdr (invalid-metadata-sizes)
[244.320174] Starting subtest: invalid-metadata-sizes
[244.327069] Subtest invalid-metadata-sizes: SKIP (0.000s)
[244.373106] [064/131] (773s left) gem_ctx_persistence (engines-persistence)
[244.441446] Starting subtest: engines-persistence
[244.443801] Starting dynamic subtest: rcs0
[245.292855] Dynamic subtest rcs0: SUCCESS (0.851s)
[245.304492] Starting dynamic subtest: bcs0
[246.052903] Dynamic subtest bcs0: SUCCESS (0.759s)
[246.064655] Starting dynamic subtest: vcs0
[246.844865] Dynamic subtest vcs0: SUCCESS (0.791s)
[246.857116] Starting dynamic subtest: vcs1
[247.604578] Dynamic subtest vcs1: SUCCESS (0.758s)
[247.616410] Starting dynamic subtest: vecs0
[248.375980] Dynamic subtest vecs0: SUCCESS (0.771s)
[248.386867] Starting dynamic subtest: ccs0
[249.104798] Dynamic subtest ccs0: SUCCESS (0.728s)
[249.107224] Subtest engines-persistence: SUCCESS (4.663s)
[249.217094] [065/131] (768s left) kms_prop_blob (invalid-get-prop-any)
[249.266217] Starting subtest: invalid-get-prop-any
[249.268525] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[249.343052] [066/131] (768s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[249.448322] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[249.452725] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[249.524078] [067/131] (768s left) kms_chamelium_audio (dp-audio-edid)
[249.899888] Subtest dp-audio-edid: SKIP (0.000s)
[250.723162] [068/131] (767s left) kms_psr (pr-sprite-mmap-cpu)
[250.819999] Starting subtest: pr-sprite-mmap-cpu
[250.824554] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[250.870588] [069/131] (767s left) kms_cursor_legacy (flip-vs-cursor-atomic)
[250.990272] Starting subtest: flip-vs-cursor-atomic
[257.905095] Subtest flip-vs-cursor-atomic: SUCCESS (6.915s)
[258.673141] [070/131] (759s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render)
[258.777926] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render
[263.299937] Subtest psr-1p-primscrn-spr-indfb-draw-render: SUCCESS (4.525s)
[263.436762] [071/131] (754s left) gem_exec_schedule (noreorder-corked)
[263.624234] Starting subtest: noreorder-corked
[263.626571] Starting dynamic subtest: rcs0
[264.783802] Dynamic subtest rcs0: SUCCESS (1.160s)
[264.794571] Starting dynamic subtest: vcs0
[265.980583] Dynamic subtest vcs0: SUCCESS (1.195s)
[265.995695] Starting dynamic subtest: vcs1
[267.920818] Dynamic subtest vcs1: SUCCESS (1.937s)
[267.931621] Starting dynamic subtest: vecs0
[269.910630] Dynamic subtest vecs0: SUCCESS (1.989s)
[269.920035] Starting dynamic subtest: ccs0
[271.070387] Dynamic subtest ccs0: SUCCESS (1.160s)
[271.072880] Subtest noreorder-corked: SUCCESS (7.447s)
[271.234039] [072/131] (747s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[271.350949] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[271.355166] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[271.458337] [073/131] (746s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[271.561079] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[271.563398] Starting dynamic subtest: pipe-A-eDP-1
[271.572561] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[271.582274] Starting dynamic subtest: pipe-B-eDP-1
[271.591202] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[271.599556] Starting dynamic subtest: pipe-C-eDP-1
[271.608338] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[271.616838] Starting dynamic subtest: pipe-D-eDP-1
[271.625264] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[271.629511] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.004s)
[273.664418] [074/131] (744s left) dmabuf_sync_file (import-multiple-read-write)
[273.704923] Starting subtest: import-multiple-read-write
[273.707166] Subtest import-multiple-read-write: SUCCESS (0.003s)
[273.740954] [075/131] (744s left) gem_exec_balancer (bonded-chain)
[273.806096] Starting subtest: bonded-chain
[280.670138] Subtest bonded-chain: SUCCESS (6.862s)
[280.964084] [076/131] (737s left) gem_mmap_gtt (fault-concurrent-x)
[281.017856] Subtest fault-concurrent-X: SKIP (0.000s)
[281.063754] [077/131] (737s left) syncobj_wait (invalid-reset-one-illegal-handle)
[281.120852] Starting subtest: invalid-reset-one-illegal-handle
[281.123082] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[281.199790] [078/131] (737s left) kms_force_connector_basic (prune-stale-modes)
[281.275499] Starting subtest: prune-stale-modes
[281.524573] Subtest prune-stale-modes: SKIP (0.246s)
[281.666186] [079/131] (736s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[281.763369] Starting subtest: plane-primary-toggle-with-vblank-wait
[281.765815] Starting dynamic subtest: pipe-A-eDP-1
[281.940039] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s)
[282.249632] Starting dynamic subtest: pipe-B-eDP-1
[283.172339] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.932s)
[283.462791] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.696s)
[284.283140] [080/131] (734s left) kms_histogram (global-color)
[284.383135] Starting subtest: global-color
[284.387652] Subtest global-color: SKIP (0.000s)
[284.436576] [081/131] (734s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[284.561696] Starting subtest: cursor-vs-flip-toggle
[314.908915] Subtest cursor-vs-flip-toggle: SUCCESS (30.346s)
[315.679440] [082/131] (702s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[315.788388] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[315.792737] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[315.879107] [083/131] (702s left) kms_addfb_basic (bad-pitch-32)
[315.927805] Starting subtest: bad-pitch-32
[315.930240] Subtest bad-pitch-32: SUCCESS (0.000s)
[316.068174] [084/131] (702s left) gem_exec_schedule (semaphore-resolve)
[316.145479] Starting subtest: semaphore-resolve
[316.170618] Subtest semaphore-resolve: SUCCESS (0.034s)
[316.491297] [085/131] (702s left) vgem_basic (mmap)
[316.532023] Starting subtest: mmap
[316.546340] Subtest mmap: SUCCESS (0.017s)
[316.581370] [086/131] (701s left) gem_mmap_wc (write-cpu-read-wc-unflushed)
[316.642250] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s)
[316.687896] [087/131] (701s left) gem_workarounds (suspend-resume-context)
[316.760364] Starting subtest: suspend-resume-context
[332.795253] Subtest suspend-resume-context: SUCCESS (1.184s)
[332.913795] [088/131] (700s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[332.985744] Starting subtest: map-fixed-invalidate-overlap
[332.990001] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[333.094646] [089/131] (700s left) syncobj_timeline (etime-single-wait-available-unsubmitted)
[333.156845] Starting subtest: etime-single-wait-available-unsubmitted
[333.263827] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.107s)
[333.319724] [090/131] (700s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[333.419534] Starting subtest: fbc-pr-cursor-mmap-cpu
[333.423822] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[333.471981] [091/131] (700s left) syncobj_basic (bad-flags-fd-to-handle)
[333.543722] Starting subtest: bad-flags-fd-to-handle
[333.545680] Subtest bad-flags-fd-to-handle: SUCCESS (0.000s)
[333.643042] [092/131] (699s left) gem_set_tiling_vs_blt (tiled-to-tiled)
[333.707390] Subtest tiled-to-tiled: SKIP (0.000s)
[333.764347] [093/131] (699s left) kms_cursor_crc (cursor-dpms)
[333.881178] Starting subtest: cursor-dpms
[333.883380] Starting dynamic subtest: pipe-A-eDP-1
[336.757161] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.957s)
[336.768562] Starting dynamic subtest: pipe-D-eDP-1
[340.295196] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.603s)
[340.297505] Subtest cursor-dpms: SUCCESS (6.562s)
[341.069668] [094/131] (692s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[341.175540] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[346.256245] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (5.134s)
[346.362520] [095/131] (686s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-mmap-cpu)
[346.469011] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-mmap-cpu
[349.327609] Subtest fbc-1p-offscren-pri-shrfb-draw-mmap-cpu: SUCCESS (2.878s)
[349.421626] [096/131] (683s left) sysfs_preempt_timeout (invalid)
[349.486556] Starting subtest: invalid
[349.488889] Starting dynamic subtest: vecs0
[349.491254] Dynamic subtest vecs0: SUCCESS (0.000s)
[349.501703] Starting dynamic subtest: ccs0
[349.503596] Dynamic subtest ccs0: SUCCESS (0.000s)
[349.512331] Starting dynamic subtest: vcs0
[349.514228] Dynamic subtest vcs0: SUCCESS (0.000s)
[349.522949] Starting dynamic subtest: bcs0
[349.524912] Dynamic subtest bcs0: SUCCESS (0.000s)
[349.534067] Starting dynamic subtest: rcs0
[349.536026] Dynamic subtest rcs0: SUCCESS (0.000s)
[349.544497] Starting dynamic subtest: vcs1
[349.546398] Dynamic subtest vcs1: SUCCESS (0.000s)
[349.548324] Subtest invalid: SUCCESS (0.005s)
[349.591114] [097/131] (683s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[349.655093] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[349.702711] [098/131] (683s left) gem_render_linear_blits (basic)
[349.766848] Starting subtest: basic
[349.787891] Subtest basic: SUCCESS (0.021s)
[349.850455] [099/131] (683s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[349.908760] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[350.016308] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.107s)
[350.073740] [100/131] (683s left) drm_read (short-buffer-nonblock)
[350.226163] Starting subtest: short-buffer-nonblock
[350.228442] Subtest short-buffer-nonblock: SUCCESS (0.000s)
[350.342933] [101/131] (683s left) gem_mmap_offset (open-flood)
[350.406894] Starting subtest: open-flood
[371.871111] Subtest open-flood: SUCCESS (21.494s)
[371.968036] [102/131] (661s left) gen3_render_mixed_blits
[372.059606] [103/131] (661s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[372.160540] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[372.162610] Starting dynamic subtest: pipe-A-default-mode
[373.294486] Dynamic subtest pipe-A-default-mode: SKIP (1.130s)
[373.299202] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.132s)
[373.441737] [104/131] (660s left) kms_vblank (wait-forked-busy)
[373.543386] Starting subtest: wait-forked-busy
[373.545748] Starting dynamic subtest: pipe-A-eDP-1
[375.419511] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.874s)
[375.433539] Starting dynamic subtest: pipe-D-eDP-1
[378.020666] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.597s)
[378.022927] Subtest wait-forked-busy: SUCCESS (4.475s)
[378.862281] [105/131] (654s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[378.968865] Starting subtest: 4-tiled-8bpp-rotate-180
[379.956574] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (0.989s)
[380.073932] [106/131] (653s left) kms_properties (crtc-properties-legacy)
[380.166338] Starting subtest: crtc-properties-legacy
[380.168649] Starting dynamic subtest: pipe-A-eDP-1
[380.601120] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.433s)
[380.611143] Starting dynamic subtest: pipe-B-eDP-1
[381.714183] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.113s)
[381.724720] Starting dynamic subtest: pipe-C-eDP-1
[382.891702] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.175s)
[382.902070] Starting dynamic subtest: pipe-D-eDP-1
[383.990917] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.098s)
[383.993208] Subtest crtc-properties-legacy: SUCCESS (3.824s)
[384.759961] [107/131] (648s left) kms_flip (blocking-wf_vblank)
[384.865483] Starting subtest: blocking-wf_vblank
[384.867862] Starting dynamic subtest: A-eDP1
[393.797050] Dynamic subtest A-eDP1: SUCCESS (8.933s)
[393.806733] Starting dynamic subtest: B-eDP1
[402.691912] Dynamic subtest B-eDP1: SUCCESS (8.896s)
[402.701199] Starting dynamic subtest: C-eDP1
[411.580577] Dynamic subtest C-eDP1: SUCCESS (8.889s)
[411.590495] Starting dynamic subtest: D-eDP1
[420.472947] Dynamic subtest D-eDP1: SUCCESS (8.896s)
[420.475332] Subtest blocking-wf_vblank: SUCCESS (35.622s)
[421.645630] [108/131] (611s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[421.754639] Starting subtest: 4-tiled-32bpp-rotate-270
[421.773969] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.019s)
[421.879312] [109/131] (611s left) kms_psr (fbc-psr-cursor-render)
[421.969074] Starting subtest: fbc-psr-cursor-render
[421.971371] Starting dynamic subtest: eDP-1
[421.975692] Dynamic subtest eDP-1: SKIP (0.000s)
[421.979753] Subtest fbc-psr-cursor-render: SKIP (0.001s)
[422.026429] [110/131] (611s left) intel_hwmon (hwmon-read)
[422.080894] Subtest hwmon-read: SKIP (0.000s)
[422.124564] [111/131] (611s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[422.238973] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[427.093742] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (4.859s)
[427.176499] [112/131] (606s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[427.278894] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[432.398378] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (5.120s)
[432.548320] [113/131] (601s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[437.630730] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area
[437.633090] Starting dynamic subtest: pipe-A-eDP-1
[438.410993] Dynamic subtest pipe-A-eDP-1: SKIP (0.773s)
[438.420757] Starting dynamic subtest: pipe-B-eDP-1
[439.513442] Dynamic subtest pipe-B-eDP-1: SKIP (1.101s)
[439.517918] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.879s)
[440.747449] [114/131] (592s left) kms_chamelium_color (ctm-max)
[440.849398] Subtest ctm-max: SKIP (0.000s)
[440.874799] [115/131] (592s left) kms_addfb_basic (unused-offsets)
[440.926961] Starting subtest: unused-offsets
[440.929358] Subtest unused-offsets: SUCCESS (0.000s)
[441.049780] [116/131] (592s left) gen9_exec_parse (cmd-crossing-page)
[441.111664] Subtest cmd-crossing-page: SKIP (0.000s)
[441.177592] [117/131] (592s left) perf_pmu (busy-idle-check-all)
[441.222489] Starting subtest: busy-idle-check-all
[441.224427] Starting dynamic subtest: rcs0
[441.911355] Dynamic subtest rcs0: SUCCESS (0.691s)
[441.923570] Starting dynamic subtest: bcs0
[442.561770] Dynamic subtest bcs0: SUCCESS (0.649s)
[442.573894] Starting dynamic subtest: vcs0
[443.271187] Dynamic subtest vcs0: FAIL (0.624s)
[443.281705] Starting dynamic subtest: vcs1
[443.889942] Dynamic subtest vcs1: FAIL (0.620s)
[443.901197] Starting dynamic subtest: vecs0
[444.517121] Dynamic subtest vecs0: FAIL (0.626s)
[444.527526] Starting dynamic subtest: ccs0
[445.144706] Dynamic subtest ccs0: FAIL (0.626s)
[445.146762] Subtest busy-idle-check-all: FAIL (3.842s)
[445.859947] [118/131] (587s left) kms_plane_scaling (plane-downscale-factor-0-25-with-rotation)
[445.969348] Starting subtest: plane-downscale-factor-0-25-with-rotation
[445.971647] Starting dynamic subtest: pipe-A
[445.986723] Dynamic subtest pipe-A: SKIP (0.011s)
[445.996786] Starting dynamic subtest: pipe-B
[446.010054] Dynamic subtest pipe-B: SKIP (0.021s)
[446.020921] Starting dynamic subtest: pipe-C
[446.029857] Dynamic subtest pipe-C: SKIP (0.022s)
[446.040706] Starting dynamic subtest: pipe-D
[446.056854] Dynamic subtest pipe-D: SKIP (0.025s)
[446.060580] Subtest plane-downscale-factor-0-25-with-rotation: SKIP (0.083s)
[446.143244] [119/131] (587s left) syncobj_timeline (multi-wait-all-signaled)
[446.206911] Starting subtest: multi-wait-all-signaled
[446.209072] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[446.297699] [120/131] (587s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-render)
[446.399033] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-render
[446.403088] Subtest fbc-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[446.486585] [121/131] (587s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[446.611063] Starting subtest: basic-flip-before-cursor-varying-size
[447.552357] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.941s)
[448.347625] [122/131] (585s left) kms_pm_rpm (modeset-lpsp-stress)
[449.973521] Starting subtest: modeset-lpsp-stress
[466.814952] Subtest modeset-lpsp-stress: SUCCESS (16.839s)
[466.894325] [123/131] (566s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal
[466.953439] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled
[467.055161] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.102s)
[467.113319] [124/131] (566s left) kms_cursor_crc (cursor-onscreen-256x85)
[467.345872] Starting subtest: cursor-onscreen-256x85
[467.383234] Subtest cursor-onscreen-256x85: SKIP (0.032s)
[467.528144] [125/131] (566s left) api_intel_allocator (fork-simple-once)
[467.590562] Starting subtest: fork-simple-once
[467.608161] Subtest fork-simple-once: SUCCESS (0.020s)
[467.722906] [126/131] (566s left) gem_exec_flush (basic-wb-ro-default)
[467.783921] Starting subtest: basic-wb-ro-default
[473.268606] Subtest basic-wb-ro-default: SUCCESS (5.485s)
[473.439156] [127/131] (560s left) i915_module_load (resize-bar)
[473.472850] Starting subtest: resize-bar
[473.479813] Subtest resize-bar: SKIP (0.005s)
[473.514260] [128/131] (560s left) gem_userptr_blits (probe)
[473.582603] Starting subtest: probe
[473.681633] Subtest probe: SUCCESS (0.098s)
[473.793361] [129/131] (560s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[473.901807] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[473.906258] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[473.986873] [130/131] (560s left) gem_exec_big (single)
[474.046102] Starting subtest: single
[476.542239] Subtest single: SUCCESS (2.496s)
[476.744115] [131/131] (557s left) kms_frontbuffer_tracking (fbc-rgb565-draw-render)
[476.895693] Starting subtest: fbc-rgb565-draw-render
[480.069248] Subtest fbc-rgb565-draw-render: SUCCESS (3.177s)
[480.185343] Closing watchdogs
Done.