[97.598771] Initializing watchdogs
[97.598942]   /dev/watchdog0
[97.639285] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[97.654413] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[97.661180] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[97.669227] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt)
[97.915561] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt
[97.922857] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[98.072685] [002/133] (960s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[98.269318] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[98.367817] [003/133] (959s left) gem_mmap (short-mmap)
[98.480132] Starting subtest: short-mmap
[98.483441] Subtest short-mmap: SUCCESS (0.000s)
[98.625275] [004/133] (959s left) kms_psr (fbc-psr2-sprite-plane-onoff)
[98.820052] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.000s)
[98.919325] [005/133] (959s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[99.134723] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt
[99.141620] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[99.276054] [006/133] (959s left) kms_frontbuffer_tracking (psr-slowdraw)
[99.490124] Starting subtest: psr-slowdraw
[99.500063] Subtest psr-slowdraw: SKIP (0.000s)
[99.625509] [007/133] (959s left) syncobj_wait (single-wait-for-submit-submitted)
[99.742677] Starting subtest: single-wait-for-submit-submitted
[99.846171] Subtest single-wait-for-submit-submitted: SUCCESS (0.103s)
[99.974287] [008/133] (958s left) kms_color (ctm-0-75)
[100.153262] Starting subtest: ctm-0-75
[100.157122] Starting dynamic subtest: pipe-A-HDMI-A-1
[103.147083] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.994s)
[103.184463] Starting dynamic subtest: pipe-A-HDMI-A-2
[105.657086] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.506s)
[105.694553] Starting dynamic subtest: pipe-B-HDMI-A-1
[108.109195] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.450s)
[108.130346] Starting dynamic subtest: pipe-B-HDMI-A-2
[110.540144] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (2.430s)
[110.563567] Starting dynamic subtest: pipe-C-HDMI-A-1
[113.004297] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.461s)
[113.023446] Starting dynamic subtest: pipe-C-HDMI-A-2
[115.413202] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.404s)
[115.418494] Subtest ctm-0-75: SUCCESS (15.255s)
[115.706830] [009/133] (943s left) i915_pm_freq_api (freq-reset)
[115.849364] Subtest freq-reset: SKIP (0.000s)
[115.952655] [010/133] (943s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[116.715917] Starting subtest: syncobj-timeline-multiple-ext-nodes
[116.719383] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.006s)
[116.999562] [FACT gem_exec_fence (syncobj-timeline-multiple-ext-nodes)] new: kernel.kmod_is_loaded.vgem: true
[117.006234] [011/133] (942s left) kms_force_connector_basic (prune-stale-modes)
[117.294427] Starting subtest: prune-stale-modes
[117.480044] Subtest prune-stale-modes: SUCCESS (0.183s)
[117.835594] [012/133] (941s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[118.066088] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu
[120.125184] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu: SUCCESS (2.071s)
[120.353905] [013/133] (938s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[120.565743] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[120.572784] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[120.723081] [014/133] (938s left) prime_self_import (basic-with_one_bo)
[120.834580] Starting subtest: basic-with_one_bo
[120.842335] Subtest basic-with_one_bo: SUCCESS (0.009s)
[121.009933] [015/133] (938s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[121.122373] Starting subtest: multi-wait-all-for-submit-available-signaled
[121.125883] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.002s)
[121.267909] [016/133] (938s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[121.389103] Starting subtest: rel-constants-invalid-rel-gen5
[121.393123] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.001s)
[121.535535] [017/133] (938s left) i915_pm_rps (reset)
[121.658737] Starting subtest: reset
[126.249288] Subtest reset: SUCCESS (4.589s)
[126.403271] [018/133] (933s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[126.597066] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[126.604077] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[126.767802] [019/133] (933s left) gem_mmap_wc (invalid-flags)
[126.882516] Starting subtest: invalid-flags
[126.885607] Subtest invalid-flags: SUCCESS (0.000s)
[127.033801] [020/133] (932s left) kms_joiner (basic-force-ultra-joiner)
[127.220120] Starting subtest: basic-force-ultra-joiner
[127.227998] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[127.372518] [021/133] (932s left) kms_lease (atomic-implicit-crtc)
[127.556397] Starting subtest: atomic-implicit-crtc
[127.565048] Starting dynamic subtest: pipe-A-HDMI-A-1
[127.606333] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.002s)
[127.712714] Starting dynamic subtest: pipe-A-HDMI-A-2
[127.729623] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.032s)
[127.761921] Starting dynamic subtest: pipe-B-HDMI-A-1
[127.777304] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.032s)
[127.796031] Starting dynamic subtest: pipe-B-HDMI-A-2
[127.811100] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.002s)
[127.829962] Starting dynamic subtest: pipe-C-HDMI-A-1
[127.845188] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.017s)
[127.863828] Starting dynamic subtest: pipe-C-HDMI-A-2
[127.878548] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.017s)
[127.881611] Subtest atomic-implicit-crtc: SUCCESS (0.126s)
[127.989027] [022/133] (932s left) gem_render_copy (y-tiled)
[128.120228] Starting subtest: y-tiled
[128.123519] Starting dynamic subtest: smem
[128.346278] Dynamic subtest smem: SUCCESS (0.223s)
[128.350701] Subtest y-tiled: SUCCESS (0.225s)
[128.603476] [023/133] (931s left) kms_feature_discovery (display-1x)
[128.782932] Starting subtest: display-1x
[128.786608] Subtest display-1x: SUCCESS (0.000s)
[128.937460] [024/133] (931s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[129.158396] Starting subtest: yf-tiled-64bpp-rotate-0
[129.165112] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[129.303473] [025/133] (931s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary)
[129.516078] Starting subtest: fbc-indfb-scaledprimary
[133.056324] Subtest fbc-indfb-scaledprimary: SUCCESS (3.547s)
[133.339466] [026/133] (927s left) kms_busy (extended-modeset-hang-newfb)
[133.538575] Starting subtest: extended-modeset-hang-newfb
[133.544243] Starting dynamic subtest: pipe-A
[141.912484] Dynamic subtest pipe-A: SUCCESS (8.371s)
[141.937631] Starting dynamic subtest: pipe-C
[149.958727] Dynamic subtest pipe-C: SUCCESS (8.039s)
[149.965365] Subtest extended-modeset-hang-newfb: SUCCESS (16.425s)
[150.364478] [027/133] (910s left) kms_prop_blob (blob-prop-lifetime)
[150.481307] Starting subtest: blob-prop-lifetime
[150.484514] Subtest blob-prop-lifetime: SUCCESS (0.003s)
[150.672809] [028/133] (910s left) gem_pxp (reject-modify-context-protection-off-1)
[153.326244] Starting subtest: reject-modify-context-protection-off-1
[153.333542] Subtest reject-modify-context-protection-off-1: SKIP (0.000s)
[153.482124] [029/133] (907s left) perf (invalid-open-flags)
[153.697300] Starting subtest: invalid-open-flags
[153.700493] Subtest invalid-open-flags: SUCCESS (0.001s)
[153.811892] [030/133] (907s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[154.017697] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[154.035097] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.003s)
[154.175808] [031/133] (906s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[154.385078] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[157.326338] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (2.949s)
[157.641776] [032/133] (903s left) core_setmaster (master-drop-set-user)
[157.870311] Starting subtest: master-drop-set-user
[157.911091] Subtest master-drop-set-user: SUCCESS (0.043s)
[158.007119] [033/133] (903s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled)
[158.129592] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled
[158.137323] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[158.393643] [034/133] (903s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[158.519453] Starting subtest: writes-after-reads-snoop
[179.048681] Subtest writes-after-reads-snoop: SUCCESS (20.534s)
[179.224551] [035/133] (882s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[179.443085] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt
[179.451062] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[179.606152] [036/133] (882s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[179.826353] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[179.834233] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[179.977617] [037/133] (881s left) gem_userptr_blits (dmabuf-unsync)
[180.116071] Subtest dmabuf-unsync: SKIP (0.000s)
[180.308172] [038/133] (881s left) kms_psr (psr2-sprite-blt)
[180.497065] Subtest psr2-sprite-blt: SKIP (0.000s)
[180.619750] [039/133] (881s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping)
[180.806554] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping
[180.813693] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping: SKIP (0.000s)
[180.959587] [040/133] (881s left) perf_pmu (enable-race)
[181.079122] Starting subtest: enable-race
[181.083166] Starting dynamic subtest: rcs0
[193.704091] Dynamic subtest rcs0: SUCCESS (12.625s)
[193.725510] Starting dynamic subtest: bcs0
[206.358589] Dynamic subtest bcs0: SUCCESS (12.655s)
[206.378976] Starting dynamic subtest: vcs0
[218.992164] Dynamic subtest vcs0: SUCCESS (12.631s)
[219.013135] Starting dynamic subtest: vecs0
[231.624464] Dynamic subtest vecs0: SUCCESS (12.630s)
[231.629895] Subtest enable-race: SUCCESS (50.550s)
[231.818534] [041/133] (830s left) kms_pm_rpm (drm-resources-equal)
[233.741246] Starting subtest: drm-resources-equal
[235.096516] Subtest drm-resources-equal: SUCCESS (1.354s)
[235.392132] [042/133] (826s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[235.598517] Starting subtest: addfb25-framebuffer-vs-set-tiling
[235.601523] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s)
[235.750584] [043/133] (826s left) prime_vgem (busy)
[235.892705] Starting subtest: busy
[235.899572] Starting dynamic subtest: rcs0
[235.928193] Dynamic subtest rcs0: SUCCESS (0.041s)
[235.958551] Starting dynamic subtest: vcs0
[235.963579] Dynamic subtest vcs0: SUCCESS (0.014s)
[235.991909] Starting dynamic subtest: vecs0
[235.998188] Dynamic subtest vecs0: SUCCESS (0.015s)
[236.001706] Subtest busy: SUCCESS (0.078s)
[236.129559] [044/133] (826s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[236.329293] Starting subtest: nonblocking-crc-frame-sequence
[236.332601] Starting dynamic subtest: pipe-A-HDMI-A-1
[237.359169] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.031s)
[237.385015] Starting dynamic subtest: pipe-B-HDMI-A-2
[238.097961] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.730s)
[238.125064] Starting dynamic subtest: pipe-C-HDMI-A-1
[238.817199] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.711s)
[238.823564] Subtest nonblocking-crc-frame-sequence: SUCCESS (2.490s)
[239.149235] [045/133] (823s left) kms_psr (fbc-pr-cursor-plane-move)
[239.345032] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[239.456074] [046/133] (823s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[239.650810] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[240.257644] Subtest async-flip-with-page-flip-events-linear-atomic: SKIP (0.606s)
[240.605042] [047/133] (822s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted)
[240.726082] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted
[240.829106] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.103s)
[240.986782] [048/133] (821s left) kms_vrr (max-min)
[241.172241] Starting subtest: max-min
[241.190078] Subtest max-min: SKIP (0.000s)
[241.323583] [049/133] (821s left) gem_spin_batch (spin-each)
[241.458728] Starting subtest: spin-each
[244.748839] Subtest spin-each: SUCCESS (3.289s)
[245.052094] [050/133] (818s left) kms_chamelium_color (ctm-0-50)
[245.242077] Subtest ctm-0-50: SKIP (0.000s)
[245.365357] [051/133] (817s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[245.561332] Starting subtest: basic-flip-after-cursor-legacy
[246.976460] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.297s)
[247.354976] [052/133] (816s left) gem_pwrite (basic-exhaustion)
[247.475065] Starting subtest: basic-exhaustion
[273.776273] Subtest basic-exhaustion: SUCCESS (26.315s)
[273.932366] [053/133] (789s left) kms_pm_rpm (modeset-non-lpsp)
[275.877516] Starting subtest: modeset-non-lpsp
[276.385044] Subtest modeset-non-lpsp: SUCCESS (0.499s)
[276.743654] [054/133] (786s left) i915_selftest (live)
[278.544259] Starting subtest: live
[278.549444] Starting dynamic subtest: sanitycheck
[280.978695] Dynamic subtest sanitycheck: SUCCESS (2.432s)
[281.000817] Starting dynamic subtest: uncore
[283.638849] Dynamic subtest uncore: SUCCESS (2.656s)
[283.662371] Starting dynamic subtest: workarounds
[286.247841] Dynamic subtest workarounds: SUCCESS (2.605s)
[286.271347] Starting dynamic subtest: gt_engines
[289.071704] Dynamic subtest gt_engines: SUCCESS (2.821s)
[289.096458] Starting dynamic subtest: gt_timelines
[305.344947] Dynamic subtest gt_timelines: SUCCESS (16.268s)
[305.368409] Starting dynamic subtest: gt_contexts
[307.951751] Dynamic subtest gt_contexts: SUCCESS (2.601s)
[307.976262] Starting dynamic subtest: gt_lrc
[313.026747] Dynamic subtest gt_lrc: SUCCESS (5.073s)
[313.054330] Starting dynamic subtest: gt_mocs
[315.562032] Dynamic subtest gt_mocs: SUCCESS (2.530s)
[315.586332] Starting dynamic subtest: gt_pm
[327.359138] Dynamic subtest gt_pm: SUCCESS (11.792s)
[327.381597] Starting dynamic subtest: gt_heartbeat
[329.899959] Dynamic subtest gt_heartbeat: SUCCESS (2.536s)
[329.923335] Starting dynamic subtest: gt_tlb
[333.684184] Dynamic subtest gt_tlb: SUCCESS (3.781s)
[333.708165] Starting dynamic subtest: requests
[342.548797] Dynamic subtest requests: SUCCESS (8.859s)
[342.571629] Starting dynamic subtest: migrate
[347.969146] Dynamic subtest migrate: SUCCESS (5.417s)
[347.997083] Starting dynamic subtest: active
[350.725810] Dynamic subtest active: SUCCESS (2.751s)
[350.748428] Starting dynamic subtest: objects
[355.013895] Dynamic subtest objects: SUCCESS (4.285s)
[355.038266] Starting dynamic subtest: mman
[363.153755] Dynamic subtest mman: SUCCESS (8.136s)
[363.183303] Starting dynamic subtest: dmabuf
[365.751839] Dynamic subtest dmabuf: SUCCESS (2.592s)
[365.775324] Starting dynamic subtest: vma
[368.185362] Dynamic subtest vma: SUCCESS (2.429s)
[368.209379] Starting dynamic subtest: coherency
[373.291757] Dynamic subtest coherency: SUCCESS (5.103s)
[373.314807] Starting dynamic subtest: gtt
[383.427426] Dynamic subtest gtt: SUCCESS (10.132s)
[383.450229] Starting dynamic subtest: gem
[386.346839] Dynamic subtest gem: SUCCESS (2.916s)
[386.377112] Starting dynamic subtest: evict
[392.075878] Dynamic subtest evict: SUCCESS (5.724s)
[392.106272] Starting dynamic subtest: hugepages
[400.945129] Dynamic subtest hugepages: SUCCESS (8.862s)
[400.968833] Starting dynamic subtest: gem_contexts
[421.733979] Dynamic subtest gem_contexts: SUCCESS (20.786s)
[421.758456] Starting dynamic subtest: client
[424.545886] Dynamic subtest client: SUCCESS (2.806s)
[424.570259] Starting dynamic subtest: gem_migrate
[427.023986] Dynamic subtest gem_migrate: SUCCESS (2.476s)
[427.054316] Starting dynamic subtest: reset
[433.574481] Dynamic subtest reset: SUCCESS (6.545s)
[433.597767] Starting dynamic subtest: memory_region
[436.185578] Dynamic subtest memory_region: SUCCESS (2.608s)
[436.208174] Starting dynamic subtest: hangcheck
[461.757187] Dynamic subtest hangcheck: SUCCESS (25.568s)
[461.782298] Starting dynamic subtest: execlists
[473.748209] Dynamic subtest execlists: SUCCESS (11.977s)
[473.770516] Starting dynamic subtest: ring_submission
[476.317190] Dynamic subtest ring_submission: SUCCESS (2.574s)
[476.340986] Starting dynamic subtest: perf
[478.859903] Dynamic subtest perf: SUCCESS (2.539s)
[478.884343] Starting dynamic subtest: slpc
[481.450925] Dynamic subtest slpc: SUCCESS (2.586s)
[481.482230] Starting dynamic subtest: guc
[483.896838] Dynamic subtest guc: SUCCESS (2.441s)
[483.919967] Starting dynamic subtest: guc_multi_lrc
[486.481449] Dynamic subtest guc_multi_lrc: SUCCESS (2.581s)
[486.505635] Starting dynamic subtest: guc_hang
[488.843983] Dynamic subtest guc_hang: SUCCESS (2.359s)
[488.869411] Starting dynamic subtest: late_gt_pm
[491.513025] Dynamic subtest late_gt_pm: SUCCESS (2.663s)
[491.516784] Subtest live: SUCCESS (212.972s)
[491.589349] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[491.592218] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[491.599066] [055/133] (572s left) sysfs_preempt_timeout (timeout)
[494.406828] Starting subtest: timeout
[494.413206] Starting dynamic subtest: vecs0
[495.348035] Dynamic subtest vecs0: SUCCESS (0.939s)
[495.373717] Starting dynamic subtest: vcs0
[496.170173] Dynamic subtest vcs0: SUCCESS (0.818s)
[496.192835] Starting dynamic subtest: bcs0
[497.012283] Dynamic subtest bcs0: SUCCESS (0.835s)
[497.039446] Starting dynamic subtest: rcs0
[497.875778] Dynamic subtest rcs0: SUCCESS (0.853s)
[497.879117] Subtest timeout: SUCCESS (3.463s)
[497.989197] [FACT sysfs_preempt_timeout (timeout)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[497.991958] [FACT sysfs_preempt_timeout (timeout)] new: kernel.kmod_is_loaded.i915: true
[498.001938] [056/133] (565s left) kms_psr (fbc-psr2-primary-render)
[498.210607] Subtest fbc-psr2-primary-render: SKIP (0.000s)
[498.341308] [057/133] (565s left) gem_exec_fence (basic-busy)
[498.622333] Starting subtest: basic-busy
[498.626360] Starting dynamic subtest: rcs0
[498.640576] Dynamic subtest rcs0: SUCCESS (0.025s)
[498.666344] Starting dynamic subtest: bcs0
[498.673917] Dynamic subtest bcs0: SUCCESS (0.021s)
[498.700306] Starting dynamic subtest: vcs0
[498.708563] Dynamic subtest vcs0: SUCCESS (0.017s)
[498.730163] Starting dynamic subtest: vecs0
[498.738136] Dynamic subtest vecs0: SUCCESS (0.017s)
[498.742336] Subtest basic-busy: SUCCESS (0.096s)
[499.431294] [058/133] (564s left) kms_plane (pixel-format-x-tiled-modifier-source-clamping)
[499.616380] Starting subtest: pixel-format-x-tiled-modifier-source-clamping
[500.046190] Starting dynamic subtest: pipe-A-plane-0
[500.746871] Dynamic subtest pipe-A-plane-0: SUCCESS (0.699s)
[500.770259] Starting dynamic subtest: pipe-A-plane-1
[501.418047] Dynamic subtest pipe-A-plane-1: SUCCESS (0.666s)
[501.440367] Starting dynamic subtest: pipe-A-plane-2
[501.913126] Dynamic subtest pipe-A-plane-2: SUCCESS (0.494s)
[501.935586] Starting dynamic subtest: pipe-A-plane-3
[502.395679] Dynamic subtest pipe-A-plane-3: SUCCESS (0.480s)
[502.900472] Starting dynamic subtest: pipe-B-plane-0
[504.141177] Dynamic subtest pipe-B-plane-0: SUCCESS (0.649s)
[504.170446] Starting dynamic subtest: pipe-B-plane-1
[504.249722] Dynamic subtest pipe-B-plane-1: SUCCESS (0.646s)
[504.272277] Starting dynamic subtest: pipe-B-plane-2
[504.561926] Dynamic subtest pipe-B-plane-2: SUCCESS (0.480s)
[504.584546] Starting dynamic subtest: pipe-B-plane-3
[505.044463] Dynamic subtest pipe-B-plane-3: SUCCESS (0.480s)
[505.312257] Subtest pixel-format-x-tiled-modifier-source-clamping: SUCCESS (5.700s)
[505.617470] [059/133] (558s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[505.844516] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[505.851524] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[505.998999] [060/133] (558s left) syncobj_timeline (single-wait-available-signaled)
[506.114474] Starting subtest: single-wait-available-signaled
[506.117910] Subtest single-wait-available-signaled: SUCCESS (0.001s)
[506.264970] [061/133] (558s left) gem_exec_schedule (preempt-engines)
[506.411241] Starting subtest: preempt-engines
[506.414363] Starting dynamic subtest: rcs0
[506.638159] Dynamic subtest rcs0: SUCCESS (0.223s)
[506.678323] Starting dynamic subtest: bcs0
[506.988388] Dynamic subtest bcs0: SUCCESS (0.329s)
[507.034208] Starting dynamic subtest: vcs0
[507.206228] Dynamic subtest vcs0: SUCCESS (0.233s)
[507.248146] Starting dynamic subtest: vecs0
[507.462809] Dynamic subtest vecs0: SUCCESS (0.245s)
[507.468042] Subtest preempt-engines: SUCCESS (1.047s)
[507.868092] [062/133] (556s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[507.981540] Starting subtest: multi-wait-all-for-submit-unsubmitted
[508.085758] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.104s)
[508.232952] [063/133] (556s left) perf (non-system-wide-paranoid)
[508.458125] Starting subtest: non-system-wide-paranoid
[508.531105] Subtest non-system-wide-paranoid: SUCCESS (0.078s)
[508.650725] [064/133] (556s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[508.841119] Starting subtest: cursor-rapid-movement-32x32
[509.000630] Subtest cursor-rapid-movement-32x32: SKIP (0.155s)
[509.197754] [065/133] (555s left) gem_exec_reloc (basic-range)
[509.324685] Starting subtest: basic-range
[509.404954] Subtest basic-range: SUCCESS (0.075s)
[509.636149] [066/133] (555s left) gen7_exec_parse (basic-offset)
[509.765055] Subtest basic-offset: SKIP (0.000s)
[509.895922] [067/133] (555s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[510.126294] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[510.134487] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[510.284772] [068/133] (554s left) gem_exec_schedule (timeslicing)
[510.430350] Starting subtest: timeslicing
[510.437231] Starting dynamic subtest: rcs0
[510.441070] Dynamic subtest rcs0: SUCCESS (0.009s)
[510.470279] Starting dynamic subtest: bcs0
[510.474275] Dynamic subtest bcs0: SUCCESS (0.012s)
[510.499743] Starting dynamic subtest: vcs0
[510.503755] Dynamic subtest vcs0: SUCCESS (0.009s)
[510.526449] Starting dynamic subtest: vecs0
[510.530370] Dynamic subtest vecs0: SUCCESS (0.009s)
[510.534534] Subtest timeslicing: SUCCESS (0.059s)
[510.898763] [069/133] (554s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[511.094038] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[511.097109] Starting dynamic subtest: pipe-A-HDMI-A-1
[511.246013] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.011s)
[511.286427] Starting dynamic subtest: pipe-A-HDMI-A-2
[511.424393] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.011s)
[511.446377] Starting dynamic subtest: pipe-B-HDMI-A-1
[511.568898] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.011s)
[511.590746] Starting dynamic subtest: pipe-B-HDMI-A-2
[511.738380] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.011s)
[511.780444] Starting dynamic subtest: pipe-C-HDMI-A-1
[511.915682] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.011s)
[511.937753] Starting dynamic subtest: pipe-C-HDMI-A-2
[512.089127] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.011s)
[512.095369] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SKIP (0.098s)
[512.213854] [070/133] (553s left) gem_ctx_shared (q-independent)
[512.350989] Starting subtest: Q-independent
[512.354727] Starting dynamic subtest: rcs0
[512.412286] Dynamic subtest rcs0: SUCCESS (0.059s)
[512.442689] Starting dynamic subtest: bcs0
[512.492911] Dynamic subtest bcs0: SUCCESS (0.072s)
[512.519441] Starting dynamic subtest: vcs0
[512.550619] Dynamic subtest vcs0: SUCCESS (0.058s)
[512.583398] Starting dynamic subtest: vecs0
[512.612721] Dynamic subtest vecs0: SUCCESS (0.052s)
[512.618978] Subtest Q-independent: SUCCESS (0.258s)
[512.892704] [071/133] (552s left) gem_mmap_offset (blt-coherency)
[513.007652] Starting subtest: blt-coherency
[513.026105] Subtest blt-coherency: SUCCESS (0.023s)
[513.192156] [072/133] (552s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[513.390985] Starting subtest: crc-primary-basic-y-tiled-gen12-mc-ccs
[513.395116] Starting dynamic subtest: pipe-A-HDMI-A-1
[513.451501] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.003s)
[513.496608] Starting dynamic subtest: pipe-A-HDMI-A-2
[513.546563] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.003s)
[513.572471] Starting dynamic subtest: pipe-B-HDMI-A-1
[513.612450] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.003s)
[513.638219] Starting dynamic subtest: pipe-B-HDMI-A-2
[513.670490] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.003s)
[513.692908] Starting dynamic subtest: pipe-C-HDMI-A-1
[513.724271] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.003s)
[513.746713] Starting dynamic subtest: pipe-C-HDMI-A-2
[513.780144] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.002s)
[513.786518] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.052s)
[514.479581] [073/133] (551s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[514.680097] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[514.684118] Starting dynamic subtest: pipe-A-HDMI-A-1
[514.729335] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[514.771118] Starting dynamic subtest: pipe-A-HDMI-A-2
[514.828022] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.001s)
[514.894103] Starting dynamic subtest: pipe-B-HDMI-A-1
[514.932091] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[514.961194] Starting dynamic subtest: pipe-B-HDMI-A-2
[514.999165] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.000s)
[515.023082] Starting dynamic subtest: pipe-C-HDMI-A-1
[515.054125] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[515.080604] Starting dynamic subtest: pipe-C-HDMI-A-2
[515.108739] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.001s)
[515.114766] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.039s)
[515.763870] [074/133] (550s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[515.971330] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[515.974426] Starting dynamic subtest: pipe-A-HDMI-A-1
[515.989937] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[516.035365] Starting dynamic subtest: pipe-A-HDMI-A-2
[516.055208] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.001s)
[516.096242] Starting dynamic subtest: pipe-B-HDMI-A-1
[516.117392] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[516.157110] Starting dynamic subtest: pipe-B-HDMI-A-2
[516.173193] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.001s)
[516.196355] Starting dynamic subtest: pipe-C-HDMI-A-1
[516.208415] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[516.230405] Starting dynamic subtest: pipe-C-HDMI-A-2
[516.242395] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.002s)
[516.247926] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SKIP (0.048s)
[517.046650] [075/133] (548s left) kms_flip (flip-vs-panning-vs-hang)
[517.235884] Starting subtest: flip-vs-panning-vs-hang
[517.238965] Starting dynamic subtest: A-HDMI-A1
[531.654407] Dynamic subtest A-HDMI-A1: SUCCESS (14.418s)
[531.681159] Starting dynamic subtest: C-HDMI-A1
[544.655569] Dynamic subtest C-HDMI-A1: SUCCESS (12.980s)
[544.678464] Starting dynamic subtest: A-HDMI-A2
[557.706967] Dynamic subtest A-HDMI-A2: SUCCESS (13.062s)
[557.745343] Starting dynamic subtest: C-HDMI-A2
[570.696302] Dynamic subtest C-HDMI-A2: SUCCESS (12.982s)
[570.699955] Subtest flip-vs-panning-vs-hang: SUCCESS (53.464s)
[571.290145] [076/133] (494s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[571.513174] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[571.520207] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[571.667494] [077/133] (494s left) kms_hdr (invalid-metadata-sizes)
[571.853077] Starting subtest: invalid-metadata-sizes
[600.708149] Subtest invalid-metadata-sizes: SKIP (28.842s)
[601.170883] [078/133] (465s left) kms_async_flips (invalid-async-flip)
[601.389581] Starting subtest: invalid-async-flip
[602.011929] Starting dynamic subtest: pipe-A-HDMI-A-1
[602.285722] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.271s)
[602.610436] Starting dynamic subtest: pipe-A-HDMI-A-2
[602.870930] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.286s)
[603.187167] Starting dynamic subtest: pipe-B-HDMI-A-1
[603.393599] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.229s)
[603.731280] Starting dynamic subtest: pipe-B-HDMI-A-2
[603.918161] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.233s)
[604.248127] Starting dynamic subtest: pipe-C-HDMI-A-1
[604.444574] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.233s)
[604.787229] Starting dynamic subtest: pipe-C-HDMI-A-2
[604.973258] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.240s)
[604.980584] Subtest invalid-async-flip: SUCCESS (3.592s)
[605.597666] [079/133] (460s left) kms_rotation_crc (primary-rotation-90)
[605.811356] Starting subtest: primary-rotation-90
[621.538200] Subtest primary-rotation-90: SUCCESS (15.740s)
[621.823275] [080/133] (444s left) kms_cursor_edge_walk (256x256-top-edge)
[622.033068] Starting subtest: 256x256-top-edge
[622.037053] Starting dynamic subtest: pipe-A-HDMI-A-1
[625.948733] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.918s)
[625.978412] Starting dynamic subtest: pipe-C-HDMI-A-1
[629.385832] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (3.432s)
[629.390425] Subtest 256x256-top-edge: SUCCESS (7.363s)
[629.700714] [081/133] (436s left) gem_exec_flush (basic-wb-ro-default)
[629.848248] Starting subtest: basic-wb-ro-default
[635.266628] Subtest basic-wb-ro-default: SUCCESS (5.423s)
[635.534238] [082/133] (431s left) kms_psr (psr2-basic)
[635.736057] Subtest psr2-basic: SKIP (0.000s)
[635.845962] [083/133] (430s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[636.038042] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[636.044228] Starting dynamic subtest: pipe-A-valid-mode
[636.616371] Dynamic subtest pipe-A-valid-mode: SKIP (0.571s)
[636.633263] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SKIP (0.578s)
[637.088262] [084/133] (429s left) gem_workarounds (suspend-resume-fd)
[637.240801] Starting subtest: suspend-resume-fd