[61.135174] Initializing watchdogs
[61.135221]   /dev/watchdog0
[61.150056] [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]
[61.154801] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[61.157537] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.159495] [001/132] (960s left) kms_flip (wf_vblank-ts-check)
[61.265574] Starting subtest: wf_vblank-ts-check
[61.266876] Starting dynamic subtest: A-eDP1
[70.256344] Dynamic subtest A-eDP1: SUCCESS (9.000s)
[70.265396] Starting dynamic subtest: B-eDP1
[79.184572] Dynamic subtest B-eDP1: SUCCESS (8.932s)
[79.193351] Starting dynamic subtest: C-eDP1
[88.115402] Dynamic subtest C-eDP1: SUCCESS (8.920s)
[88.122899] Starting dynamic subtest: D-eDP1
[97.049405] Dynamic subtest D-eDP1: SUCCESS (8.936s)
[97.050361] Subtest wf_vblank-ts-check: SUCCESS (35.799s)
[98.241648] [002/132] (923s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[98.343245] Starting subtest: 4-tiled-8bpp-rotate-270
[98.377798] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.034s)
[98.471789] [003/132] (923s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite)
[98.555590] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite
[107.527143] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.974s)
[107.618436] [004/132] (914s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[107.711571] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[107.713286] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[107.781564] [005/132] (914s left) gem_exec_reloc (basic-active)
[107.830331] Subtest basic-active: SKIP (0.000s)
[107.891201] [006/132] (913s left) syncobj_wait (multi-wait-for-submit-signaled)
[107.933512] Starting subtest: multi-wait-for-submit-signaled
[107.934338] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[108.003208] [007/132] (913s left) kms_async_flips (alternate-sync-async-flip-atomic)
[108.094738] Starting subtest: alternate-sync-async-flip-atomic
[108.469205] Starting dynamic subtest: pipe-A-eDP-1
[111.212018] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.742s)
[111.603952] Starting dynamic subtest: pipe-B-eDP-1
[114.346954] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.749s)
[114.726044] Starting dynamic subtest: pipe-C-eDP-1
[117.474401] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.755s)
[117.854345] Starting dynamic subtest: pipe-D-eDP-1
[120.610094] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.761s)
[120.611490] Subtest alternate-sync-async-flip-atomic: SUCCESS (12.517s)
[121.786359] [008/132] (900s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[121.883550] Starting subtest: psr2-overlay-plane-update-continuous-sf
[121.884421] Starting dynamic subtest: pipe-A-eDP-1
[123.015230] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.131s)
[123.023463] Starting dynamic subtest: pipe-B-eDP-1
[124.732810] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.716s)
[124.733824] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (2.849s)
[125.552899] [009/132] (896s left) kms_chamelium_hpd (dp-hpd)
[125.928240] Subtest dp-hpd: SKIP (0.000s)
[126.747836] [010/132] (895s left) gem_wait (await)
[126.802232] Starting subtest: await
[126.803308] Starting dynamic subtest: all-engines
[127.903625] Dynamic subtest all-engines: SUCCESS (1.102s)
[127.920890] Starting dynamic subtest: rcs0
[128.959189] Dynamic subtest rcs0: SUCCESS (1.054s)
[128.975955] Starting dynamic subtest: bcs0
[130.016233] Dynamic subtest bcs0: SUCCESS (1.055s)
[130.033075] Starting dynamic subtest: vcs0
[131.070542] Dynamic subtest vcs0: SUCCESS (1.053s)
[131.086423] Starting dynamic subtest: vcs1
[132.125044] Dynamic subtest vcs1: SUCCESS (1.053s)
[132.141279] Starting dynamic subtest: vecs0
[133.182042] Dynamic subtest vecs0: SUCCESS (1.055s)
[133.198913] Starting dynamic subtest: ccs0
[134.239756] Dynamic subtest ccs0: SUCCESS (1.056s)
[134.240862] Subtest await: SUCCESS (7.439s)
[134.431724] [FACT gem_wait (await)] new: kernel.kmod_is_loaded.vgem: true
[134.433783] [011/132] (887s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[134.530702] Starting subtest: fbc-rgb101010-draw-blt
[139.110906] Subtest fbc-rgb101010-draw-blt: SUCCESS (4.582s)
[140.291228] [012/132] (881s left) kms_flip (2x-flip-vs-dpms-on-nop)
[140.388492] Starting subtest: 2x-flip-vs-dpms-on-nop
[140.400177] Subtest 2x-flip-vs-dpms-on-nop: SKIP (0.011s)
[140.475894] [013/132] (881s left) syncobj_timeline (signal-array)
[140.525730] Starting subtest: signal-array
[140.526556] Subtest signal-array: SUCCESS (0.000s)
[140.626872] [014/132] (881s left) gem_ctx_isolation (preservation)
[140.690350] Starting subtest: preservation
[140.691486] Starting dynamic subtest: rcs0
[140.837133] Dynamic subtest rcs0: SUCCESS (0.146s)
[140.847748] Starting dynamic subtest: bcs0
[140.990812] Dynamic subtest bcs0: SUCCESS (0.152s)
[141.001047] Starting dynamic subtest: vcs0
[141.155909] Dynamic subtest vcs0: SUCCESS (0.165s)
[141.169486] Starting dynamic subtest: vcs1
[142.390764] Dynamic subtest vcs1: SUCCESS (1.235s)
[142.401918] Starting dynamic subtest: vecs0
[144.471884] Dynamic subtest vecs0: SUCCESS (2.081s)
[144.478950] Starting dynamic subtest: ccs0
[146.475415] Dynamic subtest ccs0: SUCCESS (2.002s)
[146.477405] Subtest preservation: SUCCESS (5.785s)
[146.709957] [015/132] (875s left) perf_pmu (init-sema)
[146.747763] Starting subtest: init-sema
[146.748580] Starting dynamic subtest: rcs0
[146.750372] Dynamic subtest rcs0: SUCCESS (0.003s)
[146.760025] Starting dynamic subtest: bcs0
[146.760837] Dynamic subtest bcs0: SUCCESS (0.001s)
[146.767437] Starting dynamic subtest: vcs0
[146.768327] Dynamic subtest vcs0: SUCCESS (0.001s)
[146.774718] Starting dynamic subtest: vcs1
[146.775471] Dynamic subtest vcs1: SUCCESS (0.001s)
[146.782059] Starting dynamic subtest: vecs0
[146.782978] Dynamic subtest vecs0: SUCCESS (0.001s)
[146.789474] Starting dynamic subtest: ccs0
[146.790347] Dynamic subtest ccs0: SUCCESS (0.000s)
[146.791177] Subtest init-sema: SUCCESS (0.008s)
[146.863817] [016/132] (875s left) syncobj_basic (bad-pad-handle-to-fd)
[146.909442] Starting subtest: bad-pad-handle-to-fd
[146.910425] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[147.010626] [017/132] (875s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[147.064352] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[147.066082] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[147.241873] [018/132] (874s left) gem_exec_balancer (sequential)
[147.293286] Starting subtest: sequential
[150.437398] Subtest sequential: SUCCESS (3.144s)
[150.761320] [019/132] (871s left) kms_addfb_basic (bad-pitch-999)
[150.814688] Starting subtest: bad-pitch-999
[150.815617] Subtest bad-pitch-999: SUCCESS (0.000s)
[150.940031] [020/132] (871s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-sf)
[151.023121] Starting subtest: psr2-cursor-plane-move-continuous-sf
[151.023997] Starting dynamic subtest: pipe-A-eDP-1
[161.385031] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.361s)
[161.393434] Starting dynamic subtest: pipe-B-eDP-1
[172.475392] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.087s)
[172.476249] Subtest psr2-cursor-plane-move-continuous-sf: SUCCESS (21.451s)
[173.265848] [021/132] (849s left) kms_chamelium_frames (dp-crc-fast)
[173.646377] Subtest dp-crc-fast: SKIP (0.000s)
[174.473858] [022/132] (847s left) kms_cursor_crc (cursor-size-change)
[174.564541] Starting subtest: cursor-size-change
[174.565489] Starting dynamic subtest: pipe-A-eDP-1
[175.364720] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.799s)
[175.373163] Starting dynamic subtest: pipe-D-eDP-1
[176.863804] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.499s)
[176.865034] Subtest cursor-size-change: SUCCESS (2.300s)
[177.666871] [023/132] (844s left) kms_concurrent (multi-plane-atomic-lowres)
[177.756112] Starting subtest: multi-plane-atomic-lowres
[177.757030] Starting dynamic subtest: pipe-A-eDP-1
[178.258636] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.502s)
[178.266353] Starting dynamic subtest: pipe-B-eDP-1
[179.499395] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.239s)
[179.507034] Starting dynamic subtest: pipe-C-eDP-1
[180.725761] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.225s)
[180.732931] Starting dynamic subtest: pipe-D-eDP-1
[181.956829] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.229s)
[181.957661] Subtest multi-plane-atomic-lowres: SUCCESS (4.200s)
[182.786333] [024/132] (839s left) gem_partial_pwrite_pread (writes-after-reads-display)
[182.831907] Subtest writes-after-reads-display: SKIP (0.000s)
[182.892703] [025/132] (839s left) gem_mmap_wc (bad-size)
[182.941475] Subtest bad-size: SKIP (0.000s)
[182.998516] [026/132] (839s left) kms_vrr (flip-basic-fastset)
[183.093511] Starting subtest: flip-basic-fastset
[183.096297] Subtest flip-basic-fastset: SKIP (0.000s)
[183.159369] [027/132] (839s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[183.212945] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[183.213740] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[183.312154] [028/132] (839s left) perf_pmu (semaphore-wait-idle)
[183.349866] Starting subtest: semaphore-wait-idle
[183.350931] Starting dynamic subtest: rcs0
[183.872693] Dynamic subtest rcs0: SUCCESS (0.512s)
[183.882611] Starting dynamic subtest: bcs0
[184.385480] Dynamic subtest bcs0: SUCCESS (0.510s)
[184.393499] Starting dynamic subtest: vcs0
[184.898614] Dynamic subtest vcs0: SUCCESS (0.511s)
[184.906751] Starting dynamic subtest: vcs1
[185.414534] Dynamic subtest vcs1: SUCCESS (0.511s)
[185.422869] Starting dynamic subtest: vecs0
[185.927590] Dynamic subtest vecs0: SUCCESS (0.510s)
[185.937421] Starting dynamic subtest: ccs0
[186.442306] Dynamic subtest ccs0: SUCCESS (0.513s)
[186.443575] Subtest semaphore-wait-idle: SUCCESS (3.084s)
[186.557723] [029/132] (836s left) gem_exec_schedule (u-fairslice-all)
[186.624287] Starting subtest: u-fairslice-all
[188.701572] Subtest u-fairslice-all: SUCCESS (2.078s)
[190.387185] [030/132] (832s left) gem_exec_schedule (pi-common)
[190.562433] Starting subtest: pi-common
[190.563590] Starting dynamic subtest: rcs0
[190.599312] Dynamic subtest rcs0: SUCCESS (0.038s)
[190.607407] Starting dynamic subtest: bcs0
[190.635903] Dynamic subtest bcs0: SUCCESS (0.036s)
[190.643338] Starting dynamic subtest: vcs0
[190.670480] Dynamic subtest vcs0: SUCCESS (0.034s)
[190.678300] Starting dynamic subtest: vcs1
[190.704921] Dynamic subtest vcs1: SUCCESS (0.034s)
[190.712092] Starting dynamic subtest: vecs0
[190.735352] Dynamic subtest vecs0: SUCCESS (0.030s)
[190.742878] Starting dynamic subtest: ccs0
[190.765418] Dynamic subtest ccs0: SUCCESS (0.029s)
[190.766262] Subtest pi-common: SUCCESS (0.205s)
[190.994312] [031/132] (831s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[191.090544] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[191.092392] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[191.182915] [032/132] (831s left) gem_eio (wait-wedge-immediate)
[191.416038] Starting subtest: wait-wedge-immediate
[192.428074] Subtest wait-wedge-immediate: SUCCESS (1.014s)
[192.550640] [033/132] (830s left) gem_mmap_gtt (basic-write-cpu-read-gtt)
[192.605022] Subtest basic-write-cpu-read-gtt: SKIP (0.000s)
[192.664291] [034/132] (830s left) gem_mmap_offset (blt-coherency)
[192.715512] Starting subtest: blt-coherency
[192.723657] Subtest blt-coherency: SUCCESS (0.009s)
[192.839351] [035/132] (829s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[192.928509] Starting subtest: coverage-vs-premult-vs-constant
[193.221389] Starting dynamic subtest: pipe-A-eDP-1
[193.876168] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.653s)
[193.884450] Starting dynamic subtest: pipe-D-eDP-1
[195.222833] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.346s)
[195.223866] Subtest coverage-vs-premult-vs-constant: SUCCESS (2.294s)
[196.064226] [036/132] (826s left) gem_exec_reloc (basic-write-wc)
[196.113171] Subtest basic-write-wc: SKIP (0.000s)
[196.188299] [037/132] (826s left) perf_pmu (interrupts-sync)
[196.222317] Starting subtest: interrupts-sync
[197.305324] Subtest interrupts-sync: SUCCESS (1.072s)
[197.399981] [038/132] (825s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[197.493605] Starting subtest: fbcpsr-shrfb-scaledprimary
[203.285218] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (5.791s)
[203.437525] [039/132] (819s left) gem_create (create-size-update)
[203.491715] Starting subtest: create-size-update
[203.492759] Subtest create-size-update: SUCCESS (0.000s)
[203.704122] [040/132] (819s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[203.754603] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[203.858479] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[203.940372] [041/132] (819s left) kms_psr (psr2-sprite-blt)
[204.030724] Starting subtest: psr2-sprite-blt
[204.031740] Starting dynamic subtest: eDP-1
[205.808887] Dynamic subtest eDP-1: SUCCESS (1.778s)
[205.809763] Subtest psr2-sprite-blt: SUCCESS (1.779s)
[206.661736] [042/132] (816s left) kms_addfb_basic (addfb25-bad-modifier)
[206.755088] Starting subtest: addfb25-bad-modifier
[206.755911] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[206.845538] [043/132] (816s left) perf (gen12-mi-rpc)
[206.959703] Starting subtest: gen12-mi-rpc
[206.960704] Starting dynamic subtest: rcs0
[206.976215] Dynamic subtest rcs0: SUCCESS (0.017s)
[206.977116] Subtest gen12-mi-rpc: SUCCESS (0.017s)
[207.012464] [044/132] (816s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[207.115344] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[207.117106] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[208.225387] [045/132] (814s left) gem_exec_reloc (basic-write-cpu-active)
[208.281099] Subtest basic-write-cpu-active: SKIP (0.000s)
[208.351611] [046/132] (814s left) syncobj_eventfd (invalid-bad-pad)
[208.406526] Starting subtest: invalid-bad-pad
[208.407523] Subtest invalid-bad-pad: SUCCESS (0.000s)
[208.508953] [047/132] (814s left) fbdev (unaligned-write)
[208.543638] Starting subtest: unaligned-write
[208.644777] Subtest unaligned-write: SUCCESS (0.102s)
[208.702686] [048/132] (814s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[208.791833] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[213.343531] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (4.552s)
[214.505739] [049/132] (808s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[214.598463] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[214.600141] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[214.701407] [050/132] (808s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[214.789762] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[214.791749] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[214.889289] [051/132] (808s left) sw_sync (sync_merge_same)
[214.918063] Starting subtest: sync_merge_same
[214.918972] Subtest sync_merge_same: SUCCESS (0.000s)
[214.975604] [052/132] (808s left) kms_cursor_crc (cursor-sliding-64x21)
[215.155765] Starting subtest: cursor-sliding-64x21
[215.204916] Subtest cursor-sliding-64x21: SKIP (0.047s)
[215.433086] [053/132] (807s left) i915_pm_freq_mult (media-freq)
[215.474410] Starting subtest: media-freq
[215.475338] Starting dynamic subtest: gt0
[215.477115] Dynamic subtest gt0: SKIP (0.000s)
[215.485145] Starting dynamic subtest: gt1
[215.486708] Dynamic subtest gt1: SKIP (0.000s)
[215.488281] Subtest media-freq: SKIP (0.002s)
[215.572816] [054/132] (807s left) kms_big_fb (y-tiled-32bpp-rotate-270)
[215.658059] Starting subtest: y-tiled-32bpp-rotate-270
[215.659874] Subtest y-tiled-32bpp-rotate-270: SKIP (0.000s)
[215.765218] [055/132] (807s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[215.850703] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[223.447369] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.597s)
[223.587434] [056/132] (799s left) kms_psr (fbc-psr2-no-drrs)
[223.667505] Starting subtest: fbc-psr2-no-drrs
[223.668571] Starting dynamic subtest: eDP-1
[223.670584] Dynamic subtest eDP-1: SKIP (0.000s)
[223.680336] Subtest fbc-psr2-no-drrs: SKIP (0.001s)
[223.736483] [057/132] (799s left) gem_partial_pwrite_pread (write-snoop)
[223.788520] Subtest write-snoop: SKIP (0.000s)
[223.844291] [058/132] (799s left) gem_sync (basic-many-each)
[223.899849] Starting subtest: basic-many-each
[226.172030] Subtest basic-many-each: SUCCESS (2.273s)
[226.358874] [059/132] (797s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[226.451628] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[233.061629] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.612s)
[233.170692] [060/132] (790s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[233.264596] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[233.265596] Starting dynamic subtest: pipe-A-eDP-1
[233.273742] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[233.282655] Starting dynamic subtest: pipe-B-eDP-1
[233.294030] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[233.302875] Starting dynamic subtest: pipe-C-eDP-1
[233.310347] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[233.318435] Starting dynamic subtest: pipe-D-eDP-1
[233.325796] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[233.326640] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.008s)
[235.556561] [061/132] (788s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[235.639384] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[235.640254] Starting dynamic subtest: pipe-A-eDP-1
[235.648409] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[235.656777] Starting dynamic subtest: pipe-B-eDP-1
[235.665133] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[235.673398] Starting dynamic subtest: pipe-C-eDP-1
[235.682248] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[235.690169] Starting dynamic subtest: pipe-D-eDP-1
[235.698202] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[235.699739] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.007s)
[237.923183] [062/132] (785s left) kms_draw_crc (draw-method-mmap-cpu)
[238.012376] Starting subtest: draw-method-mmap-cpu
[238.013375] Starting dynamic subtest: xrgb8888-untiled
[238.279184] Dynamic subtest xrgb8888-untiled: SUCCESS (0.267s)
[238.292308] Starting dynamic subtest: rgb565-untiled
[238.512303] Dynamic subtest rgb565-untiled: SUCCESS (0.232s)
[238.522076] Starting dynamic subtest: xrgb2101010-untiled
[238.734478] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.221s)
[238.744347] Starting dynamic subtest: xbgr16161616f-untiled
[238.978919] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.243s)
[238.987532] Starting dynamic subtest: xrgb8888-xtiled
[239.112346] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.132s)
[239.121541] Starting dynamic subtest: rgb565-xtiled
[239.245639] Dynamic subtest rgb565-xtiled: SUCCESS (0.133s)
[239.254202] Starting dynamic subtest: xrgb2101010-xtiled
[239.379051] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.133s)
[239.387884] Starting dynamic subtest: xbgr16161616f-xtiled
[239.512166] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.132s)
[239.520272] Starting dynamic subtest: xrgb8888-4tiled
[239.656867] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.144s)
[239.665565] Starting dynamic subtest: rgb565-4tiled
[239.801193] Dynamic subtest rgb565-4tiled: SUCCESS (0.143s)
[239.809298] Starting dynamic subtest: xrgb2101010-4tiled
[239.945669] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.144s)
[239.954074] Starting dynamic subtest: xbgr16161616f-4tiled
[240.090080] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.144s)
[240.090966] Subtest draw-method-mmap-cpu: SUCCESS (2.079s)
[240.190381] [063/132] (783s left) kms_dp_link_training (uhbr-mst)
[240.278106] Starting subtest: uhbr-mst
[240.281489] Subtest uhbr-mst: SKIP (0.000s)
[240.357389] [064/132] (783s left) kms_psr2_sf (fbc-pr-overlay-primary-update-sf-dmg-area)
[240.444857] Starting subtest: fbc-pr-overlay-primary-update-sf-dmg-area
[240.446610] Subtest fbc-pr-overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[240.511883] [065/132] (783s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[240.611488] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[240.612538] Starting dynamic subtest: pipe-A
[240.628996] Dynamic subtest pipe-A: SKIP (0.019s)
[240.639847] Starting dynamic subtest: pipe-B
[240.663258] Dynamic subtest pipe-B: SKIP (0.034s)
[240.671488] Starting dynamic subtest: pipe-C
[240.698838] Dynamic subtest pipe-C: SKIP (0.033s)
[240.707032] Starting dynamic subtest: pipe-D
[240.732989] Dynamic subtest pipe-D: SKIP (0.034s)
[240.734838] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.123s)
[240.840212] [066/132] (783s left) kms_chamelium_audio (dp-audio)
[241.231023] Subtest dp-audio: SKIP (0.000s)
[242.027894] [067/132] (781s left) gem_exec_whisper (basic-fds-forked-all)
[242.085078] Starting subtest: basic-fds-forked-all
[263.700709] Subtest basic-fds-forked-all: SUCCESS (21.615s)
[263.884489] [068/132] (760s left) kms_big_fb (linear-64bpp-rotate-90)
[263.979842] Starting subtest: linear-64bpp-rotate-90
[264.000028] Subtest linear-64bpp-rotate-90: SKIP (0.020s)
[264.115212] [069/132] (759s left) core_debugfs (read-all-entries)
[264.169096] Starting subtest: read-all-entries
[264.264443] Subtest read-all-entries: SUCCESS (0.097s)
[264.326449] [070/132] (759s left) gem_softpin (allocator-nopin-reserve)
[264.387466] Starting subtest: allocator-nopin-reserve
[264.510046] Subtest allocator-nopin-reserve: SUCCESS (0.113s)
[264.621618] [071/132] (759s left) kms_big_fb (x-tiled-addfb)
[264.718624] Starting subtest: x-tiled-addfb
[264.719682] Subtest x-tiled-addfb: SUCCESS (0.000s)
[264.811879] [072/132] (759s left) vgem_basic (bad-handle)
[264.854360] Starting subtest: bad-handle
[264.855273] Subtest bad-handle: SUCCESS (0.000s)
[264.907091] [073/132] (759s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-pwrite)
[264.993723] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-pwrite
[269.998083] Subtest fbc-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (5.004s)
[271.154337] [074/132] (752s left) kms_plane_scaling (invalid-parameters)
[271.247458] Starting subtest: invalid-parameters
[271.248280] Starting dynamic subtest: less-than-1-height-src
[271.261978] Dynamic subtest less-than-1-height-src: SUCCESS (0.014s)
[271.270784] Starting dynamic subtest: less-than-1-width-src
[271.276581] Dynamic subtest less-than-1-width-src: SUCCESS (0.014s)
[271.277386] Subtest invalid-parameters: SUCCESS (0.029s)
[271.384491] [075/132] (752s left) kms_cursor_legacy (cursor-vs-flip-varying-size)
[271.500906] Starting subtest: cursor-vs-flip-varying-size
[302.844287] Subtest cursor-vs-flip-varying-size: SUCCESS (31.342s)
[303.680849] [076/132] (720s left) gem_eio (wait-immediate)
[303.910440] Starting subtest: wait-immediate
[304.283364] Subtest wait-immediate: SUCCESS (0.373s)
[304.422175] [077/132] (719s left) gem_exec_balancer (bonded-true-hang)
[304.685137] Starting subtest: bonded-true-hang
[304.686683] Subtest bonded-true-hang: SKIP (0.000s)
[304.773037] [078/132] (719s left) kms_invalid_mode (zero-hdisplay)
[304.853242] Starting subtest: zero-hdisplay
[304.854076] Starting dynamic subtest: pipe-A-eDP-1
[305.139213] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[305.148929] Starting dynamic subtest: pipe-B-eDP-1
[305.149870] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[305.157860] Starting dynamic subtest: pipe-C-eDP-1
[305.158770] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[305.167226] Starting dynamic subtest: pipe-D-eDP-1
[305.168198] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[305.169078] Subtest zero-hdisplay: SUCCESS (0.291s)
[306.000924] [079/132] (718s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[306.116406] Starting subtest: cursorA-vs-flipB-atomic
[306.118165] Subtest cursorA-vs-flipB-atomic: SKIP (0.001s)
[306.255437] [080/132] (718s left) kms_lease (setcrtc-implicit-plane)
[306.341032] Starting subtest: setcrtc-implicit-plane
[306.341870] Starting dynamic subtest: pipe-A-eDP-1
[306.817833] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.476s)
[306.829709] Starting dynamic subtest: pipe-B-eDP-1
[307.951695] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.131s)
[307.961469] Starting dynamic subtest: pipe-C-eDP-1
[309.052644] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.100s)
[309.065223] Starting dynamic subtest: pipe-D-eDP-1
[310.179407] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.124s)
[310.180510] Subtest setcrtc-implicit-plane: SUCCESS (3.837s)
[311.023650] [081/132] (713s left) kms_pm_dc (dc5-retention-flops)
[312.120480] Starting subtest: dc5-retention-flops
[312.122721] Subtest dc5-retention-flops: SKIP (0.000s)
[312.192929] [082/132] (712s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[312.279295] Starting subtest: psr-farfromfence-mmap-gtt
[312.281225] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[312.372689] [083/132] (712s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[312.457768] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-cpu
[319.234455] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.775s)
[319.358833] [084/132] (705s left) gem_exec_reloc (basic-softpin)
[319.416039] Subtest basic-softpin: SKIP (0.000s)
[319.479278] [085/132] (705s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[319.566176] Starting subtest: multiplane-rotation-cropping-top
[337.048734] Subtest multiplane-rotation-cropping-top: SUCCESS (17.482s)
[337.157425] [086/132] (687s left) gem_ctx_persistence (legacy-engines-hostile-preempt)
[337.222122] Starting subtest: legacy-engines-hostile-preempt
[337.223080] Starting dynamic subtest: render
[337.310757] Dynamic subtest render: SUCCESS (0.089s)
[337.326383] Starting dynamic subtest: bsd1
[339.279016] Dynamic subtest bsd1: SUCCESS (1.956s)
[339.289020] Starting dynamic subtest: bsd2
[341.348046] Dynamic subtest bsd2: SUCCESS (2.065s)
[341.359210] Starting dynamic subtest: blt
[341.375516] Dynamic subtest blt: SUCCESS (0.034s)
[341.386783] Starting dynamic subtest: vebox
[343.308239] Dynamic subtest vebox: SUCCESS (1.922s)
[343.309387] Subtest legacy-engines-hostile-preempt: SUCCESS (6.080s)
[343.427211] [087/132] (681s left) kms_plane (pixel-format-y-tiled-ccs-modifier-source-clamping)
[343.514160] Starting subtest: pixel-format-y-tiled-ccs-modifier-source-clamping
[343.515702] Subtest pixel-format-y-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[343.594946] [088/132] (681s left) kms_fbcon_fbt (fbc)
[343.646200] Starting subtest: fbc
[349.991865] Subtest fbc: SUCCESS (6.332s)
[351.057746] [089/132] (673s left) gem_sync (basic-store-each)
[351.134209] Starting subtest: basic-store-each
[353.532545] Subtest basic-store-each: SUCCESS (2.399s)
[353.712225] [090/132] (670s left) vgem_basic (sysfs)
[353.757374] Starting subtest: sysfs
[353.758358] Subtest sysfs: SUCCESS (0.001s)
[353.811472] [091/132] (670s left) gem_mmap_gtt (cpuset-basic-small-copy-odd)
[353.859892] Subtest cpuset-basic-small-copy-odd: SKIP (0.000s)
[353.925919] [092/132] (670s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite)
[354.011780] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite
[354.013522] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[354.102388] [093/132] (670s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[354.188895] Starting subtest: yf-tiled-addfb-size-offset-overflow
[354.190743] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[354.316162] [094/132] (670s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[354.396212] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[354.398064] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[354.486080] [095/132] (670s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier)
[354.571438] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier
[354.573280] Subtest pixel-format-4-tiled-bmg-ccs-modifier: SKIP (0.000s)
[354.639841] [096/132] (670s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[354.733680] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[359.254435] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.520s)
[360.390469] [097/132] (664s left) kms_psr (pr-suspend)
[360.474925] Starting subtest: pr-suspend
[360.476412] Subtest pr-suspend: SKIP (0.000s)
[360.548356] [098/132] (664s left) drm_mm (drm_mm)
[360.576871] Starting subtest: drm_mm
[360.676439] Starting dynamic subtest: drm_test_mm_init
[360.776812] Dynamic subtest drm_test_mm_init: SUCCESS (0.099s)
[360.788914] Starting dynamic subtest: drm_test_mm_debug
[360.878382] Dynamic subtest drm_test_mm_debug: SUCCESS (0.100s)
[360.888416] Starting dynamic subtest: drm_test_mm_align32
[360.951535] Dynamic subtest drm_test_mm_align32: SUCCESS (0.073s)
[360.961540] Starting dynamic subtest: drm_test_mm_align64
[361.042658] Dynamic subtest drm_test_mm_align64: SUCCESS (0.091s)
[361.053752] Starting dynamic subtest: drm_test_mm_lowest
[361.131412] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.087s)
[361.140550] Starting dynamic subtest: drm_test_mm_highest
[361.219609] Dynamic subtest drm_test_mm_highest: SUCCESS (0.087s)
[361.220697] Subtest drm_mm: SUCCESS (0.643s)
[361.373436] [099/132] (663s left) gem_exec_reloc (basic-wc-gtt)
[361.421070] Subtest basic-wc-gtt: SKIP (0.000s)
[361.494979] [100/132] (663s left) gem_exec_fence (syncobj-signal)
[361.901159] Starting subtest: syncobj-signal
[361.905944] Subtest syncobj-signal: SUCCESS (0.005s)
[363.408069] [101/132] (661s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[363.533092] Starting subtest: verify-pxp-key-change-after-suspend-resume
[370.832782] Subtest verify-pxp-key-change-after-suspend-resume: SUCCESS (7.299s)
[380.992819] [102/132] (654s left) i915_drm_fdinfo (busy-idle-check-all)
[381.032369] Starting subtest: busy-idle-check-all
[381.033464] Starting dynamic subtest: rcs0
[381.038526] Dynamic subtest rcs0: SKIP (0.006s)
[381.050218] Starting dynamic subtest: bcs0
[381.051876] Dynamic subtest bcs0: SKIP (0.000s)
[381.061235] Starting dynamic subtest: vcs0
[381.062841] Dynamic subtest vcs0: SKIP (0.000s)
[381.071901] Starting dynamic subtest: vcs1
[381.073837] Dynamic subtest vcs1: SKIP (0.000s)
[381.082805] Starting dynamic subtest: vecs0
[381.084728] Dynamic subtest vecs0: SKIP (0.000s)
[381.093871] Starting dynamic subtest: ccs0
[381.095733] Dynamic subtest ccs0: SKIP (0.000s)
[381.097734] Subtest busy-idle-check-all: SKIP (0.011s)
[381.128113] [103/132] (654s left) template (a)
[381.195363] Starting subtest: A
[381.196411] Subtest A: SUCCESS (0.000s)
[381.296170] [104/132] (653s left) kms_big_fb (yf-tiled-32bpp-rotate-90)
[381.385443] Starting subtest: yf-tiled-32bpp-rotate-90
[381.387403] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s)
[381.484080] [105/132] (653s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[381.744419] Starting subtest: cursor-rapid-movement-512x512
[381.747394] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[381.912134] [106/132] (653s left) kms_pm_rpm (pm-tiling)
[383.525030] Starting subtest: pm-tiling
[383.528146] Subtest pm-tiling: SKIP (0.000s)
[384.148045] [107/132] (651s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[384.266610] Starting subtest: basic-flip-after-cursor-atomic
[385.192640] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.925s)
[386.075300] [108/132] (649s left) perf_pmu (all-busy-check-all)
[386.116157] Starting subtest: all-busy-check-all
[387.304525] Subtest all-busy-check-all: SUCCESS (1.177s)
[387.384276] [109/132] (648s left) syncobj_wait (single-wait-submitted)
[387.438471] Starting subtest: single-wait-submitted
[387.546889] Subtest single-wait-submitted: SUCCESS (0.107s)
[387.634596] [110/132] (647s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[387.733070] Starting subtest: psr-rgb565-draw-mmap-gtt
[387.735085] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[387.827903] [111/132] (647s left) kms_psr (fbc-psr-cursor-mmap-gtt)
[387.918396] Starting subtest: fbc-psr-cursor-mmap-gtt
[387.919326] Starting dynamic subtest: eDP-1
[387.920860] Dynamic subtest eDP-1: SKIP (0.000s)
[387.922554] Subtest fbc-psr-cursor-mmap-gtt: SKIP (0.001s)
[387.999635] [112/132] (647s left) gen9_exec_parse (bb-chained)
[388.052908] Subtest bb-chained: SKIP (0.000s)
[388.115340] [113/132] (647s left) gem_exec_suspend (basic-s4-devices)
[388.174303] Starting subtest: basic-S4-devices
[388.175532] Starting dynamic subtest: smem
[399.336991] Dynamic subtest smem: SUCCESS (11.152s)
[399.338532] Subtest basic-S4-devices: SUCCESS (11.155s)
[404.571598] [114/132] (636s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[404.663504] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[404.664611] Starting dynamic subtest: pipe-A-eDP-1
[404.688526] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[404.699486] Starting dynamic subtest: pipe-B-eDP-1
[404.722335] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[404.732344] Starting dynamic subtest: pipe-C-eDP-1
[404.752806] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[404.762292] Starting dynamic subtest: pipe-D-eDP-1
[404.782789] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[404.784429] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[406.840019] [115/132] (633s left) kms_selftest (drm_damage_helper)
[406.884457] Starting subtest: drm_damage_helper
[406.931881] Starting dynamic subtest: drm_test_damage_iter_no_damage
[407.025733] Dynamic subtest drm_test_damage_iter_no_damage: SUCCESS (0.094s)
[407.037086] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src
[407.110712] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src: SUCCESS (0.085s)
[407.121997] Starting dynamic subtest: drm_test_damage_iter_no_damage_src_moved
[407.197570] Dynamic subtest drm_test_damage_iter_no_damage_src_moved: SUCCESS (0.086s)
[407.208538] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src_moved
[407.289895] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src_moved: SUCCESS (0.091s)
[407.301984] Starting dynamic subtest: drm_test_damage_iter_no_damage_not_visible
[407.368821] Dynamic subtest drm_test_damage_iter_no_damage_not_visible: SUCCESS (0.078s)
[407.380591] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_crtc
[407.466769] Dynamic subtest drm_test_damage_iter_no_damage_no_crtc: SUCCESS (0.097s)
[407.477070] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_fb
[407.549475] Dynamic subtest drm_test_damage_iter_no_damage_no_fb: SUCCESS (0.081s)
[407.560618] Starting dynamic subtest: drm_test_damage_iter_simple_damage
[407.642429] Dynamic subtest drm_test_damage_iter_simple_damage: SUCCESS (0.092s)
[407.653155] Starting dynamic subtest: drm_test_damage_iter_single_damage
[407.749501] Dynamic subtest drm_test_damage_iter_single_damage: SUCCESS (0.106s)
[407.760590] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_src
[407.829832] Dynamic subtest drm_test_damage_iter_single_damage_intersect_src: SUCCESS (0.079s)
[407.841175] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_src
[407.911955] Dynamic subtest drm_test_damage_iter_single_damage_outside_src: SUCCESS (0.080s)
[407.921569] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src
[408.011012] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src: SUCCESS (0.098s)
[408.023577] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_fractional_src
[408.105634] Dynamic subtest drm_test_damage_iter_single_damage_intersect_fractional_src: SUCCESS (0.094s)
[408.117264] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_fractional_src
[408.188824] Dynamic subtest drm_test_damage_iter_single_damage_outside_fractional_src: SUCCESS (0.081s)
[408.199504] Starting dynamic subtest: drm_test_damage_iter_single_damage_src_moved
[408.275425] Dynamic subtest drm_test_damage_iter_single_damage_src_moved: SUCCESS (0.086s)
[408.287108] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src_moved
[408.368312] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src_moved: SUCCESS (0.084s)
[408.380052] Starting dynamic subtest: drm_test_damage_iter_damage
[408.448432] Dynamic subtest drm_test_damage_iter_damage: SUCCESS (0.086s)
[408.458778] Starting dynamic subtest: drm_test_damage_iter_damage_one_intersect
[408.559024] Dynamic subtest drm_test_damage_iter_damage_one_intersect: SUCCESS (0.110s)
[408.569798] Starting dynamic subtest: drm_test_damage_iter_damage_one_outside
[408.637543] Dynamic subtest drm_test_damage_iter_damage_one_outside: SUCCESS (0.077s)
[408.649292] Starting dynamic subtest: drm_test_damage_iter_damage_src_moved
[408.722732] Dynamic subtest drm_test_damage_iter_damage_src_moved: SUCCESS (0.084s)
[408.733546] Starting dynamic subtest: drm_test_damage_iter_damage_not_visible
[408.810669] Dynamic subtest drm_test_damage_iter_damage_not_visible: SUCCESS (0.087s)
[408.811826] Subtest drm_damage_helper: SUCCESS (1.926s)
[408.976889] [116/132] (631s left) i915_pm_rc6_residency (rc6-accuracy)
[409.017094] Starting subtest: rc6-accuracy
[409.018039] Starting dynamic subtest: gt0
[412.233759] Dynamic subtest gt0: SUCCESS (3.169s)
[412.246886] Starting dynamic subtest: gt1
[415.403376] Dynamic subtest gt1: SUCCESS (3.168s)
[415.404455] Subtest rc6-accuracy: SUCCESS (6.343s)
[415.449090] [117/132] (625s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[415.541628] Starting subtest: psr-rgb565-draw-render
[422.674509] Subtest psr-rgb565-draw-render: SUCCESS (7.133s)
[422.796184] [118/132] (617s left) kms_content_protection (dp-mst-lic-type-0-hdcp14)
[422.929520] Starting subtest: dp-mst-lic-type-0-hdcp14
[422.931764] Subtest dp-mst-lic-type-0-hdcp14: SKIP (0.000s)
[423.044025] [119/132] (617s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[423.132046] Starting subtest: 4-tiled-16bpp-rotate-180
[424.390871] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.259s)
[424.530999] [120/132] (616s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff)
[424.628748] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff
[424.630248] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[424.742917] [121/132] (616s left) i915_selftest (mock)
[429.388699] Starting subtest: mock
[429.389795] Starting dynamic subtest: sanitycheck
[430.131973] Dynamic subtest sanitycheck: SUCCESS (0.745s)
[430.142216] Starting dynamic subtest: shmem
[430.822960] Dynamic subtest shmem: SUCCESS (0.689s)
[430.833039] Starting dynamic subtest: fence
[438.432864] Dynamic subtest fence: SUCCESS (7.607s)
[438.443154] Starting dynamic subtest: scatterlist
[440.127979] Dynamic subtest scatterlist: SUCCESS (1.693s)
[440.139372] Starting dynamic subtest: syncmap
[443.205150] Dynamic subtest syncmap: SUCCESS (3.075s)
[443.215918] Starting dynamic subtest: uncore
[443.916148] Dynamic subtest uncore: SUCCESS (0.709s)
[443.926371] Starting dynamic subtest: ring
[444.619880] Dynamic subtest ring: SUCCESS (0.702s)
[444.630271] Starting dynamic subtest: engine
[445.300905] Dynamic subtest engine: SUCCESS (0.679s)
[445.312630] Starting dynamic subtest: timelines
[449.294452] Dynamic subtest timelines: SUCCESS (3.990s)
[449.309098] Starting dynamic subtest: requests
[453.152856] Dynamic subtest requests: SUCCESS (3.857s)
[453.162788] Starting dynamic subtest: objects
[453.955705] Dynamic subtest objects: SUCCESS (0.802s)
[453.965579] Starting dynamic subtest: phys
[454.779744] Dynamic subtest phys: SUCCESS (0.823s)
[454.789870] Starting dynamic subtest: dmabuf
[455.603167] Dynamic subtest dmabuf: SUCCESS (0.822s)
[455.613394] Starting dynamic subtest: vma
[461.771588] Dynamic subtest vma: SUCCESS (6.166s)
[461.782207] Starting dynamic subtest: evict
[463.223409] Dynamic subtest evict: SUCCESS (1.451s)
[463.234172] Starting dynamic subtest: gtt
[466.691127] Dynamic subtest gtt: SUCCESS (3.466s)
[466.701367] Starting dynamic subtest: hugepages
[467.632380] Dynamic subtest hugepages: SUCCESS (0.940s)
[467.640360] Starting dynamic subtest: memory_region
[470.331738] Dynamic subtest memory_region: SUCCESS (2.696s)
[470.333045] Subtest mock: SUCCESS (40.944s)
[470.355362] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[470.356059] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[470.357797] [122/132] (570s left) gem_lmem_swapping (massive-random)
[471.862315] Subtest massive-random: SKIP (0.000s)
[471.922482] [FACT gem_lmem_swapping (massive-random)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[471.923847] [FACT gem_lmem_swapping (massive-random)] new: kernel.kmod_is_loaded.i915: true
[471.926473] [123/132] (569s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[472.017908] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[479.482772] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.465s)
[479.605457] [124/132] (561s left) api_intel_allocator (reserve-simple)
[479.655454] Starting subtest: reserve-simple
[479.657746] Subtest reserve-simple: SUCCESS (0.003s)
[479.787977] [125/132] (561s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[479.838763] Starting subtest: single-wait-all-for-submit-unsubmitted
[479.945930] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[480.017659] [126/132] (561s left) syncobj_timeline (invalid-transfer-non-existent-point)
[480.065965] Starting subtest: invalid-transfer-non-existent-point
[480.067079] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[480.155659] [127/132] (560s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[480.239142] Starting subtest: bad-pixel-format-y-tiled-ccs
[480.240086] Starting dynamic subtest: pipe-A-eDP-1
[480.248854] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[480.258374] Starting dynamic subtest: pipe-B-eDP-1
[480.267562] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[480.282256] Starting dynamic subtest: pipe-C-eDP-1
[480.291028] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[480.299675] Starting dynamic subtest: pipe-D-eDP-1
[480.307445] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[480.309089] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.004s)
[482.513910] [128/132] (558s left) gem_ctx_sseu (engines)
[482.568572] Subtest engines: SKIP (0.000s)
[482.629927] [129/132] (558s left) gem_fence_thrash (bo-write-verify-x)
[482.658857] Starting subtest: bo-write-verify-x
[482.679399] Subtest bo-write-verify-x: SKIP (0.019s)
[482.741985] [130/132] (558s left) syncobj_timeline (multi-wait-available-submitted)
[482.789308] Starting subtest: multi-wait-available-submitted
[482.790379] Subtest multi-wait-available-submitted: SUCCESS (0.000s)
[482.873819] [131/132] (558s left) sw_sync (alloc_fence)
[482.902967] Starting subtest: alloc_fence
[482.904860] Subtest alloc_fence: SUCCESS (0.000s)
[482.949328] [132/132] (558s left) kms_cursor_crc (cursor-dpms)
[483.075981] Starting subtest: cursor-dpms
[483.076935] Starting dynamic subtest: pipe-A-eDP-1
[486.118683] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.047s)
[486.130581] Starting dynamic subtest: pipe-D-eDP-1
[489.687826] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.567s)
[489.688693] Subtest cursor-dpms: SUCCESS (6.617s)
[490.518586] Closing watchdogs
results: parsing output: 0/ for test: kms_flip
results: parsing output: 1/ for test: kms_big_fb
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_flip_scaled_crc
results: parsing output: 4/ for test: gem_exec_reloc
results: parsing output: 5/ for test: syncobj_wait
results: parsing output: 6/ for test: kms_async_flips
results: parsing output: 7/ for test: kms_psr2_sf
results: parsing output: 8/ for test: kms_chamelium_hpd
results: parsing output: 9/ for test: gem_wait
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_flip
results: parsing output: 12/ for test: syncobj_timeline
results: parsing output: 13/ for test: gem_ctx_isolation
results: parsing output: 14/ for test: perf_pmu
results: parsing output: 15/ for test: syncobj_basic
results: parsing output: 16/ for test: gem_render_copy
results: parsing output: 17/ for test: gem_exec_balancer
results: parsing output: 18/ for test: kms_addfb_basic
results: parsing output: 19/ for test: kms_psr2_sf
results: parsing output: 20/ for test: kms_chamelium_frames
results: parsing output: 21/ for test: kms_cursor_crc
results: parsing output: 22/ for test: kms_concurrent
results: parsing output: 23/ for test: gem_partial_pwrite_pread
results: parsing output: 24/ for test: gem_mmap_wc
results: parsing output: 25/ for test: kms_vrr
results: parsing output: 26/ for test: syncobj_wait
results: parsing output: 27/ for test: perf_pmu
results: parsing output: 28/ for test: gem_exec_schedule
results: parsing output: 29/ for test: gem_exec_schedule
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: gem_eio
results: parsing output: 32/ for test: gem_mmap_gtt
results: parsing output: 33/ for test: gem_mmap_offset
results: parsing output: 34/ for test: kms_plane_alpha_blend
results: parsing output: 35/ for test: gem_exec_reloc
results: parsing output: 36/ for test: perf_pmu
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: gem_create
results: parsing output: 39/ for test: syncobj_timeline
results: parsing output: 40/ for test: kms_psr
results: parsing output: 41/ for test: kms_addfb_basic
results: parsing output: 42/ for test: perf
results: parsing output: 43/ for test: kms_ccs
results: parsing output: 44/ for test: gem_exec_reloc
results: parsing output: 45/ for test: syncobj_eventfd
results: parsing output: 46/ for test: fbdev
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: sw_sync
results: parsing output: 51/ for test: kms_cursor_crc
results: parsing output: 52/ for test: i915_pm_freq_mult
results: parsing output: 53/ for test: kms_big_fb
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_psr
results: parsing output: 56/ for test: gem_partial_pwrite_pread
results: parsing output: 57/ for test: gem_sync
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_ccs
results: parsing output: 61/ for test: kms_draw_crc
results: parsing output: 62/ for test: kms_dp_link_training
results: parsing output: 63/ for test: kms_psr2_sf
results: parsing output: 64/ for test: kms_plane_scaling
results: parsing output: 65/ for test: kms_chamelium_audio
results: parsing output: 66/ for test: gem_exec_whisper
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: core_debugfs
results: parsing output: 69/ for test: gem_softpin
results: parsing output: 70/ for test: kms_big_fb
results: parsing output: 71/ for test: vgem_basic
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_plane_scaling
results: parsing output: 74/ for test: kms_cursor_legacy
results: parsing output: 75/ for test: gem_eio
results: parsing output: 76/ for test: gem_exec_balancer
results: parsing output: 77/ for test: kms_invalid_mode
results: parsing output: 78/ for test: kms_cursor_legacy
results: parsing output: 79/ for test: kms_lease
results: parsing output: 80/ for test: kms_pm_dc
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: gem_exec_reloc
results: parsing output: 84/ for test: kms_rotation_crc
results: parsing output: 85/ for test: gem_ctx_persistence
results: parsing output: 86/ for test: kms_plane
results: parsing output: 87/ for test: kms_fbcon_fbt
results: parsing output: 88/ for test: gem_sync
results: parsing output: 89/ for test: vgem_basic
results: parsing output: 90/ for test: gem_mmap_gtt
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_big_fb
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_plane
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_psr
results: parsing output: 97/ for test: drm_mm
results: parsing output: 98/ for test: gem_exec_reloc
results: parsing output: 99/ for test: gem_exec_fence
results: parsing output: 100/ for test: gem_pxp
results: parsing output: 101/ for test: i915_drm_fdinfo
results: parsing output: 102/ for test: template
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: kms_cursor_crc
results: parsing output: 105/ for test: kms_pm_rpm
results: parsing output: 106/ for test: kms_cursor_legacy
results: parsing output: 107/ for test: perf_pmu
results: parsing output: 108/ for test: syncobj_wait
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_psr
results: parsing output: 111/ for test: gen9_exec_parse
results: parsing output: 112/ for test: gem_exec_suspend
results: parsing output: 113/ for test: kms_ccs
results: parsing output: 114/ for test: kms_selftest
results: parsing output: 115/ for test: i915_pm_rc6_residency
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_content_protection
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: i915_selftest
results: parsing output: 121/ for test: gem_lmem_swapping
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: api_intel_allocator
results: parsing output: 124/ for test: syncobj_wait
results: parsing output: 125/ for test: syncobj_timeline
results: parsing output: 126/ for test: kms_ccs
results: parsing output: 127/ for test: gem_ctx_sseu
results: parsing output: 128/ for test: gem_fence_thrash
results: parsing output: 129/ for test: syncobj_timeline
results: parsing output: 130/ for test: sw_sync
results: parsing output: 131/ for test: kms_cursor_crc
Done.