[55.865433] Initializing watchdogs
[55.865481]   /dev/watchdog0
[55.879787] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[55.883977] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[55.886303] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[55.889926] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[56.012017] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[56.016291] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[56.114233] [002/133] (960s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[56.207360] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[56.211438] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[56.311093] [003/133] (960s left) syncobj_timeline (etime-single-wait-for-submit-submitted)
[56.373964] Starting subtest: etime-single-wait-for-submit-submitted
[56.478571] Subtest etime-single-wait-for-submit-submitted: SUCCESS (0.104s)
[56.550102] [004/133] (959s left) kms_debugfs (display-off-read-all)
[56.634828] Starting subtest: display-off-read-all
[56.933709] Subtest display-off-read-all: SUCCESS (0.299s)
[57.757214] [005/133] (958s left) gem_fenced_exec_thrash (no-spare-fences)
[57.826529] Subtest no-spare-fences: SKIP (0.000s)
[57.886043] [006/133] (958s left) gem_exec_balancer (full-late-pulse)
[57.949801] Starting subtest: full-late-pulse
[62.160959] Subtest full-late-pulse: SUCCESS (4.216s)
[62.485565] [007/133] (954s left) kms_chamelium_color (ctm-green-to-red)
[62.582386] Subtest ctm-green-to-red: SKIP (0.000s)
[62.624729] [008/133] (954s left) kms_psr (fbc-psr-cursor-plane-move)
[62.724029] Starting subtest: fbc-psr-cursor-plane-move
[62.726237] Starting dynamic subtest: eDP-1
[62.730219] Dynamic subtest eDP-1: SKIP (0.000s)
[62.734126] Subtest fbc-psr-cursor-plane-move: SKIP (0.000s)
[62.790524] [009/133] (953s left) gem_pxp (fail-invalid-protected-context)
[62.914453] Starting subtest: fail-invalid-protected-context
[62.916678] Subtest fail-invalid-protected-context: SUCCESS (0.000s)
[63.026700] [010/133] (953s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[63.120245] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[64.130343] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.012s)
[64.238315] [011/133] (952s left) kms_plane_multiple (2x-tiling-4)
[64.330834] Starting subtest: 2x-tiling-4
[64.334697] Subtest 2x-tiling-4: SKIP (0.000s)
[64.397807] [012/133] (952s left) sysfs_defaults (readonly)
[64.454036] Starting subtest: readonly
[64.456020] Starting dynamic subtest: vecs0
[64.457946] Dynamic subtest vecs0: SUCCESS (0.000s)
[64.465953] Starting dynamic subtest: ccs0
[64.467833] Dynamic subtest ccs0: SUCCESS (0.000s)
[64.474661] Starting dynamic subtest: vcs0
[64.476530] Dynamic subtest vcs0: SUCCESS (0.000s)
[64.483234] Starting dynamic subtest: bcs0
[64.485045] Dynamic subtest bcs0: SUCCESS (0.000s)
[64.492358] Starting dynamic subtest: rcs0
[64.493983] Dynamic subtest rcs0: SUCCESS (0.000s)
[64.500571] Starting dynamic subtest: vcs1
[64.502589] Dynamic subtest vcs1: SUCCESS (0.000s)
[64.504483] Subtest readonly: SUCCESS (0.003s)
[64.544788] [013/133] (952s left) gem_exec_schedule (preempt-other-chain)
[64.606847] Starting subtest: preempt-other-chain
[64.608628] Starting dynamic subtest: rcs0
[64.690951] Dynamic subtest rcs0: SUCCESS (0.089s)
[64.698995] Starting dynamic subtest: bcs0
[64.770256] Dynamic subtest bcs0: SUCCESS (0.079s)
[64.782654] Starting dynamic subtest: vcs0
[64.847125] Dynamic subtest vcs0: SUCCESS (0.077s)
[64.860690] Starting dynamic subtest: vcs1
[64.922992] Dynamic subtest vcs1: SUCCESS (0.076s)
[64.932248] Starting dynamic subtest: vecs0
[65.002179] Dynamic subtest vecs0: SUCCESS (0.079s)
[65.014248] Starting dynamic subtest: ccs0
[65.080918] Dynamic subtest ccs0: SUCCESS (0.079s)
[65.083160] Subtest preempt-other-chain: SUCCESS (0.480s)
[66.404948] [014/133] (950s left) kms_vblank (wait-idle)
[66.491082] Starting subtest: wait-idle
[66.493447] Starting dynamic subtest: pipe-A-eDP-1
[68.266425] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.769s)
[68.278341] Starting dynamic subtest: pipe-D-eDP-1
[70.693212] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.431s)
[70.695158] Subtest wait-idle: SUCCESS (4.203s)
[71.503472] [015/133] (945s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[71.604213] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[71.607255] Starting dynamic subtest: pipe-A-eDP-1
[103.670067] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.127s)
[103.679569] Starting dynamic subtest: pipe-B-eDP-1
[136.607060] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.684s)
[136.616683] Starting dynamic subtest: pipe-C-eDP-1
[169.594567] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.609s)
[169.603615] Starting dynamic subtest: pipe-D-eDP-1
[202.610757] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.669s)
[202.613049] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SUCCESS (15.091s)
[203.840740] [016/133] (813s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs)
[203.945280] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs
[203.949779] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s)
[205.053208] [017/133] (811s left) kms_big_fb (linear-32bpp-rotate-180)
[205.167747] Starting subtest: linear-32bpp-rotate-180
[206.686870] Subtest linear-32bpp-rotate-180: SUCCESS (1.524s)
[206.805810] [018/133] (810s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[206.905917] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[206.907953] Starting dynamic subtest: pipe-A
[207.018128] Dynamic subtest pipe-A: SKIP (0.110s)
[207.028904] Starting dynamic subtest: pipe-B
[208.213342] Dynamic subtest pipe-B: SKIP (1.198s)
[208.223428] Starting dynamic subtest: pipe-C
[209.364181] Dynamic subtest pipe-C: SUCCESS (1.158s)
[209.372918] Starting dynamic subtest: pipe-D
[210.594182] Dynamic subtest pipe-D: SUCCESS (1.231s)
[210.596524] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.699s)
[211.798151] [019/133] (805s left) gem_mmap_gtt (basic-small-copy)
[211.861583] Subtest basic-small-copy: SKIP (0.000s)
[211.914901] [020/133] (805s left) i915_pm_rc6_residency (rc6-accuracy)
[211.972613] Starting subtest: rc6-accuracy
[211.974721] Starting dynamic subtest: gt0
[215.146794] Dynamic subtest gt0: SUCCESS (3.174s)
[215.157218] Starting dynamic subtest: gt1
[218.317902] Dynamic subtest gt1: SUCCESS (3.172s)
[218.322129] Subtest rc6-accuracy: SUCCESS (6.351s)
[218.392721] [021/133] (798s left) kms_prop_blob (invalid-set-prop-any)
[218.440779] Starting subtest: invalid-set-prop-any
[218.442984] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[218.522305] [022/133] (798s left) prime_mmap (test_map_unmap)
[218.583172] Starting subtest: test_map_unmap
[218.585489] Starting dynamic subtest: test_map_unmap-smem
[218.612978] Dynamic subtest test_map_unmap-smem: SUCCESS (0.031s)
[218.615626] Subtest test_map_unmap: SUCCESS (0.031s)
[218.726435] [023/133] (798s left) syncobj_wait (reset-multiple-signaled)
[218.777354] Starting subtest: reset-multiple-signaled
[218.779645] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[218.889182] [024/133] (798s left) gem_blits (basic)
[218.950562] Starting subtest: basic
[221.065111] Subtest basic: SUCCESS (2.115s)
[221.190143] [025/133] (796s left) template (a)
[221.254042] Starting subtest: A
[221.256224] Subtest A: SUCCESS (0.000s)
[221.341792] [026/133] (796s left) kms_pipe_crc_basic (hang-read-crc)
[221.441074] Starting subtest: hang-read-crc
[221.443542] Starting dynamic subtest: pipe-A-eDP-1
[223.552628] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.113s)
[223.562945] Starting dynamic subtest: pipe-B-eDP-1
[226.328081] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.777s)
[226.338689] Starting dynamic subtest: pipe-C-eDP-1
[228.950162] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.621s)
[228.962285] Starting dynamic subtest: pipe-D-eDP-1
[231.620062] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.672s)
[231.622500] Subtest hang-read-crc: SUCCESS (10.188s)
[232.453584] [027/133] (784s left) kms_flip_tiling (flip-change-tiling)
[232.544141] Starting subtest: flip-change-tiling
[232.546653] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs
[232.705048] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (0.162s)
[232.716872] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs
[232.839761] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.132s)
[232.852094] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[232.983891] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.142s)
[232.996283] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4
[233.127203] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4: SUCCESS (0.142s)
[233.138715] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-x
[233.271042] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-x: SUCCESS (0.142s)
[233.284027] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-linear
[233.416053] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.143s)
[233.433174] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs
[233.549341] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.131s)
[233.563135] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs
[233.660339] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.109s)
[233.673156] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[233.794813] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.132s)
[233.807873] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4
[233.937655] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4: SUCCESS (0.143s)
[233.950812] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-x
[234.081844] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-x: SUCCESS (0.142s)
[234.094792] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-linear
[234.237191] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.154s)
[234.249736] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[234.371233] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.132s)
[234.383495] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[234.505092] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.131s)
[234.517573] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[234.615321] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.109s)
[234.627125] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4
[234.759415] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.143s)
[234.772775] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-x
[234.903851] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.143s)
[234.916399] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-linear
[235.048072] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.143s)
[235.063726] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-mc-ccs
[235.192128] Dynamic subtest pipe-A-eDP-1-4-to-4-mc-ccs: SUCCESS (0.143s)
[235.204260] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs
[235.325840] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs: SUCCESS (0.132s)
[235.338607] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs-cc
[235.459012] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.131s)
[235.471828] Starting dynamic subtest: pipe-A-eDP-1-4-to-4
[235.580763] Dynamic subtest pipe-A-eDP-1-4-to-4: SUCCESS (0.120s)
[235.593226] Starting dynamic subtest: pipe-A-eDP-1-4-to-x
[235.752569] Dynamic subtest pipe-A-eDP-1-4-to-x: SUCCESS (0.170s)
[235.767284] Starting dynamic subtest: pipe-A-eDP-1-4-to-linear
[235.896714] Dynamic subtest pipe-A-eDP-1-4-to-linear: SUCCESS (0.143s)
[235.907799] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-mc-ccs
[236.041365] Dynamic subtest pipe-A-eDP-1-x-to-4-mc-ccs: SUCCESS (0.143s)
[236.053698] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs
[236.185585] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs: SUCCESS (0.142s)
[236.198823] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs-cc
[236.329665] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.143s)
[236.340261] Starting dynamic subtest: pipe-A-eDP-1-x-to-4
[236.485628] Dynamic subtest pipe-A-eDP-1-x-to-4: SUCCESS (0.154s)
[236.496910] Starting dynamic subtest: pipe-A-eDP-1-x-to-x
[236.607537] Dynamic subtest pipe-A-eDP-1-x-to-x: SUCCESS (0.120s)
[236.619740] Starting dynamic subtest: pipe-A-eDP-1-x-to-linear
[236.763369] Dynamic subtest pipe-A-eDP-1-x-to-linear: SUCCESS (0.154s)
[236.775686] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-mc-ccs
[236.896500] Dynamic subtest pipe-A-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.131s)
[236.908978] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs
[237.029146] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.131s)
[237.041772] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs-cc
[237.174443] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.143s)
[237.185442] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4
[237.318216] Dynamic subtest pipe-A-eDP-1-linear-to-4: SUCCESS (0.143s)
[237.331014] Starting dynamic subtest: pipe-A-eDP-1-linear-to-x
[237.462629] Dynamic subtest pipe-A-eDP-1-linear-to-x: SUCCESS (0.143s)
[237.474392] Starting dynamic subtest: pipe-A-eDP-1-linear-to-linear
[237.584902] Dynamic subtest pipe-A-eDP-1-linear-to-linear: SUCCESS (0.121s)
[237.639168] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs
[238.829025] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.198s)
[238.841928] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs
[238.963289] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.132s)
[238.976150] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[239.107260] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.142s)
[239.117651] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4
[239.239376] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4: SUCCESS (0.131s)
[239.251696] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-x
[239.383487] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-x: SUCCESS (0.143s)
[239.395708] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-linear
[239.528508] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.142s)
[239.543971] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs
[239.661968] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.131s)
[239.674430] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs
[239.772924] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.109s)
[239.785340] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[239.918686] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.143s)
[239.932762] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4
[240.061639] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4: SUCCESS (0.141s)
[240.074907] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-x
[240.205396] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-x: SUCCESS (0.143s)
[240.217976] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-linear
[240.349580] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.143s)
[240.361270] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[240.483492] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.132s)
[240.496380] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[240.618025] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.131s)
[240.629013] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[240.729223] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.109s)
[240.741954] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4
[240.872243] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.143s)
[240.885067] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-x
[241.015860] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.143s)
[241.028657] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-linear
[241.160208] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.143s)
[241.175646] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-mc-ccs
[241.305377] Dynamic subtest pipe-B-eDP-1-4-to-4-mc-ccs: SUCCESS (0.140s)
[241.317924] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs
[241.449557] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs: SUCCESS (0.143s)
[241.462345] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs-cc
[241.583037] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.132s)
[241.596023] Starting dynamic subtest: pipe-B-eDP-1-4-to-4
[241.716023] Dynamic subtest pipe-B-eDP-1-4-to-4: SUCCESS (0.131s)
[241.728732] Starting dynamic subtest: pipe-B-eDP-1-4-to-x
[241.859933] Dynamic subtest pipe-B-eDP-1-4-to-x: SUCCESS (0.143s)
[241.872408] Starting dynamic subtest: pipe-B-eDP-1-4-to-linear
[242.004211] Dynamic subtest pipe-B-eDP-1-4-to-linear: SUCCESS (0.143s)
[242.016788] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-mc-ccs
[242.148288] Dynamic subtest pipe-B-eDP-1-x-to-4-mc-ccs: SUCCESS (0.143s)
[242.160495] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs
[242.282042] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs: SUCCESS (0.131s)
[242.299156] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs-cc
[242.426402] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.143s)
[242.438520] Starting dynamic subtest: pipe-B-eDP-1-x-to-4
[242.570922] Dynamic subtest pipe-B-eDP-1-x-to-4: SUCCESS (0.142s)
[242.583125] Starting dynamic subtest: pipe-B-eDP-1-x-to-x
[242.692384] Dynamic subtest pipe-B-eDP-1-x-to-x: SUCCESS (0.121s)
[242.705055] Starting dynamic subtest: pipe-B-eDP-1-x-to-linear
[242.837527] Dynamic subtest pipe-B-eDP-1-x-to-linear: SUCCESS (0.143s)
[242.849922] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-mc-ccs
[242.981467] Dynamic subtest pipe-B-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.143s)
[242.994095] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs
[243.125853] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.143s)
[243.138544] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs-cc
[243.270701] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s)
[243.283079] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4
[243.414701] Dynamic subtest pipe-B-eDP-1-linear-to-4: SUCCESS (0.142s)
[243.427188] Starting dynamic subtest: pipe-B-eDP-1-linear-to-x
[243.559094] Dynamic subtest pipe-B-eDP-1-linear-to-x: SUCCESS (0.143s)
[243.573497] Starting dynamic subtest: pipe-B-eDP-1-linear-to-linear
[243.681060] Dynamic subtest pipe-B-eDP-1-linear-to-linear: SUCCESS (0.120s)
[243.733544] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs
[244.966232] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.240s)
[244.978801] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs
[245.077206] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.109s)
[245.088378] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[245.177893] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[245.190273] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4
[245.288602] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4: SUCCESS (0.109s)
[245.300283] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-x
[245.399046] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-x: SUCCESS (0.109s)
[245.410251] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-linear
[245.510092] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.110s)
[245.521930] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs
[245.620987] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.109s)
[245.634036] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs
[245.721795] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[245.734213] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[245.821683] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[245.834232] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4
[245.920830] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4: SUCCESS (0.099s)
[245.933195] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-x
[246.031335] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-x: SUCCESS (0.109s)
[246.043180] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-linear
[246.142703] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.110s)
[246.154611] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[246.242991] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.099s)
[246.254673] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[246.342975] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.099s)
[246.354616] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[246.442738] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s)
[246.454005] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4
[246.553811] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.110s)
[246.565180] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-x
[246.664687] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.109s)
[246.676075] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-linear
[246.764523] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.099s)
[246.775961] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-mc-ccs
[246.864591] Dynamic subtest pipe-C-eDP-1-4-to-4-mc-ccs: SUCCESS (0.099s)
[246.878400] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs
[246.965019] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs: SUCCESS (0.098s)
[246.979844] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs-cc
[247.075897] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.110s)
[247.087983] Starting dynamic subtest: pipe-C-eDP-1-4-to-4
[247.198249] Dynamic subtest pipe-C-eDP-1-4-to-4: SUCCESS (0.120s)
[247.210497] Starting dynamic subtest: pipe-C-eDP-1-4-to-x
[247.308557] Dynamic subtest pipe-C-eDP-1-4-to-x: SUCCESS (0.109s)
[247.319512] Starting dynamic subtest: pipe-C-eDP-1-4-to-linear
[247.420437] Dynamic subtest pipe-C-eDP-1-4-to-linear: SUCCESS (0.110s)
[247.434111] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-mc-ccs
[247.531069] Dynamic subtest pipe-C-eDP-1-x-to-4-mc-ccs: SUCCESS (0.109s)
[247.542018] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs
[247.630629] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs: SUCCESS (0.099s)
[247.641974] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs-cc
[247.742353] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.110s)
[247.758546] Starting dynamic subtest: pipe-C-eDP-1-x-to-4
[247.853386] Dynamic subtest pipe-C-eDP-1-x-to-4: SUCCESS (0.109s)
[247.868052] Starting dynamic subtest: pipe-C-eDP-1-x-to-x
[247.974890] Dynamic subtest pipe-C-eDP-1-x-to-x: SUCCESS (0.119s)
[247.986992] Starting dynamic subtest: pipe-C-eDP-1-x-to-linear
[248.086337] Dynamic subtest pipe-C-eDP-1-x-to-linear: SUCCESS (0.109s)
[248.098227] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-mc-ccs
[248.197184] Dynamic subtest pipe-C-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.109s)
[248.209346] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs
[248.296891] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.098s)
[248.309069] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs-cc
[248.408030] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.110s)
[248.420163] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4
[248.519046] Dynamic subtest pipe-C-eDP-1-linear-to-4: SUCCESS (0.109s)
[248.530439] Starting dynamic subtest: pipe-C-eDP-1-linear-to-x
[248.630838] Dynamic subtest pipe-C-eDP-1-linear-to-x: SUCCESS (0.110s)
[248.642309] Starting dynamic subtest: pipe-C-eDP-1-linear-to-linear
[248.741885] Dynamic subtest pipe-C-eDP-1-linear-to-linear: SUCCESS (0.109s)
[248.788893] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs
[249.993313] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.216s)
[250.005118] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs
[250.104551] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.109s)
[250.116968] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[250.204305] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[250.216291] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4
[250.315247] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4: SUCCESS (0.110s)
[250.327835] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-x
[250.425666] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-x: SUCCESS (0.110s)
[250.437363] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-linear
[250.525623] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.099s)
[250.537324] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs
[250.626337] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.099s)
[250.638252] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs
[250.726275] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[250.736710] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[250.826198] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[250.836726] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4
[250.936851] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4: SUCCESS (0.109s)
[250.947252] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-x
[251.049457] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-x: SUCCESS (0.109s)
[251.059045] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-linear
[251.158266] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.110s)
[251.169838] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[251.258337] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.099s)
[251.269539] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[251.358517] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.098s)
[251.370101] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[251.458343] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s)
[251.470093] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4
[251.569418] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.109s)
[251.580387] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-x
[251.680455] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.109s)
[251.691836] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-linear
[251.780531] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.098s)
[251.792115] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-mc-ccs
[251.880667] Dynamic subtest pipe-D-eDP-1-4-to-4-mc-ccs: SUCCESS (0.099s)
[251.892519] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs
[251.991927] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs: SUCCESS (0.109s)
[252.004557] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs-cc
[252.091854] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.098s)
[252.103843] Starting dynamic subtest: pipe-D-eDP-1-4-to-4
[252.202712] Dynamic subtest pipe-D-eDP-1-4-to-4: SUCCESS (0.110s)
[252.213240] Starting dynamic subtest: pipe-D-eDP-1-4-to-x
[252.313403] Dynamic subtest pipe-D-eDP-1-4-to-x: SUCCESS (0.109s)
[252.323575] Starting dynamic subtest: pipe-D-eDP-1-4-to-linear
[252.424368] Dynamic subtest pipe-D-eDP-1-4-to-linear: SUCCESS (0.109s)
[252.437134] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-mc-ccs
[252.574066] Dynamic subtest pipe-D-eDP-1-x-to-4-mc-ccs: SUCCESS (0.148s)
[252.585112] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs
[252.685499] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs: SUCCESS (0.109s)
[252.701735] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs-cc
[252.807325] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.120s)
[252.817093] Starting dynamic subtest: pipe-D-eDP-1-x-to-4
[252.929553] Dynamic subtest pipe-D-eDP-1-x-to-4: SUCCESS (0.121s)
[252.941250] Starting dynamic subtest: pipe-D-eDP-1-x-to-x
[253.040826] Dynamic subtest pipe-D-eDP-1-x-to-x: SUCCESS (0.109s)
[253.053177] Starting dynamic subtest: pipe-D-eDP-1-x-to-linear
[253.163044] Dynamic subtest pipe-D-eDP-1-x-to-linear: SUCCESS (0.120s)
[253.174539] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-mc-ccs
[253.273824] Dynamic subtest pipe-D-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.109s)
[253.285640] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs
[253.373675] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.099s)
[253.387882] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs-cc
[253.495829] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.120s)
[253.507653] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4
[253.606922] Dynamic subtest pipe-D-eDP-1-linear-to-4: SUCCESS (0.109s)
[253.617292] Starting dynamic subtest: pipe-D-eDP-1-linear-to-x
[253.718095] Dynamic subtest pipe-D-eDP-1-linear-to-x: SUCCESS (0.110s)
[253.730344] Starting dynamic subtest: pipe-D-eDP-1-linear-to-linear
[253.840577] Dynamic subtest pipe-D-eDP-1-linear-to-linear: SUCCESS (0.120s)
[253.873197] Subtest flip-change-tiling: SUCCESS (21.343s)
[255.094263] [028/133] (762s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt)
[255.191053] Starting subtest: fbcpsr-rgb101010-draw-blt
[261.969904] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (6.786s)
[262.120054] [029/133] (755s left) gem_softpin (evict-active)
[262.170473] Starting subtest: evict-active
[262.176973] Subtest evict-active: SUCCESS (0.006s)
[262.310431] [030/133] (755s left) kms_flip (flip-vs-panning-vs-hang)
[262.407858] Starting subtest: flip-vs-panning-vs-hang
[262.410613] Starting dynamic subtest: A-eDP1
[313.765336] Dynamic subtest A-eDP1: SUCCESS (51.389s)
[313.777138] Starting dynamic subtest: D-eDP1
[362.729092] Dynamic subtest D-eDP1: SUCCESS (48.986s)
[362.731383] Subtest flip-vs-panning-vs-hang: SUCCESS (100.380s)
[363.879226] [031/133] (653s left) perf_pmu (faulting-read)
[363.919153] Starting subtest: faulting-read
[363.921339] Starting dynamic subtest: wb
[363.923676] Dynamic subtest wb: SUCCESS (0.001s)
[363.932836] Starting dynamic subtest: wc
[363.934667] Dynamic subtest wc: SUCCESS (0.000s)
[363.943243] Starting dynamic subtest: uc
[363.945089] Dynamic subtest uc: SUCCESS (0.000s)
[363.946906] Subtest faulting-read: SUCCESS (0.003s)
[364.023291] [032/133] (653s left) gem_ctx_exec (basic-norecovery)
[364.091860] Starting subtest: basic-norecovery
[364.388403] Subtest basic-norecovery: SUCCESS (0.298s)
[364.533912] [033/133] (653s left) kms_psr (fbc-psr2-cursor-render)
[364.621096] Starting subtest: fbc-psr2-cursor-render
[364.623367] Starting dynamic subtest: eDP-1
[364.627777] Dynamic subtest eDP-1: SKIP (0.000s)
[364.632242] Subtest fbc-psr2-cursor-render: SKIP (0.001s)
[364.690076] [034/133] (652s left) kms_hdr (bpc-switch)
[364.780202] Starting subtest: bpc-switch
[365.852053] Starting dynamic subtest: pipe-A-eDP-1
[369.245483] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.398s)
[369.247859] Subtest bpc-switch: SUCCESS (4.470s)
[369.358298] [035/133] (648s left) gem_ctx_exec (basic-invalid-context)
[369.425454] Starting subtest: basic-invalid-context
[369.427788] Subtest basic-invalid-context: SUCCESS (0.005s)
[369.571234] [036/133] (648s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[369.666151] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[369.668373] Starting dynamic subtest: pipe-A-default-mode
[372.466441] Dynamic subtest pipe-A-default-mode: SUCCESS (2.803s)
[372.468826] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.804s)
[373.292164] [037/133] (644s left) gem_exec_reloc (basic-wc-noreloc)
[373.358304] Subtest basic-wc-noreloc: SKIP (0.000s)
[373.417068] [038/133] (644s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[373.522758] Starting subtest: fbc-rgb565-draw-pwrite
[378.073075] Subtest fbc-rgb565-draw-pwrite: SUCCESS (4.556s)
[379.202415] [039/133] (638s left) kms_cursor_edge_walk (128x128-top-edge)
[379.292208] Starting subtest: 128x128-top-edge
[379.294544] Starting dynamic subtest: pipe-A-eDP-1
[382.759367] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.470s)
[382.770930] Starting dynamic subtest: pipe-D-eDP-1
[385.884544] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.124s)
[385.886861] Subtest 128x128-top-edge: SUCCESS (6.597s)
[386.690479] [040/133] (631s left) gem_exec_schedule (u-lateslice)
[386.772740] Starting subtest: u-lateslice
[386.775149] Starting dynamic subtest: rcs0
[386.786654] Dynamic subtest rcs0: SUCCESS (0.025s)
[386.796941] Starting dynamic subtest: bcs0
[386.804431] Dynamic subtest bcs0: SUCCESS (0.017s)
[386.814172] Starting dynamic subtest: vcs0
[386.822523] Dynamic subtest vcs0: SUCCESS (0.018s)
[386.831978] Starting dynamic subtest: vcs1
[386.841313] Dynamic subtest vcs1: SUCCESS (0.018s)
[386.850516] Starting dynamic subtest: vecs0
[386.859169] Dynamic subtest vecs0: SUCCESS (0.017s)
[386.868186] Starting dynamic subtest: ccs0
[386.876208] Dynamic subtest ccs0: SUCCESS (0.016s)
[386.878526] Subtest u-lateslice: SUCCESS (0.116s)
[388.358845] [041/133] (629s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[388.445073] Starting subtest: bo-too-small-due-to-tiling
[388.449587] Subtest bo-too-small-due-to-tiling: SKIP (0.000s)
[388.552591] [042/133] (629s left) gem_mmap_gtt (cpuset-medium-copy-xy)
[388.606808] Subtest cpuset-medium-copy-XY: SKIP (0.000s)
[388.662532] [043/133] (629s left) gem_flink_race (flink_close)
[388.699858] Starting subtest: flink_close
[393.782151] Subtest flink_close: SUCCESS (5.088s)
[393.859977] [044/133] (624s left) kms_psr (pr-dpms)
[393.970197] Starting subtest: pr-dpms
[393.974756] Subtest pr-dpms: SKIP (0.000s)
[394.044522] [045/133] (624s left) gem_exec_whisper (basic-fds-all)
[394.116524] Starting subtest: basic-fds-all
[405.632812] Subtest basic-fds-all: SUCCESS (11.519s)
[405.819177] [046/133] (612s left) i915_module_load (reload-no-display)
[405.857978] Starting subtest: reload-no-display
[411.777924] Subtest reload-no-display: SUCCESS (5.921s)
[411.804203] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[411.807463] [047/133] (606s left) kms_color (ctm-0-25)
[413.387431] Starting subtest: ctm-0-25
[413.389800] Starting dynamic subtest: pipe-A-eDP-1
[416.923968] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.537s)
[416.933646] Starting dynamic subtest: pipe-B-eDP-1
[421.121383] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.202s)
[421.130418] Starting dynamic subtest: pipe-C-eDP-1
[425.064706] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.944s)
[425.075010] Starting dynamic subtest: pipe-D-eDP-1
[429.110098] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.009s)
[429.112842] Subtest ctm-0-25: SUCCESS (15.696s)
[429.968476] [FACT kms_color (ctm-0-25)] new: kernel.kmod_is_loaded.i915: true
[429.972344] [048/133] (588s left) kms_plane (pixel-format-yf-tiled-ccs-modifier-source-clamping)
[430.073584] Starting subtest: pixel-format-yf-tiled-ccs-modifier-source-clamping
[430.078066] Subtest pixel-format-yf-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[430.144504] [049/133] (588s left) gem_exec_reloc (basic-write-cpu-active)
[430.203758] Subtest basic-write-cpu-active: SKIP (0.000s)
[430.282054] [050/133] (588s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[430.396750] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[430.401201] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[430.482492] [051/133] (587s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[430.544700] Starting subtest: invalid-smem-bo-on-discrete
[430.549212] Subtest invalid-smem-bo-on-discrete: SKIP (0.000s)
[430.674897] [052/133] (587s left) kms_lease (lease-unleased-crtc)
[430.773226] Starting subtest: lease-unleased-crtc
[430.775485] Starting dynamic subtest: pipe-A-eDP-1
[431.063688] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.289s)
[431.073314] Starting dynamic subtest: pipe-B-eDP-1
[431.814514] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.740s)
[431.824417] Starting dynamic subtest: pipe-C-eDP-1
[431.826798] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.004s)
[431.835261] Starting dynamic subtest: pipe-D-eDP-1
[431.837420] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s)
[431.839585] Subtest lease-unleased-crtc: SUCCESS (1.043s)
[432.174526] [053/133] (586s left) kms_flip (plain-flip-fb-recreate)
[432.269765] Starting subtest: plain-flip-fb-recreate
[432.272078] Starting dynamic subtest: A-eDP1
[441.179372] Dynamic subtest A-eDP1: SUCCESS (8.864s)
[441.192668] Starting dynamic subtest: B-eDP1
[450.037174] Dynamic subtest B-eDP1: SUCCESS (8.838s)
[450.048257] Starting dynamic subtest: C-eDP1
[458.876046] Dynamic subtest C-eDP1: SUCCESS (8.829s)
[458.886123] Starting dynamic subtest: D-eDP1
[467.719496] Dynamic subtest D-eDP1: SUCCESS (8.843s)
[467.723903] Subtest plain-flip-fb-recreate: SUCCESS (35.387s)
[468.887625] [054/133] (549s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[469.002560] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[469.006652] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[469.106109] [055/133] (549s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[469.216584] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[469.220633] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[469.323465] [056/133] (549s left) gem_userptr_blits (stress-purge)
[469.388519] Starting subtest: stress-purge
[474.796575] Subtest stress-purge: SUCCESS (5.408s)
[474.932552] [057/133] (543s left) gem_spin_batch (legacy-resubmit-new)
[475.029451] Starting subtest: legacy-resubmit-new
[475.032229] Starting dynamic subtest: default
[475.043094] Dynamic subtest default: SUCCESS (0.013s)
[475.056235] Starting dynamic subtest: render
[475.058198] Dynamic subtest render: SUCCESS (0.005s)
[475.067619] Starting dynamic subtest: bsd
[475.069233] Dynamic subtest bsd: SUCCESS (0.007s)
[475.078210] Starting dynamic subtest: bsd1
[475.080065] Dynamic subtest bsd1: SUCCESS (0.004s)
[475.088834] Starting dynamic subtest: bsd2
[475.090585] Dynamic subtest bsd2: SUCCESS (0.007s)
[475.098961] Starting dynamic subtest: blt
[475.100815] Dynamic subtest blt: SUCCESS (0.008s)
[475.109385] Starting dynamic subtest: vebox
[475.111226] Dynamic subtest vebox: SUCCESS (0.007s)
[475.113019] Subtest legacy-resubmit-new: SUCCESS (0.056s)
[476.330936] [058/133] (542s left) vgem_slow (nohang)
[476.408920] Starting subtest: nohang
[486.626849] Subtest nohang: SUCCESS (10.215s)
[486.691463] [FACT vgem_slow (nohang)] new: kernel.kmod_is_loaded.vgem: true
[486.694433] [059/133] (531s left) kms_tv_load_detect (load-detect)
[486.756584] Subtest load-detect: SKIP (0.000s)
[486.812006] [060/133] (531s left) gem_mmap_gtt (basic)
[486.878901] Subtest basic: SKIP (0.000s)
[486.948840] [061/133] (531s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[487.008254] Starting subtest: invalid-multi-wait-all-unsubmitted
[487.010767] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[487.112629] [062/133] (531s left) kms_rotation_crc (primary-rotation-90)
[487.226151] Starting subtest: primary-rotation-90
[487.230287] Subtest primary-rotation-90: SKIP (0.001s)
[487.309290] [063/133] (531s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[487.437314] Starting subtest: yf-tiled-8bpp-rotate-0
[487.442047] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[487.554333] [064/133] (531s left) kms_big_fb (y-tiled-64bpp-rotate-180)
[487.671151] Starting subtest: y-tiled-64bpp-rotate-180
[487.674741] Subtest y-tiled-64bpp-rotate-180: SKIP (0.001s)
[487.769732] [065/133] (531s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[487.827822] Starting subtest: etime-multi-wait-all-for-submit-submitted
[487.936796] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.108s)
[488.011682] [066/133] (530s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render)
[488.116666] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render
[488.121070] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[488.214600] [067/133] (530s left) kms_dsc (dsc-fractional-bpp-with-bpc)
[488.308269] Starting subtest: dsc-fractional-bpp-with-bpc
[488.338958] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s)
[488.379222] [068/133] (530s left) kms_async_flips (crc-atomic)
[488.481371] Starting subtest: crc-atomic
[488.860482] Starting dynamic subtest: pipe-A-eDP-1
[491.825407] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.962s)
[492.204053] Starting dynamic subtest: pipe-B-eDP-1
[495.150752] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.956s)
[495.531900] Starting dynamic subtest: pipe-C-eDP-1
[498.444852] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.924s)
[499.580788] Starting dynamic subtest: pipe-D-eDP-1
[501.977613] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.422s)
[501.980333] Subtest crc-atomic: SUCCESS (13.493s)
[503.143084] [069/133] (515s left) api_intel_allocator (reopen-fork)
[503.202471] Starting subtest: reopen-fork
[506.707059] Subtest reopen-fork: SUCCESS (3.505s)
[506.797448] [070/133] (512s left) gem_exec_balancer (sequential)
[506.866801] Starting subtest: sequential
[509.930247] Subtest sequential: SUCCESS (3.064s)
[510.245245] [071/133] (508s left) gem_render_copy (linear)
[510.297624] Starting subtest: linear
[510.299950] Starting dynamic subtest: smem
[510.344079] Dynamic subtest smem: SUCCESS (0.046s)
[510.346732] Subtest linear: SUCCESS (0.046s)
[510.583845] [072/133] (508s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area)
[510.682889] Starting subtest: psr2-primary-plane-update-sf-dmg-area
[510.685288] Starting dynamic subtest: pipe-A-eDP-1
[516.536421] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.854s)
[516.547065] Starting dynamic subtest: pipe-B-eDP-1
[523.209991] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.668s)
[523.212338] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (12.526s)
[524.076365] [073/133] (495s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[524.176352] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[524.178657] Starting dynamic subtest: pipe-A-default-mode
[526.903249] Dynamic subtest pipe-A-default-mode: SUCCESS (2.725s)
[526.905111] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.727s)
[527.767387] [074/133] (491s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[527.870638] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[527.875183] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[527.976566] [075/133] (491s left) gem_ctx_exec (basic)
[528.030852] Starting subtest: basic
[528.036776] Subtest basic: SUCCESS (0.008s)
[528.159130] [076/133] (491s left) kms_chamelium_hpd (common-hpd-after-suspend)
[528.532163] Subtest common-hpd-after-suspend: SKIP (0.000s)
[529.379720] [077/133] (490s left) kms_psr (psr-no-drrs)
[529.474521] Starting subtest: psr-no-drrs
[529.476872] Starting dynamic subtest: eDP-1
[531.079259] Dynamic subtest eDP-1: SUCCESS (1.605s)
[531.081131] Subtest psr-no-drrs: SUCCESS (1.606s)
[531.961603] [078/133] (487s left) gem_render_copy_redux (normal)
[532.041250] Starting subtest: normal
[532.319355] Subtest normal: SUCCESS (0.279s)
[532.445413] [079/133] (487s left) kms_frontbuffer_tracking (fbc-tiling-4)
[532.541690] Starting subtest: fbc-tiling-4
[536.766869] Subtest fbc-tiling-4: SUCCESS (4.231s)
[537.971276] [080/133] (481s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[538.370619] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[539.161581] [081/133] (480s left) i915_pm_rps (thresholds-park)
[539.231035] Starting subtest: thresholds-park
[539.235782] Subtest thresholds-park: SKIP (0.001s)
[539.332250] [082/133] (480s left) gem_eio (wait-wedge-10ms)
[539.557808] Starting subtest: wait-wedge-10ms
[541.325187] Subtest wait-wedge-10ms: SUCCESS (1.767s)
[541.472887] [083/133] (478s left) gem_exec_alignment (pi)
[541.531815] Starting subtest: pi
[592.801871] Subtest pi: SUCCESS (51.261s)
[594.055464] [084/133] (425s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs)
[594.158516] Starting subtest: mixed-tiled-to-yf-tiled-ccs
[594.163336] Subtest mixed-tiled-to-yf-tiled-ccs: SKIP (0.000s)
[594.366444] [085/133] (425s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[594.476621] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[594.480653] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[594.580462] [086/133] (425s left) kms_vblank (query-busy)
[594.684142] Starting subtest: query-busy
[594.685981] Starting dynamic subtest: pipe-A-eDP-1
[596.576581] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.892s)
[596.591669] Starting dynamic subtest: pipe-D-eDP-1
[599.144800] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.566s)
[599.147159] Subtest query-busy: SUCCESS (4.462s)
[599.976245] [087/133] (419s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-wc)
[600.069736] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-wc
[600.074188] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[600.177640] [088/133] (419s left) kms_content_protection (lic-type-0-hdcp14)
[600.317499] Starting subtest: lic-type-0-hdcp14
[600.322043] Subtest lic-type-0-hdcp14: SKIP (0.000s)
[600.458526] [089/133] (419s left) gem_lmem_swapping (parallel-multi)
[600.513337] Subtest parallel-multi: SKIP (0.000s)
[600.564398] [090/133] (419s left) dmabuf_sync_file (export-wait-after-attach)
[600.614099] Starting subtest: export-wait-after-attach
[600.616442] Subtest export-wait-after-attach: SUCCESS (0.001s)
[600.671530] [091/133] (419s left) kms_flip (2x-flip-vs-fences-interruptible)
[600.761855] Starting subtest: 2x-flip-vs-fences-interruptible
[600.766975] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s)
[600.857314] [092/133] (419s left) gem_exec_reloc (basic-gtt-read-noreloc)
[600.917249] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[600.989836] [093/133] (419s left) core_getstats (basic)
[601.030401] Starting subtest: basic
[601.032049] Subtest basic: SUCCESS (0.000s)
[601.117135] [094/133] (419s left) sw_sync (sync_merge_invalid)
[601.156864] Starting subtest: sync_merge_invalid
[601.190546] Subtest sync_merge_invalid: SUCCESS (0.035s)
[601.271294] [095/133] (418s left) kms_vrr (flipline)
[601.367514] Starting subtest: flipline
[601.373064] Subtest flipline: SKIP (0.000s)
[601.454858] [096/133] (418s left) kms_flip (nonexisting-fb-interruptible)
[601.555898] Starting subtest: nonexisting-fb-interruptible
[601.557972] Starting dynamic subtest: A-eDP1
[602.742559] Dynamic subtest A-eDP1: SUCCESS (1.184s)
[602.756059] Starting dynamic subtest: B-eDP1
[603.875890] Dynamic subtest B-eDP1: SUCCESS (1.132s)
[603.893788] Starting dynamic subtest: C-eDP1
[605.002585] Dynamic subtest C-eDP1: SUCCESS (1.124s)
[605.016459] Starting dynamic subtest: D-eDP1
[606.132594] Dynamic subtest D-eDP1: SUCCESS (1.127s)
[606.137638] Subtest nonexisting-fb-interruptible: SUCCESS (4.579s)
[607.314107] [097/133] (412s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[607.429641] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[608.530321] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.101s)
[608.645969] [098/133] (411s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[608.742262] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[608.745800] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[608.845474] [099/133] (411s left) kms_pm_backlight (basic-brightness)
[608.940652] Starting subtest: basic-brightness
[608.992579] Starting dynamic subtest: eDP-1
[609.523272] Dynamic subtest eDP-1: SUCCESS (0.529s)
[609.525540] Subtest basic-brightness: SUCCESS (0.583s)
[610.348131] [100/133] (410s left) gem_exec_fence (syncobj-backward-timeline-chain-engines)
[610.930800] Starting subtest: syncobj-backward-timeline-chain-engines
[611.064308] Subtest syncobj-backward-timeline-chain-engines: SUCCESS (0.137s)
[612.349976] [101/133] (408s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[612.407725] Starting subtest: yf-tiled-to-vebox-y-tiled
[612.412281] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s)
[612.605949] [102/133] (407s left) kms_cursor_crc (cursor-size-hints)
[612.729123] Starting subtest: cursor-size-hints
[612.731363] Starting dynamic subtest: pipe-A-eDP-1
[613.341238] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.613s)
[613.352147] Starting dynamic subtest: pipe-D-eDP-1
[614.612676] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.269s)
[614.615100] Subtest cursor-size-hints: SUCCESS (1.886s)
[615.420600] [103/133] (405s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[615.517416] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[616.342393] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.826s)
[616.507636] [104/133] (404s left) syncobj_timeline (wait-any-interrupted)
[616.551662] Starting subtest: wait-any-interrupted
[616.657299] Subtest wait-any-interrupted: SUCCESS (0.105s)
[616.733737] [105/133] (403s left) sw_sync (sync_multi_producer_single_consumer)
[616.766768] Starting subtest: sync_multi_producer_single_consumer
[617.839901] Subtest sync_multi_producer_single_consumer: SUCCESS (1.075s)
[617.901291] [106/133] (402s left) syncobj_basic (test-valid-cycle)
[617.976792] Starting subtest: test-valid-cycle
[617.978810] Subtest test-valid-cycle: SUCCESS (0.000s)
[618.071538] [107/133] (402s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[618.158954] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[618.163120] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[618.255277] [108/133] (402s left) kms_cursor_crc (cursor-onscreen-64x64)
[618.434962] Starting subtest: cursor-onscreen-64x64
[618.440365] Starting dynamic subtest: pipe-A-eDP-1
[620.540298] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.100s)
[620.568583] Starting dynamic subtest: pipe-D-eDP-1
[623.299964] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.738s)
[623.302033] Subtest cursor-onscreen-64x64: SUCCESS (4.862s)
[624.173174] [109/133] (396s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[624.224593] Starting subtest: rel-constants-invalid-rel-gen5
[624.227055] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[624.343519] [110/133] (396s left) gem_exec_fence (syncobj-timeline-signal)
[624.890679] Starting subtest: syncobj-timeline-signal
[624.898038] Subtest syncobj-timeline-signal: SUCCESS (0.009s)
[626.300770] [111/133] (394s left) gem_mmap_gtt (ptrace)
[626.357385] Subtest ptrace: SKIP (0.000s)
[626.427687] [112/133] (394s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[626.519540] Starting subtest: fbc-2p-pri-indfb-multidraw
[626.523627] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s)
[626.633491] [113/133] (394s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[626.730054] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[626.732268] Starting dynamic subtest: pipe-A
[626.750028] Dynamic subtest pipe-A: SKIP (0.016s)
[626.761174] Starting dynamic subtest: pipe-B
[626.778066] Dynamic subtest pipe-B: SKIP (0.028s)
[626.790129] Starting dynamic subtest: pipe-C
[626.808284] Dynamic subtest pipe-C: SKIP (0.029s)
[626.819395] Starting dynamic subtest: pipe-D
[626.838812] Dynamic subtest pipe-D: SKIP (0.029s)
[626.843205] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.104s)
[626.949491] [114/133] (394s left) kms_joiner (invalid-modeset-force-big-joiner)
[627.048935] Starting subtest: invalid-modeset-force-big-joiner
[627.053094] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s)
[627.115468] [115/133] (393s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[627.196886] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[627.199347] Starting dynamic subtest: pipe-A-eDP-1
[627.226603] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[627.238957] Starting dynamic subtest: pipe-B-eDP-1
[627.256251] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[627.265895] Starting dynamic subtest: pipe-C-eDP-1
[627.281517] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[627.291107] Starting dynamic subtest: pipe-D-eDP-1
[627.306549] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[627.308247] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.007s)
[629.447323] [116/133] (391s left) tools_test (tools_test)
[629.507123] Starting subtest: tools_test
[629.563622] Subtest tools_test: SUCCESS (0.069s)
[629.642876] [117/133] (391s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[629.748934] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[638.309889] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.561s)
[638.426424] [118/133] (382s left) gem_exec_params (invalid-bsd1-flag-on-blt)
[638.479227] Starting subtest: invalid-bsd1-flag-on-blt
[638.481577] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s)
[638.582368] [119/133] (382s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[638.675071] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[638.677306] Starting dynamic subtest: pipe-A-eDP-1
[638.735773] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[638.747900] Starting dynamic subtest: pipe-B-eDP-1
[638.805396] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[638.817741] Starting dynamic subtest: pipe-C-eDP-1
[638.875027] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[638.886721] Starting dynamic subtest: pipe-D-eDP-1
[638.943708] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[638.948289] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[640.963412] [120/133] (380s left) gem_exec_alignment (single)
[641.035108] Starting subtest: single
[641.040445] Subtest single: SUCCESS (0.008s)
[641.151944] [121/133] (380s left) gem_ctx_persistence (legacy-engines-queued)
[641.216378] Starting subtest: legacy-engines-queued
[641.218561] Starting dynamic subtest: render
[641.260581] Dynamic subtest render: SUCCESS (0.047s)
[641.274398] Starting dynamic subtest: bsd1
[643.235047] Dynamic subtest bsd1: SUCCESS (1.971s)
[643.248840] Starting dynamic subtest: bsd2
[645.219100] Dynamic subtest bsd2: SUCCESS (1.980s)
[645.232655] Starting dynamic subtest: blt
[645.259326] Dynamic subtest blt: SUCCESS (0.039s)
[645.270056] Starting dynamic subtest: vebox
[647.202812] Dynamic subtest vebox: SUCCESS (1.940s)
[647.205507] Subtest legacy-engines-queued: SUCCESS (5.987s)
[647.284963] [122/133] (374s left) i915_drm_fdinfo (most-busy-idle-check-all)
[647.328163] Starting subtest: most-busy-idle-check-all
[647.330226] Starting dynamic subtest: rcs0
[647.334970] Dynamic subtest rcs0: SKIP (0.004s)
[647.347651] Starting dynamic subtest: bcs0
[647.352183] Dynamic subtest bcs0: SKIP (0.000s)
[647.362153] Starting dynamic subtest: vcs0
[647.366385] Dynamic subtest vcs0: SKIP (0.000s)
[647.376430] Starting dynamic subtest: vcs1
[647.380816] Dynamic subtest vcs1: SKIP (0.000s)
[647.391311] Starting dynamic subtest: vecs0
[647.395580] Dynamic subtest vecs0: SKIP (0.000s)
[647.405641] Starting dynamic subtest: ccs0
[647.409839] Dynamic subtest ccs0: SKIP (0.000s)
[647.414049] Subtest most-busy-idle-check-all: SKIP (0.010s)
[647.454066] [123/133] (373s left) kms_pm_rpm (pm-caching)
[649.394355] Starting subtest: pm-caching
[649.399833] Subtest pm-caching: SKIP (0.000s)
[649.791739] [124/133] (371s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb)
[649.889505] Starting subtest: pr-primary-plane-update-sf-dmg-area-big-fb
[649.893794] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[649.967348] [125/133] (371s left) gem_unref_active_buffers
[650.175392] [126/133] (371s left) gen7_exec_parse (chained-batch)
[650.243804] Subtest chained-batch: SKIP (0.000s)
[650.310033] [127/133] (371s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[650.403287] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[657.172279] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.774s)
[657.315403] [128/133] (364s left) kms_flip (2x-flip-vs-panning-interruptible)
[657.410852] Starting subtest: 2x-flip-vs-panning-interruptible
[657.422818] Subtest 2x-flip-vs-panning-interruptible: SKIP (0.010s)
[657.502959] [129/133] (364s left) kms_psr (psr2-no-drrs)
[657.594524] Starting subtest: psr2-no-drrs
[657.597143] Starting dynamic subtest: eDP-1
[659.192069] Dynamic subtest eDP-1: SUCCESS (1.597s)
[659.193973] Subtest psr2-no-drrs: SUCCESS (1.599s)
[659.989607] [130/133] (361s left) perf (polling-parameterized)
[660.118868] Starting subtest: polling-parameterized
[680.143920] Subtest polling-parameterized: SUCCESS (20.027s)
[680.196142] [131/133] (341s left) syncobj_wait (wait-all-for-submit-complex)
[680.252301] Starting subtest: wait-all-for-submit-complex
[680.467056] Subtest wait-all-for-submit-complex: SUCCESS (0.214s)
[680.560119] [132/133] (341s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[680.613672] Starting subtest: multi-wait-all-for-submit-signaled
[680.615909] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[680.715611] [133/133] (341s left) syncobj_timeline (invalid-query-illegal-handle)
[680.782866] Starting subtest: invalid-query-illegal-handle
[680.784865] Subtest invalid-query-illegal-handle: SUCCESS (0.000s)
[680.886862] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_big_fb
results: parsing output: 2/ for test: syncobj_timeline
results: parsing output: 3/ for test: kms_debugfs
results: parsing output: 4/ for test: gem_fenced_exec_thrash
results: parsing output: 5/ for test: gem_exec_balancer
results: parsing output: 6/ for test: kms_chamelium_color
results: parsing output: 7/ for test: kms_psr
results: parsing output: 8/ for test: gem_pxp
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: kms_plane_multiple
results: parsing output: 11/ for test: sysfs_defaults
results: parsing output: 12/ for test: gem_exec_schedule
results: parsing output: 13/ for test: kms_vblank
results: parsing output: 14/ for test: kms_ccs
results: parsing output: 15/ for test: kms_ccs
results: parsing output: 16/ for test: kms_big_fb
results: parsing output: 17/ for test: kms_plane_scaling
results: parsing output: 18/ for test: gem_mmap_gtt
results: parsing output: 19/ for test: i915_pm_rc6_residency
results: parsing output: 20/ for test: kms_prop_blob
results: parsing output: 21/ for test: prime_mmap
results: parsing output: 22/ for test: syncobj_wait
results: parsing output: 23/ for test: gem_blits
results: parsing output: 24/ for test: template
results: parsing output: 25/ for test: kms_pipe_crc_basic
results: parsing output: 26/ for test: kms_flip_tiling
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: gem_softpin
results: parsing output: 29/ for test: kms_flip
results: parsing output: 30/ for test: perf_pmu
results: parsing output: 31/ for test: gem_ctx_exec
results: parsing output: 32/ for test: kms_psr
results: parsing output: 33/ for test: kms_hdr
results: parsing output: 34/ for test: gem_ctx_exec
results: parsing output: 35/ for test: kms_flip_scaled_crc
results: parsing output: 36/ for test: gem_exec_reloc
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_cursor_edge_walk
results: parsing output: 39/ for test: gem_exec_schedule
results: parsing output: 40/ for test: kms_addfb_basic
results: parsing output: 41/ for test: gem_mmap_gtt
results: parsing output: 42/ for test: gem_flink_race
results: parsing output: 43/ for test: kms_psr
results: parsing output: 44/ for test: gem_exec_whisper
results: parsing output: 45/ for test: i915_module_load
results: parsing output: 46/ for test: kms_color
results: parsing output: 47/ for test: kms_plane
results: parsing output: 48/ for test: gem_exec_reloc
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_addfb_basic
results: parsing output: 51/ for test: kms_lease
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_userptr_blits
results: parsing output: 56/ for test: gem_spin_batch
results: parsing output: 57/ for test: vgem_slow
results: parsing output: 58/ for test: kms_tv_load_detect
results: parsing output: 59/ for test: gem_mmap_gtt
results: parsing output: 60/ for test: syncobj_wait
results: parsing output: 61/ for test: kms_rotation_crc
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: syncobj_timeline
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_dsc
results: parsing output: 67/ for test: kms_async_flips
results: parsing output: 68/ for test: api_intel_allocator
results: parsing output: 69/ for test: gem_exec_balancer
results: parsing output: 70/ for test: gem_render_copy
results: parsing output: 71/ for test: kms_psr2_sf
results: parsing output: 72/ for test: kms_flip_scaled_crc
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: gem_ctx_exec
results: parsing output: 75/ for test: kms_chamelium_hpd
results: parsing output: 76/ for test: kms_psr
results: parsing output: 77/ for test: gem_render_copy_redux
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_chamelium_frames
results: parsing output: 80/ for test: i915_pm_rps
results: parsing output: 81/ for test: gem_eio
results: parsing output: 82/ for test: gem_exec_alignment
results: parsing output: 83/ for test: gem_render_copy
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_vblank
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_content_protection
results: parsing output: 88/ for test: gem_lmem_swapping
results: parsing output: 89/ for test: dmabuf_sync_file
results: parsing output: 90/ for test: kms_flip
results: parsing output: 91/ for test: gem_exec_reloc
results: parsing output: 92/ for test: core_getstats
results: parsing output: 93/ for test: sw_sync
results: parsing output: 94/ for test: kms_vrr
results: parsing output: 95/ for test: kms_flip
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_pm_backlight
results: parsing output: 99/ for test: gem_exec_fence
results: parsing output: 100/ for test: gem_render_copy
results: parsing output: 101/ for test: kms_cursor_crc
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: syncobj_timeline
results: parsing output: 104/ for test: sw_sync
results: parsing output: 105/ for test: syncobj_basic
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_cursor_crc
results: parsing output: 108/ for test: gem_exec_params
results: parsing output: 109/ for test: gem_exec_fence
results: parsing output: 110/ for test: gem_mmap_gtt
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_plane_scaling
results: parsing output: 113/ for test: kms_joiner
results: parsing output: 114/ for test: kms_ccs
results: parsing output: 115/ for test: tools_test
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: gem_exec_params
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: gem_exec_alignment
results: parsing output: 120/ for test: gem_ctx_persistence
results: parsing output: 121/ for test: i915_drm_fdinfo
results: parsing output: 122/ for test: kms_pm_rpm
results: parsing output: 123/ for test: kms_psr2_sf
results: parsing output: 124/ for test: gem_unref_active_buffers
results: parsing output: 125/ for test: gen7_exec_parse
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_flip
results: parsing output: 128/ for test: kms_psr
results: parsing output: 129/ for test: perf
results: parsing output: 130/ for test: syncobj_wait
results: parsing output: 131/ for test: syncobj_timeline
results: parsing output: 132/ for test: syncobj_timeline
Done.