[37.901441] Initializing watchdogs
[37.901496]   /dev/watchdog0
[37.907426] [001/138] (960s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[39.854767] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[39.857533] Starting dynamic subtest: pipe-A-HDMI-A-3
[40.641502] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.784s)
[40.656073] Starting dynamic subtest: pipe-B-HDMI-A-3
[41.314723] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.667s)
[41.329057] Starting dynamic subtest: pipe-C-HDMI-A-3
[41.956973] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.636s)
[41.972928] Starting dynamic subtest: pipe-D-HDMI-A-3
[42.730346] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.765s)
[42.731392] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (2.877s)
[42.949243] [002/138] (955s left) api_intel_bb (crc32)
[43.003304] Starting subtest: crc32
[43.004166] Starting dynamic subtest: rcs0-lmem0
[43.240072] Dynamic subtest rcs0-lmem0: SUCCESS (0.227s)
[43.244607] Starting dynamic subtest: rcs0-smem0
[43.534722] Dynamic subtest rcs0-smem0: SUCCESS (0.295s)
[43.539452] Starting dynamic subtest: bcs0-lmem0
[43.750874] Dynamic subtest bcs0-lmem0: SUCCESS (0.216s)
[43.755739] Starting dynamic subtest: bcs0-smem0
[44.057495] Dynamic subtest bcs0-smem0: SUCCESS (0.306s)
[44.062201] Starting dynamic subtest: vcs0-lmem0
[44.392115] Dynamic subtest vcs0-lmem0: SUCCESS (0.334s)
[44.398998] Starting dynamic subtest: vcs0-smem0
[44.856689] Dynamic subtest vcs0-smem0: SUCCESS (0.464s)
[44.865981] Starting dynamic subtest: vcs1-lmem0
[45.195488] Dynamic subtest vcs1-lmem0: SUCCESS (0.338s)
[45.204029] Starting dynamic subtest: vcs1-smem0
[45.672123] Dynamic subtest vcs1-smem0: SUCCESS (0.477s)
[45.676602] Starting dynamic subtest: vecs0-lmem0
[46.009607] Dynamic subtest vecs0-lmem0: SUCCESS (0.337s)
[46.014208] Starting dynamic subtest: vecs0-smem0
[46.481315] Dynamic subtest vecs0-smem0: SUCCESS (0.471s)
[46.485763] Starting dynamic subtest: vecs1-lmem0
[46.821446] Dynamic subtest vecs1-lmem0: SUCCESS (0.339s)
[46.829941] Starting dynamic subtest: vecs1-smem0
[47.289234] Dynamic subtest vecs1-smem0: SUCCESS (0.468s)
[47.293856] Starting dynamic subtest: ccs0-lmem0
[47.520231] Dynamic subtest ccs0-lmem0: SUCCESS (0.230s)
[47.524886] Starting dynamic subtest: ccs0-smem0
[47.839034] Dynamic subtest ccs0-smem0: SUCCESS (0.318s)
[47.843677] Starting dynamic subtest: ccs1-lmem0
[48.070472] Dynamic subtest ccs1-lmem0: SUCCESS (0.230s)
[48.091388] Starting dynamic subtest: ccs1-smem0
[48.421788] Dynamic subtest ccs1-smem0: SUCCESS (0.351s)
[48.426410] Starting dynamic subtest: ccs2-lmem0
[48.651576] Dynamic subtest ccs2-lmem0: SUCCESS (0.228s)
[48.672728] Starting dynamic subtest: ccs2-smem0
[49.004582] Dynamic subtest ccs2-smem0: SUCCESS (0.352s)
[49.013979] Starting dynamic subtest: ccs3-lmem0
[49.241891] Dynamic subtest ccs3-lmem0: SUCCESS (0.236s)
[49.250895] Starting dynamic subtest: ccs3-smem0
[49.566770] Dynamic subtest ccs3-smem0: SUCCESS (0.324s)
[49.568763] Subtest crc32: SUCCESS (6.554s)
[49.707400] [003/138] (948s left) gem_ctx_bad_destroy (invalid-pad)
[49.765872] Starting subtest: invalid-pad
[49.766699] Subtest invalid-pad: SUCCESS (0.000s)
[49.818301] [004/138] (948s left) v3d/v3d_create_bo (create-bo-zeroed)
[49.887148] Subtest create-bo-zeroed: SKIP (0.000s)
[49.934870] [005/138] (948s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move)
[51.900336] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move
[51.903918] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[51.999412] [006/138] (946s left) i915_fb_tiling
[52.125973] [007/138] (946s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[54.072252] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[54.074532] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[54.152891] [008/138] (944s left) v3d/v3d_wait_bo (map-bo-1ns)
[54.303643] Subtest map-bo-1ns: SKIP (0.000s)
[54.348256] [009/138] (944s left) v3d/v3d_perfmon (destroy-invalid-perfmon)
[54.437432] Subtest destroy-invalid-perfmon: SKIP (0.000s)
[54.489256] [010/138] (944s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled)
[54.556740] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[54.557808] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[54.621447] [011/138] (943s left) gem_userptr_blits (set-cache-level)
[54.695305] Starting subtest: set-cache-level
[54.696184] Subtest set-cache-level: SUCCESS (0.000s)
[54.829855] [012/138] (943s left) perf_pmu (busy)
[54.919967] Starting subtest: busy
[54.920874] Starting dynamic subtest: rcs0
[55.525765] Dynamic subtest rcs0: SUCCESS (0.605s)
[55.534840] Starting dynamic subtest: bcs0
[56.083050] Dynamic subtest bcs0: SUCCESS (0.557s)
[56.092658] Starting dynamic subtest: vcs0
[56.647099] Dynamic subtest vcs0: SUCCESS (0.563s)
[56.656651] Starting dynamic subtest: vcs1
[57.206991] Dynamic subtest vcs1: SUCCESS (0.559s)
[57.216534] Starting dynamic subtest: vecs0
[57.769064] Dynamic subtest vecs0: SUCCESS (0.561s)
[57.778651] Starting dynamic subtest: vecs1
[58.331068] Dynamic subtest vecs1: SUCCESS (0.561s)
[58.340666] Starting dynamic subtest: ccs0
[58.894069] Dynamic subtest ccs0: SUCCESS (0.562s)
[58.903654] Starting dynamic subtest: ccs1
[59.456067] Dynamic subtest ccs1: SUCCESS (0.561s)
[59.468871] Starting dynamic subtest: ccs2
[60.017071] Dynamic subtest ccs2: SUCCESS (0.560s)
[60.026546] Starting dynamic subtest: ccs3
[60.578083] Dynamic subtest ccs3: SUCCESS (0.560s)
[60.580177] Subtest busy: SUCCESS (5.657s)
[60.639009] [013/138] (938s left) syncobj_wait (wait-any-complex)
[60.682441] Starting subtest: wait-any-complex
[60.744892] Subtest wait-any-complex: SUCCESS (0.062s)
[60.813179] [014/138] (937s left) kms_plane_multiple (tiling-yf)
[62.804221] Starting subtest: tiling-yf
[62.805935] Subtest tiling-yf: SKIP (0.000s)
[62.867125] [015/138] (935s left) gem_exec_schedule (fairslice)
[63.002456] Starting subtest: fairslice
[63.003681] Starting dynamic subtest: rcs0
[65.044212] Dynamic subtest rcs0: SUCCESS (2.037s)
[65.049389] Starting dynamic subtest: bcs0
[67.058603] Dynamic subtest bcs0: SUCCESS (2.015s)
[67.064147] Starting dynamic subtest: vcs0
[69.071607] Dynamic subtest vcs0: SUCCESS (2.014s)
[69.076970] Starting dynamic subtest: vcs1
[71.086770] Dynamic subtest vcs1: SUCCESS (2.015s)
[71.092097] Starting dynamic subtest: vecs0
[73.100760] Dynamic subtest vecs0: SUCCESS (2.013s)
[73.105969] Starting dynamic subtest: vecs1
[75.111360] Dynamic subtest vecs1: SUCCESS (2.011s)
[75.116609] Starting dynamic subtest: ccs0
[77.127735] Dynamic subtest ccs0: SUCCESS (2.016s)
[77.133699] Starting dynamic subtest: ccs1
[79.141110] Dynamic subtest ccs1: SUCCESS (2.013s)
[79.146530] Starting dynamic subtest: ccs2
[81.153763] Dynamic subtest ccs2: SUCCESS (2.013s)
[81.159209] Starting dynamic subtest: ccs3
[83.169062] Dynamic subtest ccs3: SUCCESS (2.015s)
[83.169863] Subtest fairslice: SUCCESS (20.162s)
[83.493263] [016/138] (915s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[85.436945] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[88.038272] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (2.603s)
[88.191846] [017/138] (910s left) kms_pm_rpm (i2c)
[92.566236] Starting subtest: i2c
[120.604060] Subtest i2c: SUCCESS (28.038s)
[121.635082] [018/138] (877s left) kms_flip (modeset-vs-vblank-race-interruptible)
[122.743009] Starting subtest: modeset-vs-vblank-race-interruptible
[122.749559] Starting dynamic subtest: A-HDMI-A3
[125.765890] Dynamic subtest A-HDMI-A3: SUCCESS (3.016s)
[125.773746] Starting dynamic subtest: B-HDMI-A3
[128.704734] Dynamic subtest B-HDMI-A3: SUCCESS (2.938s)
[128.714134] Starting dynamic subtest: C-HDMI-A3
[131.735631] Dynamic subtest C-HDMI-A3: SUCCESS (3.030s)
[131.742801] Starting dynamic subtest: D-HDMI-A3
[134.731269] Dynamic subtest D-HDMI-A3: SUCCESS (2.994s)
[134.732269] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (11.989s)
[134.876395] [019/138] (863s left) kms_concurrent (multi-plane-atomic-lowres)
[136.848136] Starting subtest: multi-plane-atomic-lowres
[136.849087] Starting dynamic subtest: pipe-A-HDMI-A-3
[137.213333] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.363s)
[137.214371] Subtest multi-plane-atomic-lowres: SUCCESS (0.365s)
[137.351730] [020/138] (861s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs)
[137.417149] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs
[137.419011] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s)
[137.630275] [021/138] (861s left) kms_frontbuffer_tracking (psr-suspend)
[139.612061] Starting subtest: psr-suspend
[139.613872] Subtest psr-suspend: SKIP (0.000s)
[139.684407] [022/138] (859s left) kms_ccs (pipe-c-crc-primary-basic-4-tiled-mtl-rc-ccs)
[141.764120] Starting subtest: pipe-C-crc-primary-basic-4-tiled-mtl-rc-ccs
[141.766018] Subtest pipe-C-crc-primary-basic-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[141.889882] [023/138] (856s left) gem_ctx_persistence (engines-mixed-process)
[141.956021] Starting subtest: engines-mixed-process
[141.956951] Starting dynamic subtest: rcs0
[143.404151] Dynamic subtest rcs0: SUCCESS (1.448s)
[143.411796] Starting dynamic subtest: bcs0
[145.385041] Dynamic subtest bcs0: SUCCESS (1.980s)
[145.391819] Starting dynamic subtest: vcs0
[147.365853] Dynamic subtest vcs0: SUCCESS (1.980s)
[147.374174] Starting dynamic subtest: vcs1
[149.347867] Dynamic subtest vcs1: SUCCESS (1.981s)
[149.355121] Starting dynamic subtest: vecs0
[151.398865] Dynamic subtest vecs0: SUCCESS (2.050s)
[151.406364] Starting dynamic subtest: vecs1
[153.383946] Dynamic subtest vecs1: SUCCESS (1.984s)
[153.391489] Starting dynamic subtest: ccs0
[155.367966] Dynamic subtest ccs0: SUCCESS (1.983s)
[155.381710] Starting dynamic subtest: ccs1
[157.346021] Dynamic subtest ccs1: SUCCESS (1.977s)
[157.353307] Starting dynamic subtest: ccs2
[159.400956] Dynamic subtest ccs2: SUCCESS (2.054s)
[159.409273] Starting dynamic subtest: ccs3
[161.380019] Dynamic subtest ccs3: SUCCESS (1.978s)
[161.381213] Subtest engines-mixed-process: SUCCESS (19.424s)
[161.465903] [024/138] (837s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled)
[161.510042] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[161.510910] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[161.592480] [025/138] (837s left) i915_pm_rpm (sysfs-read)
[166.543521] Starting subtest: sysfs-read
[169.882195] Subtest sysfs-read: SUCCESS (3.341s)
[171.018315] [026/138] (827s left) gem_exec_basic (basic)
[171.148884] Starting subtest: basic
[171.154044] Starting dynamic subtest: rcs0-smem
[171.158803] Dynamic subtest rcs0-smem: SUCCESS (0.008s)
[171.174325] Starting dynamic subtest: bcs0-smem
[171.175294] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[171.184273] Starting dynamic subtest: vcs0-smem
[171.185274] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[171.192208] Starting dynamic subtest: vcs1-smem
[171.193039] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[171.198969] Starting dynamic subtest: vecs0-smem
[171.199764] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[171.205405] Starting dynamic subtest: vecs1-smem
[171.206195] Dynamic subtest vecs1-smem: SUCCESS (0.001s)
[171.211816] Starting dynamic subtest: ccs0-smem
[171.212586] Dynamic subtest ccs0-smem: SUCCESS (0.001s)
[171.218287] Starting dynamic subtest: ccs1-smem
[171.219047] Dynamic subtest ccs1-smem: SUCCESS (0.001s)
[171.224693] Starting dynamic subtest: ccs2-smem
[171.225478] Dynamic subtest ccs2-smem: SUCCESS (0.001s)
[171.231103] Starting dynamic subtest: ccs3-smem
[171.231893] Dynamic subtest ccs3-smem: SUCCESS (0.001s)
[171.237525] Starting dynamic subtest: rcs0-lmem0
[171.238505] Dynamic subtest rcs0-lmem0: SUCCESS (0.001s)
[171.244146] Starting dynamic subtest: bcs0-lmem0
[171.244931] Dynamic subtest bcs0-lmem0: SUCCESS (0.000s)
[171.250952] Starting dynamic subtest: vcs0-lmem0
[171.252071] Dynamic subtest vcs0-lmem0: SUCCESS (0.000s)
[171.258059] Starting dynamic subtest: vcs1-lmem0
[171.259216] Dynamic subtest vcs1-lmem0: SUCCESS (0.000s)
[171.265205] Starting dynamic subtest: vecs0-lmem0
[171.266245] Dynamic subtest vecs0-lmem0: SUCCESS (0.000s)
[171.271953] Starting dynamic subtest: vecs1-lmem0
[171.273067] Dynamic subtest vecs1-lmem0: SUCCESS (0.000s)
[171.279035] Starting dynamic subtest: ccs0-lmem0
[171.280213] Dynamic subtest ccs0-lmem0: SUCCESS (0.000s)
[171.286225] Starting dynamic subtest: ccs1-lmem0
[171.287365] Dynamic subtest ccs1-lmem0: SUCCESS (0.000s)
[171.292977] Starting dynamic subtest: ccs2-lmem0
[171.293785] Dynamic subtest ccs2-lmem0: SUCCESS (0.000s)
[171.299788] Starting dynamic subtest: ccs3-lmem0
[171.300640] Dynamic subtest ccs3-lmem0: SUCCESS (0.000s)
[171.301533] Subtest basic: SUCCESS (0.042s)
[171.372228] [027/138] (827s left) gem_ctx_shared (q-promotion)
[171.449267] Starting subtest: Q-promotion
[171.450130] Starting dynamic subtest: rcs0
[171.736761] Dynamic subtest rcs0: SUCCESS (0.278s)
[171.743392] Starting dynamic subtest: bcs0
[171.922629] Dynamic subtest bcs0: SUCCESS (0.185s)
[171.928898] Starting dynamic subtest: vcs0
[172.109734] Dynamic subtest vcs0: SUCCESS (0.186s)
[172.116324] Starting dynamic subtest: vcs1
[172.302725] Dynamic subtest vcs1: SUCCESS (0.192s)
[172.309282] Starting dynamic subtest: vecs0
[172.490838] Dynamic subtest vecs0: SUCCESS (0.187s)
[172.497330] Starting dynamic subtest: vecs1
[172.683548] Dynamic subtest vecs1: SUCCESS (0.192s)
[172.689904] Starting dynamic subtest: ccs0
[172.876173] Dynamic subtest ccs0: SUCCESS (0.192s)
[172.882492] Starting dynamic subtest: ccs1
[173.072782] Dynamic subtest ccs1: SUCCESS (0.196s)
[173.079163] Starting dynamic subtest: ccs2
[173.261332] Dynamic subtest ccs2: SUCCESS (0.188s)
[173.267742] Starting dynamic subtest: ccs3
[173.537476] Dynamic subtest ccs3: SUCCESS (0.275s)
[173.538394] Subtest Q-promotion: SUCCESS (2.080s)
[173.796735] [028/138] (825s left) gem_render_copy (linear)
[173.892245] Starting subtest: linear
[173.893100] Starting dynamic subtest: smem
[173.967949] Dynamic subtest smem: SUCCESS (0.075s)
[173.974397] Starting dynamic subtest: lmem0
[174.189961] Dynamic subtest lmem0: SUCCESS (0.213s)
[174.190838] Subtest linear: SUCCESS (0.289s)
[174.409147] [029/138] (824s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[174.452938] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[174.553395] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.101s)
[174.639589] [030/138] (824s left) gem_busy (semaphore)
[174.832267] Subtest semaphore: SKIP (0.000s)
[175.060646] [031/138] (823s left) i915_pm_freq_api (freq-reset-multiple)
[175.112501] Starting subtest: freq-reset-multiple
[175.113537] Starting dynamic subtest: gt0
[196.031968] Dynamic subtest gt0: SUCCESS (20.918s)
[196.032801] Subtest freq-reset-multiple: SUCCESS (20.919s)
[196.101972] [032/138] (802s left) kms_feature_discovery (display-3x)
[198.057930] Starting subtest: display-3x
[198.059827] Subtest display-3x: SKIP (0.000s)
[198.116759] [033/138] (800s left) kms_ccs (pipe-a-bad-pixel-format-y-tiled-ccs)
[200.081199] Starting subtest: pipe-A-bad-pixel-format-y-tiled-ccs
[200.082968] Subtest pipe-A-bad-pixel-format-y-tiled-ccs: SKIP (0.000s)
[200.287464] [034/138] (798s left) kms_prop_blob (invalid-get-prop)
[200.355385] Starting subtest: invalid-get-prop
[200.356467] Subtest invalid-get-prop: SUCCESS (0.000s)
[200.459594] [035/138] (798s left) kms_big_fb (4-tiled-8bpp-rotate-0)
[202.444282] Starting subtest: 4-tiled-8bpp-rotate-0
[203.880957] Subtest 4-tiled-8bpp-rotate-0: SUCCESS (1.428s)
[204.031538] [036/138] (795s left) kms_atomic (plane-immutable-zpos)
[205.997873] Starting subtest: plane-immutable-zpos
[205.998811] Starting dynamic subtest: pipe-A-HDMI-A-3
[206.879245] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.882s)
[206.880058] Subtest plane-immutable-zpos: SUCCESS (0.883s)
[207.025448] [037/138] (792s left) prime_mmap (test_reprime)
[207.087532] Starting subtest: test_reprime
[207.088437] Starting dynamic subtest: test_reprime-smem
[207.132553] Dynamic subtest test_reprime-smem: SUCCESS (0.045s)
[207.138959] Starting dynamic subtest: test_reprime-lmem0
[207.322962] Dynamic subtest test_reprime-lmem0: SUCCESS (0.181s)
[207.323840] Subtest test_reprime: SUCCESS (0.227s)
[207.397899] [038/138] (791s left) kms_chamelium_edid (hdmi-edid-stress-resolution-4k)
[209.368449] Subtest hdmi-edid-stress-resolution-4k: SKIP (0.000s)
[209.493398] [039/138] (789s left) kms_cursor_crc (cursor-offscreen-64x64)
[211.520962] Starting subtest: cursor-offscreen-64x64
[211.525502] Starting dynamic subtest: pipe-A-HDMI-A-3
[213.971682] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.446s)
[214.004058] Starting dynamic subtest: pipe-D-HDMI-A-3
[216.318680] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.321s)
[216.319546] Subtest cursor-offscreen-64x64: SUCCESS (4.798s)
[216.613189] [040/138] (782s left) gem_exec_params (cliprects_ptr-dirt)
[216.687428] Starting subtest: cliprects_ptr-dirt
[216.688309] Subtest cliprects_ptr-dirt: SUCCESS (0.000s)
[216.800276] [041/138] (782s left) kms_addfb_basic (unused-modifier)
[216.877111] Starting subtest: unused-modifier
[216.878006] Subtest unused-modifier: SUCCESS (0.000s)
[218.861300] [042/138] (780s left) gem_fence_thrash (bo-write-verify-threaded-x)
[219.001903] Starting subtest: bo-write-verify-threaded-x
[219.007332] Subtest bo-write-verify-threaded-x: SKIP (0.003s)
[219.033941] [043/138] (780s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[220.987142] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[220.988942] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[221.057736] [044/138] (778s left) gem_userptr_blits (unsync-unmap-cycles)
[221.161290] Subtest unsync-unmap-cycles: SKIP (0.000s)
[221.330496] [045/138] (778s left) kms_invalid_mode (zero-vdisplay)
[223.319371] Starting subtest: zero-vdisplay
[223.320191] Starting dynamic subtest: pipe-A-HDMI-A-3
[223.364056] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.045s)
[223.370632] Starting dynamic subtest: pipe-B-HDMI-A-3
[223.371515] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.001s)
[223.377850] Starting dynamic subtest: pipe-C-HDMI-A-3
[223.378961] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.000s)
[223.385601] Starting dynamic subtest: pipe-D-HDMI-A-3
[223.386637] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.001s)
[223.387559] Subtest zero-vdisplay: SUCCESS (0.052s)
[223.502593] [046/138] (775s left) kms_chamelium_color (ctm-blue-to-red)
[225.497340] Subtest ctm-blue-to-red: SKIP (0.000s)
[225.513247] [047/138] (773s left) kms_ccs (pipe-d-crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc)
[227.553387] Starting subtest: pipe-D-crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc
[227.872096] Subtest pipe-D-crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc: SUCCESS (0.318s)
[228.089607] [048/138] (771s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[230.056555] Starting subtest: psr-rgb565-draw-mmap-gtt
[230.058122] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[230.139461] [049/138] (769s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[232.189401] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[233.448983] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.247s)
[233.557521] [050/138] (765s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled)
[233.606764] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled
[233.608523] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[233.791504] [051/138] (765s left) gem_mmap_gtt (basic-small-copy)
[233.836502] Subtest basic-small-copy: SKIP (0.000s)
[233.861115] [052/138] (765s left) kms_frontbuffer_tracking (psr-1p-rte)
[235.803426] Starting subtest: psr-1p-rte
[235.805200] Subtest psr-1p-rte: SKIP (0.000s)
[235.888744] [053/138] (763s left) gem_exec_whisper (basic-fds)
[236.017584] Starting subtest: basic-fds
[247.549876] Subtest basic-fds: SUCCESS (11.522s)
[247.738068] [054/138] (751s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-onoff)
[249.687112] Starting subtest: psr-1p-primscrn-cur-indfb-onoff
[249.688585] Subtest psr-1p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[249.775559] [055/138] (749s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[251.831774] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[254.071523] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (2.242s)
[254.209025] [056/138] (745s left) gem_lmem_swapping (basic)
[257.444917] Starting subtest: basic
[257.445783] Starting dynamic subtest: lmem0
[273.869966] Dynamic subtest lmem0: SUCCESS (16.390s)
[273.870868] Subtest basic: SUCCESS (16.392s)
[276.976228] [057/138] (722s left) kms_chamelium_hpd (vga-hpd-fast)
[281.787962] Subtest vga-hpd-fast: SKIP (0.000s)
[282.918173] [058/138] (716s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted)
[282.971872] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted
[283.075438] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.102s)
[283.175107] [059/138] (716s left) drm_fdinfo (busy)
[283.249840] Starting subtest: busy
[283.250786] Starting dynamic subtest: rcs0
[283.252586] Dynamic subtest rcs0: SKIP (0.000s)
[283.258381] Starting dynamic subtest: bcs0
[283.260412] Dynamic subtest bcs0: SKIP (0.000s)
[283.266017] Starting dynamic subtest: vcs0
[283.268230] Dynamic subtest vcs0: SKIP (0.000s)
[283.273527] Starting dynamic subtest: vcs1
[283.275738] Dynamic subtest vcs1: SKIP (0.000s)
[283.281181] Starting dynamic subtest: vecs0
[283.283382] Dynamic subtest vecs0: SKIP (0.000s)
[283.288737] Starting dynamic subtest: vecs1
[283.291012] Dynamic subtest vecs1: SKIP (0.000s)
[283.297069] Starting dynamic subtest: ccs0
[283.298832] Dynamic subtest ccs0: SKIP (0.000s)
[283.304228] Starting dynamic subtest: ccs1
[283.306218] Dynamic subtest ccs1: SKIP (0.000s)
[283.311468] Starting dynamic subtest: ccs2
[283.313557] Dynamic subtest ccs2: SKIP (0.000s)
[283.318833] Starting dynamic subtest: ccs3
[283.320994] Dynamic subtest ccs3: SKIP (0.000s)
[283.323146] Subtest busy: SKIP (0.007s)
[283.332851] [060/138] (716s left) dumb_buffer (invalid-bpp)
[283.377053] Starting subtest: invalid-bpp
[283.377944] Subtest invalid-bpp: SUCCESS (0.000s)
[283.450232] [061/138] (716s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[285.430944] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[285.432662] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[285.512460] [062/138] (714s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render)
[287.577977] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render
[287.579716] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[287.666232] [063/138] (712s left) kms_ccs (pipe-d-bad-pixel-format-4-tiled-mtl-rc-ccs)
[289.805728] Starting subtest: pipe-D-bad-pixel-format-4-tiled-mtl-rc-ccs
[289.807542] Subtest pipe-D-bad-pixel-format-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[289.916767] [064/138] (709s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite)
[291.876498] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite
[291.878048] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[291.950965] [065/138] (707s left) i915_query (query-regions-sanity-check)
[292.072034] Starting subtest: query-regions-sanity-check
[292.112971] Subtest query-regions-sanity-check: SUCCESS (0.042s)
[292.220105] [066/138] (707s left) kms_ccs (pipe-d-bad-aux-stride-4-tiled-mtl-mc-ccs)
[294.308928] Starting subtest: pipe-D-bad-aux-stride-4-tiled-mtl-mc-ccs
[294.310522] Subtest pipe-D-bad-aux-stride-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[294.406301] [067/138] (705s left) gem_eio (in-flight-10ms)
[294.698440] Starting subtest: in-flight-10ms
[299.356360] Subtest in-flight-10ms: SUCCESS (4.658s)
[301.323979] [068/138] (698s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite)
[303.364457] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite
[303.366178] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[303.443645] [069/138] (696s left) kms_ccs (pipe-d-crc-sprite-planes-basic-4-tiled-dg2-mc-ccs)
[305.599677] Starting subtest: pipe-D-crc-sprite-planes-basic-4-tiled-dg2-mc-ccs
[318.260315] Subtest pipe-D-crc-sprite-planes-basic-4-tiled-dg2-mc-ccs: SUCCESS (12.659s)
[318.411101] [070/138] (681s left) gem_eio (unwedge-stress)
[318.745339] Starting subtest: unwedge-stress
[360.380056] Subtest unwedge-stress: SUCCESS (41.635s)
[362.364461] [071/138] (637s left) kms_draw_crc (draw-method-blt)
[364.392287] Starting subtest: draw-method-blt
[364.393128] Starting dynamic subtest: xrgb8888-untiled
[364.742594] Dynamic subtest xrgb8888-untiled: SUCCESS (0.350s)
[364.776044] Starting dynamic subtest: rgb565-untiled
[365.075985] Dynamic subtest rgb565-untiled: SUCCESS (0.330s)
[365.107043] Starting dynamic subtest: xrgb2101010-untiled
[365.342598] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.264s)
[365.357132] Starting dynamic subtest: xrgb8888-xtiled
[365.492717] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.147s)
[365.524953] Starting dynamic subtest: rgb565-xtiled
[365.659249] Dynamic subtest rgb565-xtiled: SUCCESS (0.164s)
[365.690591] Starting dynamic subtest: xrgb2101010-xtiled
[365.809368] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.147s)
[365.839866] Starting dynamic subtest: xrgb8888-4tiled
[365.975888] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.164s)
[366.006568] Starting dynamic subtest: rgb565-4tiled
[366.142596] Dynamic subtest rgb565-4tiled: SUCCESS (0.164s)
[366.174439] Starting dynamic subtest: xrgb2101010-4tiled
[366.292493] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.147s)
[366.294354] Subtest draw-method-blt: SUCCESS (1.902s)
[366.449791] [072/138] (633s left) gem_exec_fence (syncobj-timeline-invalid-wait)
[367.375158] Starting subtest: syncobj-timeline-invalid-wait
[367.376391] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.004s)
[367.610277] [073/138] (632s left) perf (non-sampling-read-error)
[368.548819] Starting subtest: non-sampling-read-error
[368.564612] Subtest non-sampling-read-error: SUCCESS (0.016s)
[368.588407] [074/138] (631s left) kms_ccs (pipe-a-random-ccs-data-4-tiled-dg2-mc-ccs)
[370.571121] Starting subtest: pipe-A-random-ccs-data-4-tiled-dg2-mc-ccs
[371.088610] Subtest pipe-A-random-ccs-data-4-tiled-dg2-mc-ccs: SUCCESS (0.517s)
[371.282533] [075/138] (628s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[373.238733] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[373.240384] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[373.319815] [076/138] (626s left) api_intel_allocator (execbuf-with-allocator)
[373.464610] Starting subtest: execbuf-with-allocator
[373.486500] Subtest execbuf-with-allocator: SUCCESS (0.022s)
[373.612466] [077/138] (626s left) syncobj_wait (single-wait-submitted)
[373.668422] Starting subtest: single-wait-submitted
[373.770492] Subtest single-wait-submitted: SUCCESS (0.102s)
[373.853986] [078/138] (626s left) syncobj_timeline (multi-wait-all-available-submitted)
[373.899338] Starting subtest: multi-wait-all-available-submitted
[373.900144] Subtest multi-wait-all-available-submitted: SUCCESS (0.000s)
[373.990999] [079/138] (626s left) kms_ccs (pipe-c-bad-aux-stride-4-tiled-mtl-mc-ccs)
[376.055519] Starting subtest: pipe-C-bad-aux-stride-4-tiled-mtl-mc-ccs
[376.057365] Subtest pipe-C-bad-aux-stride-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[376.172882] [080/138] (623s left) kms_plane_scaling (intel-max-src-size)
[378.142249] Starting subtest: intel-max-src-size
[378.146351] Subtest intel-max-src-size: SKIP (0.004s)
[378.224510] [081/138] (621s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[380.253528] Starting subtest: cursorA-vs-flipA-toggle
[391.143926] Subtest cursorA-vs-flipA-toggle: SUCCESS (10.891s)
[391.272349] [082/138] (608s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-plflip-blt)
[393.259994] Starting subtest: fbcpsr-2p-scndscrn-indfb-plflip-blt
[393.261497] Subtest fbcpsr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[393.336756] [083/138] (606s left) vc4/vc4_purgeable_bo (access-purged-bo-mem)
[393.516856] Subtest access-purged-bo-mem: SKIP (0.000s)
[393.567996] [084/138] (606s left) kms_pm_rpm (modeset-lpsp-stress-no-wait)
[398.495649] Starting subtest: modeset-lpsp-stress-no-wait
[398.694027] Subtest modeset-lpsp-stress-no-wait: SKIP (0.198s)
[400.686389] [085/138] (599s left) gem_mmap_offset (perf)
[400.766321] Starting subtest: perf
[400.767682] Starting dynamic subtest: lmem0
[401.173129] Dynamic subtest lmem0: SUCCESS (0.398s)
[401.183472] Starting dynamic subtest: smem0
[401.188768] Dynamic subtest smem0: SUCCESS (0.002s)
[401.189894] Subtest perf: SUCCESS (0.402s)
[401.287849] [086/138] (599s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[403.242865] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[403.244543] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[403.318535] [087/138] (597s left) kms_ccs (pipe-c-crc-primary-rotation-180-4-tiled-dg2-rc-ccs)
[405.430296] Starting subtest: pipe-C-crc-primary-rotation-180-4-tiled-dg2-rc-ccs
[405.794654] Subtest pipe-C-crc-primary-rotation-180-4-tiled-dg2-rc-ccs: SUCCESS (0.363s)
[406.035554] [088/138] (594s left) core_auth (getclient-simple)
[406.090527] Starting subtest: getclient-simple
[406.094028] Subtest getclient-simple: SUCCESS (0.002s)
[406.145800] [089/138] (594s left) gem_exec_fair (basic-none)
[406.200767] Subtest basic-none: SKIP (0.000s)
[406.269046] [090/138] (594s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[408.306945] Starting subtest: cursor-rapid-movement-32x10
[408.347141] Subtest cursor-rapid-movement-32x10: SKIP (0.038s)
[408.647248] [091/138] (591s left) gem_pwrite (basic-exhaustion)
[408.713148] Subtest basic-exhaustion: SKIP (0.000s)
[408.756296] [092/138] (591s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[410.714121] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[410.714987] Starting dynamic subtest: pipe-A-valid-mode
[412.102802] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.385s)
[412.103619] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SUCCESS (1.386s)
[412.242276] [093/138] (588s left) kms_getfb (getfb-handle-protection)
[412.309112] Starting subtest: getfb-handle-protection
[412.316970] Subtest getfb-handle-protection: SUCCESS (0.009s)
[412.447231] [094/138] (588s left) syncobj_timeline (device-signal-unordered)
[412.520331] Starting subtest: device-signal-unordered
[412.521269] Subtest device-signal-unordered: SUCCESS (0.000s)
[412.589331] [095/138] (587s left) gem_ctx_param (invalid-ctx-get)
[412.644842] Starting subtest: invalid-ctx-get
[412.645630] Subtest invalid-ctx-get: SUCCESS (0.000s)
[412.702999] [096/138] (587s left) kms_ccs (pipe-b-crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[414.697147] Starting subtest: pipe-B-crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[414.698922] Subtest pipe-B-crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s)
[414.840851] [097/138] (585s left) kms_ccs (pipe-b-missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[416.858818] Starting subtest: pipe-B-missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[416.860686] Subtest pipe-B-missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s)
[416.996439] [098/138] (583s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling)
[418.961636] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling
[418.963868] Starting dynamic subtest: pipe-A-valid-mode
[420.169333] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.206s)
[420.170211] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SUCCESS (1.207s)
[420.346355] [099/138] (580s left) gem_exec_alignment (many)