[46.935779] Initializing watchdogs
[46.936088]   /dev/watchdog0
[46.954246] [001/137] (960s left) gem_eio (in-flight-suspend)
[47.196990] Starting subtest: in-flight-suspend
[86.397826] Subtest in-flight-suspend: SUCCESS (8.077s)
[90.600524] [002/137] (952s left) perf (oa-formats)
[90.930139] Starting subtest: oa-formats
[90.931819] Starting dynamic subtest: 0-rcs0
[91.129635] Dynamic subtest 0-rcs0: SUCCESS (0.199s)
[91.131169] Subtest oa-formats: SUCCESS (0.199s)
[91.174501] [003/137] (951s left) gem_exec_fence (basic-busy)
[91.500983] Starting subtest: basic-busy
[91.502663] Starting dynamic subtest: rcs0
[91.527001] Dynamic subtest rcs0: SUCCESS (0.027s)
[91.548080] Starting dynamic subtest: bcs0
[91.553109] Dynamic subtest bcs0: SUCCESS (0.026s)
[91.571276] Starting dynamic subtest: vcs0
[91.582736] Dynamic subtest vcs0: SUCCESS (0.029s)
[91.602207] Starting dynamic subtest: vecs0
[91.605155] Dynamic subtest vecs0: SUCCESS (0.023s)
[91.606630] Subtest basic-busy: SUCCESS (0.106s)
[92.241060] [004/137] (950s left) i915_pm_rpm (i2c)
[94.263860] Starting subtest: i2c
[96.022547] Subtest i2c: SUCCESS (1.758s)
[96.202496] [005/137] (946s left) gem_exec_schedule (promotion)
[96.418325] Starting subtest: promotion
[96.420582] Starting dynamic subtest: rcs0
[96.563859] Dynamic subtest rcs0: SUCCESS (0.142s)
[96.593869] Starting dynamic subtest: bcs0
[96.730585] Dynamic subtest bcs0: SUCCESS (0.166s)
[96.754277] Starting dynamic subtest: vcs0
[96.870766] Dynamic subtest vcs0: SUCCESS (0.140s)
[96.892623] Starting dynamic subtest: vecs0
[97.005584] Dynamic subtest vecs0: SUCCESS (0.136s)
[97.007591] Subtest promotion: SUCCESS (0.585s)
[97.334262] [006/137] (945s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180)
[97.636011] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180
[99.014850] Subtest x-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.378s)
[99.156706] [007/137] (943s left) kms_ccs (pipe-b-random-ccs-data-y_tiled_gen12_mc_ccs)
[99.676803] Starting subtest: pipe-B-random-ccs-data-y_tiled_gen12_mc_ccs
[99.680670] Subtest pipe-B-random-ccs-data-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[100.154219] [008/137] (942s left) gem_userptr_blits (invalid-null-pointer)
[100.347544] Starting subtest: invalid-null-pointer
[100.351927] Subtest invalid-null-pointer: SUCCESS (0.005s)
[100.505237] [009/137] (942s left) gem_wait (write-busy)
[100.720605] Starting subtest: write-busy
[100.722592] Starting dynamic subtest: all-engines
[101.255172] Dynamic subtest all-engines: SUCCESS (0.534s)
[101.279585] Starting dynamic subtest: rcs0
[101.771840] Dynamic subtest rcs0: SUCCESS (0.517s)
[101.793253] Starting dynamic subtest: bcs0
[102.294839] Dynamic subtest bcs0: SUCCESS (0.523s)
[102.316611] Starting dynamic subtest: vcs0
[102.818540] Dynamic subtest vcs0: SUCCESS (0.520s)
[102.842065] Starting dynamic subtest: vecs0
[103.354097] Dynamic subtest vecs0: SUCCESS (0.539s)
[103.355560] Subtest write-busy: SUCCESS (2.633s)
[103.627760] [010/137] (939s left) gem_mmap_gtt (basic-small-bo-tiledy)
[103.851936] Starting subtest: basic-small-bo-tiledY
[105.340045] Subtest basic-small-bo-tiledY: SUCCESS (1.487s)
[105.503091] [011/137] (937s left) gem_exec_params (sol-reset-not-gen7)
[105.814568] Starting subtest: sol-reset-not-gen7
[105.820247] Subtest sol-reset-not-gen7: SUCCESS (0.004s)
[105.937702] [012/137] (937s left) kms_plane_lowres (tiling-x)
[106.222139] Starting subtest: tiling-x
[106.223760] Starting dynamic subtest: pipe-A-DP-1
[112.420311] Dynamic subtest pipe-A-DP-1: SUCCESS (6.196s)
[112.557282] Starting dynamic subtest: pipe-B-DP-1
[118.356105] Dynamic subtest pipe-B-DP-1: SUCCESS (5.818s)
[118.460954] Starting dynamic subtest: pipe-C-DP-1
[122.354274] Dynamic subtest pipe-C-DP-1: SUCCESS (3.913s)
[122.467329] Subtest tiling-x: SUCCESS (16.245s)
[122.872437] [013/137] (920s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[123.169000] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu
[123.171488] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[123.271104] [014/137] (919s left) kms_flip (2x-flip-vs-expired-vblank)
[123.535043] Starting subtest: 2x-flip-vs-expired-vblank
[123.537723] Subtest 2x-flip-vs-expired-vblank: SKIP (0.003s)
[123.638550] [015/137] (919s left) gem_mmap_gtt (flink-race)
[123.815447] Starting subtest: flink-race
[143.899808] Subtest flink-race: SUCCESS (20.084s)
[144.006972] [016/137] (899s left) kms_cursor_legacy (cursora-vs-flipb-varying-size)
[144.283330] Starting subtest: cursorA-vs-flipB-varying-size
[144.286523] Subtest cursorA-vs-flipB-varying-size: SKIP (0.003s)
[144.373661] [017/137] (898s left) kms_lease (lease_invalid_plane)
[144.654025] Starting subtest: lease_invalid_plane
[144.655658] Starting dynamic subtest: pipe-A-DP-1
[144.656961] Dynamic subtest pipe-A-DP-1: SUCCESS (0.000s)
[144.677287] Starting dynamic subtest: pipe-B-DP-1
[144.678635] Dynamic subtest pipe-B-DP-1: SUCCESS (0.000s)
[144.698645] Starting dynamic subtest: pipe-C-DP-1
[144.699887] Dynamic subtest pipe-C-DP-1: SUCCESS (0.000s)
[144.701125] Subtest lease_invalid_plane: SUCCESS (0.008s)
[144.738186] [018/137] (898s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[144.931002] Starting subtest: yf-tiled-ccs-to-x-tiled
[144.932325] Starting dynamic subtest: smem
[145.242788] Dynamic subtest smem: SUCCESS (0.310s)
[145.244099] Subtest yf-tiled-ccs-to-x-tiled: SUCCESS (0.311s)
[145.438125] [019/137] (897s left) gem_userptr_blits (relocations)
[145.629540] Starting subtest: relocations
[145.635247] Subtest relocations: SKIP (0.006s)
[145.787128] [020/137] (897s left) gem_mmap_gtt (fault-concurrent)
[145.965617] Starting subtest: fault-concurrent
[149.256717] Subtest fault-concurrent: SUCCESS (3.290s)
[149.603119] [021/137] (893s left) perf_pmu (frequency-idle)
[149.790430] Starting subtest: frequency-idle
[150.301801] Subtest frequency-idle: SUCCESS (0.508s)
[150.387501] [022/137] (892s left) kms_chamelium_edid (vga-edid-read)
[150.751504] Subtest vga-edid-read: SKIP (0.000s)
[151.038597] [023/137] (892s left) kms_invalid_mode (clock-too-high)
[151.314171] Starting subtest: clock-too-high
[151.315585] Starting dynamic subtest: DP-1-pipe-A
[151.414493] Dynamic subtest DP-1-pipe-A: SUCCESS (0.100s)
[151.447170] Starting dynamic subtest: DP-1-pipe-B
[151.448953] Dynamic subtest DP-1-pipe-B: SUCCESS (0.014s)
[151.471472] Starting dynamic subtest: DP-1-pipe-C
[151.474229] Dynamic subtest DP-1-pipe-C: SUCCESS (0.015s)
[151.476907] Subtest clock-too-high: SUCCESS (0.139s)
[151.777538] [024/137] (891s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[152.059836] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[152.062413] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[152.144385] [025/137] (891s left) gem_lmem_swapping (heavy-verify-random-ccs)
[152.343521] Subtest heavy-verify-random-ccs: SKIP (0.000s)
[152.399083] [026/137] (891s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[152.705441] Starting subtest: 4-tiled-16bpp-rotate-0
[152.707980] Subtest 4-tiled-16bpp-rotate-0: SKIP (0.000s)
[152.810717] [027/137] (890s left) gem_userptr_blits (stress-purge)
[153.018805] Starting subtest: stress-purge
[158.401663] Subtest stress-purge: SUCCESS (5.381s)
[158.555484] [028/137] (884s left) kms_frontbuffer_tracking (fbc-rgb565-draw-blt)
[158.967234] Starting subtest: fbc-rgb565-draw-blt
[161.190111] Subtest fbc-rgb565-draw-blt: SUCCESS (2.223s)
[161.310255] [029/137] (882s left) kms_concurrent (pipe-b)
[161.588031] Starting subtest: pipe-B
[161.593392] Starting dynamic subtest: DP-1
[162.431575] Dynamic subtest DP-1: SUCCESS (0.839s)
[162.432941] Subtest pipe-B: SUCCESS (0.843s)
[162.747576] [030/137] (880s left) gem_exec_reloc (basic-write-read-noreloc)
[162.941452] Starting subtest: basic-write-read-noreloc
[162.947537] Subtest basic-write-read-noreloc: SUCCESS (0.007s)
[163.129982] [031/137] (880s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[163.407743] Starting subtest: basic-busy-flip-before-cursor-legacy
[163.410418] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[163.496174] [032/137] (880s left) i915_pm_rpm (dpms-mode-unset-lpsp)
[165.469393] Starting subtest: dpms-mode-unset-lpsp
[166.003815] Subtest dpms-mode-unset-lpsp: SKIP (0.533s)
[166.474060] [033/137] (877s left) kms_plane_scaling (plane-upscale-with-modifiers-factor-0-25)
[166.758793] Starting subtest: plane-upscale-with-modifiers-factor-0-25
[166.760329] Starting dynamic subtest: pipe-A-DP-1
[167.260774] Dynamic subtest pipe-A-DP-1: SUCCESS (0.500s)
[167.285851] Starting dynamic subtest: pipe-B-DP-1
[168.074459] Dynamic subtest pipe-B-DP-1: SUCCESS (0.810s)
[168.098697] Starting dynamic subtest: pipe-C-DP-1
[168.710953] Dynamic subtest pipe-C-DP-1: SUCCESS (0.633s)
[168.712281] Subtest plane-upscale-with-modifiers-factor-0-25: SUCCESS (1.955s)
[169.107574] [034/137] (874s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[169.402071] Starting subtest: fbc-rgb565-draw-pwrite
[171.751279] Subtest fbc-rgb565-draw-pwrite: SUCCESS (2.349s)
[171.891212] [035/137] (871s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[172.186429] Starting subtest: psr-1p-primscrn-cur-indfb-move
[172.189160] Subtest psr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[172.289975] [036/137] (871s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear)
[172.583013] Starting subtest: fbcpsr-tiling-linear
[172.585782] Subtest fbcpsr-tiling-linear: SKIP (0.000s)
[172.690156] [037/137] (871s left) syncobj_timeline (invalid-multi-wait-available-unsubmitted-submitted)
[172.883411] Starting subtest: invalid-multi-wait-available-unsubmitted-submitted
[172.885319] Subtest invalid-multi-wait-available-unsubmitted-submitted: SUCCESS (0.002s)
[172.973887] [038/137] (870s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[173.264647] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt
[173.267435] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[173.373690] [039/137] (870s left) gem_busy (parallel)
[173.701542] Starting subtest: parallel
[173.703036] Starting dynamic subtest: rcs0
[173.748383] Dynamic subtest rcs0: SUCCESS (0.048s)
[173.783212] Starting dynamic subtest: bcs0
[173.784928] Dynamic subtest bcs0: SUCCESS (0.034s)
[173.811786] Starting dynamic subtest: vcs0
[173.820175] Dynamic subtest vcs0: SUCCESS (0.036s)
[173.846269] Starting dynamic subtest: vecs0
[173.855090] Dynamic subtest vecs0: SUCCESS (0.034s)
[173.856643] Subtest parallel: SUCCESS (0.155s)
[174.091949] [040/137] (869s left) gem_tiled_partial_pwrite_pread (reads)
[174.282085] Starting subtest: reads
[175.720431] Subtest reads: SUCCESS (1.438s)
[175.840986] [041/137] (868s left) kms_vblank (pipe-d-query-forked-busy-hang)
[176.117560] Subtest pipe-D-query-forked-busy-hang: SKIP (0.000s)
[176.207313] [042/137] (867s left) kms_ccs (pipe-a-missing-ccs-buffer-yf_tiled_ccs)
[176.637251] Starting subtest: pipe-A-missing-ccs-buffer-yf_tiled_ccs
[176.639627] Subtest pipe-A-missing-ccs-buffer-yf_tiled_ccs: SUCCESS (0.001s)
[177.218078] [043/137] (866s left) kms_plane_scaling (planes-downscale-factor-0-5)
[177.496725] Starting subtest: planes-downscale-factor-0-5
[177.498106] Starting dynamic subtest: pipe-A-DP-1
[177.854984] Dynamic subtest pipe-A-DP-1: SUCCESS (0.358s)
[177.884139] Starting dynamic subtest: pipe-B-DP-1
[178.245767] Dynamic subtest pipe-B-DP-1: SUCCESS (0.388s)
[178.277946] Starting dynamic subtest: pipe-C-DP-1
[178.335154] Dynamic subtest pipe-C-DP-1: SKIP (0.083s)
[178.337163] Subtest planes-downscale-factor-0-5: SUCCESS (0.840s)
[178.726874] [044/137] (865s left) syncobj_basic (bad-fd-to-handle)
[178.906908] Starting subtest: bad-fd-to-handle
[178.908404] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[178.992722] [045/137] (865s left) gem_exec_schedule (noreorder-priority)
[179.324409] Starting subtest: noreorder-priority
[179.326017] Starting dynamic subtest: rcs0
[180.453323] Dynamic subtest rcs0: SUCCESS (1.130s)
[180.486314] Starting dynamic subtest: bcs0
[181.587331] Dynamic subtest bcs0: SUCCESS (1.133s)
[181.618284] Starting dynamic subtest: vcs0
[182.715233] Dynamic subtest vcs0: SUCCESS (1.127s)
[182.743563] Starting dynamic subtest: vecs0
[183.843131] Dynamic subtest vecs0: SUCCESS (1.127s)
[183.844580] Subtest noreorder-priority: SUCCESS (4.521s)
[184.043796] [046/137] (860s left) fbdev (unaligned-write)
[184.239281] Starting subtest: unaligned-write
[184.422903] Subtest unaligned-write: SUCCESS (0.184s)
[184.493314] [047/137] (859s left) api_intel_bb (intel-bb-blit-y)
[184.671668] Starting subtest: intel-bb-blit-y
[187.838015] Subtest intel-bb-blit-y: SUCCESS (3.166s)
[187.942445] [048/137] (856s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)
[188.217944] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible
[188.226653] Starting dynamic subtest: A-DP1
[189.405129] Dynamic subtest A-DP1: SUCCESS (1.178s)
[189.430694] Starting dynamic subtest: B-DP1
[190.459456] Dynamic subtest B-DP1: SUCCESS (1.053s)
[190.483153] Starting dynamic subtest: C-DP1
[191.522748] Dynamic subtest C-DP1: SUCCESS (1.063s)
[191.524191] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (3.306s)
[191.868563] [049/137] (852s left) gem_ctx_freq (sysfs)
[192.061785] Starting subtest: sysfs
[196.988165] Subtest sysfs: SUCCESS (4.928s)
[197.051305] [050/137] (847s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[197.341496] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[197.344295] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[197.448688] [051/137] (846s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[197.750918] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip
[197.778092] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.024s)
[197.898475] [052/137] (846s left) gem_exec_balancer (fairslice)
[198.101450] Starting subtest: fairslice
[198.104222] Subtest fairslice: SKIP (0.000s)
[201.964470] [053/137] (842s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[202.253859] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[202.256724] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[202.348688] [054/137] (842s left) kms_getfb (getfb-handle-not-fb)
[202.530091] Starting subtest: getfb-handle-not-fb
[202.625890] Subtest getfb-handle-not-fb: SUCCESS (0.091s)
[202.717428] [055/137] (841s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[203.019497] Starting subtest: 4-tiled-8bpp-rotate-270
[203.023073] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.000s)
[203.116045] [056/137] (841s left) kms_frontbuffer_tracking (psr-modesetfrombusy)
[203.405101] Starting subtest: psr-modesetfrombusy
[203.408054] Subtest psr-modesetfrombusy: SKIP (0.000s)
[203.515066] [057/137] (841s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-plflip-blt)
[203.801240] Starting subtest: fbcpsr-2p-scndscrn-shrfb-plflip-blt
[203.803920] Subtest fbcpsr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[203.898722] [058/137] (840s left) syncobj_timeline (32bits-limit)
[204.081299] Starting subtest: 32bits-limit
[204.085231] Subtest 32bits-limit: SUCCESS (0.004s)
[204.164955] [059/137] (840s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[204.457302] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[204.460005] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[204.565470] [060/137] (840s left) gem_ctx_persistence (engines-mixed)
[204.752001] Starting subtest: engines-mixed
[204.753411] Starting dynamic subtest: rcs0
[204.802169] Dynamic subtest rcs0: SUCCESS (0.049s)
[204.832042] Starting dynamic subtest: bcs0
[204.856087] Dynamic subtest bcs0: SUCCESS (0.053s)
[204.882449] Starting dynamic subtest: vcs0
[204.903135] Dynamic subtest vcs0: SUCCESS (0.046s)
[204.931182] Starting dynamic subtest: vecs0
[204.950998] Dynamic subtest vecs0: SUCCESS (0.047s)
[204.952303] Subtest engines-mixed: SUCCESS (0.199s)
[205.050476] [061/137] (839s left) i915_module_load (reload-with-fault-injection)
[205.226422] Starting subtest: reload-with-fault-injection
[211.185735] Subtest reload-with-fault-injection: SUCCESS (5.957s)
[211.217999] [062/137] (833s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-render)
[212.830961] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-render
[212.834060] Subtest fbcpsr-1p-offscren-pri-indfb-draw-render: SKIP (0.000s)
[212.970753] [063/137] (831s left) kms_ccs (pipe-c-random-ccs-data-y_tiled_gen12_rc_ccs)
[213.536422] Starting subtest: pipe-C-random-ccs-data-y_tiled_gen12_rc_ccs
[213.540444] Subtest pipe-C-random-ccs-data-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[213.876508] [064/137] (831s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled)
[214.064005] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[214.065570] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[214.143406] [065/137] (830s left) kms_flip (flip-vs-panning-vs-hang)
[214.416857] Starting subtest: flip-vs-panning-vs-hang
[214.418592] Starting dynamic subtest: A-DP1
[227.590421] Dynamic subtest A-DP1: SUCCESS (13.172s)
[227.610607] Starting dynamic subtest: C-DP1
[240.585058] Dynamic subtest C-DP1: SUCCESS (12.995s)
[240.586518] Subtest flip-vs-panning-vs-hang: SUCCESS (26.175s)
[241.009040] [066/137] (804s left) kms_ccs (pipe-c-ccs-on-another-bo-y_tiled_gen12_rc_ccs)
[241.646087] Starting subtest: pipe-C-ccs-on-another-bo-y_tiled_gen12_rc_ccs
[241.648956] Subtest pipe-C-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[241.994127] [067/137] (803s left) gem_reg_read (timestamp-moving)
[242.172908] Starting subtest: timestamp-moving
[243.173139] Subtest timestamp-moving: SUCCESS (1.001s)
[243.260851] [068/137] (801s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[243.564586] Starting subtest: y-tiled-8bpp-rotate-0
[246.572982] Subtest y-tiled-8bpp-rotate-0: SUCCESS (3.007s)
[246.795479] [069/137] (798s left) vc4/vc4_purgeable_bo (mark-unpurgeable-purged)
[247.040039] Subtest mark-unpurgeable-purged: SKIP (0.000s)
[247.110838] [070/137] (798s left) kms_universal_plane (disable-primary-vs-flip-pipe-a)
[247.389087] Starting subtest: disable-primary-vs-flip-pipe-A
[248.063790] Subtest disable-primary-vs-flip-pipe-A: SUCCESS (0.674s)
[248.396623] [071/137] (796s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[248.577203] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[248.631311] [072/137] (796s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[248.905853] Starting subtest: addfb25-y-tiled-small-legacy
[248.907492] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.001s)
[249.012213] [073/137] (796s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-downscaling)
[249.294781] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-downscaling
[249.296274] Starting dynamic subtest: pipe-A-valid-mode
[250.021269] Dynamic subtest pipe-A-valid-mode: SKIP (0.723s)
[250.024101] Subtest flip-32bpp-xtile-to-64bpp-xtile-downscaling: SKIP (0.726s)
[250.399461] [074/137] (794s left) kms_ccs (pipe-a-bad-pixel-format-y_tiled_ccs)
[250.673710] Starting subtest: pipe-A-bad-pixel-format-y_tiled_ccs
[250.675081] Subtest pipe-A-bad-pixel-format-y_tiled_ccs: SUCCESS (0.001s)
[251.420252] [075/137] (793s left) gem_exec_balancer (indices)
[251.631995] Starting subtest: indices
[255.271004] Subtest indices: SUCCESS (3.639s)
[259.137102] [076/137] (786s left) syncobj_wait (single-wait-submitted)
[259.323368] Starting subtest: single-wait-submitted
[259.428692] Subtest single-wait-submitted: SUCCESS (0.104s)
[259.519473] [077/137] (785s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[259.800496] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[259.803264] Subtest psr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[259.903958] [078/137] (785s left) kms_vblank (pipe-c-query-forked-hang)
[260.181938] Starting subtest: pipe-C-query-forked-hang
[267.669284] Subtest pipe-C-query-forked-hang: SUCCESS (7.487s)
[268.004816] [079/137] (777s left) syncobj_timeline (single-wait-for-submit-signaled)
[268.188188] Starting subtest: single-wait-for-submit-signaled
[268.189941] Subtest single-wait-for-submit-signaled: SUCCESS (0.001s)
[268.270696] [080/137] (777s left) gem_softpin (evict-active)
[268.464401] Starting subtest: evict-active
[268.480313] Subtest evict-active: SUCCESS (0.016s)
[268.587481] [081/137] (776s left) kms_psr (psr2_sprite_plane_onoff)
[268.769781] Subtest psr2_sprite_plane_onoff: SKIP (0.000s)
[268.822113] [082/137] (776s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[269.105662] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[269.108362] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[269.204540] [083/137] (776s left) gem_exec_reloc (basic-cpu-wc-noreloc)
[269.397077] Starting subtest: basic-cpu-wc-noreloc
[269.412774] Subtest basic-cpu-wc-noreloc: SUCCESS (0.016s)
[269.606043] [084/137] (776s left) kms_psr2_sf (plane-move-sf-dmg-area)
[269.784705] Subtest plane-move-sf-dmg-area: SKIP (0.000s)
[269.840121] [085/137] (775s left) i915_getparams_basic (basic-subslice-total)
[270.017887] Starting subtest: basic-subslice-total
[270.020760] Subtest basic-subslice-total: SUCCESS (0.000s)
[270.103122] [086/137] (775s left) v3d/v3d_wait_bo (unused-bo-1ns)
[270.331904] Subtest unused-bo-1ns: SKIP (0.000s)
[270.403764] [087/137] (775s left) kms_ccs (pipe-a-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc)
[270.823259] Starting subtest: pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc
[270.826331] Subtest pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[271.397582] [088/137] (774s left) drm_fdinfo (virtual-busy-idle)
[271.584090] Starting subtest: virtual-busy-idle
[274.159822] Subtest virtual-busy-idle: SUCCESS (2.575s)
[274.246776] [089/137] (771s left) kms_ccs (pipe-b-crc-primary-basic-4_tiled_dg2_rc_ccs_cc)
[274.747456] Starting subtest: pipe-B-crc-primary-basic-4_tiled_dg2_rc_ccs_cc
[274.750285] Subtest pipe-B-crc-primary-basic-4_tiled_dg2_rc_ccs_cc: SKIP (0.001s)
[275.250749] [090/137] (770s left) gem_exec_fence (submit-chain)
[275.575620] Starting subtest: submit-chain
[275.601921] Subtest submit-chain: SUCCESS (0.028s)
[276.251076] [091/137] (769s left) kms_content_protection (srm)
[276.582987] Starting subtest: srm
[276.612420] Starting dynamic subtest: pipe-A-DP-1
[397.252595] Per-test timeout exceeded. Killing the current test with SIGQUIT.
[397.961023] Closing watchdogs
[397.967511] Initializing watchdogs
[397.967717]   /dev/watchdog0
[397.994208] [092/137] (648s left) v3d/v3d_perfmon (create-perfmon-0)
[398.244251] Subtest create-perfmon-0: SKIP (0.000s)
[398.316561] [093/137] (647s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[398.497048] Starting subtest: invalid-multi-wait-unsubmitted
[398.498908] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[398.583441] [094/137] (647s left) kms_getfb (getfb-handle-zero)
[398.762627] Starting subtest: getfb-handle-zero
[398.764501] Subtest getfb-handle-zero: SUCCESS (0.000s)
[398.854198] [095/137] (647s left) gem_eio (wait-1us)
[399.067849] Starting subtest: wait-1us
[399.153298] Subtest wait-1us: SUCCESS (0.086s)
[399.337819] [096/137] (646s left) kms_big_fb (x-tiled-32bpp-rotate-0)
[399.635788] Starting subtest: x-tiled-32bpp-rotate-0
[404.576436] Subtest x-tiled-32bpp-rotate-0: SUCCESS (4.939s)
[405.102259] [097/137] (641s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[405.416116] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[405.419332] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[405.551976] [098/137] (640s left) gem_ctx_param (basic)
[405.731209] Starting subtest: basic
[405.733008] Subtest basic: SUCCESS (0.000s)
[405.819000] [099/137] (640s left) kms_vblank (pipe-a-query-forked-busy)
[406.107915] Starting subtest: pipe-A-query-forked-busy
[408.558375] Subtest pipe-A-query-forked-busy: SUCCESS (2.450s)
[408.887943] [100/137] (637s left) kms_ccs (pipe-b-bad-aux-stride-y_tiled_gen12_rc_ccs_cc)
[409.438945] Starting subtest: pipe-B-bad-aux-stride-y_tiled_gen12_rc_ccs_cc
[409.441927] Subtest pipe-B-bad-aux-stride-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[409.892870] [101/137] (636s left) gem_ctx_shared (single-timeline)
[410.094317] Starting subtest: single-timeline
[410.114158] Subtest single-timeline: SUCCESS (0.019s)
[410.343295] [102/137] (636s left) prime_vgem (fence-write-hang)
[410.554450] Subtest fence-write-hang: SKIP (0.000s)
[410.659309] [103/137] (635s left) gem_mmap_gtt (pf-nonblock)
[410.841756] Starting subtest: pf-nonblock
[410.846707] Subtest pf-nonblock: SUCCESS (0.008s)
[410.958997] [104/137] (635s left) v3d/v3d_submit_cl (simple-flush-cache)
[411.202754] Subtest simple-flush-cache: SKIP (0.000s)
[411.275928] [105/137] (635s left) kms_cursor_edge_walk (256x256-right-edge)
[411.558794] Starting subtest: 256x256-right-edge
[411.560953] Starting dynamic subtest: pipe-A-DP-1
[415.180719] Dynamic subtest pipe-A-DP-1: SUCCESS (3.620s)
[415.208899] Starting dynamic subtest: pipe-C-DP-1
[418.675646] Dynamic subtest pipe-C-DP-1: SUCCESS (3.488s)
[418.677405] Subtest 256x256-right-edge: SUCCESS (7.120s)
[418.991824] [106/137] (627s left) kms_fbcon_fbt (fbc)
[419.182653] Starting subtest: fbc
[423.084597] Subtest fbc: SUCCESS (3.904s)
[423.136695] [107/137] (623s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[423.317226] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[423.421775] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.103s)
[423.508062] [108/137] (623s left) i915_suspend (basic-s2idle-without-i915)
[423.683508] Starting subtest: basic-s2idle-without-i915
[442.447775] Subtest basic-s2idle-without-i915: SUCCESS (18.755s)
[445.594039] [109/137] (604s left) kms_plane (plane-position-hole-dpms)
[445.885617] Starting subtest: plane-position-hole-dpms
[445.887093] Starting dynamic subtest: pipe-A-planes
[448.003108] Dynamic subtest pipe-A-planes: SUCCESS (2.117s)
[448.028898] Starting dynamic subtest: pipe-B-planes
[450.374485] Dynamic subtest pipe-B-planes: SUCCESS (2.361s)
[450.375923] Subtest plane-position-hole-dpms: SUCCESS (4.492s)
[450.719724] [110/137] (599s left) core_setmaster (master-drop-set-root)
[452.566006] Starting subtest: master-drop-set-root
[452.579237] Subtest master-drop-set-root: SUCCESS (0.018s)
[452.617301] [111/137] (597s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-pwrite)
[452.906763] Starting subtest: psr-1p-offscren-pri-indfb-draw-pwrite
[452.909695] Subtest psr-1p-offscren-pri-indfb-draw-pwrite: SKIP (0.000s)
[453.003218] [112/137] (596s left) gem_exec_params (invalid-fence-in-submit)
[453.211446] Starting subtest: invalid-fence-in-submit
[453.227171] Subtest invalid-fence-in-submit: SUCCESS (0.017s)
[453.336592] [113/137] (596s left) gem_exec_flush (basic-wb-ro-before-default)
[453.540537] Starting subtest: basic-wb-ro-before-default
[459.004415] Subtest basic-wb-ro-before-default: SUCCESS (5.464s)
[459.204180] [114/137] (590s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[459.490838] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[459.493701] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[459.587468] [115/137] (590s left) syncobj_wait (wait-all-complex)
[459.769148] Starting subtest: wait-all-complex
[459.986762] Subtest wait-all-complex: SUCCESS (0.215s)
[460.069466] [116/137] (589s left) vgem_basic (bad-flag)
[460.264212] Starting subtest: bad-flag
[460.265846] Subtest bad-flag: SUCCESS (0.000s)
[460.336187] [117/137] (589s left) kms_vblank (pipe-d-ts-continuation-suspend)
[460.616744] Subtest pipe-D-ts-continuation-suspend: SKIP (0.000s)
[460.704053] [118/137] (589s left) syncobj_wait (single-wait-all-for-submit-submitted)
[460.884153] Starting subtest: single-wait-all-for-submit-submitted
[460.988845] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.103s)
[461.069791] [119/137] (589s left) gem_exec_whisper (basic-contexts-all)
[461.277971] Starting subtest: basic-contexts-all
[474.303396] Subtest basic-contexts-all: SUCCESS (13.023s)
[474.504283] [120/137] (575s left) kms_chamelium_hpd (hdmi-hpd-enable-disable-mode)
[474.863049] Subtest hdmi-hpd-enable-disable-mode: SKIP (0.000s)
[475.156643] [121/137] (575s left) gem_userptr_blits (sync-unmap)
[475.364641] Starting subtest: sync-unmap
[475.417171] Subtest sync-unmap: SUCCESS (0.052s)
[475.547252] [122/137] (574s left) kms_ccs (pipe-d-bad-pixel-format-yf_tiled_ccs)
[476.223749] Subtest pipe-D-bad-pixel-format-yf_tiled_ccs: SKIP (0.000s)
[476.537302] [123/137] (573s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-downscaling)
[476.823146] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-downscaling
[476.824790] Starting dynamic subtest: pipe-A-valid-mode
[477.553627] Dynamic subtest pipe-A-valid-mode: SKIP (0.728s)
[477.556302] Subtest flip-32bpp-ytile-to-64bpp-ytile-downscaling: SKIP (0.732s)
[477.953906] [124/137] (572s left) kms_vblank (pipe-c-ts-continuation-modeset-hang)
[478.227878] Starting subtest: pipe-C-ts-continuation-modeset-hang
[485.642806] Subtest pipe-C-ts-continuation-modeset-hang: SUCCESS (7.419s)
[485.974933] [125/137] (564s left) kms_flip (2x-plain-flip-fb-recreate)
[486.232141] Starting subtest: 2x-plain-flip-fb-recreate
[486.239279] Subtest 2x-plain-flip-fb-recreate: SKIP (0.003s)
[486.341565] [126/137] (564s left) kms_draw_crc (draw-method-pwrite)
[486.619803] Starting subtest: draw-method-pwrite
[486.621124] Starting dynamic subtest: xrgb8888-untiled
[486.917216] Dynamic subtest xrgb8888-untiled: SUCCESS (0.296s)
[486.940984] Starting dynamic subtest: xrgb8888-xtiled
[487.215684] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.299s)
[487.238748] Starting dynamic subtest: xrgb8888-ytiled
[487.531783] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.315s)
[487.554677] Starting dynamic subtest: rgb565-untiled
[487.798765] Dynamic subtest rgb565-untiled: SUCCESS (0.265s)
[487.821409] Starting dynamic subtest: rgb565-xtiled
[488.098683] Dynamic subtest rgb565-xtiled: SUCCESS (0.299s)
[488.121411] Starting dynamic subtest: rgb565-ytiled
[488.382736] Dynamic subtest rgb565-ytiled: SUCCESS (0.282s)
[488.405616] Starting dynamic subtest: xrgb2101010-untiled
[488.665078] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.282s)
[488.688014] Starting dynamic subtest: xrgb2101010-xtiled
[488.981759] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.315s)
[489.004787] Starting dynamic subtest: xrgb2101010-ytiled
[489.298445] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.315s)
[489.299693] Subtest draw-method-pwrite: SUCCESS (2.681s)
[489.407320] [127/137] (561s left) kms_chamelium_color (ctm-blue-to-red)
[489.684090] Subtest ctm-blue-to-red: SKIP (0.000s)
[489.743937] [128/137] (560s left) kms_vblank (pipe-a-ts-continuation-dpms-suspend)
[490.016397] Starting subtest: pipe-A-ts-continuation-dpms-suspend
[507.575328] Subtest pipe-A-ts-continuation-dpms-suspend: SUCCESS (1.631s)
[510.836223] [129/137] (558s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[511.145256] Starting subtest: yf-tiled-8bpp-rotate-270
[511.148047] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[511.248013] [130/137] (558s left) kms_color (ctm-negative)
[511.521175] Starting subtest: ctm-negative
[511.525847] Starting dynamic subtest: pipe-A-DP-1
[512.038484] Dynamic subtest pipe-A-DP-1: SUCCESS (0.515s)
[512.071921] Starting dynamic subtest: pipe-B-DP-1
[512.835335] Dynamic subtest pipe-B-DP-1: SUCCESS (0.787s)
[512.862143] Starting dynamic subtest: pipe-C-DP-1
[513.757244] Dynamic subtest pipe-C-DP-1: SUCCESS (0.914s)
[513.758757] Subtest ctm-negative: SUCCESS (2.237s)
[514.098629] [131/137] (555s left) gem_mmap_gtt (basic-small-copy)
[514.277917] Starting subtest: basic-small-copy
[518.316090] Subtest basic-small-copy: SUCCESS (4.040s)
[518.397880] [132/137] (550s left) gem_softpin (32b-excludes-last-page)
[518.704022] Starting subtest: 32b-excludes-last-page
[518.710925] Subtest 32b-excludes-last-page: SUCCESS (0.006s)
[518.813903] [133/137] (550s left) gem_pxp (hw-rejects-pxp-context)
[521.518125] Starting subtest: hw-rejects-pxp-context
[521.519844] Subtest hw-rejects-pxp-context: SUCCESS (0.000s)
[521.597886] [134/137] (547s left) kms_ccs (pipe-d-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs)
[522.293913] Subtest pipe-D-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[522.607247] [135/137] (546s left) v3d/v3d_get_bo_offset (create-get-offsets)
[522.866690] Subtest create-get-offsets: SKIP (0.000s)
[522.939807] [136/137] (546s left) kms_cursor_crc (cursor-onscreen-64x21)
[523.227904] Starting subtest: cursor-onscreen-64x21
[523.237547] Starting dynamic subtest: pipe-A-DP-1
[525.763911] Dynamic subtest pipe-A-DP-1: SUCCESS (2.524s)
[525.843890] Starting dynamic subtest: pipe-C-DP-1
[528.459515] Dynamic subtest pipe-C-DP-1: SUCCESS (2.636s)
[528.461011] Subtest cursor-onscreen-64x21: SUCCESS (5.232s)
[528.815364] [137/137] (540s left) perf_pmu (semaphore-wait-idle)
[529.000601] Starting subtest: semaphore-wait-idle
[529.002081] Starting dynamic subtest: rcs0
[529.521410] Dynamic subtest rcs0: SUCCESS (0.518s)
[529.547668] Starting dynamic subtest: bcs0
[530.040065] Dynamic subtest bcs0: SUCCESS (0.517s)
[530.063050] Starting dynamic subtest: vcs0
[530.555869] Dynamic subtest vcs0: SUCCESS (0.513s)
[530.579806] Starting dynamic subtest: vecs0
[531.071248] Dynamic subtest vecs0: SUCCESS (0.514s)
[531.072917] Subtest semaphore-wait-idle: SUCCESS (2.069s)
[531.174604] Closing watchdogs
Done.