[60.368986] Initializing watchdogs
[60.369080]   /dev/watchdog0
[60.384390] [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]
[60.389386] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.391756] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.394850] [001/133] (960s left) kms_cursor_crc (cursor-offscreen-64x64)
[60.607427] Starting subtest: cursor-offscreen-64x64
[60.620079] Starting dynamic subtest: pipe-A-eDP-1
[62.617646] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.988s)
[62.650812] Starting dynamic subtest: pipe-D-eDP-1
[65.208413] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.554s)
[65.210331] Subtest cursor-offscreen-64x64: SUCCESS (4.583s)
[66.053580] [002/133] (954s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[66.108820] Starting subtest: single-wait-all-for-submit-unsubmitted
[66.218485] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.108s)
[66.297840] [003/133] (954s left) kms_prop_blob (invalid-set-prop-any)
[66.352691] Starting subtest: invalid-set-prop-any
[66.354588] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[66.467583] [004/133] (954s left) syncobj_wait (invalid-reset-bad-pad)
[66.530876] Starting subtest: invalid-reset-bad-pad
[66.532929] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[66.616817] [005/133] (954s left) kms_frontbuffer_tracking (psr-modesetfrombusy)
[66.728868] Starting subtest: psr-modesetfrombusy
[72.934247] Subtest psr-modesetfrombusy: SUCCESS (6.199s)
[73.058841] [006/133] (948s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[73.137685] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs
[73.139650] Starting dynamic subtest: pipe-A-eDP-1
[73.158990] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[73.168061] Starting dynamic subtest: pipe-B-eDP-1
[73.186185] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[73.193260] Starting dynamic subtest: pipe-C-eDP-1
[73.211333] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[73.218219] Starting dynamic subtest: pipe-D-eDP-1
[73.236216] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[73.239654] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[75.405930] [007/133] (945s left) kms_psr (psr-sprite-blt)
[75.501074] Starting subtest: psr-sprite-blt
[75.503294] Starting dynamic subtest: eDP-1
[77.211869] Dynamic subtest eDP-1: SUCCESS (1.710s)
[77.214217] Subtest psr-sprite-blt: SUCCESS (1.711s)
[78.065077] [008/133] (943s left) prime_self_import (basic-with_two_bos)
[78.105365] Starting subtest: basic-with_two_bos
[78.126825] Subtest basic-with_two_bos: SUCCESS (0.021s)
[78.227327] [009/133] (942s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[78.323848] Starting subtest: x-tiled-64bpp-rotate-90
[78.346601] Subtest x-tiled-64bpp-rotate-90: SKIP (0.022s)
[78.446216] [010/133] (942s left) kms_psr (pr-primary-mmap-cpu)
[78.543922] Starting subtest: pr-primary-mmap-cpu
[78.548281] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[78.638219] [011/133] (942s left) kms_flip (2x-flip-vs-absolute-wf_vblank-interruptible)
[78.724702] Starting subtest: 2x-flip-vs-absolute-wf_vblank-interruptible
[78.736969] Subtest 2x-flip-vs-absolute-wf_vblank-interruptible: SKIP (0.011s)
[78.813495] [012/133] (942s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[78.911735] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[86.168112] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.257s)
[86.287441] [013/133] (935s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[86.360960] Starting subtest: etime-multi-wait-all-for-submit-submitted
[86.466322] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.103s)
[86.551128] [014/133] (934s left) gem_spin_batch (resubmit-all)
[86.622154] Starting subtest: resubmit-all
[86.624539] Starting dynamic subtest: rcs0
[86.636114] Dynamic subtest rcs0: SUCCESS (0.014s)
[86.645712] Starting dynamic subtest: bcs0
[86.648265] Dynamic subtest bcs0: SUCCESS (0.002s)
[86.656699] Starting dynamic subtest: vcs0
[86.659051] Dynamic subtest vcs0: SUCCESS (0.002s)
[86.666699] Starting dynamic subtest: vcs1
[86.669051] Dynamic subtest vcs1: SUCCESS (0.002s)
[86.676337] Starting dynamic subtest: vecs0
[86.678625] Dynamic subtest vecs0: SUCCESS (0.002s)
[86.686070] Starting dynamic subtest: ccs0
[86.688317] Dynamic subtest ccs0: SUCCESS (0.001s)
[86.690654] Subtest resubmit-all: SUCCESS (0.026s)
[87.943811] [015/133] (933s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[88.008775] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[88.113981] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.105s)
[88.183361] [016/133] (933s left) kms_pm_rpm (system-suspend-idle)
[90.113636] Starting subtest: system-suspend-idle
[109.639818] Subtest system-suspend-idle: SUCCESS (4.736s)
[110.028905] [017/133] (911s left) perf_pmu (interrupts)
[110.110840] Starting subtest: interrupts
[111.244769] Subtest interrupts: SUCCESS (1.103s)
[111.357319] [FACT perf_pmu (interrupts)] new: kernel.kmod_is_loaded.vgem: true
[111.360454] [018/133] (910s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[111.468639] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[111.471089] Starting dynamic subtest: pipe-A-eDP-1
[111.993487] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.484s)
[112.003523] Starting dynamic subtest: pipe-B-eDP-1
[113.452227] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.426s)
[113.463794] Starting dynamic subtest: pipe-C-eDP-1
[114.853074] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.373s)
[114.864173] Starting dynamic subtest: pipe-D-eDP-1
[116.198470] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.327s)
[116.200859] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.614s)
[117.401171] [019/133] (904s left) kms_content_protection (dp-mst-lic-type-1)
[117.551722] Starting subtest: dp-mst-lic-type-1
[117.556507] Subtest dp-mst-lic-type-1: SKIP (0.000s)
[117.677800] [020/133] (903s left) kms_color_pipeline (plane-ctm3x4)
[117.777022] Starting subtest: plane-ctm3x4
[117.936100] Starting dynamic subtest: pipe-A-plane-0
[118.081712] Dynamic subtest pipe-A-plane-0: SUCCESS (0.144s)
[118.092751] Starting dynamic subtest: pipe-A-plane-1
[118.252942] Dynamic subtest pipe-A-plane-1: SUCCESS (0.166s)
[118.262110] Starting dynamic subtest: pipe-A-plane-2
[118.362446] Dynamic subtest pipe-A-plane-2: SUCCESS (0.110s)
[119.616401] Starting dynamic subtest: pipe-B-plane-0
[119.776933] Dynamic subtest pipe-B-plane-0: SUCCESS (0.167s)
[119.793004] Starting dynamic subtest: pipe-B-plane-1
[119.935543] Dynamic subtest pipe-B-plane-1: SUCCESS (0.155s)
[119.948569] Starting dynamic subtest: pipe-B-plane-2
[120.068199] Dynamic subtest pipe-B-plane-2: SUCCESS (0.133s)
[121.247422] Starting dynamic subtest: pipe-C-plane-0
[121.370971] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s)
[121.380605] Starting dynamic subtest: pipe-C-plane-1
[121.482821] Dynamic subtest pipe-C-plane-1: SUCCESS (0.110s)
[121.492233] Starting dynamic subtest: pipe-C-plane-2
[121.594533] Dynamic subtest pipe-C-plane-2: SUCCESS (0.111s)
[122.786836] Starting dynamic subtest: pipe-D-plane-0
[122.891273] Dynamic subtest pipe-D-plane-0: SUCCESS (0.111s)
[122.901024] Starting dynamic subtest: pipe-D-plane-1
[123.025082] Dynamic subtest pipe-D-plane-1: SUCCESS (0.133s)
[123.035273] Starting dynamic subtest: pipe-D-plane-2
[123.170388] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[123.477694] Subtest plane-ctm3x4: SUCCESS (5.655s)
[124.275870] [021/133] (897s left) syncobj_timeline (invalid-transfer-non-existent-point)
[124.336598] Starting subtest: invalid-transfer-non-existent-point
[124.339001] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[124.440410] [022/133] (897s left) kms_cursor_legacy (2x-long-nonblocking-modeset-vs-cursor-atomic)
[124.558609] Starting subtest: 2x-long-nonblocking-modeset-vs-cursor-atomic
[124.563045] Subtest 2x-long-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[124.701422] [023/133] (897s left) gem_mmap_gtt (medium-copy-odd)
[124.754913] Subtest medium-copy-odd: SKIP (0.000s)
[124.823481] [024/133] (896s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[124.882521] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[124.940671] [025/133] (896s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[125.049111] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[125.053374] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[125.160520] [026/133] (896s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-render)
[125.266936] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-render
[125.270644] Subtest fbc-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[125.371439] [027/133] (896s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs-cc)
[125.474194] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs-cc
[125.476235] Starting dynamic subtest: pipe-A-eDP-1
[125.495390] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[125.506106] Starting dynamic subtest: pipe-B-eDP-1
[125.523928] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[125.533000] Starting dynamic subtest: pipe-C-eDP-1
[125.550674] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[125.558588] Starting dynamic subtest: pipe-D-eDP-1
[125.576606] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[125.580167] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[127.753951] [028/133] (894s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[127.863257] Starting subtest: compare-crc-sanitycheck-nv12
[127.865458] Starting dynamic subtest: pipe-A-eDP-1
[128.575918] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.711s)
[128.586258] Starting dynamic subtest: pipe-B-eDP-1
[129.858177] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.277s)
[129.867634] Starting dynamic subtest: pipe-C-eDP-1
[131.160599] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.297s)
[131.170378] Starting dynamic subtest: pipe-D-eDP-1
[132.369035] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.205s)
[132.371380] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.496s)
[133.215192] [029/133] (888s left) gem_exec_whisper (basic-queues)
[133.301235] Starting subtest: basic-queues
[138.636877] Subtest basic-queues: SUCCESS (5.327s)
[138.820078] [030/133] (883s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs)
[138.917060] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs
[138.919383] Starting dynamic subtest: pipe-A-eDP-1
[138.940047] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[138.950595] Starting dynamic subtest: pipe-B-eDP-1
[138.969681] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[138.978436] Starting dynamic subtest: pipe-C-eDP-1
[138.997537] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[139.005984] Starting dynamic subtest: pipe-D-eDP-1
[139.025019] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[139.026964] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs: SUCCESS (0.007s)
[141.176125] [031/133] (880s left) gem_ctx_param (invalid-param-set)
[141.233112] Starting subtest: invalid-param-set
[141.235578] Subtest invalid-param-set: SUCCESS (0.000s)
[141.328460] [032/133] (880s left) gem_render_copy (y-tiled-ccs-to-linear)
[141.388650] Starting subtest: y-tiled-ccs-to-linear
[141.393092] Subtest y-tiled-ccs-to-linear: SKIP (0.000s)
[141.573005] [033/133] (880s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[141.675095] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[149.202044] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.526s)
[149.340605] [034/133] (872s left) prime_busy (hang-wait)
[149.409633] Starting subtest: hang-wait
[149.412106] Starting dynamic subtest: rcs0
[175.092834] Dynamic subtest rcs0: SUCCESS (25.667s)
[175.101593] Starting dynamic subtest: bcs0
[182.244771] Dynamic subtest bcs0: SUCCESS (7.146s)
[182.254775] Starting dynamic subtest: vcs0
[189.217016] Dynamic subtest vcs0: SUCCESS (6.967s)
[189.225927] Starting dynamic subtest: vcs1
[196.255743] Dynamic subtest vcs1: SUCCESS (7.035s)
[196.264637] Starting dynamic subtest: vecs0
[203.228994] Dynamic subtest vecs0: SUCCESS (6.968s)
[203.239768] Starting dynamic subtest: ccs0
[217.133074] Dynamic subtest ccs0: SUCCESS (13.908s)
[217.135232] Subtest hang-wait: SUCCESS (67.701s)
[217.238006] [035/133] (805s left) gem_tiled_partial_pwrite_pread (writes)
[217.301595] Subtest writes: SKIP (0.000s)
[217.366310] [036/133] (804s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled)
[217.424983] Starting subtest: yf-tiled-to-vebox-yf-tiled
[217.429461] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[217.609380] [037/133] (804s left) sysfs_timeslice_duration (invalid)
[217.673872] Starting subtest: invalid
[217.676134] Starting dynamic subtest: vecs0
[217.678333] Dynamic subtest vecs0: SUCCESS (0.000s)
[217.688158] Starting dynamic subtest: ccs0
[217.690325] Dynamic subtest ccs0: SUCCESS (0.000s)
[217.698682] Starting dynamic subtest: vcs0
[217.700563] Dynamic subtest vcs0: SUCCESS (0.000s)
[217.708981] Starting dynamic subtest: bcs0
[217.711239] Dynamic subtest bcs0: SUCCESS (0.000s)
[217.719594] Starting dynamic subtest: rcs0
[217.721830] Dynamic subtest rcs0: SUCCESS (0.000s)
[217.730288] Starting dynamic subtest: vcs1
[217.732529] Dynamic subtest vcs1: SUCCESS (0.000s)
[217.734725] Subtest invalid: SUCCESS (0.005s)
[217.775115] [038/133] (804s left) gem_exec_gttfill (multigpu-basic)
[217.960022] Starting subtest: multigpu-basic
[232.705807] Subtest multigpu-basic: SUCCESS (14.747s)
[232.794499] [039/133] (789s left) gem_mmap_wc (write-cpu-read-wc-unflushed)
[232.895561] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s)
[232.952351] [040/133] (789s left) kms_chamelium_edid (dp-edid-read)
[233.361608] Subtest dp-edid-read: SKIP (0.000s)
[234.218606] [041/133] (788s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[234.314903] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[234.319171] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[234.416471] [042/133] (788s left) gem_ctx_persistence (file)
[234.469788] Starting subtest: file
[234.592584] Subtest file: SUCCESS (0.122s)
[234.719082] [043/133] (787s left) sw_sync (sync_multi_timeline_wait)
[234.767905] Starting subtest: sync_multi_timeline_wait
[234.770268] Subtest sync_multi_timeline_wait: SUCCESS (0.000s)
[234.829063] [044/133] (787s left) gem_exec_nop (basic-parallel)
[234.899357] Starting subtest: basic-parallel
[250.578523] Subtest basic-parallel: SUCCESS (15.681s)
[250.801432] [045/133] (771s left) api_intel_allocator (reloc-allocator)
[250.875559] Starting subtest: reloc-allocator
[250.877550] Starting dynamic subtest: basic
[250.882898] Dynamic subtest basic: SUCCESS (0.005s)
[250.893595] Starting dynamic subtest: parallel-one
[250.895871] Dynamic subtest parallel-one: SUCCESS (0.007s)
[250.905053] Starting dynamic subtest: print
[250.907323] Dynamic subtest print: SUCCESS (0.000s)
[250.915978] Starting dynamic subtest: reuse
[250.917905] Dynamic subtest reuse: SUCCESS (0.000s)
[250.926631] Starting dynamic subtest: fork-reopen-allocator
[250.928569] Dynamic subtest fork-reopen-allocator: SUCCESS (0.013s)
[250.930463] Subtest reloc-allocator: SUCCESS (0.028s)
[251.056584] [046/133] (771s left) gem_exec_schedule (u-semaphore-resolve)
[251.132826] Starting subtest: u-semaphore-resolve
[251.188078] Subtest u-semaphore-resolve: SUCCESS (0.062s)
[251.551901] [047/133] (771s left) gem_mmap_gtt (cpuset-basic-small-copy)
[251.606758] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[251.679334] [048/133] (771s left) kms_addfb_basic (too-high)
[251.802754] Starting subtest: too-high
[251.804959] Subtest too-high: SUCCESS (0.001s)
[251.919327] [049/133] (770s left) gem_eio (in-flight-internal-10ms)
[252.163788] Starting subtest: in-flight-internal-10ms
[253.732574] Subtest in-flight-internal-10ms: SUCCESS (1.567s)
[253.929363] [050/133] (769s left) kms_psr (psr2-cursor-mmap-cpu)
[254.020442] Starting subtest: psr2-cursor-mmap-cpu
[254.022769] Starting dynamic subtest: eDP-1
[255.710467] Dynamic subtest eDP-1: SUCCESS (1.690s)
[255.712835] Subtest psr2-cursor-mmap-cpu: SUCCESS (1.691s)
[256.596662] [051/133] (766s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area)
[256.697673] Starting subtest: psr2-overlay-primary-update-sf-dmg-area
[256.699966] Starting dynamic subtest: pipe-A-eDP-1
[262.581684] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.887s)
[262.594298] Starting dynamic subtest: pipe-B-eDP-1
[269.226630] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.643s)
[269.228892] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (12.533s)
[270.115752] [052/133] (752s left) gem_exec_alignment (many)
[270.185646] Starting subtest: many
[292.972108] Subtest many: SUCCESS (22.778s)
[294.930803] [053/133] (728s left) syncobj_timeline (multi-wait-signaled)
[295.024757] Starting subtest: multi-wait-signaled
[295.026989] Subtest multi-wait-signaled: SUCCESS (0.000s)
[295.116853] [054/133] (728s left) kms_atomic (plane-immutable-zpos)
[295.215931] Starting subtest: plane-immutable-zpos
[295.218031] Starting dynamic subtest: pipe-A-eDP-1
[295.886070] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.669s)
[295.888252] Subtest plane-immutable-zpos: SUCCESS (0.671s)
[296.745581] [055/133] (726s left) kms_feature_discovery (display-4x)
[296.844209] Starting subtest: display-4x
[296.848591] Subtest display-4x: SKIP (0.000s)
[296.921754] [056/133] (726s left) gen7_exec_parse (chained-batch)
[296.992881] Subtest chained-batch: SKIP (0.000s)
[297.060246] [057/133] (726s left) kms_ccs (bad-aux-stride-y-tiled-ccs)
[297.168341] Starting subtest: bad-aux-stride-y-tiled-ccs
[297.170613] Starting dynamic subtest: pipe-A-eDP-1
[297.192470] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[297.204085] Starting dynamic subtest: pipe-B-eDP-1
[297.224720] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[297.234267] Starting dynamic subtest: pipe-C-eDP-1
[297.254584] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[297.263253] Starting dynamic subtest: pipe-D-eDP-1
[297.283816] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[297.287903] Subtest bad-aux-stride-y-tiled-ccs: SKIP (0.005s)
[299.315515] [058/133] (723s left) gem_ctx_param (invalid-param-get)
[299.384277] Starting subtest: invalid-param-get
[299.386761] Subtest invalid-param-get: SUCCESS (0.001s)
[299.492363] [059/133] (723s left) gem_ctx_freq (sysfs)
[299.548232] Starting subtest: sysfs
[299.550787] Starting dynamic subtest: gt0
[305.044472] Dynamic subtest gt0: SUCCESS (5.494s)
[305.054115] Starting dynamic subtest: gt1
[346.639855] Dynamic subtest gt1: SUCCESS (41.590s)
[346.642469] Subtest sysfs: SUCCESS (47.086s)
[346.761197] [060/133] (676s left) gem_partial_pwrite_pread (write-uncached)
[346.816336] Subtest write-uncached: SKIP (0.000s)
[346.895476] [061/133] (676s left) gem_exec_fence (submit-chain)
[347.073251] Starting subtest: submit-chain
[347.100687] Subtest submit-chain: SUCCESS (0.028s)
[348.703170] [062/133] (674s left) perf_pmu (busy-start)
[348.747272] Starting subtest: busy-start
[348.749732] Starting dynamic subtest: rcs0
[351.302200] Dynamic subtest rcs0: SUCCESS (2.555s)
[351.320210] Starting dynamic subtest: bcs0
[353.852224] Dynamic subtest bcs0: SUCCESS (2.548s)
[353.865047] Starting dynamic subtest: vcs0
[357.650165] Dynamic subtest vcs0: SUCCESS (3.795s)
[357.663393] Starting dynamic subtest: vcs1
[361.616663] Dynamic subtest vcs1: SUCCESS (3.964s)
[361.630470] Starting dynamic subtest: vecs0
[365.648232] Dynamic subtest vecs0: SUCCESS (4.030s)
[365.661112] Starting dynamic subtest: ccs0
[368.199069] Dynamic subtest ccs0: SUCCESS (2.550s)
[368.202006] Subtest busy-start: SUCCESS (19.456s)
[368.297018] [063/133] (655s left) i915_pm_rps (basic-api)
[368.374318] Starting subtest: basic-api
[368.379082] Subtest basic-api: SKIP (0.001s)
[368.485576] [064/133] (655s left) kms_vblank (wait-forked)
[368.587034] Starting subtest: wait-forked
[368.589345] Starting dynamic subtest: pipe-A-eDP-1
[370.418469] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.829s)
[370.433979] Starting dynamic subtest: pipe-D-eDP-1
[372.916324] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.495s)
[372.918686] Subtest wait-forked: SUCCESS (4.329s)
[373.769309] [065/133] (649s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-downscaling)
[373.873539] Starting subtest: flip-32bpp-linear-to-64bpp-linear-downscaling
[373.875875] Starting dynamic subtest: pipe-A-default-mode
[375.032473] Dynamic subtest pipe-A-default-mode: SKIP (1.155s)
[375.036936] Subtest flip-32bpp-linear-to-64bpp-linear-downscaling: SKIP (1.157s)
[375.188504] [066/133] (648s left) testdisplay
[375.494347] [067/133] (648s left) kms_psr (fbc-psr2-suspend)
[375.577012] Starting subtest: fbc-psr2-suspend
[375.579326] Starting dynamic subtest: eDP-1
[375.583560] Dynamic subtest eDP-1: SKIP (0.000s)
[375.587798] Subtest fbc-psr2-suspend: SKIP (0.001s)
[375.662661] [068/133] (648s left) gem_exercise_blt (fast-copy-emit)
[375.731771] Starting subtest: fast-copy-emit
[375.734142] Starting dynamic subtest: linear-smem-smem-emit
[375.755744] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.023s)
[375.767464] Starting dynamic subtest: xmajor-smem-smem-emit
[375.773022] Dynamic subtest xmajor-smem-smem-emit: SUCCESS (0.017s)
[375.782732] Starting dynamic subtest: tile4-smem-smem-emit
[375.789377] Dynamic subtest tile4-smem-smem-emit: SUCCESS (0.016s)
[375.798816] Starting dynamic subtest: tile64-smem-smem-emit
[375.809358] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.019s)
[375.811647] Subtest fast-copy-emit: SUCCESS (0.078s)
[375.924714] [069/133] (647s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-msflip-blt)
[376.016965] Starting subtest: psr-2p-primscrn-shrfb-msflip-blt
[376.020256] Subtest psr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[376.114942] [070/133] (647s left) kms_plane_scaling (planes-upscale-factor-0-25)
[376.203416] Starting subtest: planes-upscale-factor-0-25
[376.205266] Starting dynamic subtest: pipe-A
[376.264249] Dynamic subtest pipe-A: SUCCESS (0.062s)
[376.274673] Starting dynamic subtest: pipe-B
[377.424979] Dynamic subtest pipe-B: SUCCESS (1.159s)
[377.436854] Starting dynamic subtest: pipe-C
[378.526055] Dynamic subtest pipe-C: SUCCESS (1.099s)
[378.535901] Starting dynamic subtest: pipe-D
[379.650816] Dynamic subtest pipe-D: SUCCESS (1.124s)
[379.653011] Subtest planes-upscale-factor-0-25: SUCCESS (3.450s)
[380.809132] [071/133] (643s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[380.926759] Starting subtest: yf-tiled-64bpp-rotate-0
[380.930974] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[381.023303] [072/133] (642s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[381.116508] Starting subtest: fbc-rgb565-draw-mmap-gtt
[381.120876] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[381.241797] [073/133] (642s left) kms_flip (flip-vs-rmfb-interruptible)
[381.354410] Starting subtest: flip-vs-rmfb-interruptible
[381.356718] Starting dynamic subtest: A-eDP1
[389.995217] Dynamic subtest A-eDP1: SUCCESS (8.640s)
[390.006280] Starting dynamic subtest: B-eDP1
[398.622176] Dynamic subtest B-eDP1: SUCCESS (8.625s)
[398.635874] Starting dynamic subtest: C-eDP1
[407.294421] Dynamic subtest C-eDP1: SUCCESS (8.669s)
[407.307616] Starting dynamic subtest: D-eDP1
[415.891706] Dynamic subtest D-eDP1: SUCCESS (8.593s)
[415.896128] Subtest flip-vs-rmfb-interruptible: SUCCESS (34.542s)
[417.077265] [074/133] (606s left) kms_flip (2x-plain-flip-fb-recreate)
[417.179485] Starting subtest: 2x-plain-flip-fb-recreate
[417.191519] Subtest 2x-plain-flip-fb-recreate: SKIP (0.011s)
[417.286401] [075/133] (606s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[417.376661] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc
[424.482354] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (7.108s)
[424.597801] [076/133] (599s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-blt)
[424.692513] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-blt
[424.696792] Subtest psr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[424.790765] [077/133] (599s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[424.896473] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[424.900708] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[424.991829] [078/133] (599s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[425.089676] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[425.769670] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.681s)
[425.921827] [079/133] (598s left) kms_async_flips (basic-modeset-with-all-modifiers-formats)
[426.016656] Starting subtest: basic-modeset-with-all-modifiers-formats
[426.406687] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB8888
[427.206821] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB8888: SUCCESS (0.801s)
[427.223122] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB2101010
[427.228509] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB2101010: SUCCESS (0.020s)
[427.238407] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB16161616F
[427.250911] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB16161616F: SUCCESS (0.021s)
[427.262908] Starting dynamic subtest: pipe-A-eDP-1-4-RGB565
[427.395753] Dynamic subtest pipe-A-eDP-1-4-RGB565: SUCCESS (0.144s)
[427.412653] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB8888
[427.417776] Dynamic subtest pipe-A-eDP-1-4-XRGB8888: SUCCESS (0.021s)
[427.433875] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB2101010
[427.439776] Dynamic subtest pipe-A-eDP-1-4-XRGB2101010: SUCCESS (0.021s)
[427.449795] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB16161616F
[427.462078] Dynamic subtest pipe-A-eDP-1-4-XRGB16161616F: SUCCESS (0.021s)
[427.472004] Starting dynamic subtest: pipe-A-eDP-1-4-YUYV
[427.484291] Dynamic subtest pipe-A-eDP-1-4-YUYV: SUCCESS (0.021s)
[427.494127] Starting dynamic subtest: pipe-A-eDP-1-4-Y210
[427.506440] Dynamic subtest pipe-A-eDP-1-4-Y210: SUCCESS (0.021s)
[427.516255] Starting dynamic subtest: pipe-A-eDP-1-4-XYUV8888
[427.528721] Dynamic subtest pipe-A-eDP-1-4-XYUV8888: SUCCESS (0.021s)
[427.538546] Starting dynamic subtest: pipe-A-eDP-1-4-XV30
[427.550944] Dynamic subtest pipe-A-eDP-1-4-XV30: SUCCESS (0.021s)
[427.561333] Starting dynamic subtest: pipe-A-eDP-1-4-XV36
[427.573193] Dynamic subtest pipe-A-eDP-1-4-XV36: SUCCESS (0.022s)
[427.582963] Starting dynamic subtest: pipe-A-eDP-1-x-RGB565
[427.728927] Dynamic subtest pipe-A-eDP-1-x-RGB565: SUCCESS (0.155s)
[427.744296] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB8888
[427.751022] Dynamic subtest pipe-A-eDP-1-x-XRGB8888: SUCCESS (0.021s)
[427.760862] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB2101010
[427.773245] Dynamic subtest pipe-A-eDP-1-x-XRGB2101010: SUCCESS (0.021s)
[427.782774] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB16161616F
[427.795495] Dynamic subtest pipe-A-eDP-1-x-XRGB16161616F: SUCCESS (0.022s)
[427.804994] Starting dynamic subtest: pipe-A-eDP-1-x-YUYV
[427.817604] Dynamic subtest pipe-A-eDP-1-x-YUYV: SUCCESS (0.021s)
[427.827152] Starting dynamic subtest: pipe-A-eDP-1-x-Y210
[427.839832] Dynamic subtest pipe-A-eDP-1-x-Y210: SUCCESS (0.022s)
[427.849550] Starting dynamic subtest: pipe-A-eDP-1-x-XYUV8888
[427.862272] Dynamic subtest pipe-A-eDP-1-x-XYUV8888: SUCCESS (0.021s)
[427.872021] Starting dynamic subtest: pipe-A-eDP-1-x-XV30
[427.884413] Dynamic subtest pipe-A-eDP-1-x-XV30: SUCCESS (0.021s)
[427.896728] Starting dynamic subtest: pipe-A-eDP-1-x-XV36
[427.906522] Dynamic subtest pipe-A-eDP-1-x-XV36: SUCCESS (0.021s)
[427.916237] Starting dynamic subtest: pipe-A-eDP-1-linear-RGB565
[428.062428] Dynamic subtest pipe-A-eDP-1-linear-RGB565: SUCCESS (0.155s)
[428.073114] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB8888
[428.084690] Dynamic subtest pipe-A-eDP-1-linear-XRGB8888: SUCCESS (0.021s)
[428.094462] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB2101010
[428.106994] Dynamic subtest pipe-A-eDP-1-linear-XRGB2101010: SUCCESS (0.021s)
[428.116640] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB16161616F
[428.129272] Dynamic subtest pipe-A-eDP-1-linear-XRGB16161616F: SUCCESS (0.021s)
[428.138983] Starting dynamic subtest: pipe-A-eDP-1-linear-YUYV
[428.151403] Dynamic subtest pipe-A-eDP-1-linear-YUYV: SUCCESS (0.022s)
[428.161251] Starting dynamic subtest: pipe-A-eDP-1-linear-Y210
[428.173810] Dynamic subtest pipe-A-eDP-1-linear-Y210: SUCCESS (0.022s)
[428.186520] Starting dynamic subtest: pipe-A-eDP-1-linear-XYUV8888
[428.195536] Dynamic subtest pipe-A-eDP-1-linear-XYUV8888: SUCCESS (0.021s)
[428.204888] Starting dynamic subtest: pipe-A-eDP-1-linear-XV30
[428.217524] Dynamic subtest pipe-A-eDP-1-linear-XV30: SUCCESS (0.021s)
[428.226667] Starting dynamic subtest: pipe-A-eDP-1-linear-XV36
[428.240065] Dynamic subtest pipe-A-eDP-1-linear-XV36: SUCCESS (0.021s)
[428.624999] Subtest basic-modeset-with-all-modifiers-formats: SUCCESS (2.610s)
[429.476066] [080/133] (594s left) kms_plane_scaling (2x-scaler-multi-pipe)
[429.576147] Starting subtest: 2x-scaler-multi-pipe
[429.580351] Subtest 2x-scaler-multi-pipe: SKIP (0.001s)
[429.669937] [081/133] (594s left) gem_userptr_blits (sd-probe)
[429.726702] Starting subtest: sd-probe
[429.728851] Subtest sd-probe: SUCCESS (0.000s)
[429.842663] [082/133] (594s left) gem_render_copy (x-tiled)
[429.898232] Starting subtest: x-tiled
[429.900128] Starting dynamic subtest: smem
[429.936974] Dynamic subtest smem: SUCCESS (0.041s)
[429.939481] Subtest x-tiled: SUCCESS (0.042s)
[430.194101] [083/133] (594s left) kms_pm_lpsp (screens-disabled)
[431.299645] Starting subtest: screens-disabled
[431.304302] Subtest screens-disabled: SKIP (0.000s)
[431.386614] [084/133] (593s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[431.508608] Starting subtest: cursor-vs-flip-atomic
[461.289297] Subtest cursor-vs-flip-atomic: SUCCESS (29.774s)
[462.121225] [085/133] (562s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[462.218730] Starting subtest: y-tiled-32bpp-rotate-180
[462.222886] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[462.335409] [086/133] (562s left) i915_fb_tiling (basic-x-tiling)
[462.396962] Subtest basic-x-tiling: SKIP (0.000s)
[462.461371] [087/133] (562s left) gem_pread (exhaustion)
[462.521554] Subtest exhaustion: SKIP (0.000s)
[462.590902] [088/133] (562s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[462.693742] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[463.751553] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.058s)
[463.879442] [089/133] (560s left) gem_ccs (ctrl-surf-copy-new-ctx)
[463.949304] Starting subtest: ctrl-surf-copy-new-ctx
[463.952810] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[464.050145] [090/133] (560s left) kms_atomic_interruptible (atomic-setmode)
[464.154413] Starting subtest: atomic-setmode
[464.156159] Starting dynamic subtest: pipe-A-eDP-1
[471.029253] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.873s)
[471.031391] Subtest atomic-setmode: SUCCESS (6.874s)
[471.820905] [091/133] (552s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[471.919803] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[471.924123] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[472.016437] [092/133] (552s left) i915_pm_sseu (full-enable)
[472.070495] Subtest full-enable: SKIP (0.000s)
[472.160575] [093/133] (552s left) gem_readwrite (beyond-eob)
[472.212305] Subtest beyond-EOB: SKIP (0.000s)
[472.291813] [094/133] (552s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[472.379163] Starting subtest: fbc-rgb101010-draw-render
[476.971958] Subtest fbc-rgb101010-draw-render: SUCCESS (4.594s)
[478.150584] [095/133] (546s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping)
[478.244604] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping
[478.249041] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (0.000s)
[478.321451] [096/133] (546s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[478.703231] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[479.537204] [097/133] (545s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[479.646041] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip
[480.671132] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.025s)
[480.800032] [098/133] (544s left) gem_exec_reloc (basic-write-wc-active)
[480.869076] Subtest basic-write-wc-active: SKIP (0.000s)
[480.939706] [099/133] (544s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[481.025617] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[481.027525] Starting dynamic subtest: pipe-A-default-mode
[482.207292] Dynamic subtest pipe-A-default-mode: SKIP (1.180s)
[482.211673] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.181s)
[482.367840] [100/133] (542s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[482.465162] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[482.469310] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[482.563594] [101/133] (542s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt)
[482.663990] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt
[487.112023] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (4.451s)
[488.284559] [102/133] (536s left) gem_ctx_param (invalid-ctx-get)
[488.348920] Starting subtest: invalid-ctx-get
[488.350965] Subtest invalid-ctx-get: SUCCESS (0.000s)
[488.424589] [103/133] (536s left) kms_lease (atomic-implicit-crtc)
[488.512548] Starting subtest: atomic-implicit-crtc
[488.514786] Starting dynamic subtest: pipe-A-eDP-1
[488.526071] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[488.537124] Starting dynamic subtest: pipe-B-eDP-1
[488.548049] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.010s)
[488.558257] Starting dynamic subtest: pipe-C-eDP-1
[488.568826] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.010s)
[488.578247] Starting dynamic subtest: pipe-D-eDP-1
[488.588594] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[488.590497] Subtest atomic-implicit-crtc: SUCCESS (0.037s)
[488.655675] [104/133] (536s left) core_setmaster (master-drop-set-root)
[488.723556] Starting subtest: master-drop-set-root
[488.747837] Subtest master-drop-set-root: SUCCESS (0.024s)
[488.816298] [105/133] (536s left) kms_cdclk (mode-transition)
[488.922499] Starting subtest: mode-transition
[488.924834] Starting dynamic subtest: pipe-A-eDP-1
[489.211597] Dynamic subtest pipe-A-eDP-1: SKIP (0.287s)
[489.222357] Starting dynamic subtest: pipe-B-eDP-1
[489.226616] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[489.236609] Starting dynamic subtest: pipe-C-eDP-1
[489.241011] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[489.250826] Starting dynamic subtest: pipe-D-eDP-1
[489.254842] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[489.258880] Subtest mode-transition: SKIP (0.295s)
[490.014099] [106/133] (535s left) syncobj_timeline (wait-all-interrupted)
[490.083818] Starting subtest: wait-all-interrupted
[490.185152] Subtest wait-all-interrupted: SUCCESS (0.102s)
[490.266331] [107/133] (535s left) kms_display_modes (extended-mode-basic)
[490.359243] Starting subtest: extended-mode-basic
[490.363462] Subtest extended-mode-basic: SKIP (0.000s)
[490.409141] [108/133] (535s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite)
[490.512948] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite
[490.517245] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[490.600457] [109/133] (534s left) kms_frontbuffer_tracking (fbcpsr-tiling-y)
[490.692317] Starting subtest: fbcpsr-tiling-y
[490.696782] Subtest fbcpsr-tiling-y: SKIP (0.000s)
[490.783411] [110/133] (534s left) gem_mmap_offset (partial-mmap)
[490.848585] Starting subtest: partial-mmap
[490.850821] Starting dynamic subtest: smem0
[490.853073] Dynamic subtest smem0: SUCCESS (0.004s)
[490.855007] Subtest partial-mmap: SUCCESS (0.005s)
[490.987553] [111/133] (534s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[491.086566] Starting subtest: fbc-psr2-overlay-primary-update-sf-dmg-area
[491.088617] Starting dynamic subtest: pipe-A-eDP-1
[491.205659] Dynamic subtest pipe-A-eDP-1: SKIP (0.122s)
[491.219669] Starting dynamic subtest: pipe-B-eDP-1
[492.373436] Dynamic subtest pipe-B-eDP-1: SKIP (1.165s)
[492.378156] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (1.290s)
[493.557512] [112/133] (532s left) gem_exec_balancer (invalid-balancer)
[493.624307] Starting subtest: invalid-balancer
[494.541545] Subtest invalid-balancer: SUCCESS (0.918s)
[494.830319] [113/133] (530s left) gem_userptr_blits (map-fixed-invalidate)
[494.887979] Starting subtest: map-fixed-invalidate
[494.892295] Subtest map-fixed-invalidate: SKIP (0.000s)
[495.006222] [114/133] (530s left) perf (gen12-group-exclusive-stream-sample-oa)
[495.146515] Starting subtest: gen12-group-exclusive-stream-sample-oa
[495.164118] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.019s)
[495.213244] [115/133] (530s left) kms_fbcon_fbt (psr)
[495.270088] Starting subtest: psr
[502.580758] Subtest psr: SUCCESS (7.304s)
[502.657406] [116/133] (523s left) kms_getfb (getfb2-into-addfb2)
[502.756321] Starting subtest: getfb2-into-addfb2
[502.758605] Subtest getfb2-into-addfb2: SUCCESS (0.000s)
[502.885269] [117/133] (522s left) kms_psr (fbc-psr2-cursor-blt)
[502.973424] Starting subtest: fbc-psr2-cursor-blt
[502.975699] Starting dynamic subtest: eDP-1
[502.979795] Dynamic subtest eDP-1: SKIP (0.000s)
[502.984094] Subtest fbc-psr2-cursor-blt: SKIP (0.001s)
[503.048590] [118/133] (522s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[503.142497] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[510.519493] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.379s)
[510.634281] [119/133] (515s left) gem_exec_capture (capture-recoverable)
[510.701156] Starting subtest: capture-recoverable
[510.703569] Subtest capture-recoverable: SUCCESS (0.002s)
[510.833103] [120/133] (515s left) gem_exec_schedule (preempt-other)
[510.908055] Starting subtest: preempt-other
[510.910053] Starting dynamic subtest: rcs0
[510.972469] Dynamic subtest rcs0: SUCCESS (0.071s)
[510.985617] Starting dynamic subtest: bcs0
[511.038785] Dynamic subtest bcs0: SUCCESS (0.065s)
[511.051825] Starting dynamic subtest: vcs0
[511.106255] Dynamic subtest vcs0: SUCCESS (0.066s)
[511.117227] Starting dynamic subtest: vcs1
[511.186942] Dynamic subtest vcs1: SUCCESS (0.080s)
[511.200967] Starting dynamic subtest: vecs0
[511.254100] Dynamic subtest vecs0: SUCCESS (0.066s)
[511.267985] Starting dynamic subtest: ccs0
[511.325882] Dynamic subtest ccs0: SUCCESS (0.072s)
[511.328755] Subtest preempt-other: SUCCESS (0.425s)
[512.671927] [121/133] (513s left) kms_sequence (queue-idle)
[512.771746] Starting subtest: queue-idle
[512.774110] Starting dynamic subtest: pipe-A-eDP-1
[514.593579] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.819s)
[514.604762] Starting dynamic subtest: pipe-B-eDP-1
[517.110088] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.516s)
[517.120401] Starting dynamic subtest: pipe-C-eDP-1
[519.532911] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.420s)
[519.543500] Starting dynamic subtest: pipe-D-eDP-1
[521.965879] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.431s)
[521.968202] Subtest queue-idle: SUCCESS (9.193s)
[522.779700] [122/133] (503s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[522.896679] Starting subtest: basic-flip-after-cursor-atomic
[523.816131] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.918s)
[524.611230] [123/133] (501s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[524.721291] Starting subtest: basic-busy-flip-before-cursor-legacy
[524.725594] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[524.869745] [124/133] (501s left) gem_ccs (large-ctrl-surf-copy)
[524.927946] Starting subtest: large-ctrl-surf-copy
[524.932304] Subtest large-ctrl-surf-copy: SKIP (0.000s)
[525.035827] [125/133] (501s left) kms_cursor_crc (cursor-sliding-32x32)
[525.166938] Starting subtest: cursor-sliding-32x32
[525.212414] Subtest cursor-sliding-32x32: SKIP (0.040s)
[525.512397] [126/133] (500s left) kms_cursor_crc (cursor-random-max-size)
[525.841250] Starting subtest: cursor-random-max-size
[525.846856] Subtest cursor-random-max-size: SKIP (0.000s)
[525.990042] [127/133] (500s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[526.086852] Starting subtest: pixel-format-y-tiled-ccs-modifier
[526.090317] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[526.210465] [128/133] (500s left) gem_render_copy (yf-tiled-ccs-to-linear)
[526.281370] Starting subtest: yf-tiled-ccs-to-linear
[526.285897] Subtest yf-tiled-ccs-to-linear: SKIP (0.000s)
[526.510889] [129/133] (499s left) kms_joiner (basic-max-non-joiner)
[526.619874] Starting subtest: basic-max-non-joiner
[526.624302] Subtest basic-max-non-joiner: SKIP (0.000s)
[526.686421] [130/133] (499s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[526.818758] Starting subtest: cursorA-vs-flipB-atomic
[526.823350] Subtest cursorA-vs-flipB-atomic: SKIP (0.001s)
[526.964923] [131/133] (499s left) i915_drm_fdinfo (memory-info-idle)
[527.010497] Starting subtest: memory-info-idle
[527.012502] Starting dynamic subtest: smem0
[527.056557] Dynamic subtest smem0: SUCCESS (0.048s)
[527.059507] Subtest memory-info-idle: SUCCESS (0.049s)
[527.133791] [132/133] (499s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-modifiers)
[527.222972] Starting subtest: plane-scaler-with-clipping-clamping-modifiers
[527.225254] Starting dynamic subtest: pipe-A
[527.593926] Dynamic subtest pipe-A: SUCCESS (0.373s)
[527.605769] Starting dynamic subtest: pipe-B
[529.016549] Dynamic subtest pipe-B: SUCCESS (1.420s)
[529.027240] Starting dynamic subtest: pipe-C
[530.451157] Dynamic subtest pipe-C: SUCCESS (1.433s)
[530.464260] Starting dynamic subtest: pipe-D
[531.902250] Dynamic subtest pipe-D: SUCCESS (1.449s)
[531.904384] Subtest plane-scaler-with-clipping-clamping-modifiers: SUCCESS (4.681s)
[533.054290] [133/133] (493s left) api_intel_bb (full-batch)
[533.119478] Starting subtest: full-batch
[533.121695] Subtest full-batch: SUCCESS (0.004s)
[533.209326] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_crc
results: parsing output: 1/ for test: syncobj_wait
results: parsing output: 2/ for test: kms_prop_blob
results: parsing output: 3/ for test: syncobj_wait
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_ccs
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: prime_self_import
results: parsing output: 8/ for test: kms_big_fb
results: parsing output: 9/ for test: kms_psr
results: parsing output: 10/ for test: kms_flip
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: syncobj_timeline
results: parsing output: 13/ for test: gem_spin_batch
results: parsing output: 14/ for test: syncobj_timeline
results: parsing output: 15/ for test: kms_pm_rpm
results: parsing output: 16/ for test: perf_pmu
results: parsing output: 17/ for test: kms_ccs
results: parsing output: 18/ for test: kms_content_protection
results: parsing output: 19/ for test: kms_color_pipeline
results: parsing output: 20/ for test: syncobj_timeline
results: parsing output: 21/ for test: kms_cursor_legacy
results: parsing output: 22/ for test: gem_mmap_gtt
results: parsing output: 23/ for test: kms_pipe_b_c_ivb
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_ccs
results: parsing output: 27/ for test: kms_pipe_crc_basic
results: parsing output: 28/ for test: gem_exec_whisper
results: parsing output: 29/ for test: kms_ccs
results: parsing output: 30/ for test: gem_ctx_param
results: parsing output: 31/ for test: gem_render_copy
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: prime_busy
results: parsing output: 34/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 35/ for test: gem_render_copy
results: parsing output: 36/ for test: sysfs_timeslice_duration
results: parsing output: 37/ for test: gem_exec_gttfill
results: parsing output: 38/ for test: gem_mmap_wc
results: parsing output: 39/ for test: kms_chamelium_edid
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: gem_ctx_persistence
results: parsing output: 42/ for test: sw_sync
results: parsing output: 43/ for test: gem_exec_nop
results: parsing output: 44/ for test: api_intel_allocator
results: parsing output: 45/ for test: gem_exec_schedule
results: parsing output: 46/ for test: gem_mmap_gtt
results: parsing output: 47/ for test: kms_addfb_basic
results: parsing output: 48/ for test: gem_eio
results: parsing output: 49/ for test: kms_psr
results: parsing output: 50/ for test: kms_psr2_sf
results: parsing output: 51/ for test: gem_exec_alignment
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: kms_atomic
results: parsing output: 54/ for test: kms_feature_discovery
results: parsing output: 55/ for test: gen7_exec_parse
results: parsing output: 56/ for test: kms_ccs
results: parsing output: 57/ for test: gem_ctx_param
results: parsing output: 58/ for test: gem_ctx_freq
results: parsing output: 59/ for test: gem_partial_pwrite_pread
results: parsing output: 60/ for test: gem_exec_fence
results: parsing output: 61/ for test: perf_pmu
results: parsing output: 62/ for test: i915_pm_rps
results: parsing output: 63/ for test: kms_vblank
results: parsing output: 64/ for test: kms_flip_scaled_crc
results: parsing output: 65/ for test: testdisplay
results: parsing output: 66/ for test: kms_psr
results: parsing output: 67/ for test: gem_exercise_blt
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_plane_scaling
results: parsing output: 70/ for test: kms_big_fb
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_flip
results: parsing output: 73/ for test: kms_flip
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: kms_async_flips
results: parsing output: 79/ for test: kms_plane_scaling
results: parsing output: 80/ for test: gem_userptr_blits
results: parsing output: 81/ for test: gem_render_copy
results: parsing output: 82/ for test: kms_pm_lpsp
results: parsing output: 83/ for test: kms_cursor_legacy
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: i915_fb_tiling
results: parsing output: 86/ for test: gem_pread
results: parsing output: 87/ for test: kms_big_fb
results: parsing output: 88/ for test: gem_ccs
results: parsing output: 89/ for test: kms_atomic_interruptible
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: i915_pm_sseu
results: parsing output: 92/ for test: gem_readwrite
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_plane
results: parsing output: 95/ for test: kms_chamelium_hpd
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: gem_exec_reloc
results: parsing output: 98/ for test: kms_flip_scaled_crc
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_ctx_param
results: parsing output: 102/ for test: kms_lease
results: parsing output: 103/ for test: core_setmaster
results: parsing output: 104/ for test: kms_cdclk
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_display_modes
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: gem_mmap_offset
results: parsing output: 110/ for test: kms_psr2_sf
results: parsing output: 111/ for test: gem_exec_balancer
results: parsing output: 112/ for test: gem_userptr_blits
results: parsing output: 113/ for test: perf
results: parsing output: 114/ for test: kms_fbcon_fbt
results: parsing output: 115/ for test: kms_getfb
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: gem_exec_capture
results: parsing output: 119/ for test: gem_exec_schedule
results: parsing output: 120/ for test: kms_sequence
results: parsing output: 121/ for test: kms_cursor_legacy
results: parsing output: 122/ for test: kms_cursor_legacy
results: parsing output: 123/ for test: gem_ccs
results: parsing output: 124/ for test: kms_cursor_crc
results: parsing output: 125/ for test: kms_cursor_crc
results: parsing output: 126/ for test: kms_plane
results: parsing output: 127/ for test: gem_render_copy
results: parsing output: 128/ for test: kms_joiner
results: parsing output: 129/ for test: kms_cursor_legacy
results: parsing output: 130/ for test: i915_drm_fdinfo
results: parsing output: 131/ for test: kms_plane_scaling
results: parsing output: 132/ for test: api_intel_bb
Done.