[86.649864] Initializing watchdogs
[86.650153]   /dev/watchdog0
[86.694295] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[86.708436] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[86.717452] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[86.725655] [001/131] (960s left) api_intel_allocator (reopen-fork)
[86.846940] Starting subtest: reopen-fork
[90.251843] Subtest reopen-fork: SUCCESS (3.404s)
[90.393133] [002/131] (956s left) gem_fence_thrash (bo-write-verify-y)
[90.499768] Starting subtest: bo-write-verify-y
[91.607634] Subtest bo-write-verify-y: SUCCESS (1.110s)
[91.733953] [003/131] (955s left) gem_exec_schedule (u-submit-early-slice)
[91.882132] Starting subtest: u-submit-early-slice
[91.885308] Starting dynamic subtest: rcs0
[91.950954] Dynamic subtest rcs0: SUCCESS (0.067s)
[91.971481] Starting dynamic subtest: bcs0
[92.015901] Dynamic subtest bcs0: SUCCESS (0.065s)
[92.034320] Starting dynamic subtest: vcs0
[92.075054] Dynamic subtest vcs0: SUCCESS (0.057s)
[92.093830] Starting dynamic subtest: vecs0
[92.132427] Dynamic subtest vecs0: SUCCESS (0.059s)
[92.136759] Subtest u-submit-early-slice: SUCCESS (0.252s)
[92.521999] [004/131] (954s left) gem_workarounds (reset-context)
[92.659333] Starting subtest: reset-context
[92.684090] Subtest reset-context: SUCCESS (0.023s)
[92.839360] [005/131] (954s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[93.010586] Starting subtest: disable-crc-after-crtc
[93.016794] Starting dynamic subtest: pipe-A-HDMI-A-2
[93.877216] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.864s)
[93.915787] Starting dynamic subtest: pipe-B-HDMI-A-2
[94.682785] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.801s)
[94.731055] Starting dynamic subtest: pipe-C-HDMI-A-2
[95.553747] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.770s)
[95.619502] Subtest disable-crc-after-crtc: SUCCESS (2.445s)
[96.274364] [006/131] (951s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[96.663155] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[96.669324] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[96.791927] [007/131] (951s left) kms_color (ctm-negative)
[96.961061] Starting subtest: ctm-negative
[96.964040] Starting dynamic subtest: pipe-A-HDMI-A-2
[97.610882] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.650s)
[97.645322] Starting dynamic subtest: pipe-B-HDMI-A-2
[98.250738] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.640s)
[98.289492] Starting dynamic subtest: pipe-C-HDMI-A-2
[98.883258] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.630s)
[98.886802] Subtest ctm-negative: SUCCESS (1.922s)
[99.117306] [008/131] (949s left) gem_mmap_offset (mmap-unmap)
[99.229394] Starting subtest: mmap-unmap
[99.232825] Starting dynamic subtest: smem0
[185.709102] Dynamic subtest smem0: SUCCESS (86.466s)
[185.714700] Subtest mmap-unmap: SUCCESS (86.467s)
[185.868869] [009/131] (862s left) i915_pm_rpm (gem-idle)
[187.577180] Starting subtest: gem-idle
[192.795462] Subtest gem-idle: SUCCESS (5.224s)
[193.037855] [010/131] (855s left) gem_exec_schedule (noreorder-corked)
[193.307678] Starting subtest: noreorder-corked
[193.311104] Starting dynamic subtest: rcs0
[194.425084] Dynamic subtest rcs0: SUCCESS (1.117s)
[194.443097] Starting dynamic subtest: bcs0
[195.538361] Dynamic subtest bcs0: SUCCESS (1.110s)
[195.556400] Starting dynamic subtest: vcs0
[196.653304] Dynamic subtest vcs0: SUCCESS (1.115s)
[196.670969] Starting dynamic subtest: vecs0
[197.763164] Dynamic subtest vecs0: SUCCESS (1.107s)
[197.767343] Subtest noreorder-corked: SUCCESS (4.456s)
[197.997804] [011/131] (850s left) drm_read (short-buffer-block)
[198.210660] Starting subtest: short-buffer-block
[198.213789] Subtest short-buffer-block: SUCCESS (0.000s)
[198.391953] [012/131] (850s left) kms_chamelium_color (ctm-0-25)
[198.560057] Subtest ctm-0-25: SKIP (0.000s)
[198.656357] [013/131] (850s left) perf_pmu (semaphore-wait)
[198.774879] Starting subtest: semaphore-wait
[198.778363] Starting dynamic subtest: rcs0
[199.292475] Dynamic subtest rcs0: SUCCESS (0.518s)
[199.312274] Starting dynamic subtest: bcs0
[199.809970] Dynamic subtest bcs0: SUCCESS (0.516s)
[199.830150] Starting dynamic subtest: vcs0
[200.324332] Dynamic subtest vcs0: SUCCESS (0.513s)
[200.343896] Starting dynamic subtest: vecs0
[200.841414] Dynamic subtest vecs0: SUCCESS (0.514s)
[200.844756] Subtest semaphore-wait: SUCCESS (2.069s)
[200.985815] [014/131] (847s left) gem_render_copy (yf-tiled-ccs-to-y-tiled)
[201.108882] Starting subtest: yf-tiled-ccs-to-y-tiled
[201.112204] Starting dynamic subtest: smem
[201.358548] Dynamic subtest smem: SUCCESS (0.251s)
[201.362886] Subtest yf-tiled-ccs-to-y-tiled: SUCCESS (0.252s)
[201.600333] [015/131] (847s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[201.793451] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[201.799913] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[201.928850] [016/131] (847s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[202.095319] Starting subtest: 2x-flip-vs-cursor-atomic
[202.108603] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.005s)
[202.229869] [017/131] (846s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[202.398898] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[202.721785] Subtest async-flip-with-page-flip-events-linear-atomic: SKIP (0.326s)
[202.948767] [018/131] (846s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[203.130042] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[203.137788] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[203.267176] [019/131] (846s left) i915_pm_rpm (gem-pread)
[204.965841] Starting subtest: gem-pread
[205.638532] Subtest gem-pread: SUCCESS (0.697s)
[205.851837] [020/131] (843s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0)
[206.041177] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0
[207.520408] Subtest y-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.476s)
[207.686988] [021/131] (841s left) core_setmaster_vs_auth
[207.936224] [022/131] (841s left) gem_softpin (allocator-evict)
[208.055950] Starting subtest: allocator-evict
[208.059891] Starting dynamic subtest: rcs0
[235.467044] Dynamic subtest rcs0: SUCCESS (27.407s)
[235.490213] Starting dynamic subtest: bcs0
[261.930467] Dynamic subtest bcs0: SUCCESS (26.464s)
[261.952529] Starting dynamic subtest: vcs0
[289.371536] Dynamic subtest vcs0: SUCCESS (27.437s)
[289.392840] Starting dynamic subtest: vecs0
[316.756227] Dynamic subtest vecs0: SUCCESS (27.386s)
[316.760468] Subtest allocator-evict: SUCCESS (108.697s)
[316.906298] [023/131] (732s left) gem_exec_reloc (basic-write-gtt)
[317.160637] Starting subtest: basic-write-gtt
[317.182823] Subtest basic-write-gtt: SUCCESS (0.020s)
[317.423243] [024/131] (732s left) tools_test (sysfs_l3_parity)
[317.569088] Starting subtest: sysfs_l3_parity
[317.694937] Subtest sysfs_l3_parity: SKIP (0.158s)
[317.807810] [025/131] (732s left) kms_cursor_legacy (2x-long-nonblocking-modeset-vs-cursor-atomic)
[317.981345] Starting subtest: 2x-long-nonblocking-modeset-vs-cursor-atomic
[317.987724] Subtest 2x-long-nonblocking-modeset-vs-cursor-atomic: SKIP (0.006s)
[318.123745] [026/131] (731s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[318.265564] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[318.431880] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.109s)
[318.910174] [027/131] (731s left) kms_plane_multiple (2x-tiling-y)
[319.396714] Starting subtest: 2x-tiling-y
[319.527432] Subtest 2x-tiling-y: SKIP (0.000s)
[319.875246] [028/131] (730s left) api_intel_allocator (default-alignment)
[320.014070] Starting subtest: default-alignment
[320.020350] Subtest default-alignment: SUCCESS (0.003s)
[320.155527] [029/131] (730s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs)
[320.342393] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs
[320.347385] Starting dynamic subtest: pipe-A-HDMI-A-2
[320.447397] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.001s)
[320.470195] Starting dynamic subtest: pipe-B-HDMI-A-2
[320.500378] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.001s)
[320.521101] Starting dynamic subtest: pipe-C-HDMI-A-2
[320.548652] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s)
[320.555076] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.010s)
[321.017560] [030/131] (729s left) syncobj_wait (multi-wait-for-submit-submitted)
[321.132630] Starting subtest: multi-wait-for-submit-submitted
[321.239101] Subtest multi-wait-for-submit-submitted: SUCCESS (0.105s)
[321.382083] [031/131] (729s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[321.567230] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[323.714344] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (2.151s)
[323.882844] [032/131] (727s left) kms_atomic (test-only)
[324.047500] Starting subtest: test-only
[324.243084] Starting dynamic subtest: pipe-A-HDMI-A-2
[325.133770] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.918s)
[325.137260] Subtest test-only: SUCCESS (1.086s)
[325.356576] [033/131] (725s left) kms_feature_discovery (display-4x)
[325.530580] Starting subtest: display-4x
[325.537228] Subtest display-4x: SKIP (0.000s)
[325.672491] [034/131] (725s left) gem_mmap_gtt (basic-small-bo-tiledy)
[325.782135] Starting subtest: basic-small-bo-tiledY
[325.995447] Subtest basic-small-bo-tiledY: SUCCESS (0.215s)
[326.185200] [035/131] (725s left) gem_mmap_offset (bad-extensions)
[326.479952] Starting subtest: bad-extensions
[326.483557] Subtest bad-extensions: SUCCESS (0.000s)
[326.629723] [036/131] (724s left) kms_psr2_su (page_flip-nv12)
[326.749871] Subtest page_flip-NV12: SKIP (0.000s)
[326.845301] [037/131] (724s left) gen3_render_linear_blits
[327.047078] [038/131] (724s left) gem_exec_whisper (basic-queues-forked)
[327.174143] Starting subtest: basic-queues-forked
[333.177430] Subtest basic-queues-forked: SUCCESS (5.999s)
[333.421647] [039/131] (718s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[333.604636] Starting subtest: 2x-long-cursor-vs-flip-atomic
[333.619184] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.007s)
[333.755933] [040/131] (718s left) kms_prop_blob (blob-multiple)
[333.865464] Starting subtest: blob-multiple
[333.868682] Subtest blob-multiple: SUCCESS (0.004s)
[334.005168] [041/131] (717s left) prime_self_import (basic-with_one_bo)
[334.111717] Starting subtest: basic-with_one_bo
[334.121544] Subtest basic-with_one_bo: SUCCESS (0.009s)
[334.245773] [042/131] (717s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area)
[334.434506] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.000s)
[334.516801] [043/131] (717s left) gem_spin_batch (resubmit-new)
[334.643651] Starting subtest: resubmit-new
[334.646739] Starting dynamic subtest: rcs0
[334.652085] Dynamic subtest rcs0: SUCCESS (0.008s)
[334.680923] Starting dynamic subtest: bcs0
[334.683919] Dynamic subtest bcs0: SUCCESS (0.011s)
[334.705978] Starting dynamic subtest: vcs0
[334.709790] Dynamic subtest vcs0: SUCCESS (0.008s)
[334.741998] Starting dynamic subtest: vecs0
[334.745764] Dynamic subtest vecs0: SUCCESS (0.007s)
[334.749165] Subtest resubmit-new: SUCCESS (0.038s)
[334.941202] [044/131] (717s left) kms_frontbuffer_tracking (psr-1p-rte)
[335.120988] Starting subtest: psr-1p-rte
[335.127304] Subtest psr-1p-rte: SKIP (0.000s)
[335.271893] [045/131] (717s left) gem_mmap_gtt (medium-copy-xy)
[335.381384] Starting subtest: medium-copy-XY
[340.591404] Subtest medium-copy-XY: SUCCESS (5.207s)
[340.748894] [046/131] (711s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs)
[341.060691] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs
[341.063919] Starting dynamic subtest: pipe-A-HDMI-A-2
[341.158057] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.003s)
[341.180292] Starting dynamic subtest: pipe-B-HDMI-A-2
[341.210358] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.002s)
[341.231501] Starting dynamic subtest: pipe-C-HDMI-A-2
[341.261793] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.003s)
[341.268027] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs: SKIP (0.015s)
[341.743873] [047/131] (710s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[341.943443] Starting subtest: yf-tiled-8bpp-rotate-0
[341.951438] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[342.092141] [048/131] (710s left) kms_getfb (getfb-handle-valid)
[342.264662] Starting subtest: getfb-handle-valid
[342.267928] Subtest getfb-handle-valid: SUCCESS (0.000s)
[342.409506] [049/131] (710s left) prime_mmap_coherency (read)
[342.531647] Starting subtest: read
[347.910861] Subtest read: SUCCESS (5.380s)
[348.060331] [050/131] (704s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[348.242693] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[348.249692] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.001s)
[348.375523] [051/131] (704s left) gem_lmem_swapping (heavy-verify-random)
[348.519862] Subtest heavy-verify-random: SKIP (0.000s)
[348.617904] [052/131] (704s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[348.796574] Starting subtest: psr-rgb565-draw-render
[348.803498] Subtest psr-rgb565-draw-render: SKIP (0.000s)
[348.928756] [053/131] (704s left) kms_big_fb (linear-addfb)
[349.114727] Starting subtest: linear-addfb
[349.119928] Subtest linear-addfb: SUCCESS (0.000s)
[349.244385] [054/131] (703s left) gen9_exec_parse (allowed-single)
[349.378499] Starting subtest: allowed-single
[349.386126] Subtest allowed-single: SUCCESS (0.009s)
[349.642806] [055/131] (703s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[349.823650] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[349.830251] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[349.961468] [056/131] (703s left) sriov_basic (bind-unbind-vf)
[350.075448] Subtest bind-unbind-vf: SKIP (0.000s)
[350.189049] [057/131] (703s left) kms_cursor_crc (cursor-offscreen-32x10)
[350.374826] Starting subtest: cursor-offscreen-32x10
[350.492190] Subtest cursor-offscreen-32x10: SKIP (0.112s)
[350.645640] [058/131] (702s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling)
[350.814407] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling
[350.839065] Starting dynamic subtest: pipe-A-valid-mode
[351.079291] Dynamic subtest pipe-A-valid-mode: SKIP (0.259s)
[351.085165] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.263s)
[351.308535] [059/131] (702s left) kms_psr (psr-sprite-plane-move)
[351.477493] Subtest psr-sprite-plane-move: SKIP (0.000s)
[351.583953] [060/131] (702s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[351.767080] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[351.775858] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[351.892481] [061/131] (701s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[352.277890] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[352.471525] [062/131] (701s left) gem_exec_schedule (semaphore-noskip)
[352.616122] Starting subtest: semaphore-noskip
[352.838721] Subtest semaphore-noskip: SUCCESS (0.224s)
[353.221417] [063/131] (700s left) kms_cursor_crc (cursor-onscreen-512x512)
[353.415661] Starting subtest: cursor-onscreen-512x512
[353.422210] Subtest cursor-onscreen-512x512: SKIP (0.003s)
[353.591226] [064/131] (700s left) kms_draw_crc (draw-method-render)
[353.765499] Starting subtest: draw-method-render
[353.768363] Starting dynamic subtest: xrgb8888-untiled
[354.103141] Dynamic subtest xrgb8888-untiled: SUCCESS (0.339s)
[354.125991] Starting dynamic subtest: rgb565-untiled
[354.402609] Dynamic subtest rgb565-untiled: SUCCESS (0.296s)
[354.425448] Starting dynamic subtest: xrgb2101010-untiled
[354.716824] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.315s)
[354.742359] Starting dynamic subtest: xbgr16161616f-untiled
[355.050710] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.332s)
[355.074899] Starting dynamic subtest: xrgb8888-xtiled
[355.236163] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.182s)
[355.259321] Starting dynamic subtest: rgb565-xtiled
[355.469183] Dynamic subtest rgb565-xtiled: SUCCESS (0.198s)
[355.492510] Starting dynamic subtest: xrgb2101010-xtiled
[355.621131] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.181s)
[355.646421] Starting dynamic subtest: xbgr16161616f-xtiled
[355.800882] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.184s)
[355.827775] Starting dynamic subtest: xrgb8888-ytiled
[355.984607] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.181s)
[356.007018] Starting dynamic subtest: rgb565-ytiled
[356.171138] Dynamic subtest rgb565-ytiled: SUCCESS (0.182s)
[356.195784] Starting dynamic subtest: xrgb2101010-ytiled
[356.350257] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.180s)
[356.375078] Starting dynamic subtest: xbgr16161616f-ytiled
[356.534579] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.182s)
[356.538537] Subtest draw-method-render: SUCCESS (2.773s)
[356.706398] [065/131] (697s left) gem_cs_tlb (engines)
[356.820372] Starting subtest: engines
[356.823807] Starting dynamic subtest: rcs0
[358.978437] Dynamic subtest rcs0: SUCCESS (2.153s)
[359.002347] Starting dynamic subtest: bcs0
[361.133156] Dynamic subtest bcs0: SUCCESS (2.155s)
[361.158925] Starting dynamic subtest: vcs0
[363.287406] Dynamic subtest vcs0: SUCCESS (2.153s)
[363.312096] Starting dynamic subtest: vecs0
[365.441717] Dynamic subtest vecs0: SUCCESS (2.153s)
[365.445056] Subtest engines: SUCCESS (8.618s)
[365.586978] [066/131] (688s left) kms_getfb (getfb-handle-zero)
[365.754903] Starting subtest: getfb-handle-zero
[365.758504] Subtest getfb-handle-zero: SUCCESS (0.000s)
[365.905414] [067/131] (688s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[366.086961] Starting subtest: fbcpsr-2p-rte
[366.093468] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[366.223069] [068/131] (688s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[366.383405] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[366.388367] Starting dynamic subtest: pipe-A
[368.173969] Dynamic subtest pipe-A: SKIP (1.779s)
[368.229097] Starting dynamic subtest: pipe-B
[370.172304] Dynamic subtest pipe-B: SKIP (1.998s)
[370.194486] Starting dynamic subtest: pipe-C
[372.168478] Dynamic subtest pipe-C: SKIP (1.995s)
[372.174925] Subtest plane-scaler-with-clipping-clamping-rotation: SKIP (5.777s)
[373.177748] [069/131] (682s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-pwrite)
[373.872343] Starting subtest: fbcpsr-rgb565-draw-pwrite
[373.878698] Subtest fbcpsr-rgb565-draw-pwrite: SKIP (0.000s)
[373.970389] [070/131] (681s left) sysfs_heartbeat_interval (precise)
[374.091261] Starting subtest: precise
[374.094344] Starting dynamic subtest: vecs0
[375.562382] Dynamic subtest vecs0: SUCCESS (1.465s)
[375.607368] Starting dynamic subtest: vcs0
[377.038916] Dynamic subtest vcs0: SUCCESS (1.473s)
[377.061235] Starting dynamic subtest: bcs0
[378.516754] Dynamic subtest bcs0: SUCCESS (1.471s)
[378.560129] Starting dynamic subtest: rcs0
[379.991341] Dynamic subtest rcs0: SUCCESS (1.474s)
[379.994619] Subtest precise: SUCCESS (5.899s)
[380.139791] [071/131] (675s left) kms_psr (pr-cursor-plane-move)
[380.326051] Subtest pr-cursor-plane-move: SKIP (0.000s)
[380.431162] [072/131] (675s left) perf_pmu (rc6)
[380.551804] Starting subtest: rc6
[380.555048] Starting dynamic subtest: gt0
[386.899377] Dynamic subtest gt0: SUCCESS (6.345s)
[386.935826] Starting dynamic subtest: runtime-pm-gt0
[394.560681] Dynamic subtest runtime-pm-gt0: SUCCESS (7.658s)
[394.583250] Starting dynamic subtest: runtime-pm-long-gt0
[407.000963] Dynamic subtest runtime-pm-long-gt0: SUCCESS (12.436s)
[407.060060] Starting dynamic subtest: other-idle-gt0
[407.068053] Dynamic subtest other-idle-gt0: SKIP (0.000s)
[407.071307] Subtest rc6: SUCCESS (26.453s)
[408.580923] [073/131] (647s left) kms_cursor_crc (cursor-sliding-512x512)
[408.792495] Starting subtest: cursor-sliding-512x512
[408.801495] Subtest cursor-sliding-512x512: SKIP (0.004s)
[408.911400] [074/131] (646s left) gem_exec_parallel (contexts)
[409.039333] Starting subtest: contexts
[409.043139] Starting dynamic subtest: rcs0
[418.227838] Dynamic subtest rcs0: SUCCESS (9.180s)
[418.251399] Starting dynamic subtest: bcs0
[427.254266] Dynamic subtest bcs0: SUCCESS (9.031s)
[427.277033] Starting dynamic subtest: vcs0
[431.512556] Dynamic subtest vcs0: SUCCESS (4.254s)
[431.536067] Starting dynamic subtest: vecs0
[441.640776] Dynamic subtest vecs0: SUCCESS (10.123s)
[441.644675] Subtest contexts: SUCCESS (32.600s)
[441.860308] [075/131] (613s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[442.060642] Starting subtest: fbcpsr-tiling-4
[442.067688] Subtest fbcpsr-tiling-4: SKIP (0.000s)
[442.180745] [076/131] (613s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[442.372809] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[442.387917] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.003s)
[442.477974] [077/131] (613s left) kms_vblank (ts-continuation-modeset)
[442.645631] Starting subtest: ts-continuation-modeset
[442.648567] Starting dynamic subtest: pipe-A-HDMI-A-2
[443.411953] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.760s)
[443.474898] Starting dynamic subtest: pipe-C-HDMI-A-2
[444.110143] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.691s)
[444.113922] Subtest ts-continuation-modeset: SUCCESS (1.468s)
[444.319896] [078/131] (611s left) gem_exec_reloc (basic-gtt-wc)
[444.448549] Starting subtest: basic-gtt-wc
[444.461709] Subtest basic-gtt-wc: SUCCESS (0.016s)
[444.649357] [079/131] (611s left) gem_tiled_blits (normal)
[444.978263] Starting subtest: normal
[487.090279] Subtest normal: SUCCESS (42.111s)
[487.219045] [080/131] (569s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[487.536793] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[487.543109] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[487.646924] [081/131] (568s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[487.828785] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[487.832830] Starting dynamic subtest: pipe-A-HDMI-A-2
[487.924189] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s)
[487.946115] Starting dynamic subtest: pipe-B-HDMI-A-2
[487.978302] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.000s)
[488.000679] Starting dynamic subtest: pipe-C-HDMI-A-2
[488.031405] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.001s)
[488.037529] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SKIP (0.021s)
[488.504806] [082/131] (567s left) gem_pwrite (basic-random)
[488.617388] Starting subtest: basic-random
[494.108656] Subtest basic-random: SUCCESS (5.486s)
[494.231552] [083/131] (562s left) gem_exec_balancer (bonded-pair)
[494.485499] Starting subtest: bonded-pair
[498.755513] Subtest bonded-pair: SUCCESS (4.271s)
[498.990357] [084/131] (557s left) kms_properties (invalid-properties-atomic)
[499.170810] Starting subtest: invalid-properties-atomic
[499.509882] Subtest invalid-properties-atomic: SUCCESS (0.341s)
[499.630470] [085/131] (557s left) gem_exec_balancer (parallel-out-fence)
[499.879364] Subtest parallel-out-fence: SKIP (0.000s)
[499.990151] [086/131] (556s left) gem_ctx_shared (q-smoketest)
[500.124478] Starting subtest: Q-smoketest
[500.127942] Starting dynamic subtest: rcs0
[505.548174] Dynamic subtest rcs0: SUCCESS (5.417s)
[505.570873] Starting dynamic subtest: bcs0
[510.981145] Dynamic subtest bcs0: SUCCESS (5.425s)
[511.005105] Starting dynamic subtest: vcs0
[516.407146] Dynamic subtest vcs0: SUCCESS (5.424s)
[516.431048] Starting dynamic subtest: vecs0
[521.837925] Dynamic subtest vecs0: SUCCESS (5.427s)
[521.842136] Subtest Q-smoketest: SUCCESS (21.708s)
[522.059661] [087/131] (534s left) gem_partial_pwrite_pread (writes-after-reads-display)
[522.196677] Starting subtest: writes-after-reads-display
[542.542876] Subtest writes-after-reads-display: SUCCESS (20.367s)
[542.676259] [088/131] (514s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[542.891856] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[542.899181] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[542.991301] [089/131] (514s left) kms_addfb_basic (basic-x-tiled-legacy)
[543.102180] Starting subtest: basic-x-tiled-legacy
[543.105341] Subtest basic-x-tiled-legacy: SUCCESS (0.000s)
[543.292655] [090/131] (513s left) syncobj_timeline (wait-all-snapshot)
[543.430562] Starting subtest: wait-all-snapshot
[543.568878] Subtest wait-all-snapshot: SUCCESS (0.086s)
[543.986931] [091/131] (513s left) kms_flip (2x-dpms-vs-vblank-race)
[544.604595] Starting subtest: 2x-dpms-vs-vblank-race
[544.735773] Subtest 2x-dpms-vs-vblank-race: SKIP (0.002s)
[544.993305] [092/131] (512s left) gem_busy (parallel)
[545.300671] Starting subtest: parallel
[545.364943] Starting dynamic subtest: rcs0
[545.429818] Dynamic subtest rcs0: SUCCESS (0.034s)
[545.526147] Starting dynamic subtest: bcs0
[545.591182] Dynamic subtest bcs0: SUCCESS (0.030s)
[545.687677] Starting dynamic subtest: vcs0
[545.752672] Dynamic subtest vcs0: SUCCESS (0.026s)
[545.849598] Starting dynamic subtest: vecs0
[545.914789] Dynamic subtest vecs0: SUCCESS (0.028s)
[545.980503] Subtest parallel: SUCCESS (0.132s)
[546.437610] [093/131] (511s left) gem_eio (suspend)
[546.679204] Starting subtest: suspend
[558.444924] Subtest suspend: SUCCESS (11.601s)
[565.608726] [094/131] (499s left) syncobj_timeline (invalid-transfer-non-existent-point)
[565.725342] Starting subtest: invalid-transfer-non-existent-point
[565.730067] Subtest invalid-transfer-non-existent-point: SUCCESS (0.001s)
[565.820634] [095/131] (499s left) kms_psr (psr2-sprite-blt)
[565.993140] Subtest psr2-sprite-blt: SKIP (0.000s)
[566.100384] [096/131] (499s left) kms_lease (atomic-implicit-crtc)
[566.274124] Starting subtest: atomic-implicit-crtc
[566.284035] Starting dynamic subtest: pipe-A-HDMI-A-2
[566.326363] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.004s)
[566.356235] Starting dynamic subtest: pipe-B-HDMI-A-2
[566.375584] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.026s)
[566.404861] Starting dynamic subtest: pipe-C-HDMI-A-2
[566.419827] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.021s)
[566.422899] Subtest atomic-implicit-crtc: SUCCESS (0.087s)
[566.517574] [097/131] (499s left) kms_pm_rpm (dpms-non-lpsp)
[568.262794] Starting subtest: dpms-non-lpsp
[568.379784] Subtest dpms-non-lpsp: SUCCESS (0.134s)
[568.548092] [098/131] (497s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[568.657380] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[568.660499] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.002s)
[568.787951] [099/131] (497s left) sw_sync (sync_expired_merge)
[568.894173] Starting subtest: sync_expired_merge
[569.967965] Subtest sync_expired_merge: SUCCESS (1.074s)
[570.062391] [100/131] (496s left) gem_userptr_blits (sync-unmap)
[570.200684] Starting subtest: sync-unmap
[570.247503] Subtest sync-unmap: SUCCESS (0.050s)
[570.393262] [101/131] (495s left) gem_exec_params (sol-reset-not-gen7)
[570.507692] Starting subtest: sol-reset-not-gen7
[570.511125] Subtest sol-reset-not-gen7: SUCCESS (0.003s)
[570.623195] [102/131] (495s left) kms_psr2_sf (pr-plane-move-sf-dmg-area)
[570.803582] Subtest pr-plane-move-sf-dmg-area: SKIP (0.000s)
[570.905750] [103/131] (495s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[571.095587] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[571.102909] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[571.213257] [104/131] (495s left) syncobj_wait (wait-delayed-signal)
[571.329628] Starting subtest: wait-delayed-signal
[571.496882] Subtest wait-delayed-signal: SUCCESS (0.104s)
[571.947218] [105/131] (495s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs)
[572.537991] Starting subtest: crc-primary-suspend-yf-tiled-ccs
[572.604818] Starting dynamic subtest: pipe-A-HDMI-A-2