[56.951058] Initializing watchdogs
[56.951105]   /dev/watchdog0
[56.967907] [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]
[56.972396] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.974592] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.978036] [001/133] (960s left) gem_partial_pwrite_pread (write-snoop)
[57.069586] Subtest write-snoop: SKIP (0.000s)
[57.146083] [002/133] (960s left) kms_content_protection (content-type-change)
[57.293071] Starting subtest: content-type-change
[57.297702] Subtest content-type-change: SKIP (0.000s)
[57.436913] [003/133] (960s left) kms_rotation_crc (multiplane-rotation)
[57.528785] Starting subtest: multiplane-rotation
[74.912804] Subtest multiplane-rotation: SUCCESS (17.437s)
[75.049321] [004/133] (942s left) kms_chamelium_color (ctm-red-to-blue)
[75.148159] Subtest ctm-red-to-blue: SKIP (0.000s)
[75.187667] [005/133] (942s left) syncobj_wait (invalid-reset-one-illegal-handle)
[75.248034] Starting subtest: invalid-reset-one-illegal-handle
[75.250054] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[75.373345] [006/133] (942s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[75.461107] Starting subtest: disable-crc-after-crtc
[75.462869] Starting dynamic subtest: pipe-A-eDP-1
[77.125035] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.665s)
[77.133165] Starting dynamic subtest: pipe-B-eDP-1
[79.392228] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.266s)
[79.400980] Starting dynamic subtest: pipe-C-eDP-1
[81.618548] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.223s)
[81.626901] Starting dynamic subtest: pipe-D-eDP-1
[83.877319] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.256s)
[83.879277] Subtest disable-crc-after-crtc: SUCCESS (8.417s)
[84.730366] [007/133] (932s left) gem_set_tiling_vs_blt (tiled-to-tiled)
[84.800651] Subtest tiled-to-tiled: SKIP (0.000s)
[84.889111] [008/133] (932s left) syncobj_wait (wait-all-interrupted)
[84.956430] Starting subtest: wait-all-interrupted
[85.057945] Subtest wait-all-interrupted: SUCCESS (0.103s)
[85.157132] [009/133] (932s left) syncobj_wait (wait-all-complex)
[85.228728] Starting subtest: wait-all-complex
[85.441262] Subtest wait-all-complex: SUCCESS (0.212s)
[85.542196] [010/133] (932s left) gem_pxp (reject-modify-context-protection-on)
[85.679827] Starting subtest: reject-modify-context-protection-on
[85.682420] Subtest reject-modify-context-protection-on: SUCCESS (0.002s)
[85.831946] [011/133] (932s left) kms_cursor_legacy (cursora-vs-flipb-varying-size)
[85.971634] Starting subtest: cursorA-vs-flipB-varying-size
[85.976340] Subtest cursorA-vs-flipB-varying-size: SKIP (0.001s)
[86.133365] [012/133] (931s left) kms_rotation_crc (primary-rotation-90)
[86.237158] Starting subtest: primary-rotation-90
[86.241602] Subtest primary-rotation-90: SKIP (0.001s)
[86.334615] [013/133] (931s left) syncobj_wait (reset-multiple-signaled)
[86.392800] Starting subtest: reset-multiple-signaled
[86.395118] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[86.522803] [014/133] (931s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[86.611050] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[86.615142] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[87.766289] [015/133] (930s left) gem_softpin (noreloc-s3)
[87.835409] Starting subtest: noreloc-S3
[107.282215] Subtest noreloc-S3: SUCCESS (5.405s)
[107.471790] [016/133] (910s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[107.616453] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[112.023453] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.483s)
[113.245642] [017/133] (904s left) gem_ctx_param (invalid-ctx-set)
[113.309110] Starting subtest: invalid-ctx-set
[113.311301] Subtest invalid-ctx-set: SUCCESS (0.001s)
[113.462568] [018/133] (904s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[113.524741] Starting subtest: single-wait-all-for-submit-unsubmitted
[113.626369] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.103s)
[113.742859] [019/133] (904s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[113.844332] Starting subtest: x-tiled-64bpp-rotate-90
[113.863955] Subtest x-tiled-64bpp-rotate-90: SKIP (0.019s)
[114.002683] [020/133] (904s left) gem_mmap_gtt (cpuset-basic-small-copy-xy)
[114.062699] Subtest cpuset-basic-small-copy-XY: SKIP (0.000s)
[114.127750] [021/133] (904s left) kms_psr (fbc-psr-cursor-plane-move)
[114.230570] Starting subtest: fbc-psr-cursor-plane-move
[114.232836] Starting dynamic subtest: eDP-1
[114.237172] Dynamic subtest eDP-1: SKIP (0.000s)
[114.241625] Subtest fbc-psr-cursor-plane-move: SKIP (0.001s)
[114.324203] [022/133] (904s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[114.439453] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[115.444185] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.012s)
[115.598801] [023/133] (902s left) kms_flip (2x-flip-vs-rmfb)
[115.689703] Starting subtest: 2x-flip-vs-rmfb
[115.698753] Subtest 2x-flip-vs-rmfb: SKIP (0.011s)
[115.832011] [024/133] (902s left) kms_plane_cursor (viewport)
[115.920938] Starting subtest: viewport
[115.924526] Starting dynamic subtest: pipe-A-eDP-1-size-64
[118.480538] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.575s)
[118.543183] Starting dynamic subtest: pipe-A-eDP-1-size-128
[121.091538] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.570s)
[121.151168] Starting dynamic subtest: pipe-A-eDP-1-size-256
[123.728549] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.593s)
[124.095612] Starting dynamic subtest: pipe-B-eDP-1-size-64
[127.305465] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.227s)
[127.365003] Starting dynamic subtest: pipe-B-eDP-1-size-128
[129.868517] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.514s)
[129.930470] Starting dynamic subtest: pipe-B-eDP-1-size-256
[132.597171] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.681s)
[132.948960] Starting dynamic subtest: pipe-C-eDP-1-size-64
[135.841600] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.905s)
[135.882135] Starting dynamic subtest: pipe-C-eDP-1-size-128
[138.076961] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.201s)
[138.114416] Starting dynamic subtest: pipe-C-eDP-1-size-256
[140.278497] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.169s)
[140.622030] Starting dynamic subtest: pipe-D-eDP-1-size-64
[143.536392] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.924s)
[143.574234] Starting dynamic subtest: pipe-D-eDP-1-size-128
[145.792981] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.224s)
[145.830986] Starting dynamic subtest: pipe-D-eDP-1-size-256
[147.994002] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.169s)
[148.324202] Subtest viewport: SUCCESS (32.455s)
[149.176272] [025/133] (869s left) kms_cdclk (mode-transition)
[149.287238] Starting subtest: mode-transition
[149.289689] Starting dynamic subtest: pipe-A-eDP-1
[149.576548] Dynamic subtest pipe-A-eDP-1: SKIP (0.288s)
[149.588718] Starting dynamic subtest: pipe-B-eDP-1
[149.593414] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[149.603663] Starting dynamic subtest: pipe-C-eDP-1
[149.608053] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[149.616656] Starting dynamic subtest: pipe-D-eDP-1
[149.620881] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[149.625299] Subtest mode-transition: SKIP (0.296s)
[150.394894] [026/133] (868s left) gem_exec_balancer (fairslice)
[150.467544] Starting subtest: fairslice
[153.365277] Subtest fairslice: SUCCESS (2.896s)
[154.091637] [027/133] (864s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[154.214757] Starting subtest: basic-flip-before-cursor-varying-size
[155.142090] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.927s)
[156.025774] [028/133] (862s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[156.118458] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[156.120639] Starting dynamic subtest: pipe-A-default-mode
[156.413039] Dynamic subtest pipe-A-default-mode: SKIP (0.292s)
[156.417852] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.294s)
[157.247811] [029/133] (861s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[157.355201] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[157.357567] Starting dynamic subtest: pipe-A-default-mode
[160.065925] Dynamic subtest pipe-A-default-mode: SUCCESS (2.709s)
[160.068208] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.711s)
[160.938098] [030/133] (857s left) core_getstats (basic)
[161.005716] Starting subtest: basic
[161.008106] Subtest basic: SUCCESS (0.000s)
[161.138350] [031/133] (857s left) kms_rmfb (close-fd)
[161.244573] Starting subtest: close-fd
[161.246852] Starting dynamic subtest: pipe-A-eDP-1
[161.354392] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.109s)
[161.370850] Starting dynamic subtest: pipe-B-eDP-1
[162.584671] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.229s)
[162.593700] Starting dynamic subtest: pipe-C-eDP-1
[163.722378] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.137s)
[163.731556] Starting dynamic subtest: pipe-D-eDP-1
[164.844555] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.118s)
[164.846376] Subtest close-fd: SUCCESS (3.601s)
[166.088836] [032/133] (852s left) gem_exec_reloc (basic-gtt-wc)
[166.157525] Subtest basic-gtt-wc: SKIP (0.000s)
[166.240851] [033/133] (852s left) kms_properties (crtc-properties-legacy)
[166.334716] Starting subtest: crtc-properties-legacy
[166.336965] Starting dynamic subtest: pipe-A-eDP-1
[166.790102] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.454s)
[166.799655] Starting dynamic subtest: pipe-B-eDP-1
[167.934496] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.143s)
[167.943765] Starting dynamic subtest: pipe-C-eDP-1
[169.060884] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.125s)
[169.069961] Starting dynamic subtest: pipe-D-eDP-1
[170.171222] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.111s)
[170.173665] Subtest crtc-properties-legacy: SUCCESS (3.839s)
[171.007952] [034/133] (847s left) kms_invalid_mode (zero-hdisplay)
[171.118856] Starting subtest: zero-hdisplay
[171.121160] Starting dynamic subtest: pipe-A-eDP-1
[171.403451] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[171.412697] Starting dynamic subtest: pipe-B-eDP-1
[171.414784] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[171.422999] Starting dynamic subtest: pipe-C-eDP-1
[171.425188] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[171.433282] Starting dynamic subtest: pipe-D-eDP-1
[171.435546] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[171.437703] Subtest zero-hdisplay: SUCCESS (0.291s)
[172.238800] [035/133] (846s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[172.338901] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[172.341224] Starting dynamic subtest: pipe-A
[173.385808] Dynamic subtest pipe-A: SUCCESS (1.050s)
[173.394173] Starting dynamic subtest: pipe-B
[175.522882] Dynamic subtest pipe-B: SUCCESS (2.137s)
[175.533247] Starting dynamic subtest: pipe-C
[176.711630] Dynamic subtest pipe-C: SUCCESS (1.188s)
[176.725014] Starting dynamic subtest: pipe-D
[177.942564] Dynamic subtest pipe-D: SUCCESS (1.230s)
[177.944683] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (5.609s)
[179.159506] [036/133] (839s left) kms_pm_rpm (legacy-planes-dpms)
[181.185683] Starting subtest: legacy-planes-dpms
[181.188460] Starting dynamic subtest: plane-63
[189.789835] Dynamic subtest plane-63: SUCCESS (8.606s)
[189.801257] Starting dynamic subtest: plane-93
[198.515963] Dynamic subtest plane-93: SUCCESS (8.727s)
[198.526458] Starting dynamic subtest: plane-123
[206.801827] Dynamic subtest plane-123: SUCCESS (8.278s)
[206.814511] Starting dynamic subtest: plane-133
[215.071015] Dynamic subtest plane-133: SUCCESS (8.263s)
[215.073585] Subtest legacy-planes-dpms: SUCCESS (33.885s)
[215.501411] [037/133] (803s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[215.617739] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[215.621791] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[215.741021] [038/133] (803s left) kms_dirtyfb (default-dirtyfb-ioctl)
[215.840587] Starting subtest: default-dirtyfb-ioctl
[215.842771] Starting dynamic subtest: A-eDP-1
[217.443796] Dynamic subtest A-eDP-1: SUCCESS (1.604s)
[217.446452] Subtest default-dirtyfb-ioctl: SUCCESS (1.605s)
[218.315840] [039/133] (800s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[218.435027] Starting subtest: cursorB-vs-flipA-legacy
[218.439635] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s)
[218.601308] [040/133] (800s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[218.663049] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[218.665282] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[218.792202] [041/133] (800s left) kms_prime (basic-crc-vgem)
[218.922868] Starting subtest: basic-crc-vgem
[218.924893] Starting dynamic subtest: second-to-first
[219.868260] Dynamic subtest second-to-first: SUCCESS (0.947s)
[219.870206] Subtest basic-crc-vgem: SUCCESS (0.948s)
[219.982717] [FACT kms_prime (basic-crc-vgem)] new: kernel.kmod_is_loaded.vgem: true
[219.987748] [042/133] (799s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[220.108815] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[220.180114] [043/133] (799s left) i915_drm_fdinfo (busy)
[220.222075] Starting subtest: busy
[220.224145] Starting dynamic subtest: rcs0
[220.263920] Dynamic subtest rcs0: SKIP (0.039s)
[220.274940] Starting dynamic subtest: bcs0
[220.278517] Dynamic subtest bcs0: SKIP (0.000s)
[220.286521] Starting dynamic subtest: vcs0
[220.289957] Dynamic subtest vcs0: SKIP (0.000s)
[220.298380] Starting dynamic subtest: vcs1
[220.301977] Dynamic subtest vcs1: SKIP (0.000s)
[220.310930] Starting dynamic subtest: vecs0
[220.314461] Dynamic subtest vecs0: SKIP (0.000s)
[220.322432] Starting dynamic subtest: ccs0
[220.326016] Dynamic subtest ccs0: SKIP (0.000s)
[220.329561] Subtest busy: SKIP (0.046s)
[220.364445] [044/133] (798s left) gem_userptr_blits (nohangcheck)
[220.441867] Starting subtest: nohangcheck
[220.727343] Subtest nohangcheck: SUCCESS (0.284s)
[220.891383] [045/133] (798s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[221.007404] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[221.620150] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.614s)
[221.859309] [046/133] (797s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[221.946879] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[221.951606] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[223.150848] [047/133] (796s left) kms_scaling_modes (scaling-mode-full)
[223.244473] Starting subtest: scaling-mode-full
[223.246337] Starting dynamic subtest: pipe-A-eDP-1
[223.337803] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.094s)
[223.347160] Starting dynamic subtest: pipe-B-eDP-1
[224.557781] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.218s)
[224.566991] Starting dynamic subtest: pipe-C-eDP-1
[225.662377] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.103s)
[225.671721] Starting dynamic subtest: pipe-D-eDP-1
[226.794516] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.130s)
[226.797248] Subtest scaling-mode-full: SUCCESS (3.553s)
[227.989977] [048/133] (791s left) kms_psr (fbc-pr-basic)
[228.094898] Starting subtest: fbc-pr-basic
[228.099104] Subtest fbc-pr-basic: SKIP (0.000s)
[228.195074] [049/133] (791s left) gem_ringfill (basic-all)
[234.043532] Starting subtest: basic-all
[235.195764] Subtest basic-all: SUCCESS (1.152s)
[235.373536] [050/133] (784s left) gem_exec_whisper (basic-fds-forked-all)
[235.445614] Starting subtest: basic-fds-forked-all
[257.122691] Subtest basic-fds-forked-all: SUCCESS (21.673s)
[257.330611] [051/133] (762s left) api_intel_bb (full-batch)
[257.387279] Starting subtest: full-batch
[257.396203] Subtest full-batch: SUCCESS (0.012s)
[257.570911] [052/133] (761s left) kms_cursor_crc (cursor-sliding-256x85)
[257.818800] Starting subtest: cursor-sliding-256x85
[257.877812] Subtest cursor-sliding-256x85: SKIP (0.053s)
[258.073068] [053/133] (761s left) kms_ccs (crc-sprite-planes-basic-y-tiled-ccs)
[258.167572] Starting subtest: crc-sprite-planes-basic-y-tiled-ccs
[258.169946] Starting dynamic subtest: pipe-A-eDP-1
[258.229574] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[258.241210] Starting dynamic subtest: pipe-B-eDP-1
[258.292226] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[258.303887] Starting dynamic subtest: pipe-C-eDP-1
[258.350872] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[258.360852] Starting dynamic subtest: pipe-D-eDP-1
[258.409858] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[258.413320] Subtest crc-sprite-planes-basic-y-tiled-ccs: SKIP (0.009s)
[260.446570] [054/133] (759s left) gen9_exec_parse (allowed-single)
[260.518004] Subtest allowed-single: SKIP (0.000s)
[260.608951] [055/133] (759s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[260.720931] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[267.778932] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.061s)
[267.961977] [056/133] (751s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[268.056464] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[268.061032] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[268.184839] [057/133] (751s left) gem_exec_fence (expired-history)
[268.669468] Starting subtest: expired-history
[275.773059] Subtest expired-history: SUCCESS (7.104s)
[276.634204] [058/133] (743s left) kms_psr (fbc-psr-sprite-plane-move)
[276.748611] Starting subtest: fbc-psr-sprite-plane-move
[276.750869] Starting dynamic subtest: eDP-1
[276.755163] Dynamic subtest eDP-1: SKIP (0.000s)
[276.759545] Subtest fbc-psr-sprite-plane-move: SKIP (0.001s)
[276.861895] [059/133] (743s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[276.963242] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[283.731713] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.772s)
[283.880212] [060/133] (736s left) gem_ctx_bad_destroy (double-destroy)
[283.941272] Starting subtest: double-destroy
[283.943613] Subtest double-destroy: SUCCESS (0.000s)
[284.051386] [061/133] (735s left) syncobj_timeline (invalid-signal-illegal-handle)
[284.111545] Starting subtest: invalid-signal-illegal-handle
[284.113728] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[284.249104] [062/133] (735s left) kms_chamelium_hpd (common-hpd-after-suspend)
[284.642318] Subtest common-hpd-after-suspend: SKIP (0.000s)
[285.455595] [063/133] (734s left) kms_frontbuffer_tracking (fbc-tiling-4)
[285.567428] Starting subtest: fbc-tiling-4
[289.810022] Subtest fbc-tiling-4: SUCCESS (4.247s)
[291.003112] [064/133] (729s left) gem_cs_tlb (engines)
[291.055685] Starting subtest: engines
[291.057928] Starting dynamic subtest: rcs0
[293.209976] Dynamic subtest rcs0: SUCCESS (2.151s)
[293.219407] Starting dynamic subtest: bcs0
[295.361070] Dynamic subtest bcs0: SUCCESS (2.151s)
[295.373166] Starting dynamic subtest: vcs0
[297.514236] Dynamic subtest vcs0: SUCCESS (2.152s)
[297.525227] Starting dynamic subtest: vcs1
[299.665573] Dynamic subtest vcs1: SUCCESS (2.151s)
[299.675585] Starting dynamic subtest: vecs0
[301.818241] Dynamic subtest vecs0: SUCCESS (2.151s)
[301.827988] Starting dynamic subtest: ccs0
[303.971958] Dynamic subtest ccs0: SUCCESS (2.154s)
[303.974122] Subtest engines: SUCCESS (12.916s)
[304.143161] [065/133] (716s left) gem_mmap_gtt (hang-busy)
[304.198368] Subtest hang-busy: SKIP (0.000s)
[304.260757] [066/133] (715s left) kms_psr (psr2-sprite-plane-onoff)
[304.357382] Starting subtest: psr2-sprite-plane-onoff
[304.359689] Starting dynamic subtest: eDP-1
[306.100521] Dynamic subtest eDP-1: SUCCESS (1.743s)
[306.102816] Subtest psr2-sprite-plane-onoff: SUCCESS (1.744s)
[306.954278] [067/133] (713s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[307.054932] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[307.668506] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.614s)
[307.878656] [068/133] (712s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[307.971921] Starting subtest: y-tiled-64bpp-rotate-270
[307.976231] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[308.106531] [069/133] (712s left) gem_bad_reloc (negative-reloc-lut)
[308.176837] Subtest negative-reloc-lut: SKIP (0.000s)
[308.260858] [070/133] (712s left) gem_ctx_persistence (engines-mixed)
[308.322302] Starting subtest: engines-mixed
[308.324673] Starting dynamic subtest: rcs0
[308.437456] Dynamic subtest rcs0: SUCCESS (0.114s)
[308.450163] Starting dynamic subtest: bcs0
[308.512824] Dynamic subtest bcs0: SUCCESS (0.073s)
[308.525676] Starting dynamic subtest: vcs0
[308.587311] Dynamic subtest vcs0: SUCCESS (0.073s)
[308.599509] Starting dynamic subtest: vcs1
[308.670017] Dynamic subtest vcs1: SUCCESS (0.081s)
[308.681963] Starting dynamic subtest: vecs0
[308.743092] Dynamic subtest vecs0: SUCCESS (0.071s)
[308.754817] Starting dynamic subtest: ccs0
[308.820139] Dynamic subtest ccs0: SUCCESS (0.075s)
[308.822712] Subtest engines-mixed: SUCCESS (0.499s)
[308.927909] [071/133] (711s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25)
[309.030984] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25
[309.032785] Starting dynamic subtest: pipe-A
[309.097559] Dynamic subtest pipe-A: SUCCESS (0.067s)
[309.108577] Starting dynamic subtest: pipe-B
[310.252401] Dynamic subtest pipe-B: SUCCESS (1.153s)
[310.264343] Starting dynamic subtest: pipe-C
[311.361439] Dynamic subtest pipe-C: SUCCESS (1.108s)
[311.372199] Starting dynamic subtest: pipe-D
[312.488683] Dynamic subtest pipe-D: SUCCESS (1.126s)
[312.490970] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.460s)
[313.675902] [072/133] (706s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[313.774737] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[313.778820] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[313.915970] [073/133] (706s left) gem_exec_schedule (semaphore-noskip)
[313.994203] Starting subtest: semaphore-noskip
[314.411283] Subtest semaphore-noskip: SUCCESS (0.420s)
[314.778330] [074/133] (705s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[314.881825] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[314.885832] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[315.016538] [075/133] (705s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[315.124186] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[315.128156] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[315.254659] [076/133] (705s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[315.347698] Starting subtest: 4-tiled-16bpp-rotate-0
[316.671038] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.323s)
[316.826822] [077/133] (703s left) gem_exec_basic (basic)
[316.885657] Starting subtest: basic
[316.887722] Starting dynamic subtest: rcs0-smem
[316.889671] Dynamic subtest rcs0-smem: SUCCESS (0.004s)
[316.900322] Starting dynamic subtest: bcs0-smem
[316.902245] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[316.911462] Starting dynamic subtest: vcs0-smem
[316.913404] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[316.922976] Starting dynamic subtest: vcs1-smem
[316.924793] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[316.933830] Starting dynamic subtest: vecs0-smem
[316.935638] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[316.944734] Starting dynamic subtest: ccs0-smem
[316.946556] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[316.948378] Subtest basic: SUCCESS (0.014s)
[318.069100] [078/133] (702s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[318.176475] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[318.180906] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[318.304703] [079/133] (702s left) gem_mmap (short-mmap)
[318.363974] Subtest short-mmap: SKIP (0.000s)
[318.425387] [080/133] (702s left) gem_exec_reloc (basic-gtt-wc-active)
[318.489066] Subtest basic-gtt-wc-active: SKIP (0.000s)
[318.578164] [081/133] (702s left) gem_ctx_shared (create-shared-gtt)
[318.634062] Starting subtest: create-shared-gtt
[320.786306] Subtest create-shared-gtt: SUCCESS (2.151s)
[321.199520] [082/133] (699s left) gem_exec_reloc (basic-write-wc)
[321.288227] Subtest basic-write-wc: SKIP (0.000s)
[321.368746] [083/133] (699s left) gem_eio (wait-immediate)
[321.622156] Starting subtest: wait-immediate
[322.023951] Subtest wait-immediate: SUCCESS (0.404s)
[322.202000] [084/133] (698s left) gem_ctx_persistence (legacy-engines-mixed)
[322.270399] Starting subtest: legacy-engines-mixed
[322.272402] Starting dynamic subtest: render
[322.395885] Dynamic subtest render: SUCCESS (0.125s)
[322.410152] Starting dynamic subtest: bsd1
[322.464060] Dynamic subtest bsd1: SUCCESS (0.064s)
[322.478104] Starting dynamic subtest: bsd2
[322.545236] Dynamic subtest bsd2: SUCCESS (0.078s)
[322.558303] Starting dynamic subtest: blt
[322.626117] Dynamic subtest blt: SUCCESS (0.078s)
[322.639497] Starting dynamic subtest: vebox
[322.705113] Dynamic subtest vebox: SUCCESS (0.075s)
[322.707875] Subtest legacy-engines-mixed: SUCCESS (0.435s)
[322.814918] [085/133] (698s left) perf_pmu (semaphore-busy)
[322.861166] Starting subtest: semaphore-busy
[322.863020] Starting dynamic subtest: rcs0
[324.532758] Dynamic subtest rcs0: SUCCESS (1.666s)
[324.545548] Starting dynamic subtest: bcs0
[326.164745] Dynamic subtest bcs0: SUCCESS (1.631s)
[326.177713] Starting dynamic subtest: vcs0
[330.545462] Dynamic subtest vcs0: SUCCESS (4.378s)
[330.558049] Starting dynamic subtest: vcs1
[336.497779] Dynamic subtest vcs1: SUCCESS (5.947s)
[336.509570] Starting dynamic subtest: vecs0
[342.514138] Dynamic subtest vecs0: SUCCESS (6.012s)
[342.526094] Starting dynamic subtest: ccs0
[345.587526] Dynamic subtest ccs0: SUCCESS (3.070s)
[345.590093] Subtest semaphore-busy: SUCCESS (22.721s)
[345.726306] [086/133] (675s left) gem_exec_schedule (pi-common)
[345.922130] Starting subtest: pi-common
[345.924873] Starting dynamic subtest: rcs0
[345.960830] Dynamic subtest rcs0: SUCCESS (0.042s)
[345.972053] Starting dynamic subtest: bcs0
[346.000307] Dynamic subtest bcs0: SUCCESS (0.039s)
[346.010365] Starting dynamic subtest: vcs0
[346.039349] Dynamic subtest vcs0: SUCCESS (0.038s)
[346.049475] Starting dynamic subtest: vcs1
[346.072300] Dynamic subtest vcs1: SUCCESS (0.032s)
[346.082520] Starting dynamic subtest: vecs0
[346.110199] Dynamic subtest vecs0: SUCCESS (0.037s)
[346.120395] Starting dynamic subtest: ccs0
[346.142657] Dynamic subtest ccs0: SUCCESS (0.032s)
[346.144910] Subtest pi-common: SUCCESS (0.225s)
[346.381881] [087/133] (674s left) i915_hangman (engine-error-state-capture)
[346.447060] Starting subtest: engine-error-state-capture
[346.449434] Starting dynamic subtest: rcs0
[349.973875] Dynamic subtest rcs0: SUCCESS (3.526s)
[349.986969] Starting dynamic subtest: bcs0
[355.989878] Dynamic subtest bcs0: SUCCESS (6.012s)
[356.003544] Starting dynamic subtest: vcs0
[361.942096] Dynamic subtest vcs0: SUCCESS (5.949s)
[361.955021] Starting dynamic subtest: vcs1
[366.933046] Dynamic subtest vcs1: SUCCESS (4.988s)
[366.945894] Starting dynamic subtest: vecs0
[370.965436] Dynamic subtest vecs0: SUCCESS (4.029s)
[370.978389] Starting dynamic subtest: ccs0
[376.981295] Dynamic subtest ccs0: SUCCESS (6.012s)
[376.984155] Subtest engine-error-state-capture: SUCCESS (30.533s)
[377.093408] [088/133] (644s left) syncobj_timeline (wait-for-submit-snapshot)
[377.157044] Starting subtest: wait-for-submit-snapshot
[377.238155] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[377.344345] [089/133] (643s left) kms_color (ctm-blue-to-red)
[377.448255] Starting subtest: ctm-blue-to-red
[377.450068] Starting dynamic subtest: pipe-A-eDP-1
[378.139837] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.692s)
[378.150686] Starting dynamic subtest: pipe-B-eDP-1
[379.543593] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.402s)
[379.553523] Starting dynamic subtest: pipe-C-eDP-1
[380.878638] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.336s)
[380.889540] Starting dynamic subtest: pipe-D-eDP-1
[382.219986] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.339s)
[382.222453] Subtest ctm-blue-to-red: SUCCESS (4.773s)
[383.079655] [090/133] (638s left) prime_vgem (basic-gtt)
[383.166159] Starting subtest: basic-gtt
[383.170811] Subtest basic-gtt: SKIP (0.000s)
[383.310827] [091/133] (637s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[383.403041] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[390.827703] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.426s)
[390.999441] [092/133] (630s left) api_intel_allocator (default-alignment)
[391.071030] Starting subtest: default-alignment
[391.073457] Subtest default-alignment: SUCCESS (0.003s)
[391.245745] [093/133] (630s left) i915_pm_rps (fence-order)
[391.313953] Starting subtest: fence-order
[394.294660] Subtest fence-order: SUCCESS (2.983s)
[394.461851] [094/133] (626s left) kms_vblank (query-busy)
[394.549662] Starting subtest: query-busy
[394.551898] Starting dynamic subtest: pipe-A-eDP-1
[396.423634] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.873s)
[396.439322] Starting dynamic subtest: pipe-D-eDP-1
[399.037364] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.611s)
[399.039894] Subtest query-busy: SUCCESS (4.489s)
[399.862088] [095/133] (621s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[399.973420] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[399.977740] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[400.094349] [096/133] (621s left) kms_addfb_basic (invalid-get-prop-any)
[400.162077] Starting subtest: invalid-get-prop-any
[400.164053] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[400.341549] [097/133] (621s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[400.446663] Starting subtest: fbc-psr2-cursor-mmap-gtt
[400.448892] Starting dynamic subtest: eDP-1
[400.453078] Dynamic subtest eDP-1: SKIP (0.000s)
[400.457193] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.001s)
[400.546805] [098/133] (621s left) kms_flip (2x-blocking-absolute-wf_vblank)
[400.633260] Starting subtest: 2x-blocking-absolute-wf_vblank
[400.643076] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.011s)
[400.781496] [099/133] (620s left) kms_cursor_crc (cursor-onscreen-256x85)
[401.051836] Starting subtest: cursor-onscreen-256x85
[401.102555] Subtest cursor-onscreen-256x85: SKIP (0.045s)
[401.324861] [100/133] (620s left) kms_flip (2x-modeset-vs-vblank-race)
[401.428869] Starting subtest: 2x-modeset-vs-vblank-race
[401.440558] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[401.547525] [101/133] (620s left) kms_atomic_interruptible (atomic-setmode)
[401.642097] Starting subtest: atomic-setmode
[401.643973] Starting dynamic subtest: pipe-A-eDP-1
[408.559525] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.915s)
[408.561465] Subtest atomic-setmode: SUCCESS (6.916s)
[409.461165] [102/133] (612s left) kms_frontbuffer_tracking (psr-argb161616f-draw-render)
[409.572774] Starting subtest: psr-argb161616f-draw-render
[409.576878] Subtest psr-argb161616f-draw-render: SKIP (0.000s)
[409.701380] [103/133] (612s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[409.802998] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[409.807330] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[409.946232] [104/133] (611s left) kms_plane_scaling (invalid-num-scalers)
[410.043123] Starting subtest: invalid-num-scalers
[410.045442] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[410.063087] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.020s)
[410.074972] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[410.098438] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.032s)
[410.108875] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[410.132416] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.033s)
[410.142507] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[410.166340] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.033s)
[410.168612] Subtest invalid-num-scalers: SUCCESS (0.125s)
[410.308629] [105/133] (611s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[410.407451] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[410.410769] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[410.562185] [106/133] (611s left) sw_sync (alloc_fence_invalid_timeline)
[410.596044] Starting subtest: alloc_fence_invalid_timeline
[410.597784] Subtest alloc_fence_invalid_timeline: SUCCESS (0.000s)
[410.675631] [107/133] (611s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[410.725397] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[410.835365] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.108s)
[410.940776] [108/133] (611s left) kms_flip (flip-vs-absolute-wf_vblank-interruptible)
[411.040801] Starting subtest: flip-vs-absolute-wf_vblank-interruptible
[411.043160] Starting dynamic subtest: A-eDP1
[419.977341] Dynamic subtest A-eDP1: SUCCESS (8.937s)
[419.993789] Starting dynamic subtest: B-eDP1
[428.911652] Dynamic subtest B-eDP1: SUCCESS (8.932s)
[428.924569] Starting dynamic subtest: C-eDP1
[437.831831] Dynamic subtest C-eDP1: SUCCESS (8.918s)
[437.845674] Starting dynamic subtest: D-eDP1
[446.756016] Dynamic subtest D-eDP1: SUCCESS (8.923s)
[446.761357] Subtest flip-vs-absolute-wf_vblank-interruptible: SUCCESS (35.723s)
[448.008842] [109/133] (574s left) kms_addfb_basic (size-max)
[448.112426] Starting subtest: size-max
[448.114368] Subtest size-max: SUCCESS (0.000s)
[448.239901] [110/133] (573s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[448.487854] Starting subtest: cursor-rapid-movement-256x256
[448.492568] Starting dynamic subtest: pipe-A-eDP-1
[449.036078] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.541s)
[449.077351] Starting dynamic subtest: pipe-D-eDP-1
[450.289372] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.234s)
[450.291770] Subtest cursor-rapid-movement-256x256: SUCCESS (1.802s)
[451.174252] [111/133] (570s left) gem_exec_whisper (basic-queues-all)
[451.237266] Starting subtest: basic-queues-all
[459.711545] Subtest basic-queues-all: SUCCESS (8.472s)
[459.924335] [112/133] (562s left) kms_dsc (dsc-fractional-bpp)
[460.031664] Starting subtest: dsc-fractional-bpp
[460.045572] Subtest dsc-fractional-bpp: SKIP (0.001s)
[460.130064] [113/133] (562s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[460.210036] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[460.212368] Starting dynamic subtest: pipe-A-default-mode
[460.501981] Dynamic subtest pipe-A-default-mode: SKIP (0.287s)
[460.506852] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.289s)
[461.395837] [114/133] (560s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[461.499701] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[461.504116] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[461.616135] [115/133] (560s left) gem_softpin (evict-prime)
[461.680832] Starting subtest: evict-prime
[461.683258] Starting dynamic subtest: rcs0
[462.877715] Dynamic subtest rcs0: SUCCESS (1.197s)
[462.891371] Starting dynamic subtest: bcs0
[464.044480] Dynamic subtest bcs0: SUCCESS (1.165s)
[464.057319] Starting dynamic subtest: vcs0
[465.978901] Dynamic subtest vcs0: SUCCESS (1.931s)
[465.991053] Starting dynamic subtest: vcs1
[468.000624] Dynamic subtest vcs1: SUCCESS (2.019s)
[468.013636] Starting dynamic subtest: vecs0
[470.021449] Dynamic subtest vecs0: SUCCESS (2.019s)
[470.035046] Starting dynamic subtest: ccs0
[471.178932] Dynamic subtest ccs0: SUCCESS (1.157s)
[471.192185] Starting dynamic subtest: all
[472.954793] Dynamic subtest all: SUCCESS (1.773s)
[472.957446] Subtest evict-prime: SUCCESS (11.276s)
[473.063081] [116/133] (549s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[473.173251] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[473.177667] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[473.317302] [117/133] (549s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[473.419715] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s)
[473.568558] [118/133] (548s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[473.629041] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[473.729948] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.102s)
[473.831674] [119/133] (548s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[473.930912] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[473.935292] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[474.059325] [120/133] (548s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move)
[474.168952] Starting subtest: fbc-1p-primscrn-cur-indfb-move
[478.281217] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (4.115s)
[479.478944] [121/133] (543s left) gem_mmap_wc (bad-size)
[479.547257] Subtest bad-size: SKIP (0.000s)
[479.630851] [122/133] (542s left) kms_hdr (static-toggle-suspend)
[479.724683] Starting subtest: static-toggle-suspend
[479.730789] Subtest static-toggle-suspend: SKIP (0.000s)
[479.822734] [123/133] (542s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[479.937317] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[479.941307] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[480.055459] [124/133] (542s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[485.049870] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf
[485.052217] Starting dynamic subtest: pipe-A-eDP-1
[485.860476] Dynamic subtest pipe-A-eDP-1: SKIP (0.806s)
[485.871572] Starting dynamic subtest: pipe-B-eDP-1
[486.989734] Dynamic subtest pipe-B-eDP-1: SKIP (1.127s)
[486.994219] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.938s)
[488.186302] [125/133] (534s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[488.301683] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[488.305816] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[488.439920] [126/133] (534s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[488.548214] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[488.550058] Starting dynamic subtest: pipe-A-eDP-1
[488.569494] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[488.580335] Starting dynamic subtest: pipe-B-eDP-1
[488.599081] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[488.608561] Starting dynamic subtest: pipe-C-eDP-1
[488.626751] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[488.635870] Starting dynamic subtest: pipe-D-eDP-1
[488.654209] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[488.656080] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.008s)
[490.852230] [127/133] (531s left) syncobj_timeline (single-wait-all-available-submitted)
[490.922361] Starting subtest: single-wait-all-available-submitted
[490.924641] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[491.065961] [128/133] (531s left) gem_exec_parallel (userptr)
[491.131305] Starting subtest: userptr
[491.133560] Starting dynamic subtest: rcs0
[492.608440] Dynamic subtest rcs0: SUCCESS (1.477s)
[492.621549] Starting dynamic subtest: bcs0
[494.102381] Dynamic subtest bcs0: SUCCESS (1.492s)
[494.115470] Starting dynamic subtest: vcs0
[496.017220] Dynamic subtest vcs0: SUCCESS (1.913s)
[496.028801] Starting dynamic subtest: vcs1
[498.039187] Dynamic subtest vcs1: SUCCESS (2.019s)
[498.052369] Starting dynamic subtest: vecs0
[499.968218] Dynamic subtest vecs0: SUCCESS (1.927s)
[499.980939] Starting dynamic subtest: ccs0
[501.467379] Dynamic subtest ccs0: SUCCESS (1.498s)
[501.469874] Subtest userptr: SUCCESS (10.338s)
[501.677733] [129/133] (521s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[501.798887] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[501.802960] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[501.915292] [130/133] (521s left) i915_selftest (mock)
[505.506440] Starting subtest: mock
[505.508684] Starting dynamic subtest: sanitycheck
[506.250820] Dynamic subtest sanitycheck: SUCCESS (0.745s)
[506.267247] Starting dynamic subtest: shmem
[506.962795] Dynamic subtest shmem: SUCCESS (0.710s)
[506.971078] Starting dynamic subtest: fence
[515.176835] Dynamic subtest fence: SUCCESS (8.212s)
[515.186917] Starting dynamic subtest: scatterlist
[516.931257] Dynamic subtest scatterlist: SUCCESS (1.753s)
[516.941550] Starting dynamic subtest: syncmap
[520.773524] Dynamic subtest syncmap: SUCCESS (3.841s)
[520.783885] Starting dynamic subtest: uncore
[521.514679] Dynamic subtest uncore: SUCCESS (0.740s)
[521.524903] Starting dynamic subtest: ring
[522.275705] Dynamic subtest ring: SUCCESS (0.759s)
[522.285909] Starting dynamic subtest: engine
[523.044685] Dynamic subtest engine: SUCCESS (0.767s)
[523.054983] Starting dynamic subtest: timelines
[527.046425] Dynamic subtest timelines: SUCCESS (4.000s)
[527.055871] Starting dynamic subtest: requests
[530.777646] Dynamic subtest requests: SUCCESS (3.729s)
[530.788156] Starting dynamic subtest: objects
[531.678086] Dynamic subtest objects: SUCCESS (0.899s)
[531.687708] Starting dynamic subtest: phys
[532.528982] Dynamic subtest phys: SUCCESS (0.849s)
[532.538465] Starting dynamic subtest: dmabuf
[533.372034] Dynamic subtest dmabuf: SUCCESS (0.841s)
[533.381667] Starting dynamic subtest: vma
[538.872532] Dynamic subtest vma: SUCCESS (5.499s)
[538.882354] Starting dynamic subtest: evict
[540.365801] Dynamic subtest evict: SUCCESS (1.491s)
[540.376185] Starting dynamic subtest: gtt
[543.675550] Dynamic subtest gtt: SUCCESS (3.308s)
[543.685188] Starting dynamic subtest: hugepages
[544.788395] Dynamic subtest hugepages: SUCCESS (1.111s)
[544.798902] Starting dynamic subtest: memory_region
[547.566620] Dynamic subtest memory_region: SUCCESS (2.777s)
[547.569135] Subtest mock: SUCCESS (42.069s)
[547.595813] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[547.596544] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[547.599710] [131/133] (475s left) gem_mmap_gtt (basic-write-read)
[549.133189] Subtest basic-write-read: SKIP (0.000s)
[549.195027] [FACT gem_mmap_gtt (basic-write-read)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[549.196267] [FACT gem_mmap_gtt (basic-write-read)] new: kernel.kmod_is_loaded.i915: true
[549.200410] [132/133] (473s left) perf (gen12-group-exclusive-stream-sample-oa)
[549.357186] Starting subtest: gen12-group-exclusive-stream-sample-oa
[549.375762] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.020s)
[549.424266] [133/133] (473s left) perf_pmu (busy-double-start)
[549.474040] Starting subtest: busy-double-start
[549.476283] Starting dynamic subtest: rcs0
[553.056477] Dynamic subtest rcs0: SUCCESS (3.583s)
[553.067778] Starting dynamic subtest: bcs0
[556.638127] Dynamic subtest bcs0: SUCCESS (3.580s)
[556.649185] Starting dynamic subtest: vcs0
[560.554210] Dynamic subtest vcs0: SUCCESS (3.915s)
[560.564319] Starting dynamic subtest: vcs1
[564.547416] Dynamic subtest vcs1: SUCCESS (3.991s)
[564.557275] Starting dynamic subtest: vecs0
[568.602237] Dynamic subtest vecs0: SUCCESS (4.053s)
[568.612358] Starting dynamic subtest: ccs0
[572.244086] Dynamic subtest ccs0: FAIL (3.585s)
[572.246266] Subtest busy-double-start: FAIL (22.721s)
[572.317849] Closing watchdogs
results: parsing output: 0/ for test: gem_partial_pwrite_pread
results: parsing output: 1/ for test: kms_content_protection
results: parsing output: 2/ for test: kms_rotation_crc
results: parsing output: 3/ for test: kms_chamelium_color
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: kms_pipe_crc_basic
results: parsing output: 6/ for test: gem_set_tiling_vs_blt
results: parsing output: 7/ for test: syncobj_wait
results: parsing output: 8/ for test: syncobj_wait
results: parsing output: 9/ for test: gem_pxp
results: parsing output: 10/ for test: kms_cursor_legacy
results: parsing output: 11/ for test: kms_rotation_crc
results: parsing output: 12/ for test: syncobj_wait
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: gem_softpin
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: gem_ctx_param
results: parsing output: 17/ for test: syncobj_wait
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: gem_mmap_gtt
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: kms_flip
results: parsing output: 23/ for test: kms_plane_cursor
results: parsing output: 24/ for test: kms_cdclk
results: parsing output: 25/ for test: gem_exec_balancer
results: parsing output: 26/ for test: kms_cursor_legacy
results: parsing output: 27/ for test: kms_flip_scaled_crc
results: parsing output: 28/ for test: kms_flip_scaled_crc
results: parsing output: 29/ for test: core_getstats
results: parsing output: 30/ for test: kms_rmfb
results: parsing output: 31/ for test: gem_exec_reloc
results: parsing output: 32/ for test: kms_properties
results: parsing output: 33/ for test: kms_invalid_mode
results: parsing output: 34/ for test: kms_plane_scaling
results: parsing output: 35/ for test: kms_pm_rpm
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_dirtyfb
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: syncobj_timeline
results: parsing output: 40/ for test: kms_prime
results: parsing output: 41/ for test: kms_pipe_b_c_ivb
results: parsing output: 42/ for test: i915_drm_fdinfo
results: parsing output: 43/ for test: gem_userptr_blits
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: kms_scaling_modes
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: gem_ringfill
results: parsing output: 49/ for test: gem_exec_whisper
results: parsing output: 50/ for test: api_intel_bb
results: parsing output: 51/ for test: kms_cursor_crc
results: parsing output: 52/ for test: kms_ccs
results: parsing output: 53/ for test: gen9_exec_parse
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: gem_exec_fence
results: parsing output: 57/ for test: kms_psr
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: gem_ctx_bad_destroy
results: parsing output: 60/ for test: syncobj_timeline
results: parsing output: 61/ for test: kms_chamelium_hpd
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_cs_tlb
results: parsing output: 64/ for test: gem_mmap_gtt
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: gem_bad_reloc
results: parsing output: 69/ for test: gem_ctx_persistence
results: parsing output: 70/ for test: kms_plane_scaling
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_exec_schedule
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: gem_exec_basic
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_mmap
results: parsing output: 79/ for test: gem_exec_reloc
results: parsing output: 80/ for test: gem_ctx_shared
results: parsing output: 81/ for test: gem_exec_reloc
results: parsing output: 82/ for test: gem_eio
results: parsing output: 83/ for test: gem_ctx_persistence
results: parsing output: 84/ for test: perf_pmu
results: parsing output: 85/ for test: gem_exec_schedule
results: parsing output: 86/ for test: i915_hangman
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_color
results: parsing output: 89/ for test: prime_vgem
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: api_intel_allocator
results: parsing output: 92/ for test: i915_pm_rps
results: parsing output: 93/ for test: kms_vblank
results: parsing output: 94/ for test: kms_big_fb
results: parsing output: 95/ for test: kms_addfb_basic
results: parsing output: 96/ for test: kms_psr
results: parsing output: 97/ for test: kms_flip
results: parsing output: 98/ for test: kms_cursor_crc
results: parsing output: 99/ for test: kms_flip
results: parsing output: 100/ for test: kms_atomic_interruptible
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_plane_scaling
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: sw_sync
results: parsing output: 106/ for test: syncobj_timeline
results: parsing output: 107/ for test: kms_flip
results: parsing output: 108/ for test: kms_addfb_basic
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: gem_exec_whisper
results: parsing output: 111/ for test: kms_dsc
results: parsing output: 112/ for test: kms_flip_scaled_crc
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: gem_softpin
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_addfb_basic
results: parsing output: 117/ for test: syncobj_timeline
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_mmap_wc
results: parsing output: 121/ for test: kms_hdr
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_psr2_sf
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: syncobj_timeline
results: parsing output: 127/ for test: gem_exec_parallel
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: i915_selftest
results: parsing output: 130/ for test: gem_mmap_gtt
results: parsing output: 131/ for test: perf
results: parsing output: 132/ for test: perf_pmu
Done.