[147.222358] Initializing watchdogs
[147.222503]   /dev/watchdog0
[147.235961] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[147.239702] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[147.241829] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[147.245180] [001/130] (960s left) drm_fdinfo (virtual-busy)
[147.342256] Starting subtest: virtual-busy
[147.346872] Subtest virtual-busy: SKIP (0.000s)
[147.404655] [002/130] (960s left) sw_sync (sync_multi_consumer_producer)
[147.439391] Starting subtest: sync_multi_consumer_producer
[147.767218] Subtest sync_multi_consumer_producer: SUCCESS (0.328s)
[147.819308] [003/130] (959s left) gem_ctx_persistence (engines-queued)
[147.881304] Starting subtest: engines-queued
[147.883705] Starting dynamic subtest: rcs0
[147.991192] Dynamic subtest rcs0: SUCCESS (0.110s)
[148.000253] Starting dynamic subtest: bcs0
[148.071240] Dynamic subtest bcs0: SUCCESS (0.080s)
[148.080409] Starting dynamic subtest: vcs0
[149.899101] Dynamic subtest vcs0: SUCCESS (1.825s)
[149.911995] Starting dynamic subtest: vcs1
[151.877872] Dynamic subtest vcs1: SUCCESS (1.978s)
[151.888389] Starting dynamic subtest: vecs0
[153.928158] Dynamic subtest vecs0: SUCCESS (2.050s)
[153.936634] Starting dynamic subtest: ccs0
[154.097700] Dynamic subtest ccs0: SUCCESS (0.171s)
[154.100243] Subtest engines-queued: SUCCESS (6.217s)
[154.222903] [004/130] (953s left) kms_cursor_crc (cursor-offscreen-128x42)
[154.444704] Starting subtest: cursor-offscreen-128x42
[154.485751] Subtest cursor-offscreen-128x42: SKIP (0.037s)
[154.670758] [005/130] (953s left) dmabuf_sync_file (export-multiwait)
[154.731465] Starting subtest: export-multiwait
[154.733463] Subtest export-multiwait: SUCCESS (0.001s)
[154.779801] [FACT dmabuf_sync_file (export-multiwait)] new: kernel.kmod_is_loaded.vgem: true
[154.782794] [006/130] (953s left) kms_big_fb (y-tiled-32bpp-rotate-90)
[154.882709] Starting subtest: y-tiled-32bpp-rotate-90
[154.887370] Subtest y-tiled-32bpp-rotate-90: SKIP (0.000s)
[154.980562] [007/130] (952s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs)
[155.075805] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs
[155.078023] Starting dynamic subtest: pipe-A-eDP-1
[155.099327] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[155.108382] Starting dynamic subtest: pipe-B-eDP-1
[155.126517] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[155.132368] Starting dynamic subtest: pipe-C-eDP-1
[155.150905] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[155.156633] Starting dynamic subtest: pipe-D-eDP-1
[155.176029] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[155.179614] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs: SKIP (0.002s)
[157.196044] [008/130] (950s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[157.251946] Starting subtest: single-wait-for-submit-available-signaled
[157.254124] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[157.350418] [009/130] (950s left) kms_universal_plane (universal-plane-pageflip-windowed)
[157.451998] Starting subtest: universal-plane-pageflip-windowed
[157.455081] Starting dynamic subtest: pipe-A-eDP-1
[158.052714] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.599s)
[158.060392] Starting dynamic subtest: pipe-B-eDP-1
[159.240664] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.186s)
[159.246845] Starting dynamic subtest: pipe-C-eDP-1
[160.441615] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.199s)
[160.449363] Starting dynamic subtest: pipe-D-eDP-1
[161.667316] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.224s)
[161.669294] Subtest universal-plane-pageflip-windowed: SUCCESS (4.213s)
[162.505318] [010/130] (945s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[162.616600] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[167.813078] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (5.199s)
[167.943183] [011/130] (940s left) kms_big_fb (4-tiled-32bpp-rotate-90)
[168.052259] Starting subtest: 4-tiled-32bpp-rotate-90
[168.073606] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.021s)
[168.168928] [012/130] (939s left) kms_flip (2x-flip-vs-suspend)
[168.272155] Starting subtest: 2x-flip-vs-suspend
[168.282589] Subtest 2x-flip-vs-suspend: SKIP (0.010s)
[168.377848] [013/130] (939s left) kms_psr (psr-primary-blt)
[168.472117] Starting subtest: psr-primary-blt
[168.474384] Starting dynamic subtest: eDP-1
[170.242940] Dynamic subtest eDP-1: SUCCESS (1.767s)
[170.245326] Subtest psr-primary-blt: SUCCESS (1.767s)
[171.098310] [014/130] (937s left) kms_joiner (basic-force-big-joiner)
[171.197717] Starting subtest: basic-force-big-joiner
[171.199864] Starting dynamic subtest: single
[174.522303] Dynamic subtest single: SUCCESS (3.332s)
[174.524272] Subtest basic-force-big-joiner: SUCCESS (3.333s)
[175.696261] [015/130] (932s left) vgem_basic (dmabuf-mmap)
[175.746318] Starting subtest: dmabuf-mmap
[175.754256] Subtest dmabuf-mmap: SUCCESS (0.010s)
[175.805621] [016/130] (932s left) kms_async_flips (invalid-async-flip-atomic)
[175.893944] Starting subtest: invalid-async-flip-atomic
[175.898262] Subtest invalid-async-flip-atomic: SKIP (0.000s)
[177.127667] [017/130] (931s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt)
[177.238401] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt
[180.685753] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (3.452s)
[180.813516] [018/130] (927s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-mmap-wc)
[180.918241] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-mmap-wc
[183.857254] Subtest fbc-1p-offscren-pri-shrfb-draw-mmap-wc: SUCCESS (2.942s)
[183.984673] [019/130] (924s left) gem_exec_schedule (preempt-queue)
[184.055225] Subtest preempt-queue: SKIP (0.000s)
[184.363549] [020/130] (924s left) prime_vgem (fence-read-hang)
[184.446080] Subtest fence-read-hang: SKIP (0.000s)
[184.542847] [021/130] (923s left) i915_pm_rps (engine-order)
[184.607702] Starting subtest: engine-order
[189.224916] Subtest engine-order: SUCCESS (4.616s)
[189.294089] [022/130] (919s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[189.450444] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu
[189.454944] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[189.545536] [023/130] (918s left) i915_selftest (live)
[193.142401] Starting subtest: live
[193.144614] Starting dynamic subtest: sanitycheck
[197.539098] Dynamic subtest sanitycheck: SUCCESS (4.396s)
[197.548195] Starting dynamic subtest: uncore
[201.863452] Dynamic subtest uncore: SUCCESS (4.323s)
[201.871985] Starting dynamic subtest: workarounds
[205.029079] Dynamic subtest workarounds: SUCCESS (3.165s)
[205.037455] Starting dynamic subtest: gt_engines
[209.540799] Dynamic subtest gt_engines: SUCCESS (4.511s)
[209.549207] Starting dynamic subtest: gt_timelines
[226.131725] Dynamic subtest gt_timelines: SUCCESS (16.590s)
[226.139531] Starting dynamic subtest: gt_contexts
[230.516962] Dynamic subtest gt_contexts: SUCCESS (4.385s)
[230.525177] Starting dynamic subtest: gt_lrc
[236.732799] Dynamic subtest gt_lrc: SUCCESS (6.215s)
[236.741728] Starting dynamic subtest: gt_mocs
[239.709893] Dynamic subtest gt_mocs: SUCCESS (2.976s)
[239.717298] Starting dynamic subtest: gt_pm
[244.507913] Dynamic subtest gt_pm: SUCCESS (4.797s)
[244.515682] Starting dynamic subtest: gt_heartbeat
[248.890147] Dynamic subtest gt_heartbeat: SUCCESS (4.381s)
[248.897851] Starting dynamic subtest: gt_tlb
[257.084522] Dynamic subtest gt_tlb: SUCCESS (8.193s)
[257.092724] Starting dynamic subtest: requests
[268.563834] Dynamic subtest requests: SUCCESS (11.478s)
[268.572675] Starting dynamic subtest: migrate
[276.528070] Dynamic subtest migrate: SUCCESS (7.963s)
[276.536261] Starting dynamic subtest: active
[280.943881] Dynamic subtest active: SUCCESS (4.415s)
[280.952066] Starting dynamic subtest: objects
[285.648901] Dynamic subtest objects: SUCCESS (4.704s)
[285.657060] Starting dynamic subtest: mman
[289.022221] Dynamic subtest mman: SUCCESS (3.372s)
[289.030514] Starting dynamic subtest: dmabuf
[293.416209] Dynamic subtest dmabuf: SUCCESS (4.393s)
[293.425190] Starting dynamic subtest: vma
[297.746045] Dynamic subtest vma: SUCCESS (4.328s)
[297.754801] Starting dynamic subtest: coherency
[302.800258] Dynamic subtest coherency: SUCCESS (5.053s)
[302.809332] Starting dynamic subtest: gtt
[312.480225] Dynamic subtest gtt: SUCCESS (9.679s)
[312.488734] Starting dynamic subtest: gem
[318.841037] Dynamic subtest gem: SUCCESS (6.359s)
[318.849520] Starting dynamic subtest: evict
[322.716298] Dynamic subtest evict: SUCCESS (3.874s)
[322.725285] Starting dynamic subtest: hugepages
[333.596243] Dynamic subtest hugepages: SUCCESS (10.878s)
[333.604787] Starting dynamic subtest: gem_contexts
[358.832256] Dynamic subtest gem_contexts: SUCCESS (25.233s)
[358.842975] Starting dynamic subtest: client
[363.236050] Dynamic subtest client: SUCCESS (4.403s)
[363.247419] Starting dynamic subtest: gem_migrate
[367.586089] Dynamic subtest gem_migrate: SUCCESS (4.348s)
[367.594854] Starting dynamic subtest: reset
[370.412051] Dynamic subtest reset: SUCCESS (2.824s)
[370.420774] Starting dynamic subtest: memory_region
[374.841086] Dynamic subtest memory_region: SUCCESS (4.427s)
[374.850465] Starting dynamic subtest: hangcheck
[390.108071] Dynamic subtest hangcheck: SUCCESS (15.265s)
[390.117046] Starting dynamic subtest: execlists
[394.502872] Dynamic subtest execlists: SUCCESS (4.392s)
[394.511686] Starting dynamic subtest: ring_submission
[398.921936] Dynamic subtest ring_submission: SUCCESS (4.417s)
[398.933455] Starting dynamic subtest: perf
[403.303057] Dynamic subtest perf: SUCCESS (4.379s)
[403.314806] Starting dynamic subtest: slpc
[415.520147] Dynamic subtest slpc: SUCCESS (12.215s)
[415.527574] Starting dynamic subtest: guc
[419.375057] Dynamic subtest guc: SUCCESS (3.853s)
[419.383727] Starting dynamic subtest: guc_multi_lrc
[423.790587] Dynamic subtest guc_multi_lrc: SUCCESS (4.413s)
[423.799189] Starting dynamic subtest: guc_hang
[428.754295] Dynamic subtest guc_hang: SUCCESS (4.962s)
[428.766723] Starting dynamic subtest: late_gt_pm
[433.138328] Dynamic subtest late_gt_pm: SUCCESS (4.382s)
[433.141270] Subtest live: SUCCESS (239.988s)
[433.163399] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[433.164179] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[433.167316] [024/130] (675s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[434.773685] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[434.778063] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[434.839287] [FACT kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[434.840932] [FACT kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)] new: kernel.kmod_is_loaded.i915: true
[434.841490] [FACT kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)] new: kernel.kmod_is_loaded.xe: true
[434.844404] [025/130] (673s left) kms_lease (lease-invalid-connector)
[434.948130] Starting subtest: lease-invalid-connector
[434.950394] Starting dynamic subtest: pipe-A-eDP-1
[434.952618] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[434.959880] Starting dynamic subtest: pipe-B-eDP-1
[434.962157] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[434.971588] Starting dynamic subtest: pipe-C-eDP-1
[434.973478] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[434.979913] Starting dynamic subtest: pipe-D-eDP-1
[434.982103] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[434.984227] Subtest lease-invalid-connector: SUCCESS (0.004s)
[435.016122] [026/130] (673s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen)
[435.120704] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen
[435.125157] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[435.215273] [027/130] (673s left) gem_mmap_offset (mmap-unmap)
[435.272628] Starting subtest: mmap-unmap
[435.274610] Starting dynamic subtest: smem0
[459.096382] Dynamic subtest smem0: SUCCESS (23.823s)
[459.098638] Subtest mmap-unmap: SUCCESS (23.824s)
[459.271760] [028/130] (649s left) gem_partial_pwrite_pread (write)
[459.345954] Subtest write: SKIP (0.000s)
[459.412204] [029/130] (649s left) kms_fbcon_fbt (fbc-suspend)
[459.464557] Starting subtest: fbc-suspend
[506.414420] Subtest fbc-suspend: SUCCESS (17.601s)
[506.490387] [030/130] (631s left) kms_addfb_basic (addfb25-bad-modifier)
[506.595684] Starting subtest: addfb25-bad-modifier
[506.598138] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[506.681753] [031/130] (631s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[506.781775] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[506.787152] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[506.872475] [032/130] (631s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[506.988133] Starting subtest: 4-tiled-addfb-size-offset-overflow
[506.990555] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[507.089229] [033/130] (631s left) debugfs_test (read_all_entries)
[507.152175] Starting subtest: read_all_entries
[507.413396] Subtest read_all_entries: SUCCESS (0.259s)
[507.518597] [034/130] (630s left) gem_exec_flush (basic-wb-ro-before-default)
[507.588139] Starting subtest: basic-wb-ro-before-default
[513.080786] Subtest basic-wb-ro-before-default: SUCCESS (5.486s)
[513.261918] [035/130] (624s left) kms_properties (invalid-properties-legacy)
[513.370396] Starting subtest: invalid-properties-legacy
[513.471473] Subtest invalid-properties-legacy: SUCCESS (0.101s)
[513.540106] [036/130] (624s left) gem_exec_schedule (u-submit-early-slice)
[513.622114] Starting subtest: u-submit-early-slice
[513.624573] Starting dynamic subtest: rcs0
[513.660150] Dynamic subtest rcs0: SUCCESS (0.048s)
[513.669722] Starting dynamic subtest: bcs0
[513.692928] Dynamic subtest bcs0: SUCCESS (0.032s)
[513.702627] Starting dynamic subtest: vcs0
[513.727565] Dynamic subtest vcs0: SUCCESS (0.034s)
[513.739115] Starting dynamic subtest: vcs1
[513.759070] Dynamic subtest vcs1: SUCCESS (0.031s)
[513.767908] Starting dynamic subtest: vecs0
[513.792840] Dynamic subtest vecs0: SUCCESS (0.033s)
[513.802409] Starting dynamic subtest: ccs0
[513.825039] Dynamic subtest ccs0: SUCCESS (0.031s)
[513.828820] Subtest u-submit-early-slice: SUCCESS (0.212s)
[515.360061] [037/130] (622s left) i915_fb_tiling (basic-x-tiling)
[515.430930] Subtest basic-x-tiling: SKIP (0.000s)
[515.482610] [038/130] (622s left) sw_sync (sync_multi_timeline_wait)
[515.521165] Starting subtest: sync_multi_timeline_wait
[515.523558] Subtest sync_multi_timeline_wait: SUCCESS (0.000s)
[515.561286] [039/130] (622s left) syncobj_eventfd (invalid-bad-pad)
[515.627665] Starting subtest: invalid-bad-pad
[515.630152] Subtest invalid-bad-pad: SUCCESS (0.000s)
[515.731935] [040/130] (622s left) kms_flip (wf_vblank-ts-check-interruptible)
[515.839048] Starting subtest: wf_vblank-ts-check-interruptible
[515.841889] Starting dynamic subtest: A-eDP1
[524.722577] Dynamic subtest A-eDP1: SUCCESS (8.878s)
[524.733196] Starting dynamic subtest: B-eDP1
[533.653820] Dynamic subtest B-eDP1: SUCCESS (8.926s)
[533.662724] Starting dynamic subtest: C-eDP1
[542.567137] Dynamic subtest C-eDP1: SUCCESS (8.915s)
[542.577983] Starting dynamic subtest: D-eDP1
[551.492880] Dynamic subtest D-eDP1: SUCCESS (8.926s)
[551.495770] Subtest wf_vblank-ts-check-interruptible: SUCCESS (35.652s)
[552.714513] [041/130] (585s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[552.834167] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[552.839776] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[552.932468] [042/130] (585s left) gem_mmap_gtt (flink-race)
[552.983770] Subtest flink-race: SKIP (0.000s)
[553.039627] [043/130] (585s left) i915_query (query-topology-matches-eu-total)
[553.101990] Starting subtest: query-topology-matches-eu-total
[553.104975] Subtest query-topology-matches-eu-total: SUCCESS (0.000s)
[553.204343] [044/130] (585s left) api_intel_allocator (reloc-allocator)
[553.264685] Starting subtest: reloc-allocator
[553.267132] Starting dynamic subtest: basic
[553.269936] Dynamic subtest basic: SUCCESS (0.004s)
[553.279999] Starting dynamic subtest: parallel-one
[553.282852] Dynamic subtest parallel-one: SUCCESS (0.008s)
[553.291174] Starting dynamic subtest: print
[553.293507] Dynamic subtest print: SUCCESS (0.000s)
[553.301957] Starting dynamic subtest: reuse
[553.304609] Dynamic subtest reuse: SUCCESS (0.000s)
[553.312951] Starting dynamic subtest: fork-reopen-allocator
[553.315761] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[553.318352] Subtest reloc-allocator: SUCCESS (0.028s)
[553.390199] [045/130] (585s left) kms_color (ctm-negative)
[553.484855] Starting subtest: ctm-negative
[553.487672] Starting dynamic subtest: pipe-A-eDP-1
[554.231693] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.745s)
[554.241112] Starting dynamic subtest: pipe-B-eDP-1
[555.603890] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.371s)
[555.613029] Starting dynamic subtest: pipe-C-eDP-1
[556.961062] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.358s)
[556.970634] Starting dynamic subtest: pipe-D-eDP-1
[558.306849] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.344s)
[558.309016] Subtest ctm-negative: SUCCESS (4.820s)
[559.123782] [046/130] (579s left) kms_cursor_edge_walk (64x64-right-edge)
[559.217126] Starting subtest: 64x64-right-edge
[559.219853] Starting dynamic subtest: pipe-A-eDP-1
[562.694791] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.473s)
[562.708157] Starting dynamic subtest: pipe-D-eDP-1
[565.798783] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.102s)
[565.801397] Subtest 64x64-right-edge: SUCCESS (6.577s)
[566.602854] [047/130] (572s left) gem_userptr_blits (access-control)
[566.692197] Starting subtest: access-control
[566.696903] Subtest access-control: SKIP (0.000s)
[566.819949] [048/130] (571s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[566.873939] Starting subtest: x-tiled-to-vebox-yf-tiled
[566.879863] Subtest x-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[567.050600] [049/130] (571s left) perf (invalid-remove-userspace-config)
[567.159470] Starting subtest: invalid-remove-userspace-config
[567.168031] Subtest invalid-remove-userspace-config: SUCCESS (0.009s)
[567.206420] [050/130] (571s left) gem_pwrite (basic-exhaustion)
[567.282884] Subtest basic-exhaustion: SKIP (0.000s)
[567.334835] [051/130] (571s left) prime_self_import (basic-llseek-bad)
[567.370834] Starting subtest: basic-llseek-bad
[567.392949] Subtest basic-llseek-bad: SUCCESS (0.020s)
[567.492879] [052/130] (571s left) kms_psr2_sf (fbc-psr2-primary-plane-update-sf-dmg-area)
[572.464281] Starting subtest: fbc-psr2-primary-plane-update-sf-dmg-area
[572.466630] Starting dynamic subtest: pipe-A-eDP-1
[573.265063] Dynamic subtest pipe-A-eDP-1: SKIP (0.798s)
[573.278851] Starting dynamic subtest: pipe-B-eDP-1
[574.392386] Dynamic subtest pipe-B-eDP-1: SKIP (1.123s)
[574.396935] Subtest fbc-psr2-primary-plane-update-sf-dmg-area: SKIP (1.925s)
[575.566680] [053/130] (563s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[575.661658] Starting subtest: x-tiled-8bpp-rotate-90
[575.684054] Subtest x-tiled-8bpp-rotate-90: SKIP (0.020s)
[575.804480] [054/130] (563s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[575.921816] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[575.926981] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[576.016468] [055/130] (562s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite)
[576.109796] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite
[576.114619] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[576.201403] [056/130] (562s left) perf (per-context-mode-unprivileged)
[576.280062] Starting subtest: per-context-mode-unprivileged
[576.285622] Subtest per-context-mode-unprivileged: SKIP (0.000s)
[576.322928] [057/130] (562s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[576.429681] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[580.995479] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SUCCESS (4.569s)
[581.134341] [058/130] (557s left) kms_plane_cursor (overlay)
[581.237908] Starting subtest: overlay
[581.243041] Starting dynamic subtest: pipe-A-eDP-1-size-64
[584.151928] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.911s)
[584.209414] Starting dynamic subtest: pipe-A-eDP-1-size-128
[587.242012] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (3.037s)
[587.305528] Starting dynamic subtest: pipe-A-eDP-1-size-256
[590.210971] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.914s)
[590.560936] Starting dynamic subtest: pipe-B-eDP-1-size-64
[594.086832] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.537s)
[594.145386] Starting dynamic subtest: pipe-B-eDP-1-size-128
[597.076135] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.937s)
[597.134199] Starting dynamic subtest: pipe-B-eDP-1-size-256
[600.009011] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.882s)
[600.357967] Starting dynamic subtest: pipe-C-eDP-1-size-64
[603.632910] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (3.283s)
[603.667917] Starting dynamic subtest: pipe-C-eDP-1-size-128
[606.165041] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.502s)
[606.201494] Starting dynamic subtest: pipe-C-eDP-1-size-256
[608.753948] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.558s)
[609.078482] Starting dynamic subtest: pipe-D-eDP-1-size-64
[612.245041] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (3.175s)
[612.279780] Starting dynamic subtest: pipe-D-eDP-1-size-128
[614.764921] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.491s)
[614.801846] Starting dynamic subtest: pipe-D-eDP-1-size-256
[617.254609] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.457s)
[617.570024] Subtest overlay: SUCCESS (36.329s)
[618.431409] [059/130] (520s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[618.523172] Starting subtest: psr-dirtyfb-ioctl
[618.525652] Starting dynamic subtest: A-eDP-1
[620.396035] Dynamic subtest A-eDP-1: SUCCESS (1.870s)
[620.399001] Subtest psr-dirtyfb-ioctl: SUCCESS (1.871s)
[621.251334] [060/130] (517s left) gem_exec_flush (basic-uc-prw-default)
[621.316670] Starting subtest: basic-uc-prw-default
[626.816016] Subtest basic-uc-prw-default: SUCCESS (5.500s)
[626.999448] [061/130] (512s left) kms_psr (fbc-pr-cursor-blt)
[627.106958] Starting subtest: fbc-pr-cursor-blt
[627.111800] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[627.172158] [062/130] (511s left) syncobj_timeline (invalid-single-wait-unsubmitted)
[627.227174] Starting subtest: invalid-single-wait-unsubmitted
[627.229509] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[627.334388] [063/130] (511s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25)
[627.434780] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25
[627.437114] Starting dynamic subtest: pipe-A
[627.508632] Dynamic subtest pipe-A: SUCCESS (0.073s)
[627.517562] Starting dynamic subtest: pipe-B
[628.682834] Dynamic subtest pipe-B: SUCCESS (1.173s)
[628.691933] Starting dynamic subtest: pipe-C
[629.789995] Dynamic subtest pipe-C: SUCCESS (1.107s)
[629.798182] Starting dynamic subtest: pipe-D
[630.913171] Dynamic subtest pipe-D: SUCCESS (1.122s)
[630.916001] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.479s)
[632.070379] [064/130] (507s left) vgem_basic (second-client)
[632.129948] Starting subtest: second-client
[632.148953] Subtest second-client: SUCCESS (0.021s)
[632.199983] [065/130] (507s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[632.326109] Starting subtest: cursorA-vs-flipA-toggle
[643.470543] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.149s)
[644.289031] [066/130] (495s left) gen7_exec_parse (cmd-crossing-page)
[644.351383] Subtest cmd-crossing-page: SKIP (0.000s)
[644.418566] [067/130] (494s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc)
[644.517427] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs-cc
[644.519915] Starting dynamic subtest: pipe-A-eDP-1
[644.547531] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[644.555991] Starting dynamic subtest: pipe-B-eDP-1
[644.584254] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[644.592828] Starting dynamic subtest: pipe-C-eDP-1
[644.622759] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[644.631836] Starting dynamic subtest: pipe-D-eDP-1
[644.660640] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[644.665957] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[646.644473] [068/130] (492s left) perf (blocking-parameterized)
[646.721072] Starting subtest: blocking-parameterized
[666.755657] Subtest blocking-parameterized: SUCCESS (20.031s)
[666.802316] [069/130] (472s left) gem_exec_reloc (basic-write-gtt)
[666.860583] Subtest basic-write-gtt: SKIP (0.000s)
[666.937511] [070/130] (472s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[667.181583] Starting subtest: parallel-dmabuf-import-out-fence
[668.367148] Subtest parallel-dmabuf-import-out-fence: SUCCESS (1.185s)
[668.490395] [071/130] (470s left) kms_cursor_edge_walk (128x128-left-edge)
[668.606567] Starting subtest: 128x128-left-edge
[668.608888] Starting dynamic subtest: pipe-A-eDP-1
[672.015013] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.405s)
[672.024060] Starting dynamic subtest: pipe-D-eDP-1
[675.112702] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.096s)
[675.115471] Subtest 128x128-left-edge: SUCCESS (6.504s)
[675.933519] [072/130] (463s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[675.988045] Starting subtest: single-wait-all-for-submit-available-submitted
[675.990977] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[676.088769] [073/130] (463s left) gem_exec_whisper (basic-fds)
[676.158571] Starting subtest: basic-fds
[682.209802] Subtest basic-fds: SUCCESS (6.046s)
[682.385260] [074/130] (457s left) kms_psr (fbc-psr-sprite-blt)
[682.484875] Starting subtest: fbc-psr-sprite-blt
[682.487581] Starting dynamic subtest: eDP-1
[682.492790] Dynamic subtest eDP-1: SKIP (0.000s)
[682.497947] Subtest fbc-psr-sprite-blt: SKIP (0.001s)
[682.552918] [075/130] (457s left) kms_plane (planar-pixel-format-settings)
[682.649444] Starting subtest: planar-pixel-format-settings
[682.677166] Subtest planar-pixel-format-settings: SUCCESS (0.026s)
[682.776473] [076/130] (456s left) debugfs_test (basic-hwmon)
[682.831593] Starting subtest: basic-hwmon
[682.836057] Subtest basic-hwmon: SKIP (0.000s)
[682.941403] [077/130] (456s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs)
[683.044720] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs
[683.047166] Starting dynamic subtest: pipe-A-eDP-1
[683.070847] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[683.080720] Starting dynamic subtest: pipe-B-eDP-1
[683.103813] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[683.111653] Starting dynamic subtest: pipe-C-eDP-1
[683.134878] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[683.142630] Starting dynamic subtest: pipe-D-eDP-1
[683.165817] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[683.167969] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs: SUCCESS (0.006s)
[685.187157] [078/130] (454s left) i915_pm_freq_api (freq-reset)
[685.257655] Starting subtest: freq-reset
[685.260326] Starting dynamic subtest: gt0
[685.450966] Dynamic subtest gt0: SUCCESS (0.189s)
[685.460377] Starting dynamic subtest: gt1
[685.619986] Dynamic subtest gt1: SUCCESS (0.170s)
[685.622776] Subtest freq-reset: SUCCESS (0.362s)
[685.689747] [079/130] (454s left) kms_pm_dc (dc6-dpms)
[686.810887] Starting subtest: dc6-dpms
[693.847537] Subtest dc6-dpms: FAIL (6.639s)
[693.881395] [080/130] (445s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[693.971911] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs
[693.974727] Starting dynamic subtest: pipe-A-eDP-1
[693.999149] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[694.008170] Starting dynamic subtest: pipe-B-eDP-1
[694.032704] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[694.040925] Starting dynamic subtest: pipe-C-eDP-1
[694.066729] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[694.074840] Starting dynamic subtest: pipe-D-eDP-1
[694.100582] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[694.105534] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[696.100510] [081/130] (443s left) kms_frontbuffer_tracking (fbc-2p-indfb-fliptrack-mmap-gtt)
[696.205984] Starting subtest: fbc-2p-indfb-fliptrack-mmap-gtt
[696.211240] Subtest fbc-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[696.295418] [082/130] (443s left) kms_flip (bo-too-big)
[696.391111] Starting subtest: bo-too-big
[696.393835] Starting dynamic subtest: A-eDP1
[698.091788] Dynamic subtest A-eDP1: SUCCESS (1.700s)
[698.101943] Starting dynamic subtest: B-eDP1
[699.814953] Dynamic subtest B-eDP1: SUCCESS (1.722s)
[699.823922] Starting dynamic subtest: C-eDP1
[701.555973] Dynamic subtest C-eDP1: SUCCESS (1.740s)
[701.566129] Starting dynamic subtest: D-eDP1
[703.277820] Dynamic subtest D-eDP1: SUCCESS (1.721s)
[703.280305] Subtest bo-too-big: SUCCESS (6.889s)
[704.541758] [083/130] (435s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[704.650942] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[704.656132] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[704.756906] [084/130] (435s left) kms_getfb (getfb-repeated-different-handles)
[704.811881] Starting subtest: getfb-repeated-different-handles
[704.814705] Subtest getfb-repeated-different-handles: SUCCESS (0.000s)
[704.917482] [085/130] (435s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[704.970034] Starting subtest: etime-multi-wait-all-for-submit-submitted
[705.075649] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.105s)
[705.143109] [086/130] (434s left) kms_flip (flip-vs-wf_vblank-interruptible)
[705.249147] Starting subtest: flip-vs-wf_vblank-interruptible
[705.251855] Starting dynamic subtest: A-eDP1
[707.189137] Dynamic subtest A-eDP1: SUCCESS (1.939s)
[707.197960] Starting dynamic subtest: B-eDP1
[709.118989] Dynamic subtest B-eDP1: SUCCESS (1.928s)
[709.128522] Starting dynamic subtest: C-eDP1
[711.028767] Dynamic subtest C-eDP1: SUCCESS (1.909s)
[711.037831] Starting dynamic subtest: D-eDP1
[712.957033] Dynamic subtest D-eDP1: SUCCESS (1.927s)
[712.959805] Subtest flip-vs-wf_vblank-interruptible: SUCCESS (7.709s)
[714.169170] [087/130] (425s left) gem_ccs (block-multicopy-compressed)
[714.224105] Starting subtest: block-multicopy-compressed
[714.229913] Subtest block-multicopy-compressed: SKIP (0.000s)
[714.331751] [088/130] (425s left) gem_userptr_blits (stress-purge)
[714.394393] Starting subtest: stress-purge
[719.790375] Subtest stress-purge: SUCCESS (5.396s)
[719.919965] [089/130] (420s left) gem_exec_fence (syncobj-export)
[720.395665] Starting subtest: syncobj-export
[720.403103] Subtest syncobj-export: SUCCESS (0.008s)
[722.343402] [090/130] (417s left) kms_psr (psr2-sprite-blt)
[722.459496] Starting subtest: psr2-sprite-blt
[722.462014] Starting dynamic subtest: eDP-1
[724.152357] Dynamic subtest eDP-1: SUCCESS (1.695s)
[724.154996] Subtest psr2-sprite-blt: SUCCESS (1.695s)
[725.014585] [091/130] (415s left) kms_pm_rpm (dpms-mode-unset-non-lpsp)
[726.583645] Starting subtest: dpms-mode-unset-non-lpsp
[727.743137] Subtest dpms-mode-unset-non-lpsp: SKIP (1.156s)
[728.104824] [092/130] (412s left) perf_pmu (idle)
[728.149939] Starting subtest: idle
[728.152942] Starting dynamic subtest: rcs0
[728.724980] Dynamic subtest rcs0: SUCCESS (0.571s)
[728.737033] Starting dynamic subtest: bcs0
[729.248003] Dynamic subtest bcs0: SUCCESS (0.525s)
[729.260714] Starting dynamic subtest: vcs0
[729.770965] Dynamic subtest vcs0: SUCCESS (0.517s)
[729.781941] Starting dynamic subtest: vcs1
[730.297217] Dynamic subtest vcs1: SUCCESS (0.527s)
[730.309749] Starting dynamic subtest: vecs0
[730.821718] Dynamic subtest vecs0: SUCCESS (0.522s)
[730.835025] Starting dynamic subtest: ccs0
[731.348782] Dynamic subtest ccs0: SUCCESS (0.525s)
[731.351931] Subtest idle: SUCCESS (3.201s)
[731.442930] [093/130] (408s left) kms_fbcon_fbt (psr)
[731.509275] Starting subtest: psr
[736.844335] Subtest psr: SUCCESS (5.337s)
[736.923164] [094/130] (403s left) kms_cursor_crc (cursor-offscreen-max-size)
[737.225016] Starting subtest: cursor-offscreen-max-size
[737.233582] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[737.342161] [095/130] (402s left) sw_sync (sync_busy_fork)
[737.391115] Starting subtest: sync_busy_fork
[738.407700] Subtest sync_busy_fork: SUCCESS (1.015s)
[738.463706] [096/130] (401s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[738.595630] Starting subtest: basic-flip-before-cursor-atomic
[739.517014] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.920s)
[740.379872] [097/130] (400s left) sysfs_heartbeat_interval (mixed)
[740.441689] Starting subtest: mixed
[740.444329] Starting dynamic subtest: vecs0
[745.703914] Dynamic subtest vecs0: SUCCESS (5.262s)
[745.715421] Starting dynamic subtest: ccs0
[750.949711] Dynamic subtest ccs0: SUCCESS (5.245s)
[750.961455] Starting dynamic subtest: vcs0
[756.133879] Dynamic subtest vcs0: SUCCESS (5.183s)
[756.145454] Starting dynamic subtest: bcs0
[761.365357] Dynamic subtest bcs0: SUCCESS (5.229s)
[761.375626] Starting dynamic subtest: rcs0
[766.604608] Dynamic subtest rcs0: SUCCESS (5.239s)
[766.617330] Starting dynamic subtest: vcs1
[771.803304] Dynamic subtest vcs1: SUCCESS (5.197s)
[771.806266] Subtest mixed: SUCCESS (31.364s)
[771.874665] [098/130] (368s left) gem_exec_fence (submit3)
[772.057507] Starting subtest: submit3
[772.062898] Subtest submit3: SKIP (0.000s)
[774.330722] [099/130] (366s left) gem_ctx_isolation (nonpriv)
[774.401621] Starting subtest: nonpriv
[774.404954] Starting dynamic subtest: rcs0
[775.039971] Dynamic subtest rcs0: SUCCESS (0.638s)
[775.062387] Starting dynamic subtest: bcs0
[775.713773] Dynamic subtest bcs0: SUCCESS (0.672s)
[775.725229] Starting dynamic subtest: vcs0
[776.298821] Dynamic subtest vcs0: SUCCESS (0.586s)
[776.307846] Starting dynamic subtest: vcs1
[777.853681] Dynamic subtest vcs1: SUCCESS (1.553s)
[777.866128] Starting dynamic subtest: vecs0
[779.828957] Dynamic subtest vecs0: SUCCESS (1.975s)
[779.839179] Starting dynamic subtest: ccs0
[781.876479] Dynamic subtest ccs0: SUCCESS (2.047s)
[781.878960] Subtest nonpriv: SUCCESS (7.475s)
[782.132480] [100/130] (358s left) kms_frontbuffer_tracking (fbc-modesetfrombusy)
[782.234589] Starting subtest: fbc-modesetfrombusy
[784.999728] Subtest fbc-modesetfrombusy: SUCCESS (2.771s)
[785.159487] [101/130] (355s left) gem_basic (create-close)
[785.222416] Starting subtest: create-close
[785.227126] Subtest create-close: SUCCESS (0.000s)
[785.340496] [102/130] (355s left) gem_exec_params (mmapped)
[785.401729] Starting subtest: mmapped
[785.406925] Subtest mmapped: SUCCESS (0.003s)
[785.519418] [103/130] (355s left) perf (gen12-group-concurrent-oa-buffer-read)
[785.614160] Starting subtest: gen12-group-concurrent-oa-buffer-read
[795.677920] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.062s)
[795.722331] [104/130] (344s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[795.854329] Starting subtest: cursorA-vs-flipB-atomic
[795.859586] Subtest cursorA-vs-flipB-atomic: SKIP (0.001s)
[795.947133] [105/130] (344s left) kms_psr (fbc-psr2-no-drrs)
[796.052389] Starting subtest: fbc-psr2-no-drrs
[796.054964] Starting dynamic subtest: eDP-1
[796.059712] Dynamic subtest eDP-1: SKIP (0.000s)
[796.064770] Subtest fbc-psr2-no-drrs: SKIP (0.002s)
[796.119314] [106/130] (344s left) kms_chamelium_hpd (dp-hpd-after-suspend)
[796.505883] Subtest dp-hpd-after-suspend: SKIP (0.000s)
[797.329048] [107/130] (343s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[797.435956] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[797.441160] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[797.541032] [108/130] (343s left) gem_exec_reloc (basic-write-wc-active)
[797.612125] Subtest basic-write-wc-active: SKIP (0.000s)
[797.693600] [109/130] (343s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled)
[797.755969] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[797.758889] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[797.876370] [110/130] (342s left) kms_frontbuffer_tracking (psr-2p-pri-indfb-multidraw)
[797.982041] Starting subtest: psr-2p-pri-indfb-multidraw
[797.987007] Subtest psr-2p-pri-indfb-multidraw: SKIP (0.000s)
[798.067130] [111/130] (342s left) gem_ctx_persistence (smoketest)
[798.129049] Starting subtest: smoketest
[838.174192] Subtest smoketest: SUCCESS (40.040s)
[838.249011] [112/130] (302s left) kms_frontbuffer_tracking (fbcpsr-tiling-y)
[838.355800] Starting subtest: fbcpsr-tiling-y
[838.361499] Subtest fbcpsr-tiling-y: SKIP (0.000s)
[838.457303] [113/130] (302s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt)
[838.568957] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt
[843.132123] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (4.566s)
[843.263428] [114/130] (297s left) kms_chamelium_edid (dp-edid-stress-resolution-non-4k)
[843.646679] Subtest dp-edid-stress-resolution-non-4k: SKIP (0.000s)
[844.496707] [115/130] (296s left) gem_pipe_control_store_loop (reused-buffer)
[844.563582] Starting subtest: reused-buffer
[846.716612] Subtest reused-buffer: SUCCESS (2.152s)
[846.851816] [116/130] (294s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-gtt)
[846.967640] Starting subtest: fbcpsr-rgb101010-draw-mmap-gtt
[846.972757] Subtest fbcpsr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[847.069365] [117/130] (294s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[852.064710] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[852.067416] Starting dynamic subtest: pipe-A-eDP-1
[869.277832] Dynamic subtest pipe-A-eDP-1: SUCCESS (17.211s)
[869.289302] Starting dynamic subtest: pipe-B-eDP-1
[886.490909] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.208s)
[886.493366] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (34.422s)
[887.364419] [118/130] (253s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[887.474121] Starting subtest: 2x-long-flip-vs-cursor-atomic
[887.480172] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.001s)
[887.570983] [119/130] (253s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[887.679180] Starting subtest: x-tiled-64bpp-rotate-180
[890.008547] Subtest x-tiled-64bpp-rotate-180: SUCCESS (2.331s)
[890.260105] [120/130] (250s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[890.319804] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[890.324637] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[890.503454] [121/130] (250s left) gem_exec_balancer (bonded-true-hang)
[890.746696] Starting subtest: bonded-true-hang
[890.752568] Subtest bonded-true-hang: SKIP (0.000s)
[890.858346] [122/130] (250s left) gem_gpgpu_fill (basic)
[890.922434] Starting subtest: basic
[890.924724] Starting dynamic subtest: smem
[890.932879] Dynamic subtest smem: SUCCESS (0.013s)
[890.935777] Subtest basic: SUCCESS (0.013s)
[891.072441] [123/130] (250s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc)
[891.175951] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc
[891.178790] Starting dynamic subtest: pipe-A-eDP-1
[891.644918] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.429s)
[891.655073] Starting dynamic subtest: pipe-B-eDP-1
[893.070876] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.433s)
[893.080387] Starting dynamic subtest: pipe-C-eDP-1
[894.458972] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.386s)
[894.475944] Starting dynamic subtest: pipe-D-eDP-1
[895.810550] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.347s)
[895.812775] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (4.600s)
[896.963410] [124/130] (244s left) kms_flip (2x-blocking-absolute-wf_vblank)
[897.072605] Starting subtest: 2x-blocking-absolute-wf_vblank
[897.083772] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.010s)
[897.158059] [125/130] (244s left) kms_rmfb (close-fd)
[897.259740] Starting subtest: close-fd
[897.262263] Starting dynamic subtest: pipe-A-eDP-1
[897.381283] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.118s)
[897.390658] Starting dynamic subtest: pipe-B-eDP-1
[898.536165] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.154s)
[898.546950] Starting dynamic subtest: pipe-C-eDP-1
[899.659367] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.121s)
[899.670310] Starting dynamic subtest: pipe-D-eDP-1
[900.787447] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s)
[900.789733] Subtest close-fd: SUCCESS (3.524s)
[901.983509] [126/130] (239s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[902.087154] Starting subtest: flip-primary-invalidate-overlay
[914.561763] Subtest flip-primary-invalidate-overlay: SUCCESS (12.475s)
[914.854623] [127/130] (226s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[914.947629] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[914.950164] Starting dynamic subtest: pipe-A-default-mode
[917.590903] Dynamic subtest pipe-A-default-mode: SUCCESS (2.641s)
[917.593541] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.643s)
[918.366782] [128/130] (223s left) gem_mmap_gtt (coherency)
[918.424141] Subtest coherency: SKIP (0.000s)
[918.487389] [129/130] (223s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180)
[918.592614] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180
[918.597747] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[918.698402] [130/130] (222s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[918.813553] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[918.818743] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[918.920068] Closing watchdogs
results: parsing output: 0/ for test: drm_fdinfo
results: parsing output: 1/ for test: sw_sync
results: parsing output: 2/ for test: gem_ctx_persistence
results: parsing output: 3/ for test: kms_cursor_crc
results: parsing output: 4/ for test: dmabuf_sync_file
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: kms_ccs
results: parsing output: 7/ for test: syncobj_timeline
results: parsing output: 8/ for test: kms_universal_plane
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: kms_flip
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: kms_joiner
results: parsing output: 14/ for test: vgem_basic
results: parsing output: 15/ for test: kms_async_flips
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: gem_exec_schedule
results: parsing output: 19/ for test: prime_vgem
results: parsing output: 20/ for test: i915_pm_rps
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: i915_selftest
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_lease
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: gem_mmap_offset
results: parsing output: 27/ for test: gem_partial_pwrite_pread
results: parsing output: 28/ for test: kms_fbcon_fbt
results: parsing output: 29/ for test: kms_addfb_basic
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: debugfs_test
results: parsing output: 33/ for test: gem_exec_flush
results: parsing output: 34/ for test: kms_properties
results: parsing output: 35/ for test: gem_exec_schedule
results: parsing output: 36/ for test: i915_fb_tiling
results: parsing output: 37/ for test: sw_sync
results: parsing output: 38/ for test: syncobj_eventfd
results: parsing output: 39/ for test: kms_flip
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: gem_mmap_gtt
results: parsing output: 42/ for test: i915_query
results: parsing output: 43/ for test: api_intel_allocator
results: parsing output: 44/ for test: kms_color
results: parsing output: 45/ for test: kms_cursor_edge_walk
results: parsing output: 46/ for test: gem_userptr_blits
results: parsing output: 47/ for test: gem_render_copy
results: parsing output: 48/ for test: perf
results: parsing output: 49/ for test: gem_pwrite
results: parsing output: 50/ for test: prime_self_import
results: parsing output: 51/ for test: kms_psr2_sf
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: perf
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_plane_cursor
results: parsing output: 58/ for test: kms_dirtyfb
results: parsing output: 59/ for test: gem_exec_flush
results: parsing output: 60/ for test: kms_psr
results: parsing output: 61/ for test: syncobj_timeline
results: parsing output: 62/ for test: kms_plane_scaling
results: parsing output: 63/ for test: vgem_basic
results: parsing output: 64/ for test: kms_cursor_legacy
results: parsing output: 65/ for test: gen7_exec_parse
results: parsing output: 66/ for test: kms_ccs
results: parsing output: 67/ for test: perf
results: parsing output: 68/ for test: gem_exec_reloc
results: parsing output: 69/ for test: gem_exec_balancer
results: parsing output: 70/ for test: kms_cursor_edge_walk
results: parsing output: 71/ for test: syncobj_timeline
results: parsing output: 72/ for test: gem_exec_whisper
results: parsing output: 73/ for test: kms_psr
results: parsing output: 74/ for test: kms_plane
results: parsing output: 75/ for test: debugfs_test
results: parsing output: 76/ for test: kms_ccs
results: parsing output: 77/ for test: i915_pm_freq_api
results: parsing output: 78/ for test: kms_pm_dc
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_flip
results: parsing output: 82/ for test: kms_big_fb
results: parsing output: 83/ for test: kms_getfb
results: parsing output: 84/ for test: syncobj_timeline
results: parsing output: 85/ for test: kms_flip
results: parsing output: 86/ for test: gem_ccs
results: parsing output: 87/ for test: gem_userptr_blits
results: parsing output: 88/ for test: gem_exec_fence
results: parsing output: 89/ for test: kms_psr
results: parsing output: 90/ for test: kms_pm_rpm
results: parsing output: 91/ for test: perf_pmu
results: parsing output: 92/ for test: kms_fbcon_fbt
results: parsing output: 93/ for test: kms_cursor_crc
results: parsing output: 94/ for test: sw_sync
results: parsing output: 95/ for test: kms_cursor_legacy
results: parsing output: 96/ for test: sysfs_heartbeat_interval
results: parsing output: 97/ for test: gem_exec_fence
results: parsing output: 98/ for test: gem_ctx_isolation
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: gem_basic
results: parsing output: 101/ for test: gem_exec_params
results: parsing output: 102/ for test: perf
results: parsing output: 103/ for test: kms_cursor_legacy
results: parsing output: 104/ for test: kms_psr
results: parsing output: 105/ for test: kms_chamelium_hpd
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gem_exec_reloc
results: parsing output: 108/ for test: syncobj_timeline
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: gem_ctx_persistence
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_chamelium_edid
results: parsing output: 114/ for test: gem_pipe_control_store_loop
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_psr2_sf
results: parsing output: 117/ for test: kms_cursor_legacy
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: gem_render_copy
results: parsing output: 120/ for test: gem_exec_balancer
results: parsing output: 121/ for test: gem_gpgpu_fill
results: parsing output: 122/ for test: kms_ccs
results: parsing output: 123/ for test: kms_flip
results: parsing output: 124/ for test: kms_rmfb
results: parsing output: 125/ for test: kms_psr_stress_test
results: parsing output: 126/ for test: kms_flip_scaled_crc
results: parsing output: 127/ for test: gem_mmap_gtt
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: kms_frontbuffer_tracking
Done.