[57.226451] Initializing watchdogs
[57.226497]   /dev/watchdog0
[57.241017] [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.245642] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.247838] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.249740] [001/133] (960s left) gem_partial_pwrite_pread (write-snoop)
[57.319449] Subtest write-snoop: SKIP (0.000s)
[57.392756] [002/133] (960s left) kms_content_protection (content-type-change)
[57.536929] Starting subtest: content-type-change
[57.539139] Subtest content-type-change: SKIP (0.000s)
[57.665895] [003/133] (960s left) kms_rotation_crc (multiplane-rotation)
[57.750141] Starting subtest: multiplane-rotation
[75.102541] Subtest multiplane-rotation: SUCCESS (17.403s)
[75.252644] [004/133] (942s left) kms_chamelium_color (ctm-red-to-blue)
[75.356088] Subtest ctm-red-to-blue: SKIP (0.000s)
[75.391270] [005/133] (942s left) syncobj_wait (invalid-reset-one-illegal-handle)
[75.452223] Starting subtest: invalid-reset-one-illegal-handle
[75.453267] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[75.588330] [006/133] (942s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[75.678215] Starting subtest: disable-crc-after-crtc
[75.679044] Starting dynamic subtest: pipe-A-eDP-1
[77.543948] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.866s)
[77.553915] Starting dynamic subtest: pipe-B-eDP-1
[79.811120] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.266s)
[79.818196] Starting dynamic subtest: pipe-C-eDP-1
[82.079971] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.268s)
[82.087186] Starting dynamic subtest: pipe-D-eDP-1
[84.322281] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.241s)
[84.323173] Subtest disable-crc-after-crtc: SUCCESS (8.645s)
[85.171230] [007/133] (932s left) gem_set_tiling_vs_blt (tiled-to-tiled)
[85.232448] Subtest tiled-to-tiled: SKIP (0.000s)
[85.307463] [008/133] (932s left) syncobj_wait (wait-all-interrupted)
[85.355364] Starting subtest: wait-all-interrupted
[85.457852] Subtest wait-all-interrupted: SUCCESS (0.102s)
[85.549517] [009/133] (932s left) syncobj_wait (wait-all-complex)
[85.604435] Starting subtest: wait-all-complex
[85.819352] Subtest wait-all-complex: SUCCESS (0.212s)
[85.907255] [010/133] (932s left) gem_pxp (reject-modify-context-protection-on)
[86.049737] Starting subtest: reject-modify-context-protection-on
[86.051088] Subtest reject-modify-context-protection-on: SUCCESS (0.002s)
[86.184767] [011/133] (931s left) kms_cursor_legacy (cursora-vs-flipb-varying-size)
[86.296610] Starting subtest: cursorA-vs-flipB-varying-size
[86.298762] Subtest cursorA-vs-flipB-varying-size: SKIP (0.001s)
[86.456389] [012/133] (931s left) kms_rotation_crc (primary-rotation-90)
[86.548244] Starting subtest: primary-rotation-90
[86.550046] Subtest primary-rotation-90: SKIP (0.001s)
[86.639283] [013/133] (931s left) syncobj_wait (reset-multiple-signaled)
[86.700955] Starting subtest: reset-multiple-signaled
[86.702076] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[86.827924] [014/133] (931s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[86.923837] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[86.925786] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[88.104935] [015/133] (930s left) gem_softpin (noreloc-s3)
[88.164466] Starting subtest: noreloc-S3
[108.273846] Subtest noreloc-S3: SUCCESS (5.409s)
[110.489443] [016/133] (909s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[110.611300] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[115.054269] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.556s)
[116.211074] [017/133] (904s left) gem_ctx_param (invalid-ctx-set)
[116.265821] Starting subtest: invalid-ctx-set
[116.267889] Subtest invalid-ctx-set: SUCCESS (0.001s)
[116.390999] [018/133] (903s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[116.435213] Starting subtest: single-wait-all-for-submit-unsubmitted
[116.539351] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.103s)
[116.624241] [019/133] (903s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[116.737086] Starting subtest: x-tiled-64bpp-rotate-90
[116.756766] Subtest x-tiled-64bpp-rotate-90: SKIP (0.019s)
[116.907792] [020/133] (903s left) gem_mmap_gtt (cpuset-basic-small-copy-xy)
[116.963884] Subtest cpuset-basic-small-copy-XY: SKIP (0.000s)
[117.013810] [021/133] (903s left) kms_psr (fbc-psr-cursor-plane-move)
[117.106422] Starting subtest: fbc-psr-cursor-plane-move
[117.107271] Starting dynamic subtest: eDP-1
[117.108937] Dynamic subtest eDP-1: SKIP (0.000s)
[117.110583] Subtest fbc-psr-cursor-plane-move: SKIP (0.001s)
[117.193861] [022/133] (903s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[117.299776] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[118.279380] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (0.993s)
[118.467676] [023/133] (901s left) kms_flip (2x-flip-vs-rmfb)
[118.555239] Starting subtest: 2x-flip-vs-rmfb
[118.565136] Subtest 2x-flip-vs-rmfb: SKIP (0.011s)
[118.700650] [024/133] (901s left) kms_plane_cursor (viewport)
[118.794765] Starting subtest: viewport
[118.797006] Starting dynamic subtest: pipe-A-eDP-1-size-64
[121.199141] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.429s)
[121.259139] Starting dynamic subtest: pipe-A-eDP-1-size-128
[123.637631] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.405s)
[123.697595] Starting dynamic subtest: pipe-A-eDP-1-size-256
[126.135835] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.460s)
[126.493839] Starting dynamic subtest: pipe-B-eDP-1-size-64
[129.576722] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.101s)
[129.638077] Starting dynamic subtest: pipe-B-eDP-1-size-128
[132.081378] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.460s)
[132.142669] Starting dynamic subtest: pipe-B-eDP-1-size-256
[134.523182] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.393s)
[134.870615] Starting dynamic subtest: pipe-C-eDP-1-size-64
[137.694485] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.835s)
[137.733048] Starting dynamic subtest: pipe-C-eDP-1-size-128
[139.783192] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.058s)
[139.821283] Starting dynamic subtest: pipe-C-eDP-1-size-256
[141.861292] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.047s)
[142.184401] Starting dynamic subtest: pipe-D-eDP-1-size-64
[144.896005] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.719s)
[144.934517] Starting dynamic subtest: pipe-D-eDP-1-size-128
[146.973360] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.046s)
[147.015768] Starting dynamic subtest: pipe-D-eDP-1-size-256
[149.050692] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.047s)
[149.365826] Subtest viewport: SUCCESS (30.661s)
[150.212457] [025/133] (870s left) kms_cdclk (mode-transition)
[150.318331] Starting subtest: mode-transition
[150.319205] Starting dynamic subtest: pipe-A-eDP-1
[150.603736] Dynamic subtest pipe-A-eDP-1: SKIP (0.284s)
[150.610453] Starting dynamic subtest: pipe-B-eDP-1
[150.612066] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[150.618434] Starting dynamic subtest: pipe-C-eDP-1
[150.620046] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[150.626290] Starting dynamic subtest: pipe-D-eDP-1
[150.628741] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[150.630705] Subtest mode-transition: SKIP (0.292s)
[151.438614] [026/133] (869s left) gem_exec_balancer (fairslice)
[151.505440] Starting subtest: fairslice
[154.396451] Subtest fairslice: SUCCESS (2.889s)
[155.693738] [027/133] (864s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[155.826683] Starting subtest: basic-flip-before-cursor-varying-size
[156.750958] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.923s)
[157.568680] [028/133] (862s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[157.661548] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[157.662406] Starting dynamic subtest: pipe-A-default-mode
[157.962273] Dynamic subtest pipe-A-default-mode: SKIP (0.299s)
[157.964117] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.301s)
[158.803733] [029/133] (861s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[158.895635] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[158.896599] Starting dynamic subtest: pipe-A-default-mode
[161.628679] Dynamic subtest pipe-A-default-mode: SUCCESS (2.733s)
[161.629572] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.735s)
[162.490387] [030/133] (858s left) core_getstats (basic)
[162.544336] Starting subtest: basic
[162.545318] Subtest basic: SUCCESS (0.000s)
[162.675034] [031/133] (857s left) kms_rmfb (close-fd)
[162.763545] Starting subtest: close-fd
[162.764442] Starting dynamic subtest: pipe-A-eDP-1
[162.872276] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s)
[162.879938] Starting dynamic subtest: pipe-B-eDP-1
[164.035469] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.164s)
[164.043854] Starting dynamic subtest: pipe-C-eDP-1
[165.161333] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.125s)
[165.169785] Starting dynamic subtest: pipe-D-eDP-1
[166.281425] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.118s)
[166.282337] Subtest close-fd: SUCCESS (3.520s)
[167.519557] [032/133] (853s left) gem_exec_reloc (basic-gtt-wc)
[167.587514] Subtest basic-gtt-wc: SKIP (0.000s)
[167.637479] [033/133] (853s left) kms_properties (crtc-properties-legacy)
[167.731597] Starting subtest: crtc-properties-legacy
[167.732567] Starting dynamic subtest: pipe-A-eDP-1
[168.170951] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.439s)
[168.177946] Starting dynamic subtest: pipe-B-eDP-1
[169.364142] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.191s)
[169.371481] Starting dynamic subtest: pipe-C-eDP-1
[170.485413] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.122s)
[170.493772] Starting dynamic subtest: pipe-D-eDP-1
[171.608371] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.121s)
[171.609314] Subtest crtc-properties-legacy: SUCCESS (3.879s)
[172.442865] [034/133] (848s left) kms_invalid_mode (zero-hdisplay)
[172.535048] Starting subtest: zero-hdisplay
[172.536005] Starting dynamic subtest: pipe-A-eDP-1
[172.822108] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.286s)
[172.829489] Starting dynamic subtest: pipe-B-eDP-1
[172.830516] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[172.837100] Starting dynamic subtest: pipe-C-eDP-1
[172.838169] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[172.845249] Starting dynamic subtest: pipe-D-eDP-1
[172.846171] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[172.847104] Subtest zero-hdisplay: SUCCESS (0.292s)
[173.668700] [035/133] (847s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[173.760684] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[173.761634] Starting dynamic subtest: pipe-A
[174.809144] Dynamic subtest pipe-A: SUCCESS (1.050s)
[174.823126] Starting dynamic subtest: pipe-B
[176.962998] Dynamic subtest pipe-B: SUCCESS (2.154s)
[176.970155] Starting dynamic subtest: pipe-C
[178.156883] Dynamic subtest pipe-C: SUCCESS (1.194s)
[178.165014] Starting dynamic subtest: pipe-D
[179.303769] Dynamic subtest pipe-D: SUCCESS (1.146s)
[179.304680] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (5.548s)
[180.509539] [036/133] (840s left) kms_pm_rpm (legacy-planes-dpms)
[182.742938] Starting subtest: legacy-planes-dpms
[182.744294] Starting dynamic subtest: plane-63
[191.026542] Dynamic subtest plane-63: SUCCESS (8.289s)
[191.037846] Starting dynamic subtest: plane-93
[199.618269] Dynamic subtest plane-93: SUCCESS (8.594s)
[199.629307] Starting dynamic subtest: plane-123
[207.900684] Dynamic subtest plane-123: SUCCESS (8.276s)
[207.912686] Starting dynamic subtest: plane-133
[216.197052] Dynamic subtest plane-133: SUCCESS (8.290s)
[216.199018] Subtest legacy-planes-dpms: SUCCESS (33.460s)
[216.570659] [037/133] (804s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[216.668732] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[216.670417] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[216.804125] [038/133] (804s left) kms_dirtyfb (default-dirtyfb-ioctl)
[216.892101] Starting subtest: default-dirtyfb-ioctl
[216.893449] Starting dynamic subtest: A-eDP-1
[218.455286] Dynamic subtest A-eDP-1: SUCCESS (1.562s)
[218.456156] Subtest default-dirtyfb-ioctl: SUCCESS (1.564s)
[219.297049] [039/133] (801s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[219.427958] Starting subtest: cursorB-vs-flipA-legacy
[219.430970] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s)
[219.588851] [040/133] (801s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[219.650985] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[219.652026] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[219.765645] [041/133] (801s left) kms_prime (basic-crc-vgem)
[219.889112] Starting subtest: basic-crc-vgem
[219.890208] Starting dynamic subtest: second-to-first
[220.805420] Dynamic subtest second-to-first: SUCCESS (0.916s)
[220.806303] Subtest basic-crc-vgem: SUCCESS (0.917s)
[220.913951] [FACT kms_prime (basic-crc-vgem)] new: kernel.kmod_is_loaded.vgem: true
[220.915930] [042/133] (800s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[221.013431] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[221.082502] [043/133] (799s left) i915_drm_fdinfo (busy)
[221.116581] Starting subtest: busy
[221.117523] Starting dynamic subtest: rcs0
[221.152640] Dynamic subtest rcs0: SKIP (0.035s)
[221.162273] Starting dynamic subtest: bcs0
[221.163991] Dynamic subtest bcs0: SKIP (0.000s)
[221.170807] Starting dynamic subtest: vcs0
[221.172576] Dynamic subtest vcs0: SKIP (0.000s)
[221.179457] Starting dynamic subtest: vcs1
[221.181119] Dynamic subtest vcs1: SKIP (0.000s)
[221.187853] Starting dynamic subtest: vecs0
[221.189629] Dynamic subtest vecs0: SKIP (0.000s)
[221.196479] Starting dynamic subtest: ccs0
[221.198140] Dynamic subtest ccs0: SKIP (0.000s)
[221.199945] Subtest busy: SKIP (0.041s)
[221.245118] [044/133] (799s left) gem_userptr_blits (nohangcheck)
[221.320157] Starting subtest: nohangcheck
[221.580964] Subtest nohangcheck: SUCCESS (0.260s)
[221.719032] [045/133] (799s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[221.814734] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[222.416916] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.603s)
[222.622234] [046/133] (798s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[222.719172] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[222.721129] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[223.826125] [047/133] (797s left) kms_scaling_modes (scaling-mode-full)
[223.912279] Starting subtest: scaling-mode-full
[223.913080] Starting dynamic subtest: pipe-A-eDP-1
[224.006387] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.094s)
[224.015210] Starting dynamic subtest: pipe-B-eDP-1
[225.137487] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.129s)
[225.147016] Starting dynamic subtest: pipe-C-eDP-1
[226.246096] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.107s)
[226.255155] Starting dynamic subtest: pipe-D-eDP-1
[227.385431] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.137s)
[227.386423] Subtest scaling-mode-full: SUCCESS (3.474s)
[228.566585] [048/133] (792s left) kms_psr (fbc-pr-basic)
[228.649403] Starting subtest: fbc-pr-basic
[228.651035] Subtest fbc-pr-basic: SKIP (0.000s)
[228.739263] [049/133] (792s left) gem_ringfill (basic-all)
[234.626639] Starting subtest: basic-all
[235.787862] Subtest basic-all: SUCCESS (1.159s)
[235.929469] [050/133] (785s left) gem_exec_whisper (basic-fds-forked-all)
[235.987151] Starting subtest: basic-fds-forked-all
[258.423891] Subtest basic-fds-forked-all: SUCCESS (22.438s)
[258.625622] [051/133] (762s left) api_intel_bb (full-batch)
[258.674451] Starting subtest: full-batch
[258.681317] Subtest full-batch: SUCCESS (0.008s)
[258.839624] [052/133] (762s left) kms_cursor_crc (cursor-sliding-256x85)
[259.104728] Starting subtest: cursor-sliding-256x85
[259.147172] Subtest cursor-sliding-256x85: SKIP (0.040s)
[259.366275] [053/133] (761s left) kms_ccs (crc-sprite-planes-basic-y-tiled-ccs)
[259.454659] Starting subtest: crc-sprite-planes-basic-y-tiled-ccs
[259.455603] Starting dynamic subtest: pipe-A-eDP-1
[259.480744] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[259.490491] Starting dynamic subtest: pipe-B-eDP-1
[259.511900] Dynamic subtest pipe-B-eDP-1: SKIP (0.002s)
[259.519292] Starting dynamic subtest: pipe-C-eDP-1
[259.541453] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[259.549475] Starting dynamic subtest: pipe-D-eDP-1
[259.570354] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[259.571969] Subtest crc-sprite-planes-basic-y-tiled-ccs: SKIP (0.010s)
[261.725832] [054/133] (759s left) gen9_exec_parse (allowed-single)
[261.785437] Subtest allowed-single: SKIP (0.000s)
[261.872059] [055/133] (759s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[261.958679] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[268.968049] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.012s)
[269.131855] [056/133] (752s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[269.227585] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[269.229338] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[269.356141] [057/133] (752s left) gem_exec_fence (expired-history)
[269.850589] Starting subtest: expired-history
[277.387436] Subtest expired-history: SUCCESS (7.537s)
[278.009082] [058/133] (743s left) kms_psr (fbc-psr-sprite-plane-move)
[278.101647] Starting subtest: fbc-psr-sprite-plane-move
[278.102483] Starting dynamic subtest: eDP-1
[278.104291] Dynamic subtest eDP-1: SKIP (0.000s)
[278.105944] Subtest fbc-psr-sprite-plane-move: SKIP (0.001s)
[278.195541] [059/133] (743s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[278.292524] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[285.013970] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.724s)
[285.160234] [060/133] (736s left) gem_ctx_bad_destroy (double-destroy)
[285.217950] Starting subtest: double-destroy
[285.219134] Subtest double-destroy: SUCCESS (0.000s)
[285.308458] [061/133] (736s left) syncobj_timeline (invalid-signal-illegal-handle)
[285.369936] Starting subtest: invalid-signal-illegal-handle
[285.370942] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[285.478301] [062/133] (736s left) kms_chamelium_hpd (common-hpd-after-suspend)
[285.865706] Subtest common-hpd-after-suspend: SKIP (0.000s)
[286.654881] [063/133] (735s left) kms_frontbuffer_tracking (fbc-tiling-4)
[286.750629] Starting subtest: fbc-tiling-4
[291.020069] Subtest fbc-tiling-4: SUCCESS (4.271s)
[292.213855] [064/133] (729s left) gem_cs_tlb (engines)
[292.273720] Starting subtest: engines
[292.274652] Starting dynamic subtest: rcs0
[294.426165] Dynamic subtest rcs0: SUCCESS (2.151s)
[294.435738] Starting dynamic subtest: bcs0
[296.578024] Dynamic subtest bcs0: SUCCESS (2.151s)
[296.586299] Starting dynamic subtest: vcs0
[298.729239] Dynamic subtest vcs0: SUCCESS (2.152s)
[298.737076] Starting dynamic subtest: vcs1
[300.881685] Dynamic subtest vcs1: SUCCESS (2.151s)
[300.890749] Starting dynamic subtest: vecs0
[303.035731] Dynamic subtest vecs0: SUCCESS (2.154s)
[303.043755] Starting dynamic subtest: ccs0
[305.192584] Dynamic subtest ccs0: SUCCESS (2.156s)
[305.193550] Subtest engines: SUCCESS (12.921s)
[305.347480] [065/133] (716s left) gem_mmap_gtt (hang-busy)
[305.410989] Subtest hang-busy: SKIP (0.000s)
[305.466653] [066/133] (716s left) kms_psr (psr2-sprite-plane-onoff)
[305.563882] Starting subtest: psr2-sprite-plane-onoff
[305.564885] Starting dynamic subtest: eDP-1
[307.293029] Dynamic subtest eDP-1: SUCCESS (1.729s)
[307.293959] Subtest psr2-sprite-plane-onoff: SUCCESS (1.730s)
[308.160687] [067/133] (713s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[308.263285] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[308.966170] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.704s)
[309.179354] [068/133] (712s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[309.287547] Starting subtest: y-tiled-64bpp-rotate-270
[309.289141] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[309.420103] [069/133] (712s left) gem_bad_reloc (negative-reloc-lut)
[309.475213] Subtest negative-reloc-lut: SKIP (0.000s)
[309.532521] [070/133] (712s left) gem_ctx_persistence (engines-mixed)
[309.591268] Starting subtest: engines-mixed
[309.592326] Starting dynamic subtest: rcs0
[309.692246] Dynamic subtest rcs0: SUCCESS (0.100s)
[309.704952] Starting dynamic subtest: bcs0
[309.760730] Dynamic subtest bcs0: SUCCESS (0.067s)
[309.772874] Starting dynamic subtest: vcs0
[309.835032] Dynamic subtest vcs0: SUCCESS (0.072s)
[309.847409] Starting dynamic subtest: vcs1
[309.904126] Dynamic subtest vcs1: SUCCESS (0.067s)
[309.916105] Starting dynamic subtest: vecs0
[309.963184] Dynamic subtest vecs0: SUCCESS (0.057s)
[309.974560] Starting dynamic subtest: ccs0
[310.026589] Dynamic subtest ccs0: SUCCESS (0.062s)
[310.027645] Subtest engines-mixed: SUCCESS (0.436s)
[310.122155] [071/133] (711s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25)
[310.214813] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25
[310.215818] Starting dynamic subtest: pipe-A
[310.278967] Dynamic subtest pipe-A: SUCCESS (0.065s)
[310.300781] Starting dynamic subtest: pipe-B
[311.459425] Dynamic subtest pipe-B: SUCCESS (1.178s)
[311.470551] Starting dynamic subtest: pipe-C
[312.557670] Dynamic subtest pipe-C: SUCCESS (1.095s)
[312.565636] Starting dynamic subtest: pipe-D
[313.684135] Dynamic subtest pipe-D: SUCCESS (1.126s)
[313.685015] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.472s)
[314.867198] [072/133] (707s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[314.960951] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[314.962715] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[315.094859] [073/133] (706s left) gem_exec_schedule (semaphore-noskip)
[315.151624] Starting subtest: semaphore-noskip
[315.567596] Subtest semaphore-noskip: SUCCESS (0.414s)
[315.954507] [074/133] (706s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[316.037834] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[316.039421] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[316.169034] [075/133] (705s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[316.280969] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[316.282784] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[316.422526] [076/133] (705s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[316.523860] Starting subtest: 4-tiled-16bpp-rotate-0
[317.735489] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.212s)
[317.898964] [077/133] (704s left) gem_exec_basic (basic)
[317.954590] Starting subtest: basic
[317.955599] Starting dynamic subtest: rcs0-smem
[317.957950] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[317.965714] Starting dynamic subtest: bcs0-smem
[317.966722] Dynamic subtest bcs0-smem: SUCCESS (0.002s)
[317.974302] Starting dynamic subtest: vcs0-smem
[317.975198] Dynamic subtest vcs0-smem: SUCCESS (0.002s)
[317.982480] Starting dynamic subtest: vcs1-smem
[317.983398] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[317.990724] Starting dynamic subtest: vecs0-smem
[317.991678] Dynamic subtest vecs0-smem: SUCCESS (0.002s)
[317.999046] Starting dynamic subtest: ccs0-smem
[318.000018] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[318.001026] Subtest basic: SUCCESS (0.016s)
[319.671593] [078/133] (702s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[319.766162] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[319.768044] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[319.896057] [079/133] (702s left) gem_mmap (short-mmap)
[319.944524] Subtest short-mmap: SKIP (0.000s)
[320.006306] [080/133] (702s left) gem_exec_reloc (basic-gtt-wc-active)
[320.080858] Subtest basic-gtt-wc-active: SKIP (0.000s)
[320.157211] [081/133] (702s left) gem_ctx_shared (create-shared-gtt)
[320.226641] Starting subtest: create-shared-gtt
[322.381933] Subtest create-shared-gtt: SUCCESS (2.155s)
[322.824097] [082/133] (699s left) gem_exec_reloc (basic-write-wc)
[322.891172] Subtest basic-write-wc: SKIP (0.000s)
[322.946281] [083/133] (699s left) gem_eio (wait-immediate)
[323.192946] Starting subtest: wait-immediate
[323.599696] Subtest wait-immediate: SUCCESS (0.408s)
[323.734910] [084/133] (698s left) gem_ctx_persistence (legacy-engines-mixed)
[323.781581] Starting subtest: legacy-engines-mixed
[323.782654] Starting dynamic subtest: render
[323.887187] Dynamic subtest render: SUCCESS (0.105s)
[323.899999] Starting dynamic subtest: bsd1
[323.948957] Dynamic subtest bsd1: SUCCESS (0.059s)
[323.960891] Starting dynamic subtest: bsd2
[324.005496] Dynamic subtest bsd2: SUCCESS (0.054s)
[324.018308] Starting dynamic subtest: blt
[324.083783] Dynamic subtest blt: SUCCESS (0.076s)
[324.096068] Starting dynamic subtest: vebox
[324.157613] Dynamic subtest vebox: SUCCESS (0.071s)
[324.160850] Subtest legacy-engines-mixed: SUCCESS (0.377s)
[324.254597] [085/133] (698s left) perf_pmu (semaphore-busy)
[324.288765] Starting subtest: semaphore-busy
[324.289788] Starting dynamic subtest: rcs0
[325.956911] Dynamic subtest rcs0: SUCCESS (1.664s)
[325.968029] Starting dynamic subtest: bcs0
[327.589530] Dynamic subtest bcs0: SUCCESS (1.630s)
[327.600839] Starting dynamic subtest: vcs0
[332.089209] Dynamic subtest vcs0: SUCCESS (4.497s)
[332.100477] Starting dynamic subtest: vcs1
[338.105435] Dynamic subtest vcs1: SUCCESS (6.010s)
[338.116137] Starting dynamic subtest: vecs0
[344.123427] Dynamic subtest vecs0: SUCCESS (6.012s)
[344.133879] Starting dynamic subtest: ccs0
[347.195025] Dynamic subtest ccs0: SUCCESS (3.068s)
[347.196569] Subtest semaphore-busy: SUCCESS (22.899s)
[347.326587] [086/133] (675s left) gem_exec_schedule (pi-common)
[347.517967] Starting subtest: pi-common
[347.518955] Starting dynamic subtest: rcs0
[347.558774] Dynamic subtest rcs0: SUCCESS (0.041s)
[347.572637] Starting dynamic subtest: bcs0
[347.602652] Dynamic subtest bcs0: SUCCESS (0.043s)
[347.621960] Starting dynamic subtest: vcs0
[347.646588] Dynamic subtest vcs0: SUCCESS (0.043s)
[347.656068] Starting dynamic subtest: vcs1
[347.683064] Dynamic subtest vcs1: SUCCESS (0.036s)
[347.691822] Starting dynamic subtest: vecs0
[347.715733] Dynamic subtest vecs0: SUCCESS (0.032s)
[347.724297] Starting dynamic subtest: ccs0
[347.746169] Dynamic subtest ccs0: SUCCESS (0.030s)
[347.747095] Subtest pi-common: SUCCESS (0.230s)
[348.031041] [087/133] (674s left) i915_hangman (engine-error-state-capture)
[348.114093] Starting subtest: engine-error-state-capture
[348.115595] Starting dynamic subtest: rcs0
[351.582445] Dynamic subtest rcs0: SUCCESS (3.464s)
[351.593763] Starting dynamic subtest: bcs0
[357.597833] Dynamic subtest bcs0: SUCCESS (6.011s)
[357.609544] Starting dynamic subtest: vcs0
[363.550173] Dynamic subtest vcs0: SUCCESS (5.948s)
[363.561197] Starting dynamic subtest: vcs1
[369.568023] Dynamic subtest vcs1: SUCCESS (6.014s)
[369.579562] Starting dynamic subtest: vecs0
[375.518126] Dynamic subtest vecs0: SUCCESS (5.946s)
[375.529660] Starting dynamic subtest: ccs0
[380.573566] Dynamic subtest ccs0: SUCCESS (5.052s)
[380.575144] Subtest engine-error-state-capture: SUCCESS (32.452s)
[380.671810] [088/133] (641s left) syncobj_timeline (wait-for-submit-snapshot)
[380.735464] Starting subtest: wait-for-submit-snapshot
[380.818709] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[380.926268] [089/133] (641s left) kms_color (ctm-blue-to-red)
[381.022273] Starting subtest: ctm-blue-to-red
[381.023251] Starting dynamic subtest: pipe-A-eDP-1
[381.691149] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.667s)
[381.702086] Starting dynamic subtest: pipe-B-eDP-1
[383.037009] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.346s)
[383.045990] Starting dynamic subtest: pipe-C-eDP-1
[384.394210] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.355s)
[384.405256] Starting dynamic subtest: pipe-D-eDP-1
[385.723638] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.329s)
[385.724542] Subtest ctm-blue-to-red: SUCCESS (4.701s)
[386.597462] [090/133] (636s left) prime_vgem (basic-gtt)
[386.665845] Starting subtest: basic-gtt
[386.667770] Subtest basic-gtt: SKIP (0.000s)
[386.805201] [091/133] (635s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[386.900089] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[394.424102] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.524s)
[394.582072] [092/133] (628s left) api_intel_allocator (default-alignment)
[394.646116] Starting subtest: default-alignment
[394.649669] Subtest default-alignment: SUCCESS (0.004s)
[394.811033] [093/133] (627s left) i915_pm_rps (fence-order)
[394.877001] Starting subtest: fence-order
[398.313522] Subtest fence-order: SUCCESS (3.434s)
[398.472695] [094/133] (624s left) kms_vblank (query-busy)
[398.571359] Starting subtest: query-busy
[398.572247] Starting dynamic subtest: pipe-A-eDP-1
[400.443612] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.872s)
[400.454329] Starting dynamic subtest: pipe-D-eDP-1
[403.001294] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.553s)
[403.002256] Subtest query-busy: SUCCESS (4.430s)
[403.821212] [095/133] (618s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[403.912245] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[403.913985] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[404.051751] [096/133] (618s left) kms_addfb_basic (invalid-get-prop-any)
[404.103597] Starting subtest: invalid-get-prop-any
[404.104555] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[404.277130] [097/133] (618s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[404.381928] Starting subtest: fbc-psr2-cursor-mmap-gtt
[404.382841] Starting dynamic subtest: eDP-1
[404.384608] Dynamic subtest eDP-1: SKIP (0.000s)
[404.386260] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.001s)
[404.474271] [098/133] (618s left) kms_flip (2x-blocking-absolute-wf_vblank)
[404.574786] Starting subtest: 2x-blocking-absolute-wf_vblank
[404.586547] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.011s)
[404.719604] [099/133] (618s left) kms_cursor_crc (cursor-onscreen-256x85)
[404.980069] Starting subtest: cursor-onscreen-256x85
[405.027979] Subtest cursor-onscreen-256x85: SKIP (0.045s)
[405.223778] [100/133] (617s left) kms_flip (2x-modeset-vs-vblank-race)
[405.307365] Starting subtest: 2x-modeset-vs-vblank-race
[405.317553] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[405.463024] [101/133] (617s left) kms_atomic_interruptible (atomic-setmode)
[405.562594] Starting subtest: atomic-setmode
[405.563436] Starting dynamic subtest: pipe-A-eDP-1
[412.475659] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.911s)
[412.476622] Subtest atomic-setmode: SUCCESS (6.913s)
[413.365689] [102/133] (609s left) kms_frontbuffer_tracking (psr-argb161616f-draw-render)
[413.474392] Starting subtest: psr-argb161616f-draw-render
[413.476054] Subtest psr-argb161616f-draw-render: SKIP (0.000s)
[413.614135] [103/133] (609s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[413.703920] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[413.705769] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[413.830733] [104/133] (609s left) kms_plane_scaling (invalid-num-scalers)
[413.925733] Starting subtest: invalid-num-scalers
[413.926676] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[413.943213] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.017s)
[413.953008] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[413.973292] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.028s)
[413.981623] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[414.003059] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.028s)
[414.012650] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[414.031747] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.028s)
[414.032606] Subtest invalid-num-scalers: SUCCESS (0.107s)
[414.163214] [105/133] (608s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[414.275356] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[414.277083] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[414.389695] [106/133] (608s left) sw_sync (alloc_fence_invalid_timeline)
[414.417611] Starting subtest: alloc_fence_invalid_timeline
[414.418494] Subtest alloc_fence_invalid_timeline: SUCCESS (0.000s)
[414.488674] [107/133] (608s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[414.539457] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[414.642078] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.101s)
[414.735257] [108/133] (608s left) kms_flip (flip-vs-absolute-wf_vblank-interruptible)
[414.835025] Starting subtest: flip-vs-absolute-wf_vblank-interruptible
[414.837493] Starting dynamic subtest: A-eDP1
[423.704774] Dynamic subtest A-eDP1: SUCCESS (8.867s)
[423.715717] Starting dynamic subtest: B-eDP1
[432.630755] Dynamic subtest B-eDP1: SUCCESS (8.926s)
[432.642188] Starting dynamic subtest: C-eDP1
[441.539054] Dynamic subtest C-eDP1: SUCCESS (8.908s)
[441.548870] Starting dynamic subtest: D-eDP1
[450.471650] Dynamic subtest D-eDP1: SUCCESS (8.933s)
[450.475916] Subtest flip-vs-absolute-wf_vblank-interruptible: SUCCESS (35.644s)
[451.713741] [109/133] (571s left) kms_addfb_basic (size-max)
[451.806338] Starting subtest: size-max
[451.807214] Subtest size-max: SUCCESS (0.000s)
[451.926683] [110/133] (571s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[452.160340] Starting subtest: cursor-rapid-movement-256x256
[452.164056] Starting dynamic subtest: pipe-A-eDP-1
[452.694673] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.531s)
[452.722291] Starting dynamic subtest: pipe-D-eDP-1
[453.893558] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.178s)
[453.894551] Subtest cursor-rapid-movement-256x256: SUCCESS (1.732s)
[454.788044] [111/133] (568s left) gem_exec_whisper (basic-queues-all)
[454.848978] Starting subtest: basic-queues-all
[462.939888] Subtest basic-queues-all: SUCCESS (8.091s)
[463.143705] [112/133] (560s left) kms_dsc (dsc-fractional-bpp)
[463.247373] Starting subtest: dsc-fractional-bpp
[463.252423] Subtest dsc-fractional-bpp: SKIP (0.000s)
[463.338824] [113/133] (560s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[463.431740] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[463.432725] Starting dynamic subtest: pipe-A-default-mode
[463.718164] Dynamic subtest pipe-A-default-mode: SKIP (0.285s)
[463.720026] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.286s)
[464.609476] [114/133] (558s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[464.699614] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[464.701192] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[464.809666] [115/133] (558s left) gem_softpin (evict-prime)
[464.870507] Starting subtest: evict-prime
[464.871532] Starting dynamic subtest: rcs0
[466.058252] Dynamic subtest rcs0: SUCCESS (1.187s)
[466.071139] Starting dynamic subtest: bcs0
[467.221205] Dynamic subtest bcs0: SUCCESS (1.161s)
[467.233580] Starting dynamic subtest: vcs0
[468.582320] Dynamic subtest vcs0: SUCCESS (1.357s)
[468.593777] Starting dynamic subtest: vcs1
[470.626290] Dynamic subtest vcs1: SUCCESS (2.042s)
[470.637658] Starting dynamic subtest: vecs0
[472.600898] Dynamic subtest vecs0: SUCCESS (1.972s)
[472.613450] Starting dynamic subtest: ccs0
[473.753287] Dynamic subtest ccs0: SUCCESS (1.152s)
[473.766658] Starting dynamic subtest: all
[475.611310] Dynamic subtest all: SUCCESS (1.854s)
[475.612553] Subtest evict-prime: SUCCESS (10.741s)
[475.708415] [116/133] (547s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[475.802853] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[475.804646] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[475.926872] [117/133] (547s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[476.015638] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s)
[476.133586] [118/133] (547s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[476.195319] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[476.298619] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.102s)
[476.390752] [119/133] (547s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[476.480793] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[476.482386] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[476.624280] [120/133] (547s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move)
[476.723111] Starting subtest: fbc-1p-primscrn-cur-indfb-move
[480.810293] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (4.088s)
[482.005634] [121/133] (541s left) gem_mmap_wc (bad-size)
[482.053926] Subtest bad-size: SKIP (0.000s)
[482.120297] [122/133] (541s left) kms_hdr (static-toggle-suspend)
[482.214597] Starting subtest: static-toggle-suspend
[482.217134] Subtest static-toggle-suspend: SKIP (0.000s)
[482.307399] [123/133] (541s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[482.402467] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[482.404254] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[482.542847] [124/133] (541s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[487.579420] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf
[487.580285] Starting dynamic subtest: pipe-A-eDP-1
[488.369895] Dynamic subtest pipe-A-eDP-1: SKIP (0.789s)
[488.379857] Starting dynamic subtest: pipe-B-eDP-1
[489.502038] Dynamic subtest pipe-B-eDP-1: SKIP (1.130s)
[489.503777] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.923s)
[490.700526] [125/133] (533s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[490.808140] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[490.809853] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[490.923568] [126/133] (532s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[491.001713] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[491.002609] Starting dynamic subtest: pipe-A-eDP-1
[491.009939] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[491.019420] Starting dynamic subtest: pipe-B-eDP-1
[491.027974] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[491.037051] Starting dynamic subtest: pipe-C-eDP-1
[491.044219] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[491.052813] Starting dynamic subtest: pipe-D-eDP-1
[491.060032] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[491.060867] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.007s)
[493.181598] [127/133] (530s left) syncobj_timeline (single-wait-all-available-submitted)
[493.241950] Starting subtest: single-wait-all-available-submitted
[493.242895] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[493.372250] [128/133] (530s left) gem_exec_parallel (userptr)
[493.426136] Starting subtest: userptr
[493.427050] Starting dynamic subtest: rcs0
[494.874017] Dynamic subtest rcs0: SUCCESS (1.447s)
[494.884956] Starting dynamic subtest: bcs0
[496.402665] Dynamic subtest bcs0: SUCCESS (1.525s)
[496.412684] Starting dynamic subtest: vcs0
[499.583538] Dynamic subtest vcs0: SUCCESS (3.178s)
[499.593099] Starting dynamic subtest: vcs1
[501.566696] Dynamic subtest vcs1: SUCCESS (1.981s)
[501.578576] Starting dynamic subtest: vecs0
[503.551038] Dynamic subtest vecs0: SUCCESS (1.982s)
[503.560486] Starting dynamic subtest: ccs0
[505.069660] Dynamic subtest ccs0: SUCCESS (1.518s)
[505.070781] Subtest userptr: SUCCESS (11.646s)
[505.273477] [129/133] (518s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[505.376930] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[505.378564] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[505.491195] [130/133] (518s left) i915_selftest (mock)
[509.083663] Starting subtest: mock
[509.085108] Starting dynamic subtest: sanitycheck
[509.755195] Dynamic subtest sanitycheck: SUCCESS (0.672s)
[509.763794] Starting dynamic subtest: shmem
[510.412145] Dynamic subtest shmem: SUCCESS (0.655s)
[510.420062] Starting dynamic subtest: fence
[517.803847] Dynamic subtest fence: SUCCESS (7.391s)
[517.811983] Starting dynamic subtest: scatterlist
[519.497091] Dynamic subtest scatterlist: SUCCESS (1.691s)
[519.505804] Starting dynamic subtest: syncmap
[522.707289] Dynamic subtest syncmap: SUCCESS (3.208s)
[522.716697] Starting dynamic subtest: uncore
[523.352039] Dynamic subtest uncore: SUCCESS (0.644s)
[523.360406] Starting dynamic subtest: ring
[524.040968] Dynamic subtest ring: SUCCESS (0.687s)
[524.049944] Starting dynamic subtest: engine
[524.693039] Dynamic subtest engine: SUCCESS (0.650s)
[524.702185] Starting dynamic subtest: timelines
[528.523047] Dynamic subtest timelines: SUCCESS (3.828s)
[528.531428] Starting dynamic subtest: requests
[532.108015] Dynamic subtest requests: SUCCESS (3.583s)
[532.116435] Starting dynamic subtest: objects
[532.923478] Dynamic subtest objects: SUCCESS (0.814s)
[532.931843] Starting dynamic subtest: phys
[533.767331] Dynamic subtest phys: SUCCESS (0.842s)
[533.776461] Starting dynamic subtest: dmabuf
[534.598685] Dynamic subtest dmabuf: SUCCESS (0.829s)
[534.607468] Starting dynamic subtest: vma
[539.954822] Dynamic subtest vma: SUCCESS (5.355s)
[539.963388] Starting dynamic subtest: evict
[541.336914] Dynamic subtest evict: SUCCESS (1.381s)
[541.344110] Starting dynamic subtest: gtt
[544.519878] Dynamic subtest gtt: SUCCESS (3.182s)
[544.528449] Starting dynamic subtest: hugepages
[545.407662] Dynamic subtest hugepages: SUCCESS (0.886s)
[545.416776] Starting dynamic subtest: memory_region
[547.999744] Dynamic subtest memory_region: SUCCESS (2.590s)
[548.000850] Subtest mock: SUCCESS (38.926s)
[548.021667] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[548.022338] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[548.023935] [131/133] (475s left) gem_mmap_gtt (basic-write-read)
[549.438394] Subtest basic-write-read: SKIP (0.000s)
[549.529562] [FACT gem_mmap_gtt (basic-write-read)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[549.531411] [FACT gem_mmap_gtt (basic-write-read)] new: kernel.kmod_is_loaded.i915: true
[549.533942] [132/133] (474s left) perf (gen12-group-exclusive-stream-sample-oa)
[549.671685] Starting subtest: gen12-group-exclusive-stream-sample-oa
[549.694919] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.022s)
[549.727351] [133/133] (474s left) perf_pmu (busy-double-start)
[549.766451] Starting subtest: busy-double-start
[549.767254] Starting dynamic subtest: rcs0
[553.368659] Dynamic subtest rcs0: FAIL (3.582s)
[553.376421] Starting dynamic subtest: bcs0
[556.931778] Dynamic subtest bcs0: SUCCESS (3.580s)
[556.946807] Starting dynamic subtest: vcs0
[561.095268] Dynamic subtest vcs0: SUCCESS (4.165s)
[561.113496] Starting dynamic subtest: vcs1
[565.143741] Dynamic subtest vcs1: SUCCESS (4.047s)
[565.154848] Starting dynamic subtest: vecs0
[569.086944] Dynamic subtest vecs0: SUCCESS (3.942s)
[569.096932] Starting dynamic subtest: ccs0
[572.679249] Dynamic subtest ccs0: FAIL (3.567s)
[572.680078] Subtest busy-double-start: FAIL (22.894s)
[572.789925] 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.