[57.639690] Initializing watchdogs
[57.639740]   /dev/watchdog0
[57.655064] [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]
[57.659698] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.661926] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.665205] [001/132] (960s left) kms_chamelium_hpd (hdmi-hpd-enable-disable-mode)
[58.074856] Subtest hdmi-hpd-enable-disable-mode: SKIP (0.000s)
[58.890757] [002/132] (959s left) gem_exec_create (basic)
[58.959881] Starting subtest: basic
[58.962390] Starting dynamic subtest: smem
[62.871534] Dynamic subtest smem: SUCCESS (3.899s)
[62.874323] Subtest basic: SUCCESS (3.900s)
[63.075383] [003/132] (955s left) gen9_exec_parse (bb-chained)
[63.143775] Subtest bb-chained: SKIP (0.000s)
[63.225939] [004/132] (955s left) kms_addfb_basic (bad-pitch-128)
[63.273875] Starting subtest: bad-pitch-128
[63.275786] Subtest bad-pitch-128: SUCCESS (0.000s)
[63.415753] [005/132] (954s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[63.501377] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[63.503652] Starting dynamic subtest: pipe-A-eDP-1
[63.523757] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[63.533555] Starting dynamic subtest: pipe-B-eDP-1
[63.552793] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[63.560074] Starting dynamic subtest: pipe-C-eDP-1
[63.579418] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[63.586539] Starting dynamic subtest: pipe-D-eDP-1
[63.606042] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[63.607941] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.004s)
[65.805538] [006/132] (952s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted-signaled)
[65.861111] Starting subtest: multi-wait-available-unsubmitted-submitted-signaled
[65.863518] Subtest multi-wait-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[65.968350] [007/132] (952s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite)
[66.072135] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite
[66.076484] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[66.199764] [008/132] (952s left) gem_exec_balancer (nop)
[66.262574] Starting subtest: nop
[113.078905] Subtest nop: SUCCESS (46.802s)
[113.365114] [009/132] (905s left) gem_exec_params (rel-constants-invalid-ring)
[113.423607] Starting subtest: rel-constants-invalid-ring
[113.426080] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[113.533170] [010/132] (904s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[113.620939] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[113.623343] Starting dynamic subtest: pipe-A-default-mode
[116.334460] Dynamic subtest pipe-A-default-mode: SUCCESS (2.713s)
[116.336510] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.714s)
[117.213941] [011/132] (901s left) kms_addfb_basic (unused-modifier)
[117.276084] Starting subtest: unused-modifier
[117.278408] Subtest unused-modifier: SUCCESS (0.000s)
[117.428677] [012/132] (901s left) kms_plane_scaling (2x-scaler-multi-pipe)
[117.524794] Starting subtest: 2x-scaler-multi-pipe
[117.529380] Subtest 2x-scaler-multi-pipe: SKIP (0.001s)
[117.643141] [013/132] (900s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[117.740677] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[117.745200] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[117.867211] [014/132] (900s left) gem_exec_fence (submit)
[118.048092] Starting subtest: submit
[118.052893] Subtest submit: SKIP (0.000s)
[119.974552] [FACT gem_exec_fence (submit)] new: kernel.kmod_is_loaded.vgem: true
[119.977538] [015/132] (898s left) device_reset (unbind-cold-reset-rebind)
[120.022645] Starting subtest: unbind-cold-reset-rebind
[120.027368] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[120.101313] [016/132] (898s left) syncobj_basic (bad-destroy-pad)
[120.158092] Starting subtest: bad-destroy-pad
[120.160072] Subtest bad-destroy-pad: SUCCESS (0.000s)
[120.267651] [017/132] (898s left) gem_exercise_blt (fast-copy)
[120.322545] Starting subtest: fast-copy
[120.324864] Starting dynamic subtest: linear-smem-smem
[120.354400] Dynamic subtest linear-smem-smem: SUCCESS (0.032s)
[120.364297] Starting dynamic subtest: xmajor-smem-smem
[120.373383] Dynamic subtest xmajor-smem-smem: SUCCESS (0.019s)
[120.380843] Starting dynamic subtest: tile4-smem-smem
[120.394436] Dynamic subtest tile4-smem-smem: SUCCESS (0.021s)
[120.401959] Starting dynamic subtest: tile64-smem-smem
[120.414815] Dynamic subtest tile64-smem-smem: SUCCESS (0.020s)
[120.417228] Subtest fast-copy: SUCCESS (0.092s)
[120.568490] [018/132] (898s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[120.677649] Starting subtest: x-tiled-8bpp-rotate-90
[120.700396] Subtest x-tiled-8bpp-rotate-90: SKIP (0.022s)
[120.861644] [019/132] (897s left) gem_mmap_offset (partial-unmap)
[120.921858] Starting subtest: partial-unmap
[120.923891] Starting dynamic subtest: smem0
[121.427942] Dynamic subtest smem0: SUCCESS (0.507s)
[121.430758] Subtest partial-unmap: SUCCESS (0.507s)
[121.582022] [020/132] (897s left) kms_content_protection (atomic-dpms)
[121.729864] Starting subtest: atomic-dpms
[121.734485] Subtest atomic-dpms: SKIP (0.000s)
[121.860442] [021/132] (897s left) kms_pipe_stress (stress-xrgb8888-yftiled)
[121.958104] Starting subtest: stress-xrgb8888-yftiled
[121.962608] Subtest stress-xrgb8888-yftiled: SKIP (0.000s)
[122.042157] [022/132] (896s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset)
[122.141458] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset
[122.152616] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.011s)
[122.265804] [023/132] (896s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs)
[122.328804] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs
[122.333388] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[122.531613] [024/132] (896s left) sw_sync (sync_multi_timeline_wait)
[122.564398] Starting subtest: sync_multi_timeline_wait
[122.566606] Subtest sync_multi_timeline_wait: SUCCESS (0.000s)
[122.640106] [025/132] (896s left) gem_madvise (dontneed-before-pwrite)
[122.673992] Starting subtest: dontneed-before-pwrite
[122.708290] Subtest dontneed-before-pwrite: SKIP (0.030s)
[122.772825] [026/132] (896s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[122.872846] Starting subtest: addfb25-y-tiled-legacy
[122.874800] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[122.991210] [027/132] (896s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[123.084346] Starting subtest: primary-x-tiled-reflect-x-180
[130.170205] Subtest primary-x-tiled-reflect-x-180: SUCCESS (7.087s)
[131.376858] [028/132] (887s left) gem_mmap_wc (read)
[131.440274] Subtest read: SKIP (0.000s)
[131.508205] [029/132] (887s left) kms_invalid_mode (bad-vtotal)
[131.606077] Starting subtest: bad-vtotal
[131.608530] Starting dynamic subtest: pipe-A-eDP-1
[131.882688] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.282s)
[131.892406] Starting dynamic subtest: pipe-B-eDP-1
[131.894785] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[131.904349] Starting dynamic subtest: pipe-C-eDP-1
[131.906632] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[131.914052] Starting dynamic subtest: pipe-D-eDP-1
[131.916310] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[131.918564] Subtest bad-vtotal: SUCCESS (0.287s)
[132.697945] [030/132] (886s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[132.786740] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[132.789058] Starting dynamic subtest: pipe-A-default-mode
[135.557278] Dynamic subtest pipe-A-default-mode: SUCCESS (2.768s)
[135.559739] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.769s)
[136.414852] [031/132] (882s left) kms_chamelium_edid (hdmi-edid-stress-resolution-non-4k)
[136.808983] Subtest hdmi-edid-stress-resolution-non-4k: SKIP (0.000s)
[137.608145] [032/132] (881s left) gem_ppgtt (shrink-vs-evict-pinned)
[137.670597] Starting subtest: shrink-vs-evict-pinned
[142.907591] Subtest shrink-vs-evict-pinned: SUCCESS (5.238s)
[143.001650] [033/132] (876s left) kms_dp_link_training (uhbr-sst)
[143.093080] Starting subtest: uhbr-sst
[143.102289] Subtest uhbr-sst: SKIP (0.000s)
[143.178482] [034/132] (876s left) kms_flip (basic-flip-vs-dpms)
[143.260894] Starting subtest: basic-flip-vs-dpms
[143.263331] Starting dynamic subtest: A-eDP1
[145.827597] Dynamic subtest A-eDP1: SUCCESS (2.563s)
[145.838349] Starting dynamic subtest: B-eDP1
[148.001549] Dynamic subtest B-eDP1: SUCCESS (2.174s)
[148.009724] Starting dynamic subtest: C-eDP1
[150.157266] Dynamic subtest C-eDP1: SUCCESS (2.155s)
[150.166804] Starting dynamic subtest: D-eDP1
[152.235692] Dynamic subtest D-eDP1: SUCCESS (2.079s)
[152.237863] Subtest basic-flip-vs-dpms: SUCCESS (8.977s)
[153.040582] [035/132] (866s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[153.136455] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[153.138692] Starting dynamic subtest: pipe-A-eDP-1
[153.161188] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[153.171494] Starting dynamic subtest: pipe-B-eDP-1
[153.192876] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[153.200632] Starting dynamic subtest: pipe-C-eDP-1
[153.223420] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[153.232477] Starting dynamic subtest: pipe-D-eDP-1
[153.255720] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[153.260275] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[155.401762] [036/132] (864s left) gem_mmap_wc (coherency)
[155.450810] Subtest coherency: SKIP (0.000s)
[155.517858] [037/132] (864s left) i915_drm_fdinfo (virtual-idle)
[155.554185] Starting subtest: virtual-idle
[158.630797] Subtest virtual-idle: SUCCESS (3.073s)
[158.714850] [038/132] (860s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[158.813415] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[158.817539] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[158.947970] [039/132] (860s left) sw_sync (timeline_closed)
[158.983686] Starting subtest: timeline_closed
[158.985510] Subtest timeline_closed: SUCCESS (0.000s)
[159.058780] [040/132] (860s left) gem_exec_schedule (pi-shared-iova)
[159.238977] Starting subtest: pi-shared-iova
[159.241377] Starting dynamic subtest: rcs0
[159.316781] Dynamic subtest rcs0: SUCCESS (0.079s)
[159.328645] Starting dynamic subtest: vcs0
[159.381076] Dynamic subtest vcs0: SUCCESS (0.063s)
[159.389148] Starting dynamic subtest: vcs1
[159.440257] Dynamic subtest vcs1: SUCCESS (0.057s)
[159.451460] Starting dynamic subtest: vecs0
[159.495756] Dynamic subtest vecs0: SUCCESS (0.054s)
[159.507137] Starting dynamic subtest: ccs0
[159.548697] Dynamic subtest ccs0: SUCCESS (0.053s)
[159.551066] Subtest pi-shared-iova: SUCCESS (0.313s)
[161.059300] [041/132] (858s left) api_intel_bb (object-noreloc-purge-cache-simple)
[161.107943] Starting subtest: object-noreloc-purge-cache-simple
[161.110246] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.004s)
[161.264533] [042/132] (858s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[161.405609] Starting subtest: cursor-rapid-movement-32x32
[161.454071] Subtest cursor-rapid-movement-32x32: SKIP (0.044s)
[161.754592] [043/132] (858s left) i915_drm_fdinfo (most-busy-check-all)
[161.793046] Starting subtest: most-busy-check-all
[161.795609] Starting dynamic subtest: rcs0
[161.800318] Dynamic subtest rcs0: SKIP (0.003s)
[161.809743] Starting dynamic subtest: bcs0
[161.814142] Dynamic subtest bcs0: SKIP (0.000s)
[161.822272] Starting dynamic subtest: vcs0
[161.826751] Dynamic subtest vcs0: SKIP (0.000s)
[161.834491] Starting dynamic subtest: vcs1
[161.838876] Dynamic subtest vcs1: SKIP (0.000s)
[161.846763] Starting dynamic subtest: vecs0
[161.851186] Dynamic subtest vecs0: SKIP (0.000s)
[161.858939] Starting dynamic subtest: ccs0
[161.863294] Dynamic subtest ccs0: SKIP (0.000s)
[161.867574] Subtest most-busy-check-all: SKIP (0.007s)
[161.903887] [044/132] (857s left) syncobj_wait (multi-wait-all-signaled)
[162.019734] Starting subtest: multi-wait-all-signaled
[162.021721] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[162.133958] [045/132] (857s left) gem_softpin (softpin)
[162.197629] Starting subtest: softpin
[194.560496] Subtest softpin: SUCCESS (32.357s)
[194.687037] [046/132] (825s left) kms_cursor_crc (cursor-onscreen-256x85)
[194.940949] Starting subtest: cursor-onscreen-256x85
[194.987048] Subtest cursor-onscreen-256x85: SKIP (0.043s)
[195.163462] [047/132] (824s left) gem_exec_schedule (u-submit-late-slice)
[195.237224] Starting subtest: u-submit-late-slice
[195.239298] Starting dynamic subtest: rcs0
[195.266433] Dynamic subtest rcs0: SUCCESS (0.037s)
[195.277621] Starting dynamic subtest: bcs0
[195.295949] Dynamic subtest bcs0: SUCCESS (0.029s)
[195.306256] Starting dynamic subtest: vcs0
[195.328252] Dynamic subtest vcs0: SUCCESS (0.032s)
[195.336656] Starting dynamic subtest: vcs1
[195.360064] Dynamic subtest vcs1: SUCCESS (0.031s)
[195.368489] Starting dynamic subtest: vecs0
[195.388203] Dynamic subtest vecs0: SUCCESS (0.028s)
[195.396731] Starting dynamic subtest: ccs0
[195.418332] Dynamic subtest ccs0: SUCCESS (0.030s)
[195.420698] Subtest u-submit-late-slice: SUCCESS (0.189s)
[197.009010] [048/132] (823s left) syncobj_wait (wait-any-interrupted)
[197.065990] Starting subtest: wait-any-interrupted
[197.166861] Subtest wait-any-interrupted: SUCCESS (0.102s)
[197.267236] [049/132] (822s left) syncobj_timeline (reset-during-wait-for-submit)
[197.328179] Starting subtest: reset-during-wait-for-submit
[197.430338] Subtest reset-during-wait-for-submit: SUCCESS (0.103s)
[197.525199] [050/132] (822s left) kms_async_flips (invalid-async-flip)
[197.618827] Starting subtest: invalid-async-flip
[197.996452] Starting dynamic subtest: pipe-A-eDP-1
[198.812298] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.817s)
[199.174017] Starting dynamic subtest: pipe-B-eDP-1
[199.956710] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.789s)
[200.317786] Starting dynamic subtest: pipe-C-eDP-1
[201.089335] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.780s)
[201.450672] Starting dynamic subtest: pipe-D-eDP-1
[202.220563] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.777s)
[202.222810] Subtest invalid-async-flip: SUCCESS (4.603s)
[203.380917] [051/132] (816s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[203.442068] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[203.547042] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.104s)
[203.651544] [052/132] (816s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen)
[203.745645] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen
[210.395541] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.652s)
[210.555920] [053/132] (809s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions)
[210.669758] Starting subtest: short-flip-after-cursor-atomic-transitions
[211.610939] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (0.940s)
[212.465136] [054/132] (807s left) kms_psr (fbc-pr-dpms)
[212.561316] Starting subtest: fbc-pr-dpms
[212.565349] Subtest fbc-pr-dpms: SKIP (0.000s)
[212.660162] [055/132] (807s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted)
[212.713985] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted
[212.819061] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.104s)
[212.922058] [056/132] (807s left) gem_bad_reloc (negative-reloc-lut)
[212.983354] Subtest negative-reloc-lut: SKIP (0.000s)
[213.071833] [057/132] (807s left) gem_exec_gttfill (multigpu-basic)
[213.233882] Starting subtest: multigpu-basic
[228.038847] Subtest multigpu-basic: SUCCESS (14.805s)
[228.121387] [058/132] (792s left) gem_exec_params (invalid-bsd1-flag-on-blt)
[228.214312] Starting subtest: invalid-bsd1-flag-on-blt
[228.216617] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s)
[228.357100] [059/132] (792s left) kms_psr (psr2-sprite-plane-move)
[228.455944] Starting subtest: psr2-sprite-plane-move
[228.458180] Starting dynamic subtest: eDP-1
[230.280708] Dynamic subtest eDP-1: SUCCESS (1.823s)
[230.282656] Subtest psr2-sprite-plane-move: SUCCESS (1.824s)
[231.124039] [060/132] (789s left) gem_exec_endless (dispatch)
[231.194264] Starting subtest: dispatch
[231.196641] Starting dynamic subtest: rcs0
[231.200981] Dynamic subtest rcs0: SUCCESS (0.005s)
[231.212208] Starting dynamic subtest: bcs0
[231.216707] Dynamic subtest bcs0: SUCCESS (0.004s)
[231.226100] Starting dynamic subtest: vcs0
[231.230587] Dynamic subtest vcs0: SUCCESS (0.005s)
[231.238789] Starting dynamic subtest: vcs1
[231.243185] Dynamic subtest vcs1: SUCCESS (0.004s)
[231.251189] Starting dynamic subtest: vecs0
[231.255536] Dynamic subtest vecs0: SUCCESS (0.004s)
[231.263650] Starting dynamic subtest: ccs0
[231.268095] Dynamic subtest ccs0: SUCCESS (0.005s)
[231.270256] Subtest dispatch: SUCCESS (0.030s)
[232.968476] [061/132] (787s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-blt)
[233.064695] Starting subtest: psr-1p-offscreen-pri-indfb-draw-blt
[239.987622] Subtest psr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.925s)
[240.162815] [062/132] (780s left) kms_psr (fbc-psr-cursor-plane-move)
[240.254075] Starting subtest: fbc-psr-cursor-plane-move
[240.256291] Starting dynamic subtest: eDP-1
[240.260386] Dynamic subtest eDP-1: SKIP (0.000s)
[240.264496] Subtest fbc-psr-cursor-plane-move: SKIP (0.001s)
[240.335715] [063/132] (780s left) vgem_basic (dmabuf-mmap)
[240.378989] Starting subtest: dmabuf-mmap
[240.425544] Subtest dmabuf-mmap: SUCCESS (0.048s)
[240.504249] [064/132] (780s left) kms_big_fb (linear-8bpp-rotate-180)
[240.614862] Starting subtest: linear-8bpp-rotate-180
[241.838694] Subtest linear-8bpp-rotate-180: SUCCESS (1.223s)
[241.996656] [065/132] (778s left) gem_flink_basic (bad-open)
[242.058318] Starting subtest: bad-open
[242.060174] Subtest bad-open: SUCCESS (0.000s)
[242.174999] [066/132] (778s left) kms_vrr (flip-dpms)
[242.271066] Starting subtest: flip-dpms
[242.276182] Subtest flip-dpms: SKIP (0.000s)
[242.352366] [067/132] (778s left) gem_ctx_persistence (process)
[242.400355] Starting subtest: process
[242.619814] Subtest process: SUCCESS (0.219s)
[242.730215] [068/132] (778s left) i915_pm_rpm (gem-evict-pwrite)
[244.263433] Starting subtest: gem-evict-pwrite
[244.268086] Subtest gem-evict-pwrite: SKIP (0.000s)
[245.010080] [069/132] (775s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-sf)
[250.064724] Starting subtest: psr2-overlay-plane-move-continuous-sf
[250.067249] Starting dynamic subtest: pipe-A-eDP-1
[256.751963] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.686s)
[256.761624] Starting dynamic subtest: pipe-B-eDP-1
[263.379275] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.626s)
[263.381707] Subtest psr2-overlay-plane-move-continuous-sf: SUCCESS (13.316s)
[264.283787] [070/132] (756s left) gem_wait (invalid-buf)
[264.342336] Starting subtest: invalid-buf
[264.344667] Subtest invalid-buf: SUCCESS (0.000s)
[264.600159] [071/132] (756s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite)
[264.698620] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite
[270.850662] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (6.155s)
[271.997126] [072/132] (749s left) gem_lmem_swapping (parallel-random-verify)
[272.046961] Subtest parallel-random-verify: SKIP (0.000s)
[272.094466] [073/132] (748s left) prime_vgem (fence-flip-hang)
[272.184945] Subtest fence-flip-hang: SKIP (0.000s)
[272.311312] [074/132] (748s left) gem_exec_reloc (basic-range-active)
[272.369583] Subtest basic-range-active: SKIP (0.000s)
[272.432210] [075/132] (748s left) kms_cdclk (plane-scaling)
[272.544356] Starting subtest: plane-scaling
[272.546546] Starting dynamic subtest: pipe-A-eDP-1
[272.832379] Dynamic subtest pipe-A-eDP-1: SKIP (0.293s)
[272.841443] Starting dynamic subtest: pipe-B-eDP-1
[272.846028] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[272.854413] Starting dynamic subtest: pipe-C-eDP-1
[272.858910] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[272.867238] Starting dynamic subtest: pipe-D-eDP-1
[272.871250] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[272.875107] Subtest plane-scaling: SKIP (0.302s)
[273.702772] [076/132] (747s left) kms_psr (fbc-psr2-primary-page-flip)
[273.803371] Starting subtest: fbc-psr2-primary-page-flip
[273.805591] Starting dynamic subtest: eDP-1
[273.809927] Dynamic subtest eDP-1: SKIP (0.000s)
[273.814337] Subtest fbc-psr2-primary-page-flip: SKIP (0.001s)
[273.886157] [077/132] (747s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[273.991722] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[281.022721] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.033s)
[281.174234] [078/132] (740s left) gem_ccs (suspend-resume)
[281.235822] Starting subtest: suspend-resume
[281.240583] Subtest suspend-resume: SKIP (0.000s)
[281.369321] [079/132] (739s left) gem_ctx_isolation (preservation-s3)
[281.436465] Starting subtest: preservation-S3
[281.438773] Starting dynamic subtest: rcs0
[297.882249] Dynamic subtest rcs0: SUCCESS (1.436s)
[297.892241] Starting dynamic subtest: bcs0
[313.812672] Dynamic subtest bcs0: SUCCESS (1.244s)
[313.822597] Starting dynamic subtest: vcs0
[329.825639] Dynamic subtest vcs0: SUCCESS (2.756s)
[329.838261] Starting dynamic subtest: vcs1
[347.883267] Dynamic subtest vcs1: SUCCESS (5.030s)
[347.899319] Starting dynamic subtest: vecs0
[365.883367] Dynamic subtest vecs0: SUCCESS (4.955s)
[365.897463] Starting dynamic subtest: ccs0
[383.821016] Dynamic subtest ccs0: SUCCESS (3.112s)
[383.823483] Subtest preservation-S3: SUCCESS (18.538s)
[384.093342] [080/132] (637s left) kms_sequence (queue-idle)
[384.196641] Starting subtest: queue-idle
[384.198889] Starting dynamic subtest: pipe-A-eDP-1
[386.005960] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.792s)
[386.016672] Starting dynamic subtest: pipe-B-eDP-1
[388.513494] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.485s)
[388.524165] Starting dynamic subtest: pipe-C-eDP-1
[390.932667] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.404s)
[390.942507] Starting dynamic subtest: pipe-D-eDP-1
[393.382435] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.438s)
[393.384659] Subtest queue-idle: SUCCESS (9.124s)
[394.216495] [081/132] (627s left) kms_big_fb (yf-tiled-64bpp-rotate-180)
[394.327575] Starting subtest: yf-tiled-64bpp-rotate-180
[394.331959] Subtest yf-tiled-64bpp-rotate-180: SKIP (0.000s)
[394.452651] [082/132] (626s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[394.556242] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[394.560648] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[394.669973] [083/132] (626s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu)
[394.770426] Starting subtest: fbc-rgb565-draw-mmap-cpu
[398.845627] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (4.069s)
[400.036227] [084/132] (621s left) gem_exec_schedule (promotion)
[400.114757] Starting subtest: promotion
[400.116769] Starting dynamic subtest: rcs0
[400.213693] Dynamic subtest rcs0: SUCCESS (0.108s)
[400.226599] Starting dynamic subtest: vcs0
[400.300645] Dynamic subtest vcs0: SUCCESS (0.086s)
[400.312764] Starting dynamic subtest: vcs1
[400.379223] Dynamic subtest vcs1: SUCCESS (0.078s)
[400.392044] Starting dynamic subtest: vecs0
[400.455369] Dynamic subtest vecs0: SUCCESS (0.075s)
[400.467097] Starting dynamic subtest: ccs0
[400.540582] Dynamic subtest ccs0: SUCCESS (0.083s)
[400.543774] Subtest promotion: SUCCESS (0.434s)
[401.724188] [085/132] (619s left) kms_lease (lessee-list)
[401.817887] Starting subtest: lessee-list
[401.820131] Starting dynamic subtest: pipe-A-eDP-1
[401.822300] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s)
[401.832197] Starting dynamic subtest: pipe-B-eDP-1
[401.834377] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[401.843752] Starting dynamic subtest: pipe-C-eDP-1
[401.845847] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[401.855097] Starting dynamic subtest: pipe-D-eDP-1
[401.857210] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[401.859322] Subtest lessee-list: SUCCESS (0.009s)
[401.952524] [086/132] (619s left) kms_flip (2x-modeset-vs-vblank-race)
[402.046522] Starting subtest: 2x-modeset-vs-vblank-race
[402.058045] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[402.162301] [087/132] (619s left) gem_render_copy (linear-to-vebox-yf-tiled)
[402.228256] Starting subtest: linear-to-vebox-yf-tiled
[402.232483] Subtest linear-to-vebox-yf-tiled: SKIP (0.000s)
[402.434309] [088/132] (619s left) perf_pmu (busy-hang)
[402.472888] Starting subtest: busy-hang
[402.475098] Starting dynamic subtest: rcs0
[403.755716] Dynamic subtest rcs0: SUCCESS (1.278s)
[403.767663] Starting dynamic subtest: bcs0
[404.989507] Dynamic subtest bcs0: SUCCESS (1.234s)
[405.002195] Starting dynamic subtest: vcs0
[407.123813] Dynamic subtest vcs0: SUCCESS (2.130s)
[407.134876] Starting dynamic subtest: vcs1
[409.101763] Dynamic subtest vcs1: SUCCESS (1.974s)
[409.113928] Starting dynamic subtest: vecs0
[411.153821] Dynamic subtest vecs0: SUCCESS (2.045s)
[411.165893] Starting dynamic subtest: ccs0
[412.388652] Dynamic subtest ccs0: SUCCESS (1.236s)
[412.391178] Subtest busy-hang: SUCCESS (9.907s)
[412.497368] [089/132] (609s left) gem_mmap_wc (write-read-distinct)
[412.558613] Subtest write-read-distinct: SKIP (0.000s)
[412.623539] [090/132] (609s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[412.716292] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[412.718415] Starting dynamic subtest: pipe-A-eDP-1
[412.743508] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[412.755851] Starting dynamic subtest: pipe-B-eDP-1
[412.779222] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[412.789347] Starting dynamic subtest: pipe-C-eDP-1
[412.813470] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[412.824396] Starting dynamic subtest: pipe-D-eDP-1
[412.849612] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[412.854194] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.004s)
[414.978697] [091/132] (606s left) kms_prop_blob (blob-prop-lifetime)
[415.039172] Starting subtest: blob-prop-lifetime
[415.041532] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[415.177280] [092/132] (606s left) kms_psr (pr-primary-mmap-gtt)
[415.272036] Starting subtest: pr-primary-mmap-gtt
[415.276427] Subtest pr-primary-mmap-gtt: SKIP (0.000s)
[415.359331] [093/132] (606s left) kms_pm_rpm (basic-rte)
[415.393785] Starting subtest: basic-rte
[418.333631] Subtest basic-rte: SUCCESS (2.942s)
[419.855023] [094/132] (602s left) syncobj_timeline (wait-all-snapshot)
[419.912074] Starting subtest: wait-all-snapshot
[419.993981] Subtest wait-all-snapshot: SUCCESS (0.082s)
[420.081054] [095/132] (601s left) gem_userptr_blits (create-destroy-unsync)
[420.153024] Subtest create-destroy-unsync: SKIP (0.000s)
[420.317409] [096/132] (601s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[420.406608] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[420.408981] Starting dynamic subtest: pipe-A
[420.426526] Dynamic subtest pipe-A: SKIP (0.017s)
[420.437378] Starting dynamic subtest: pipe-B
[420.461413] Dynamic subtest pipe-B: SKIP (0.033s)
[420.472224] Starting dynamic subtest: pipe-C
[420.492775] Dynamic subtest pipe-C: SKIP (0.032s)
[420.503139] Starting dynamic subtest: pipe-D
[420.526636] Dynamic subtest pipe-D: SKIP (0.032s)
[420.530942] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.116s)
[420.637459] [097/132] (601s left) gem_ctx_shared (q-smoketest)
[420.695311] Starting subtest: Q-smoketest
[420.697747] Starting dynamic subtest: rcs0
[426.235860] Dynamic subtest rcs0: SUCCESS (5.496s)
[426.247793] Starting dynamic subtest: bcs0
[431.749861] Dynamic subtest bcs0: SUCCESS (5.507s)
[431.767842] Starting dynamic subtest: vcs0
[437.232758] Dynamic subtest vcs0: SUCCESS (5.481s)
[437.249513] Starting dynamic subtest: vcs1
[442.712222] Dynamic subtest vcs1: SUCCESS (5.478s)
[442.723492] Starting dynamic subtest: vecs0
[448.185765] Dynamic subtest vecs0: SUCCESS (5.476s)
[448.196383] Starting dynamic subtest: ccs0
[453.690404] Dynamic subtest ccs0: SUCCESS (5.497s)
[453.692471] Subtest Q-smoketest: SUCCESS (32.943s)
[453.838607] [098/132] (568s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[453.936057] Starting subtest: yf-tiled-addfb-size-offset-overflow
[453.940344] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[454.072253] [099/132] (568s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf)
[459.080010] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-sf
[459.082492] Starting dynamic subtest: pipe-A-eDP-1
[459.888459] Dynamic subtest pipe-A-eDP-1: SKIP (0.804s)
[459.903280] Starting dynamic subtest: pipe-B-eDP-1
[461.016951] Dynamic subtest pipe-B-eDP-1: SKIP (1.126s)
[461.021187] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (1.934s)
[462.233381] [100/132] (559s left) kms_psr (psr-sprite-plane-onoff)
[462.332664] Starting subtest: psr-sprite-plane-onoff
[462.334759] Starting dynamic subtest: eDP-1
[464.165026] Dynamic subtest eDP-1: SUCCESS (1.831s)
[464.167286] Subtest psr-sprite-plane-onoff: SUCCESS (1.832s)
[464.998321] [101/132] (557s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[465.103521] Starting subtest: fbc-rgb565-draw-pwrite
[469.739395] Subtest fbc-rgb565-draw-pwrite: SUCCESS (4.638s)
[470.908324] [102/132] (551s left) kms_frontbuffer_tracking (fbcpsr-stridechange)
[471.008147] Starting subtest: fbcpsr-stridechange
[477.234201] Subtest fbcpsr-stridechange: SUCCESS (6.225s)
[477.393941] [103/132] (544s left) prime_vgem (basic-blt)
[477.465411] Starting subtest: basic-blt
[477.502697] Subtest basic-blt: SUCCESS (0.037s)
[477.653997] [104/132] (544s left) i915_selftest (live)
[481.305621] Starting subtest: live
[481.308022] Starting dynamic subtest: sanitycheck
[485.870664] Dynamic subtest sanitycheck: SUCCESS (4.566s)
[485.881248] Starting dynamic subtest: uncore
[490.422857] Dynamic subtest uncore: SUCCESS (4.551s)
[490.433628] Starting dynamic subtest: workarounds
[493.874996] Dynamic subtest workarounds: SUCCESS (3.451s)
[493.885462] Starting dynamic subtest: gt_engines
[498.690938] Dynamic subtest gt_engines: SUCCESS (4.815s)
[498.701123] Starting dynamic subtest: gt_timelines
[514.950606] Dynamic subtest gt_timelines: SUCCESS (16.259s)
[514.961356] Starting dynamic subtest: gt_contexts
[519.456463] Dynamic subtest gt_contexts: SUCCESS (4.503s)
[519.466307] Starting dynamic subtest: gt_lrc
[523.933116] Dynamic subtest gt_lrc: SUCCESS (4.474s)
[523.944274] Starting dynamic subtest: gt_mocs
[527.138714] Dynamic subtest gt_mocs: SUCCESS (3.203s)
[527.149518] Starting dynamic subtest: gt_pm
[534.149880] Dynamic subtest gt_pm: SUCCESS (7.008s)
[534.160356] Starting dynamic subtest: gt_heartbeat
[538.771275] Dynamic subtest gt_heartbeat: SUCCESS (4.618s)
[538.781570] Starting dynamic subtest: gt_tlb
[548.938199] Dynamic subtest gt_tlb: SUCCESS (10.163s)
[548.954367] Starting dynamic subtest: requests
[562.597974] Dynamic subtest requests: SUCCESS (13.654s)
[562.607837] Starting dynamic subtest: migrate
[570.755439] Dynamic subtest migrate: SUCCESS (8.154s)
[570.766307] Starting dynamic subtest: active
[575.282729] Dynamic subtest active: SUCCESS (4.524s)
[575.292909] Starting dynamic subtest: objects
[580.201309] Dynamic subtest objects: SUCCESS (4.915s)
[580.211818] Starting dynamic subtest: mman
[585.285351] Dynamic subtest mman: SUCCESS (5.080s)
[585.295835] Starting dynamic subtest: dmabuf
[589.872577] Dynamic subtest dmabuf: SUCCESS (4.584s)
[589.882312] Starting dynamic subtest: vma
[594.326132] Dynamic subtest vma: SUCCESS (4.450s)
[594.336700] Starting dynamic subtest: coherency
[599.991537] Dynamic subtest coherency: SUCCESS (5.662s)
[600.007724] Starting dynamic subtest: gtt
[610.523912] Dynamic subtest gtt: SUCCESS (10.528s)
[610.534663] Starting dynamic subtest: gem
[618.488588] Dynamic subtest gem: SUCCESS (7.965s)
[618.498838] Starting dynamic subtest: evict
[624.156841] Dynamic subtest evict: SUCCESS (5.667s)
[624.166502] Starting dynamic subtest: hugepages
[633.902156] Dynamic subtest hugepages: SUCCESS (9.744s)
[633.918280] Starting dynamic subtest: gem_contexts
[661.778923] Dynamic subtest gem_contexts: SUCCESS (27.875s)
[661.790324] Starting dynamic subtest: client
[666.401073] Dynamic subtest client: SUCCESS (4.621s)
[666.411651] Starting dynamic subtest: gem_migrate
[671.017059] Dynamic subtest gem_migrate: SUCCESS (4.614s)
[671.026660] Starting dynamic subtest: reset
[673.990446] Dynamic subtest reset: SUCCESS (2.971s)
[674.000818] Starting dynamic subtest: memory_region
[678.497584] Dynamic subtest memory_region: SUCCESS (4.505s)
[678.508042] Starting dynamic subtest: hangcheck
[692.525406] Dynamic subtest hangcheck: SUCCESS (14.025s)
[692.538606] Starting dynamic subtest: execlists
[697.053723] Dynamic subtest execlists: SUCCESS (4.526s)
[697.063596] Starting dynamic subtest: ring_submission
[701.639881] Dynamic subtest ring_submission: SUCCESS (4.583s)
[701.650454] Starting dynamic subtest: perf
[706.230249] Dynamic subtest perf: SUCCESS (4.588s)
[706.240833] Starting dynamic subtest: slpc
[720.978104] Dynamic subtest slpc: SUCCESS (14.744s)
[720.988734] Starting dynamic subtest: guc
[725.154657] Dynamic subtest guc: SUCCESS (4.174s)
[725.163632] Starting dynamic subtest: guc_multi_lrc
[729.734507] Dynamic subtest guc_multi_lrc: SUCCESS (4.577s)
[729.744619] Starting dynamic subtest: guc_hang
[734.873637] Dynamic subtest guc_hang: SUCCESS (5.136s)
[734.884496] Starting dynamic subtest: late_gt_pm
[739.446839] Dynamic subtest late_gt_pm: SUCCESS (4.570s)
[739.449384] Subtest live: SUCCESS (258.126s)
[739.478975] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[739.479703] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[739.482866] [105/132] (282s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[741.034416] Starting subtest: y-tiled-8bpp-rotate-180
[741.038468] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s)
[741.160420] [FACT kms_big_fb (y-tiled-8bpp-rotate-180)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[741.161756] [FACT kms_big_fb (y-tiled-8bpp-rotate-180)] new: kernel.kmod_is_loaded.i915: true
[741.165409] [106/132] (281s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[741.269755] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[741.272014] Starting dynamic subtest: pipe-A-default-mode
[741.566753] Dynamic subtest pipe-A-default-mode: SKIP (0.294s)
[741.571179] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.295s)
[742.402027] [107/132] (280s left) gem_userptr_blits (coherency-unsync)
[742.462152] Subtest coherency-unsync: SKIP (0.000s)
[742.611053] [108/132] (279s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions)
[742.725244] Starting subtest: flip-vs-cursor-atomic-transitions
[751.141255] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (8.412s)
[751.612756] [109/132] (270s left) gem_softpin (evict-active-interruptible)
[751.684515] Starting subtest: evict-active-interruptible
[751.692978] Subtest evict-active-interruptible: SUCCESS (0.006s)
[751.848666] [110/132] (270s left) gem_exec_schedule (smoketest-all)
[751.923007] Starting subtest: smoketest-all
[784.283751] Subtest smoketest-all: SUCCESS (32.314s)
[785.666985] [111/132] (236s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[785.768399] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[785.772369] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[785.895483] [112/132] (236s left) gem_softpin (zero)
[785.953289] Starting subtest: zero
[785.960999] Subtest zero: SUCCESS (0.005s)
[786.103390] [113/132] (236s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[786.198822] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[793.109103] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.911s)
[793.294847] [114/132] (229s left) sriov_basic (enable-vfs-autoprobe-off)
[793.344770] Starting subtest: enable-vfs-autoprobe-off
[793.347142] Starting dynamic subtest: numvfs-1
[793.427635] Dynamic subtest numvfs-1: FAIL (0.029s)
[793.437930] Starting dynamic subtest: numvfs-2
[793.508462] Dynamic subtest numvfs-2: FAIL (0.004s)
[793.518630] Starting dynamic subtest: numvfs-3
[793.587504] Dynamic subtest numvfs-3: FAIL (0.003s)
[793.596777] Starting dynamic subtest: numvfs-4
[793.665028] Dynamic subtest numvfs-4: FAIL (0.003s)
[793.675288] Starting dynamic subtest: numvfs-5
[793.744803] Dynamic subtest numvfs-5: FAIL (0.004s)
[793.754280] Starting dynamic subtest: numvfs-6
[793.823136] Dynamic subtest numvfs-6: FAIL (0.004s)
[793.832807] Starting dynamic subtest: numvfs-7
[793.902695] Dynamic subtest numvfs-7: FAIL (0.004s)
[793.912123] Starting dynamic subtest: numvfs-random
[793.981919] Dynamic subtest numvfs-random: FAIL (0.004s)
[793.997349] Starting dynamic subtest: numvfs-all
[794.068192] Dynamic subtest numvfs-all: FAIL (0.486s)
[794.070310] Subtest enable-vfs-autoprobe-off: FAIL (0.547s)
[794.108098] [115/132] (228s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render)
[794.209098] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render
[794.212432] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[794.321646] [116/132] (228s left) kms_cursor_crc (cursor-tearing-position-change)
[794.444640] Starting subtest: cursor-tearing-position-change
[794.446586] Starting dynamic subtest: pipe-A-eDP-1
[795.012317] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.565s)
[795.022580] Starting dynamic subtest: pipe-D-eDP-1
[796.265797] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.251s)
[796.267677] Subtest cursor-tearing-position-change: SUCCESS (1.819s)
[797.108465] [117/132] (225s left) gem_workarounds (reset-context)
[797.185350] Starting subtest: reset-context
[797.388705] Subtest reset-context: SUCCESS (0.203s)
[797.539856] [118/132] (225s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[797.643768] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip
[797.648412] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[797.744711] [119/132] (225s left) kms_plane_scaling (invalid-parameters)
[797.837972] Starting subtest: invalid-parameters
[797.840410] Starting dynamic subtest: less-than-1-height-src
[797.851865] Dynamic subtest less-than-1-height-src: SUCCESS (0.014s)
[797.862364] Starting dynamic subtest: less-than-1-width-src
[797.867236] Dynamic subtest less-than-1-width-src: SUCCESS (0.013s)
[797.869437] Subtest invalid-parameters: SUCCESS (0.029s)
[797.998869] [120/132] (225s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[798.091350] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[798.093076] Starting dynamic subtest: pipe-A-eDP-1
[798.112136] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[798.125488] Starting dynamic subtest: pipe-B-eDP-1
[798.143428] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[798.154064] Starting dynamic subtest: pipe-C-eDP-1
[798.171980] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[798.182101] Starting dynamic subtest: pipe-D-eDP-1
[798.200338] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[798.203745] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.005s)
[800.363409] [121/132] (222s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[800.482355] Starting subtest: 2x-long-flip-vs-cursor-atomic
[800.487105] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.001s)
[800.655055] [122/132] (222s left) kms_big_fb (4-tiled-32bpp-rotate-90)
[800.756009] Starting subtest: 4-tiled-32bpp-rotate-90
[800.776073] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.019s)
[800.927400] [123/132] (222s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[801.021248] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[801.025335] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[801.135073] [124/132] (222s left) gem_close (many-handles-one-vma)
[801.190163] Starting subtest: many-handles-one-vma
[801.210962] Subtest many-handles-one-vma: SUCCESS (0.024s)
[801.367347] [125/132] (221s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[801.459944] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[801.463257] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[801.565670] [126/132] (221s left) kms_flip (plain-flip-fb-recreate)
[801.663071] Starting subtest: plain-flip-fb-recreate
[801.665041] Starting dynamic subtest: A-eDP1
[810.537063] Dynamic subtest A-eDP1: SUCCESS (8.871s)
[810.547729] Starting dynamic subtest: B-eDP1
[819.371487] Dynamic subtest B-eDP1: SUCCESS (8.831s)
[819.385396] Starting dynamic subtest: C-eDP1
[828.187027] Dynamic subtest C-eDP1: SUCCESS (8.811s)
[828.197368] Starting dynamic subtest: D-eDP1
[837.020666] Dynamic subtest D-eDP1: SUCCESS (8.831s)
[837.024621] Subtest plain-flip-fb-recreate: SUCCESS (35.353s)
[838.218888] [127/132] (185s left) kms_vblank (wait-forked-busy)
[838.314182] Starting subtest: wait-forked-busy
[838.316108] Starting dynamic subtest: pipe-A-eDP-1
[840.198970] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.885s)
[840.213589] Starting dynamic subtest: pipe-D-eDP-1
[842.776685] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.573s)
[842.779018] Subtest wait-forked-busy: SUCCESS (4.462s)
[843.586854] [128/132] (179s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[843.677738] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[843.681792] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[843.797884] [129/132] (179s left) sysfs_timeslice_duration (timeout)
[843.861865] Starting subtest: timeout
[843.864272] Starting dynamic subtest: vecs0
[853.659591] Dynamic subtest vecs0: SUCCESS (9.792s)
[853.672541] Starting dynamic subtest: ccs0
[855.048088] Dynamic subtest ccs0: SUCCESS (1.388s)
[855.059368] Starting dynamic subtest: vcs0
[864.600158] Dynamic subtest vcs0: SUCCESS (9.546s)
[864.612119] Starting dynamic subtest: bcs0
[865.321116] Dynamic subtest bcs0: SUCCESS (0.718s)
[865.331534] Starting dynamic subtest: rcs0
[866.688731] Dynamic subtest rcs0: SUCCESS (1.367s)
[866.701772] Starting dynamic subtest: vcs1
[876.609626] Dynamic subtest vcs1: SUCCESS (9.918s)
[876.612163] Subtest timeout: SUCCESS (32.741s)
[876.716916] [130/132] (146s left) kms_dirtyfb (fbc-dirtyfb-ioctl)
[876.811718] Starting subtest: fbc-dirtyfb-ioctl
[876.813908] Starting dynamic subtest: A-eDP-1
[879.438945] Dynamic subtest A-eDP-1: SUCCESS (2.629s)
[879.441158] Subtest fbc-dirtyfb-ioctl: SUCCESS (2.630s)
[880.242406] [131/132] (143s left) gem_userptr_blits (stress-purge)
[880.313722] Starting subtest: stress-purge
[885.749821] Subtest stress-purge: SUCCESS (5.438s)
[885.901379] [132/132] (137s left) kms_plane_cursor (primary)
[886.038619] Starting subtest: primary
[886.042140] Starting dynamic subtest: pipe-A-eDP-1-size-64
[888.740846] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.701s)
[888.766474] Starting dynamic subtest: pipe-A-eDP-1-size-128
[891.452205] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.693s)
[891.478085] Starting dynamic subtest: pipe-A-eDP-1-size-256
[894.298327] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.828s)
[894.613333] Starting dynamic subtest: pipe-B-eDP-1-size-64
[898.036187] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.435s)
[898.064109] Starting dynamic subtest: pipe-B-eDP-1-size-128
[900.793292] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.737s)
[900.818077] Starting dynamic subtest: pipe-B-eDP-1-size-256
[903.549452] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.738s)
[903.877236] Starting dynamic subtest: pipe-C-eDP-1-size-64
[906.846055] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.979s)
[906.872636] Starting dynamic subtest: pipe-C-eDP-1-size-128
[909.122710] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.258s)
[909.150539] Starting dynamic subtest: pipe-C-eDP-1-size-256
[911.288466] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.147s)
[911.606644] Starting dynamic subtest: pipe-D-eDP-1-size-64
[914.724741] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (3.131s)
[914.752852] Starting dynamic subtest: pipe-D-eDP-1-size-128
[917.082414] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.337s)
[917.108784] Starting dynamic subtest: pipe-D-eDP-1-size-256
[919.491700] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.391s)
[919.809616] Subtest primary: SUCCESS (33.774s)
[920.655914] Closing watchdogs
results: parsing output: 0/ for test: kms_chamelium_hpd
results: parsing output: 1/ for test: gem_exec_create
results: parsing output: 2/ for test: gen9_exec_parse
results: parsing output: 3/ for test: kms_addfb_basic
results: parsing output: 4/ for test: kms_ccs
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: gem_exec_balancer
results: parsing output: 8/ for test: gem_exec_params
results: parsing output: 9/ for test: kms_flip_scaled_crc
results: parsing output: 10/ for test: kms_addfb_basic
results: parsing output: 11/ for test: kms_plane_scaling
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: gem_exec_fence
results: parsing output: 14/ for test: device_reset
results: parsing output: 15/ for test: syncobj_basic
results: parsing output: 16/ for test: gem_exercise_blt
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: gem_mmap_offset
results: parsing output: 19/ for test: kms_content_protection
results: parsing output: 20/ for test: kms_pipe_stress
results: parsing output: 21/ for test: kms_flip
results: parsing output: 22/ for test: gem_render_copy
results: parsing output: 23/ for test: sw_sync
results: parsing output: 24/ for test: gem_madvise
results: parsing output: 25/ for test: kms_addfb_basic
results: parsing output: 26/ for test: kms_rotation_crc
results: parsing output: 27/ for test: gem_mmap_wc
results: parsing output: 28/ for test: kms_invalid_mode
results: parsing output: 29/ for test: kms_flip_scaled_crc
results: parsing output: 30/ for test: kms_chamelium_edid
results: parsing output: 31/ for test: gem_ppgtt
results: parsing output: 32/ for test: kms_dp_link_training
results: parsing output: 33/ for test: kms_flip
results: parsing output: 34/ for test: kms_ccs
results: parsing output: 35/ for test: gem_mmap_wc
results: parsing output: 36/ for test: i915_drm_fdinfo
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: sw_sync
results: parsing output: 39/ for test: gem_exec_schedule
results: parsing output: 40/ for test: api_intel_bb
results: parsing output: 41/ for test: kms_cursor_crc
results: parsing output: 42/ for test: i915_drm_fdinfo
results: parsing output: 43/ for test: syncobj_wait
results: parsing output: 44/ for test: gem_softpin
results: parsing output: 45/ for test: kms_cursor_crc
results: parsing output: 46/ for test: gem_exec_schedule
results: parsing output: 47/ for test: syncobj_wait
results: parsing output: 48/ for test: syncobj_timeline
results: parsing output: 49/ for test: kms_async_flips
results: parsing output: 50/ for test: syncobj_timeline
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_cursor_legacy
results: parsing output: 53/ for test: kms_psr
results: parsing output: 54/ for test: syncobj_timeline
results: parsing output: 55/ for test: gem_bad_reloc
results: parsing output: 56/ for test: gem_exec_gttfill
results: parsing output: 57/ for test: gem_exec_params
results: parsing output: 58/ for test: kms_psr
results: parsing output: 59/ for test: gem_exec_endless
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_psr
results: parsing output: 62/ for test: vgem_basic
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: gem_flink_basic
results: parsing output: 65/ for test: kms_vrr
results: parsing output: 66/ for test: gem_ctx_persistence
results: parsing output: 67/ for test: i915_pm_rpm
results: parsing output: 68/ for test: kms_psr2_sf
results: parsing output: 69/ for test: gem_wait
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_lmem_swapping
results: parsing output: 72/ for test: prime_vgem
results: parsing output: 73/ for test: gem_exec_reloc
results: parsing output: 74/ for test: kms_cdclk
results: parsing output: 75/ for test: kms_psr
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: gem_ccs
results: parsing output: 78/ for test: gem_ctx_isolation
results: parsing output: 79/ for test: kms_sequence
results: parsing output: 80/ for test: kms_big_fb
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_schedule
results: parsing output: 84/ for test: kms_lease
results: parsing output: 85/ for test: kms_flip
results: parsing output: 86/ for test: gem_render_copy
results: parsing output: 87/ for test: perf_pmu
results: parsing output: 88/ for test: gem_mmap_wc
results: parsing output: 89/ for test: kms_ccs
results: parsing output: 90/ for test: kms_prop_blob
results: parsing output: 91/ for test: kms_psr
results: parsing output: 92/ for test: kms_pm_rpm
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: gem_userptr_blits
results: parsing output: 95/ for test: kms_plane_scaling
results: parsing output: 96/ for test: gem_ctx_shared
results: parsing output: 97/ for test: kms_big_fb
results: parsing output: 98/ for test: kms_psr2_sf
results: parsing output: 99/ for test: kms_psr
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: prime_vgem
results: parsing output: 103/ for test: i915_selftest
results: parsing output: 104/ for test: kms_big_fb
results: parsing output: 105/ for test: kms_flip_scaled_crc
results: parsing output: 106/ for test: gem_userptr_blits
results: parsing output: 107/ for test: kms_cursor_legacy
results: parsing output: 108/ for test: gem_softpin
results: parsing output: 109/ for test: gem_exec_schedule
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: gem_softpin
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: sriov_basic
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_cursor_crc
results: parsing output: 116/ for test: gem_workarounds
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: kms_plane_scaling
results: parsing output: 119/ for test: kms_ccs
results: parsing output: 120/ for test: kms_cursor_legacy
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_close
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_flip
results: parsing output: 126/ for test: kms_vblank
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: sysfs_timeslice_duration
results: parsing output: 129/ for test: kms_dirtyfb
results: parsing output: 130/ for test: gem_userptr_blits
results: parsing output: 131/ for test: kms_plane_cursor
Done.