[56.841914] Initializing watchdogs
[56.842092]   /dev/watchdog0
[56.857787] [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.862343] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.864545] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.867799] [001/134] (960s left) kms_getfb (getfb-handle-closed)
[57.000656] Starting subtest: getfb-handle-closed
[57.002916] Subtest getfb-handle-closed: SUCCESS (0.000s)
[57.131555] [002/134] (960s left) gem_close_race (multigpu-basic-threads)
[57.209397] Starting subtest: multigpu-basic-threads
[57.213855] Subtest multigpu-basic-threads: SKIP (0.000s)
[57.463493] [003/134] (959s left) gem_pxp (hw-rejects-pxp-buffer)
[57.585201] Starting subtest: hw-rejects-pxp-buffer
[57.589495] Subtest hw-rejects-pxp-buffer: SKIP (0.000s)
[57.718130] [004/134] (959s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf)
[62.746608] Starting subtest: fbc-psr2-cursor-plane-move-continuous-sf
[62.748998] Starting dynamic subtest: pipe-A-eDP-1
[63.539048] Dynamic subtest pipe-A-eDP-1: SKIP (0.789s)
[63.553724] Starting dynamic subtest: pipe-B-eDP-1
[64.672318] Dynamic subtest pipe-B-eDP-1: SKIP (1.132s)
[64.676629] Subtest fbc-psr2-cursor-plane-move-continuous-sf: SKIP (1.924s)
[65.864408] [005/134] (951s left) gem_exec_flush (basic-batch-kernel-default-wb)
[65.924654] Starting subtest: basic-batch-kernel-default-wb
[73.196133] Subtest basic-batch-kernel-default-wb: SUCCESS (7.269s)
[73.390071] [006/134] (944s left) kms_frontbuffer_tracking (pipe-fbc-rte)
[73.489306] Starting subtest: pipe-fbc-rte
[73.495847] Starting dynamic subtest: pipe-B-eDP-1
[78.955214] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.469s)
[78.962333] Subtest pipe-fbc-rte: SUCCESS (5.471s)
[81.310877] [007/134] (936s left) sw_sync (alloc_timeline)
[81.349749] Starting subtest: alloc_timeline
[81.351604] Subtest alloc_timeline: SUCCESS (0.000s)
[81.425187] [008/134] (936s left) gem_exec_params (batch-first)
[81.489947] Starting subtest: batch-first
[81.494625] Subtest batch-first: SUCCESS (0.005s)
[81.646479] [009/134] (936s left) gem_mmap_gtt (basic-small-copy)
[81.692443] Subtest basic-small-copy: SKIP (0.000s)
[81.744174] [010/134] (935s left) kms_universal_plane (universal-plane-pageflip-windowed)
[81.838407] Starting subtest: universal-plane-pageflip-windowed
[81.840597] Starting dynamic subtest: pipe-A-eDP-1
[82.430309] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.589s)
[82.437665] Starting dynamic subtest: pipe-B-eDP-1
[83.627751] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.197s)
[83.636826] Starting dynamic subtest: pipe-C-eDP-1
[84.847933] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.219s)
[84.856315] Starting dynamic subtest: pipe-D-eDP-1
[86.060702] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.210s)
[86.063062] Subtest universal-plane-pageflip-windowed: SUCCESS (4.219s)
[86.930433] [011/134] (930s left) syncobj_eventfd (invalid-illegal-handle)
[86.989779] Starting subtest: invalid-illegal-handle
[86.992061] Subtest invalid-illegal-handle: SUCCESS (0.000s)
[87.099745] [012/134] (930s left) gen9_exec_parse (cmd-crossing-page)
[87.176918] Subtest cmd-crossing-page: SKIP (0.000s)
[87.264956] [013/134] (930s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[87.358989] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[95.921699] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.565s)
[96.054417] [014/134] (921s left) kms_cursor_crc (cursor-sliding-64x21)
[96.236315] Starting subtest: cursor-sliding-64x21
[96.289406] Subtest cursor-sliding-64x21: SKIP (0.047s)
[96.555938] [015/134] (921s left) kms_psr (pr-cursor-render)
[96.661133] Starting subtest: pr-cursor-render
[96.665301] Subtest pr-cursor-render: SKIP (0.000s)
[96.750243] [016/134] (921s left) kms_flip (nonexisting-fb)
[96.845749] Starting subtest: nonexisting-fb
[96.848096] Starting dynamic subtest: A-eDP1
[98.061568] Dynamic subtest A-eDP1: SUCCESS (1.217s)
[98.070664] Starting dynamic subtest: B-eDP1
[99.199090] Dynamic subtest B-eDP1: SUCCESS (1.137s)
[99.207389] Starting dynamic subtest: C-eDP1
[100.329735] Dynamic subtest C-eDP1: SUCCESS (1.130s)
[100.339015] Starting dynamic subtest: D-eDP1
[101.468487] Dynamic subtest D-eDP1: SUCCESS (1.138s)
[101.473519] Subtest nonexisting-fb: SUCCESS (4.629s)
[102.658585] [017/134] (915s left) kms_flip (basic-flip-vs-wf_vblank)
[102.765383] Starting subtest: basic-flip-vs-wf_vblank
[102.767605] Starting dynamic subtest: A-eDP1
[104.691763] Dynamic subtest A-eDP1: SUCCESS (1.927s)
[104.701355] Starting dynamic subtest: B-eDP1
[106.615054] Dynamic subtest B-eDP1: SUCCESS (1.921s)
[106.624787] Starting dynamic subtest: C-eDP1
[108.534834] Dynamic subtest C-eDP1: SUCCESS (1.919s)
[108.542230] Starting dynamic subtest: D-eDP1
[110.469759] Dynamic subtest D-eDP1: SUCCESS (1.934s)
[110.472050] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.710s)
[111.698878] [018/134] (906s left) kms_force_connector_basic (prune-stale-modes)
[111.774645] Starting subtest: prune-stale-modes
[112.217169] Subtest prune-stale-modes: SUCCESS (0.442s)
[112.372047] [019/134] (905s left) kms_dirtyfb (default-dirtyfb-ioctl)
[112.467599] Starting subtest: default-dirtyfb-ioctl
[112.469757] Starting dynamic subtest: A-eDP-1
[114.085567] Dynamic subtest A-eDP-1: SUCCESS (1.616s)
[114.087821] Subtest default-dirtyfb-ioctl: SUCCESS (1.617s)
[114.917911] [020/134] (903s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-blt)
[115.017529] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-blt
[115.021780] Subtest fbc-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[115.137031] [021/134] (902s left) gem_ctx_exec (basic-nohangcheck)
[115.199028] Starting subtest: basic-nohangcheck
[115.457604] Subtest basic-nohangcheck: SUCCESS (0.260s)
[115.598596] [022/134] (902s left) syncobj_timeline (wait-zero-handles)
[115.654077] Starting subtest: wait-zero-handles
[115.656313] Subtest wait-zero-handles: SUCCESS (0.000s)
[115.759756] [023/134] (902s left) gem_tiled_pread_basic
[115.887930] [024/134] (902s left) kms_atomic_transition (modeset-transition-fencing)
[115.977903] Starting subtest: modeset-transition-fencing
[115.980275] Starting dynamic subtest: 1x-outputs
[126.869508] Dynamic subtest 1x-outputs: SUCCESS (10.893s)
[126.872027] Subtest modeset-transition-fencing: SUCCESS (10.894s)
[127.728297] [025/134] (890s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[127.831214] Starting subtest: y-tiled-16bpp-rotate-180
[127.835161] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[127.946376] [026/134] (890s left) vgem_basic (sysfs)
[128.036053] Starting subtest: sysfs
[128.038198] Subtest sysfs: SUCCESS (0.000s)
[128.103542] [FACT vgem_basic (sysfs)] new: kernel.kmod_is_loaded.vgem: true
[128.106660] [027/134] (890s left) gem_close_race (basic-process)
[128.177361] Starting subtest: basic-process
[128.252797] Subtest basic-process: SUCCESS (0.075s)
[128.447154] [028/134] (889s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite)
[128.549868] Starting subtest: fbc-rgb101010-draw-pwrite
[133.898022] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.352s)
[135.031348] [029/134] (883s left) gem_userptr_blits (unsync-unmap-cycles)
[135.102671] Subtest unsync-unmap-cycles: SKIP (0.000s)
[135.249850] [030/134] (883s left) gem_exec_schedule (manyslice)
[135.323206] Starting subtest: manyslice
[135.325509] Starting dynamic subtest: rcs0
[139.923749] Dynamic subtest rcs0: SUCCESS (4.610s)
[139.931232] Starting dynamic subtest: bcs0
[146.547653] Dynamic subtest bcs0: SUCCESS (6.622s)
[146.558064] Starting dynamic subtest: vcs0
[152.124771] Dynamic subtest vcs0: SUCCESS (5.576s)
[152.136941] Starting dynamic subtest: vcs1
[158.713374] Dynamic subtest vcs1: SUCCESS (6.587s)
[158.722628] Starting dynamic subtest: vecs0
[163.768804] Dynamic subtest vecs0: SUCCESS (5.055s)
[163.776856] Starting dynamic subtest: ccs0
[169.426066] Dynamic subtest ccs0: SUCCESS (5.656s)
[169.428374] Subtest manyslice: SUCCESS (34.113s)
[169.736280] [031/134] (848s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc)
[169.841951] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc
[169.844306] Starting dynamic subtest: pipe-A-eDP-1
[169.867726] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[169.877513] Starting dynamic subtest: pipe-B-eDP-1
[169.899326] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[169.906797] Starting dynamic subtest: pipe-C-eDP-1
[169.928457] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[169.936079] Starting dynamic subtest: pipe-D-eDP-1
[169.957880] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[169.962047] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[172.114441] [032/134] (846s left) kms_cursor_legacy (cursorb-vs-flipb-legacy)
[172.244509] Starting subtest: cursorB-vs-flipB-legacy
[172.249067] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s)
[172.412970] [033/134] (846s left) gem_exec_params (invalid-bsd2-flag-on-render)
[172.474923] Starting subtest: invalid-bsd2-flag-on-render
[172.477188] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.000s)
[172.589299] [034/134] (846s left) kms_chamelium_edid (dp-edid-resolution-list)
[172.976686] Subtest dp-edid-resolution-list: SKIP (0.000s)
[173.788369] [035/134] (844s left) gem_spin_batch (spin-all-new)
[173.854353] Starting subtest: spin-all-new
[173.870094] Subtest spin-all-new: SUCCESS (0.014s)
[175.953863] [036/134] (842s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[176.060270] Starting subtest: flip-primary-invalidate-overlay
[187.646356] Subtest flip-primary-invalidate-overlay: SUCCESS (11.586s)
[187.799895] [037/134] (830s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping)
[187.900311] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping
[187.926886] Starting dynamic subtest: pipe-A-plane-0
[187.930337] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[187.937405] Starting dynamic subtest: pipe-A-plane-3
[187.941084] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[187.948788] Starting dynamic subtest: pipe-A-plane-5
[187.952472] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[189.064877] Starting dynamic subtest: pipe-B-plane-0
[189.069633] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[189.080876] Starting dynamic subtest: pipe-B-plane-3
[189.085714] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[189.097737] Starting dynamic subtest: pipe-B-plane-5
[189.102308] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[189.385190] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (1.482s)
[190.231500] [038/134] (828s left) kms_dsc (dsc-fractional-bpp-with-bpc)
[190.331041] Starting subtest: dsc-fractional-bpp-with-bpc
[190.362664] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s)
[190.415321] [039/134] (828s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[190.522089] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[190.526074] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[190.643753] [040/134] (828s left) i915_hangman (gt-engine-error)
[190.714262] Starting subtest: gt-engine-error
[190.716319] Starting dynamic subtest: rcs0
[191.863555] Dynamic subtest rcs0: SUCCESS (1.149s)
[191.874627] Starting dynamic subtest: bcs0
[193.910211] Dynamic subtest bcs0: SUCCESS (2.044s)
[193.921249] Starting dynamic subtest: vcs0
[195.894109] Dynamic subtest vcs0: SUCCESS (1.982s)
[195.904545] Starting dynamic subtest: vcs1
[197.814122] Dynamic subtest vcs1: SUCCESS (1.918s)
[197.824363] Starting dynamic subtest: vecs0
[198.901282] Dynamic subtest vecs0: SUCCESS (1.085s)
[198.911095] Starting dynamic subtest: ccs0
[200.822191] Dynamic subtest ccs0: SUCCESS (1.919s)
[200.825076] Subtest gt-engine-error: SUCCESS (10.109s)
[200.921585] [041/134] (817s left) gem_exec_fence (submit3)
[201.104853] Starting subtest: submit3
[201.109593] Subtest submit3: SKIP (0.000s)
[202.972310] [042/134] (815s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[203.076264] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[203.080258] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[203.212178] [043/134] (815s left) kms_plane_cursor (overlay)
[203.315264] Starting subtest: overlay
[203.319825] Starting dynamic subtest: pipe-A-eDP-1-size-64
[205.912526] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.598s)
[205.970066] Starting dynamic subtest: pipe-A-eDP-1-size-128
[208.512847] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.551s)
[208.574056] Starting dynamic subtest: pipe-A-eDP-1-size-256
[211.102198] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.538s)
[211.460654] Starting dynamic subtest: pipe-B-eDP-1-size-64
[214.754918] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.310s)
[214.815993] Starting dynamic subtest: pipe-B-eDP-1-size-128
[217.369056] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.560s)
[217.427670] Starting dynamic subtest: pipe-B-eDP-1-size-256
[220.048148] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.627s)
[220.393407] Starting dynamic subtest: pipe-C-eDP-1-size-64
[223.294648] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.910s)
[223.344512] Starting dynamic subtest: pipe-C-eDP-1-size-128
[225.606144] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.279s)
[225.642904] Starting dynamic subtest: pipe-C-eDP-1-size-256
[227.850410] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.214s)
[228.181123] Starting dynamic subtest: pipe-D-eDP-1-size-64
[231.140683] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.969s)
[231.176989] Starting dynamic subtest: pipe-D-eDP-1-size-128
[233.417412] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.247s)
[233.460035] Starting dynamic subtest: pipe-D-eDP-1-size-256
[235.740332] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.291s)
[236.058449] Subtest overlay: SUCCESS (32.744s)
[236.900411] [044/134] (782s left) kms_cursor_crc (cursor-rapid-movement-256x85)
[237.175835] Starting subtest: cursor-rapid-movement-256x85
[237.243794] Subtest cursor-rapid-movement-256x85: SKIP (0.062s)
[237.440192] [045/134] (781s left) syncobj_timeline (invalid-transfer-bad-pad)
[237.506334] Starting subtest: invalid-transfer-bad-pad
[237.508527] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[237.622623] [046/134] (781s left) syncobj_timeline (wait-all-for-submit-complex)
[237.687830] Starting subtest: wait-all-for-submit-complex
[237.901570] Subtest wait-all-for-submit-complex: SUCCESS (0.215s)
[238.006806] [047/134] (781s left) gem_partial_pwrite_pread (writes-after-reads)
[238.062702] Subtest writes-after-reads: SKIP (0.000s)
[238.141634] [048/134] (781s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[238.238272] Starting subtest: fbcpsr-rgb565-draw-blt
[245.358178] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (7.124s)
[245.541367] [049/134] (773s left) gem_blits (basic)
[245.609696] Starting subtest: basic
[246.996486] Subtest basic: SUCCESS (1.386s)
[247.159452] [050/134] (772s left) kms_psr (fbc-psr-primary-mmap-gtt)
[247.261332] Starting subtest: fbc-psr-primary-mmap-gtt
[247.263251] Starting dynamic subtest: eDP-1
[247.267164] Dynamic subtest eDP-1: SKIP (0.000s)
[247.271239] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s)
[247.353804] [051/134] (771s left) gem_madvise (dontneed-after-mmap)
[247.385202] Starting subtest: dontneed-after-mmap
[247.413807] Subtest dontneed-after-mmap: SUCCESS (0.030s)
[247.552226] [052/134] (771s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[247.613712] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[247.618221] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[247.818198] [053/134] (771s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-pwrite)
[247.916197] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-pwrite
[255.074313] Subtest fbc-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (7.160s)
[256.219515] [054/134] (763s left) api_intel_bb (object-noreloc-keep-cache-simple)
[256.287755] Starting subtest: object-noreloc-keep-cache-simple
[256.290155] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.005s)
[256.462017] [055/134] (763s left) kms_pm_rpm (modeset-non-lpsp-stress)
[258.084603] Starting subtest: modeset-non-lpsp-stress
[259.231791] Subtest modeset-non-lpsp-stress: SKIP (1.147s)
[259.626854] [056/134] (759s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs)
[259.734968] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs
[259.737374] Starting dynamic subtest: pipe-A-eDP-1
[259.760741] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[259.770207] Starting dynamic subtest: pipe-B-eDP-1
[259.791854] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[259.799519] Starting dynamic subtest: pipe-C-eDP-1
[259.821268] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[259.828774] Starting dynamic subtest: pipe-D-eDP-1
[259.850507] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[259.854844] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[262.011053] [057/134] (757s left) gem_mmap_gtt (cpuset-medium-copy)
[262.075225] Subtest cpuset-medium-copy: SKIP (0.000s)
[262.133913] [058/134] (757s left) dmabuf_sync_file (export-basic)
[262.176335] Starting subtest: export-basic
[262.178505] Subtest export-basic: SUCCESS (0.001s)
[262.245731] [059/134] (757s left) gem_eio (context-create)
[262.487198] Starting subtest: context-create
[262.853770] Subtest context-create: SUCCESS (0.363s)
[262.975481] [060/134] (756s left) kms_psr (psr2-sprite-mmap-gtt)
[263.071925] Starting subtest: psr2-sprite-mmap-gtt
[263.073719] Starting dynamic subtest: eDP-1
[264.467293] Dynamic subtest eDP-1: SKIP (1.391s)
[264.472216] Subtest psr2-sprite-mmap-gtt: SKIP (1.393s)
[264.663225] [061/134] (755s left) kms_big_fb (yf-tiled-32bpp-rotate-90)
[264.768712] Starting subtest: yf-tiled-32bpp-rotate-90
[264.773171] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s)
[264.897872] [062/134] (754s left) kms_3d (basic)
[264.948079] Starting subtest: basic
[266.952756] Subtest basic: SUCCESS (2.007s)
[267.459523] [063/134] (752s left) gem_exec_schedule (promotion)
[267.542270] Starting subtest: promotion
[267.544614] Starting dynamic subtest: rcs0
[267.633764] Dynamic subtest rcs0: SUCCESS (0.100s)
[267.643657] Starting dynamic subtest: vcs0
[267.719311] Dynamic subtest vcs0: SUCCESS (0.084s)
[267.728889] Starting dynamic subtest: vcs1
[267.805827] Dynamic subtest vcs1: SUCCESS (0.086s)
[267.817492] Starting dynamic subtest: vecs0
[267.884815] Dynamic subtest vecs0: SUCCESS (0.078s)
[267.896035] Starting dynamic subtest: ccs0
[267.966074] Dynamic subtest ccs0: SUCCESS (0.080s)
[267.969031] Subtest promotion: SUCCESS (0.433s)
[269.020960] [064/134] (750s left) perf (gen8-unprivileged-single-ctx-counters)
[269.147240] Starting subtest: gen8-unprivileged-single-ctx-counters
[269.150884] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s)
[269.186902] [065/134] (750s left) kms_cursor_crc (cursor-onscreen-64x64)
[269.371243] Starting subtest: cursor-onscreen-64x64
[269.376075] Starting dynamic subtest: pipe-A-eDP-1
[271.483365] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.108s)
[271.515024] Starting dynamic subtest: pipe-D-eDP-1
[274.232624] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.723s)
[274.234762] Subtest cursor-onscreen-64x64: SUCCESS (4.858s)
[275.107515] [066/134] (744s left) gem_exec_reloc (basic-gtt-read-noreloc)
[275.174291] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[275.264245] [067/134] (744s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[275.363755] Starting subtest: primary-y-tiled-reflect-x-90
[275.368120] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s)
[275.463897] [068/134] (744s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[275.582516] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[275.584600] Starting dynamic subtest: pipe-A-eDP-1
[276.328583] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.738s)
[276.338615] Starting dynamic subtest: pipe-B-eDP-1
[278.122699] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.792s)
[278.132873] Starting dynamic subtest: pipe-C-eDP-1
[279.896905] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.773s)
[279.906521] Starting dynamic subtest: pipe-D-eDP-1
[281.688752] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.790s)
[281.690742] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.099s)
[282.907269] [069/134] (737s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf)
[287.893805] Starting subtest: pr-overlay-plane-move-continuous-sf
[287.898229] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.002s)
[288.705584] [070/134] (731s left) kms_rotation_crc (primary-rotation-270)
[288.809656] Starting subtest: primary-rotation-270
[288.814050] Subtest primary-rotation-270: SKIP (0.001s)
[288.893378] [071/134] (731s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[293.985280] Starting subtest: psr2-overlay-plane-update-sf-dmg-area
[293.987540] Starting dynamic subtest: pipe-A-eDP-1
[300.460620] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.472s)
[300.469519] Starting dynamic subtest: pipe-B-eDP-1
[306.946085] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.485s)
[306.948231] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (12.961s)
[307.804950] [072/134] (712s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[307.921511] Starting subtest: psr-1p-primscrn-cur-indfb-move
[315.191284] Subtest psr-1p-primscrn-cur-indfb-move: SUCCESS (7.271s)
[315.362143] [073/134] (704s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[315.468564] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[315.472655] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[315.596973] [074/134] (704s left) kms_invalid_mode (bad-vsync-end)
[315.705439] Starting subtest: bad-vsync-end
[315.707728] Starting dynamic subtest: pipe-A-eDP-1
[315.988519] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[315.997412] Starting dynamic subtest: pipe-B-eDP-1
[315.999372] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[316.007189] Starting dynamic subtest: pipe-C-eDP-1
[316.009533] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[316.017622] Starting dynamic subtest: pipe-D-eDP-1
[316.019884] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[316.022075] Subtest bad-vsync-end: SUCCESS (0.290s)
[316.806504] [075/134] (703s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[316.871766] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[316.873909] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[317.010195] [076/134] (703s left) gem_mmap_offset (pf-nonblock)
[317.080204] Starting subtest: pf-nonblock
[317.086035] Subtest pf-nonblock: SUCCESS (0.006s)
[317.235798] [077/134] (703s left) gem_wait (write-wait)
[317.320950] Starting subtest: write-wait
[317.323330] Starting dynamic subtest: all-engines
[318.423780] Dynamic subtest all-engines: SUCCESS (1.105s)
[318.438931] Starting dynamic subtest: rcs0
[319.484379] Dynamic subtest rcs0: SUCCESS (1.058s)
[319.500359] Starting dynamic subtest: bcs0
[320.543092] Dynamic subtest bcs0: SUCCESS (1.057s)
[320.559522] Starting dynamic subtest: vcs0
[321.604055] Dynamic subtest vcs0: SUCCESS (1.058s)
[321.620050] Starting dynamic subtest: vcs1
[322.656622] Dynamic subtest vcs1: SUCCESS (1.050s)
[322.672576] Starting dynamic subtest: vecs0
[323.710141] Dynamic subtest vecs0: SUCCESS (1.051s)
[323.725407] Starting dynamic subtest: ccs0
[324.766053] Dynamic subtest ccs0: SUCCESS (1.054s)
[324.768718] Subtest write-wait: SUCCESS (7.449s)
[324.981431] [078/134] (695s left) perf_pmu (gt-awake)
[325.021287] Starting subtest: gt-awake
[333.913521] Subtest gt-awake: SUCCESS (8.891s)
[334.045231] [079/134] (686s left) kms_content_protection (suspend-resume)
[334.205695] Starting subtest: suspend-resume
[334.210215] Subtest suspend-resume: SKIP (0.000s)
[334.359430] [080/134] (686s left) api_intel_allocator (simple-allocator)
[334.414567] Starting subtest: simple-allocator
[334.416881] Starting dynamic subtest: basic
[334.418824] Dynamic subtest basic: SUCCESS (0.003s)
[334.432793] Starting dynamic subtest: parallel-one
[334.600656] Dynamic subtest parallel-one: SUCCESS (0.183s)
[334.609946] Starting dynamic subtest: print
[334.612305] Dynamic subtest print: SUCCESS (0.000s)
[334.621314] Starting dynamic subtest: reuse
[334.623457] Dynamic subtest reuse: SUCCESS (0.000s)
[334.631913] Starting dynamic subtest: reserve
[334.634118] Dynamic subtest reserve: SUCCESS (0.000s)
[334.642536] Starting dynamic subtest: fork-reopen-allocator
[334.644763] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[334.647042] Subtest simple-allocator: SUCCESS (0.206s)
[334.777269] [081/134] (685s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render)
[334.880519] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render
[334.884624] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[335.011653] [082/134] (685s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[335.114544] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[335.118762] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[335.241348] [083/134] (685s left) prime_mmap (test_correct)
[335.294635] Starting subtest: test_correct
[335.296864] Starting dynamic subtest: test_correct-smem
[335.346193] Dynamic subtest test_correct-smem: SUCCESS (0.052s)
[335.348574] Subtest test_correct: SUCCESS (0.053s)
[335.484599] [084/134] (685s left) syncobj_wait (multi-wait-all-for-submit-signaled)
[335.551286] Starting subtest: multi-wait-all-for-submit-signaled
[335.553690] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s)
[335.653433] [085/134] (685s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[335.742144] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[340.302857] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.563s)
[341.512751] [086/134] (679s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[341.611063] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[341.615622] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[341.711897] [087/134] (679s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling)
[341.811737] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling
[341.816185] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s)
[341.900698] [088/134] (678s left) kms_flip (plain-flip-ts-check-interruptible)
[341.991838] Starting subtest: plain-flip-ts-check-interruptible
[341.994080] Starting dynamic subtest: A-eDP1
[350.849484] Dynamic subtest A-eDP1: SUCCESS (8.855s)
[350.861579] Starting dynamic subtest: B-eDP1
[359.653739] Dynamic subtest B-eDP1: SUCCESS (8.802s)
[359.667446] Starting dynamic subtest: C-eDP1
[368.442533] Dynamic subtest C-eDP1: SUCCESS (8.786s)
[368.462898] Starting dynamic subtest: D-eDP1
[377.228843] Dynamic subtest D-eDP1: SUCCESS (8.785s)
[377.234379] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.240s)
[378.513180] [089/134] (642s left) gem_mmap_offset (partial-remap)
[378.578257] Starting subtest: partial-remap
[378.580627] Starting dynamic subtest: smem0
[378.589458] Dynamic subtest smem0: SUCCESS (0.003s)
[378.591367] Subtest partial-remap: SUCCESS (0.004s)
[378.741304] [090/134] (642s left) perf (sysctl-defaults)
[378.817383] Starting subtest: sysctl-defaults
[378.819812] Subtest sysctl-defaults: SUCCESS (0.000s)
[378.881568] [091/134] (642s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[378.999131] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[383.448684] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.452s)
[384.603512] [092/134] (636s left) kms_pm_rpm (basic-rte)
[384.645710] Starting subtest: basic-rte
[387.587133] Subtest basic-rte: SUCCESS (2.941s)
[389.423709] [093/134] (631s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs)
[389.532301] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs
[389.534660] Starting dynamic subtest: pipe-A-eDP-1
[389.593476] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[389.603759] Starting dynamic subtest: pipe-B-eDP-1
[389.661280] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[389.671504] Starting dynamic subtest: pipe-C-eDP-1
[389.727985] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[389.737550] Starting dynamic subtest: pipe-D-eDP-1
[389.794276] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[389.798313] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.009s)
[391.805035] [094/134] (629s left) kms_lease (implicit-plane-lease)
[391.908970] Starting subtest: implicit-plane-lease
[391.911191] Subtest implicit-plane-lease: SUCCESS (0.003s)
[392.032946] [095/134] (629s left) gem_exec_gttfill (engines)
[392.102751] Starting subtest: engines
[392.105120] Starting dynamic subtest: rcs0
[415.143248] Dynamic subtest rcs0: SUCCESS (23.040s)
[415.154819] Starting dynamic subtest: bcs0
[438.525286] Dynamic subtest bcs0: SUCCESS (23.378s)
[438.540707] Starting dynamic subtest: vcs0
[461.903261] Dynamic subtest vcs0: SUCCESS (23.374s)
[461.914703] Starting dynamic subtest: vcs1
[485.223712] Dynamic subtest vcs1: SUCCESS (23.319s)
[485.233511] Starting dynamic subtest: vecs0
[508.559951] Dynamic subtest vecs0: SUCCESS (23.332s)
[508.571334] Starting dynamic subtest: ccs0
[531.897373] Dynamic subtest ccs0: SUCCESS (23.333s)
[531.900693] Subtest engines: SUCCESS (139.790s)
[532.100642] [096/134] (489s left) gem_exec_store (cachelines)
[532.211757] Starting subtest: cachelines
[532.214077] Starting dynamic subtest: rcs0
[532.296776] Dynamic subtest rcs0: SUCCESS (0.088s)
[532.307993] Starting dynamic subtest: bcs0
[532.364990] Dynamic subtest bcs0: SUCCESS (0.067s)
[532.375731] Starting dynamic subtest: vcs0
[532.428100] Dynamic subtest vcs0: SUCCESS (0.061s)
[532.439067] Starting dynamic subtest: vcs1
[532.489938] Dynamic subtest vcs1: SUCCESS (0.060s)
[532.500971] Starting dynamic subtest: vecs0
[532.554183] Dynamic subtest vecs0: SUCCESS (0.062s)
[532.566903] Starting dynamic subtest: ccs0
[532.618873] Dynamic subtest ccs0: SUCCESS (0.063s)
[532.621266] Subtest cachelines: SUCCESS (0.411s)
[532.819230] [097/134] (488s left) kms_big_fb (x-tiled-addfb-size-overflow)
[532.940669] Starting subtest: x-tiled-addfb-size-overflow
[532.943061] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s)
[533.073273] [098/134] (488s left) syncobj_timeline (etime-single-wait-available-unsubmitted)
[533.135531] Starting subtest: etime-single-wait-available-unsubmitted
[533.234829] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.101s)
[533.328054] [099/134] (488s left) gem_exec_reloc (basic-softpin)
[533.386459] Subtest basic-softpin: SKIP (0.000s)
[533.481253] [100/134] (487s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[533.574898] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[533.577261] Starting dynamic subtest: pipe-A
[533.801799] Dynamic subtest pipe-A: SUCCESS (0.229s)
[533.812528] Starting dynamic subtest: pipe-B
[535.126923] Dynamic subtest pipe-B: SUCCESS (1.324s)
[535.136062] Starting dynamic subtest: pipe-C
[536.440296] Dynamic subtest pipe-C: SUCCESS (1.312s)
[536.450281] Starting dynamic subtest: pipe-D
[537.715923] Dynamic subtest pipe-D: SUCCESS (1.275s)
[537.718260] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.143s)
[538.900168] [101/134] (482s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[539.005380] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[546.511486] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.507s)
[546.668829] [102/134] (474s left) gem_ctx_persistence (heartbeat-many)
[546.736287] Starting subtest: heartbeat-many
[546.740740] Subtest heartbeat-many: SKIP (0.000s)
[546.860929] [103/134] (474s left) i915_query (query-topology-garbage-items)
[546.923753] Starting subtest: query-topology-garbage-items
[546.926182] Subtest query-topology-garbage-items: SUCCESS (0.000s)
[547.034965] [104/134] (474s left) prime_vgem (sync)
[547.117139] Starting subtest: sync
[547.119482] Starting dynamic subtest: rcs0
[547.191890] Dynamic subtest rcs0: SUCCESS (0.074s)
[547.200841] Starting dynamic subtest: bcs0
[547.284675] Dynamic subtest bcs0: SUCCESS (0.092s)
[547.293694] Starting dynamic subtest: vcs0
[547.341275] Dynamic subtest vcs0: SUCCESS (0.054s)
[547.355769] Starting dynamic subtest: vcs1
[547.388148] Dynamic subtest vcs1: SUCCESS (0.041s)
[547.397145] Starting dynamic subtest: vecs0
[547.434022] Dynamic subtest vecs0: SUCCESS (0.045s)
[547.442847] Starting dynamic subtest: ccs0
[547.481405] Dynamic subtest ccs0: SUCCESS (0.047s)
[547.483310] Subtest sync: SUCCESS (0.365s)
[547.614705] [105/134] (473s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[547.721054] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[547.722886] Starting dynamic subtest: pipe-A
[548.057254] Dynamic subtest pipe-A: SUCCESS (0.338s)
[548.066327] Starting dynamic subtest: pipe-B
[549.427045] Dynamic subtest pipe-B: SUCCESS (1.369s)
[549.435775] Starting dynamic subtest: pipe-C
[550.836620] Dynamic subtest pipe-C: SUCCESS (1.409s)
[550.856394] Starting dynamic subtest: pipe-D
[552.244256] Dynamic subtest pipe-D: SUCCESS (1.407s)
[552.246511] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.525s)
[553.477593] [106/134] (468s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-mmap-cpu)
[553.581471] Starting subtest: fbc-abgr161616f-draw-mmap-cpu
[553.586087] Subtest fbc-abgr161616f-draw-mmap-cpu: SKIP (0.000s)
[553.763070] [107/134] (467s left) gem_exec_balancer (persistence)
[554.034738] Starting subtest: persistence
[554.923239] Subtest persistence: SUCCESS (0.888s)
[555.083167] [108/134] (466s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[555.182558] Starting subtest: fbc-2p-pri-indfb-multidraw
[555.186697] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s)
[555.317513] [109/134] (466s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[555.426818] Starting subtest: psr-2p-primscrn-cur-indfb-move
[555.431193] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[555.572783] [110/134] (466s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[555.678527] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[555.682968] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[555.813036] [111/134] (466s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[555.914426] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[556.749572] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.837s)
[556.950481] [112/134] (464s left) gem_create (create-valid-nonaligned)
[557.017530] Starting subtest: create-valid-nonaligned
[557.019497] Subtest create-valid-nonaligned: SUCCESS (0.000s)
[557.213542] [113/134] (464s left) i915_drm_fdinfo (busy-idle)
[557.258896] Starting subtest: busy-idle
[557.261177] Starting dynamic subtest: rcs0
[557.306491] Dynamic subtest rcs0: SKIP (0.046s)
[557.317667] Starting dynamic subtest: bcs0
[557.322074] Dynamic subtest bcs0: SKIP (0.001s)
[557.331070] Starting dynamic subtest: vcs0
[557.335045] Dynamic subtest vcs0: SKIP (0.000s)
[557.343872] Starting dynamic subtest: vcs1
[557.348159] Dynamic subtest vcs1: SKIP (0.000s)
[557.356957] Starting dynamic subtest: vecs0
[557.361296] Dynamic subtest vecs0: SKIP (0.000s)
[557.369902] Starting dynamic subtest: ccs0
[557.374219] Dynamic subtest ccs0: SKIP (0.000s)
[557.378582] Subtest busy-idle: SKIP (0.053s)
[557.414811] [114/134] (464s left) kms_cursor_legacy (cursorb-vs-flipa-atomic)
[557.548429] Starting subtest: cursorB-vs-flipA-atomic
[557.552748] Subtest cursorB-vs-flipA-atomic: SKIP (0.001s)
[557.703907] [115/134] (464s left) gem_softpin (softpin)
[557.775992] Starting subtest: softpin
[590.141165] Subtest softpin: SUCCESS (32.358s)
[590.281503] [116/134] (431s left) gem_set_tiling_vs_blt (tiled-to-untiled)
[590.348755] Subtest tiled-to-untiled: SKIP (0.000s)
[590.420876] [117/134] (431s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier)
[590.517819] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier
[590.544924] Starting dynamic subtest: pipe-A-plane-0
[590.550077] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[590.560243] Starting dynamic subtest: pipe-A-plane-3
[590.564784] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[590.574572] Starting dynamic subtest: pipe-A-plane-5
[590.579058] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[591.619546] Starting dynamic subtest: pipe-B-plane-0
[591.623871] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[591.633147] Starting dynamic subtest: pipe-B-plane-3
[591.637809] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[591.646930] Starting dynamic subtest: pipe-B-plane-5
[591.651579] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[591.948292] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (1.427s)
[592.785344] [118/134] (429s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[592.898626] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[592.902989] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[593.028325] [119/134] (429s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[593.133272] Starting subtest: 4-tiled-8bpp-rotate-90
[593.155464] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s)
[593.305369] [120/134] (428s left) kms_color (invalid-ctm-matrix-sizes)
[593.405484] Starting subtest: invalid-ctm-matrix-sizes
[593.407817] Starting dynamic subtest: pipe-A
[593.410099] Dynamic subtest pipe-A: SUCCESS (0.002s)
[593.419423] Starting dynamic subtest: pipe-B
[593.421632] Dynamic subtest pipe-B: SUCCESS (0.003s)
[593.430837] Starting dynamic subtest: pipe-C
[593.433144] Dynamic subtest pipe-C: SUCCESS (0.003s)
[593.441946] Starting dynamic subtest: pipe-D
[593.444225] Dynamic subtest pipe-D: SUCCESS (0.004s)
[593.446094] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.015s)
[593.514636] [121/134] (428s left) kms_chamelium_hpd (dp-hpd-after-suspend)
[593.906195] Subtest dp-hpd-after-suspend: SKIP (0.000s)
[594.748143] [122/134] (427s left) kms_rmfb (close-fd)
[594.837920] Starting subtest: close-fd
[594.840302] Starting dynamic subtest: pipe-A-eDP-1
[594.946363] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s)
[594.956444] Starting dynamic subtest: pipe-B-eDP-1
[596.099468] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.151s)
[596.110195] Starting dynamic subtest: pipe-C-eDP-1
[597.283984] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.185s)
[597.293700] Starting dynamic subtest: pipe-D-eDP-1
[598.488941] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.203s)
[598.491118] Subtest close-fd: SUCCESS (3.650s)
[599.694124] [123/134] (422s left) kms_busy (extended-modeset-hang-newfb-with-reset)
[599.803316] Starting subtest: extended-modeset-hang-newfb-with-reset
[599.805506] Starting dynamic subtest: pipe-A
[614.885043] Dynamic subtest pipe-A: SUCCESS (15.079s)
[614.904730] Starting dynamic subtest: pipe-D
[631.005553] Dynamic subtest pipe-D: SUCCESS (16.114s)
[631.008012] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (31.198s)
[631.888415] [124/134] (390s left) perf_pmu (busy-accuracy-50)
[631.932072] Starting subtest: busy-accuracy-50
[631.934083] Starting dynamic subtest: rcs0
[633.464169] Dynamic subtest rcs0: SUCCESS (1.530s)
[633.475542] Starting dynamic subtest: bcs0
[635.006203] Dynamic subtest bcs0: SUCCESS (1.539s)
[635.017508] Starting dynamic subtest: vcs0
[636.547959] Dynamic subtest vcs0: SUCCESS (1.539s)
[636.559465] Starting dynamic subtest: vcs1
[638.087936] Dynamic subtest vcs1: SUCCESS (1.538s)
[638.099410] Starting dynamic subtest: vecs0
[639.629536] Dynamic subtest vecs0: SUCCESS (1.539s)
[639.640961] Starting dynamic subtest: ccs0
[641.172098] Dynamic subtest ccs0: SUCCESS (1.541s)
[641.174539] Subtest busy-accuracy-50: SUCCESS (9.239s)
[641.332807] [125/134] (381s left) gem_lmem_evict (dontneed-evict-race)
[641.378890] Subtest dontneed-evict-race: SKIP (0.000s)
[641.428729] [126/134] (381s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[641.528753] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[641.530861] Starting dynamic subtest: pipe-A-eDP-1
[641.539265] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[641.549187] Starting dynamic subtest: pipe-B-eDP-1
[641.557845] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[641.566731] Starting dynamic subtest: pipe-C-eDP-1
[641.574966] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[641.583638] Starting dynamic subtest: pipe-D-eDP-1
[641.592090] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[641.595968] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[643.777742] [127/134] (378s left) i915_pm_rpm (system-suspend-devices)
[646.017901] Starting subtest: system-suspend-devices
[653.818490] Subtest system-suspend-devices: SUCCESS (7.802s)
[654.206918] [128/134] (368s left) syncobj_wait (wait-any-complex)
[654.283609] Starting subtest: wait-any-complex
[654.344817] Subtest wait-any-complex: SUCCESS (0.062s)
[654.435431] [129/134] (368s left) kms_vblank (wait-forked)
[654.524272] Starting subtest: wait-forked
[654.526569] Starting dynamic subtest: pipe-A-eDP-1
[656.335275] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.808s)
[656.349985] Starting dynamic subtest: pipe-D-eDP-1
[658.834232] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.495s)
[658.836616] Subtest wait-forked: SUCCESS (4.307s)
[659.678977] [130/134] (362s left) gem_exec_balancer (noheartbeat)
[659.941503] Starting subtest: noheartbeat
[659.945940] Subtest noheartbeat: SKIP (0.000s)
[660.066089] [131/134] (362s left) kms_psr (fbc-psr2-cursor-mmap-cpu)
[660.170662] Starting subtest: fbc-psr2-cursor-mmap-cpu
[660.172807] Starting dynamic subtest: eDP-1
[660.176714] Dynamic subtest eDP-1: SKIP (0.000s)
[660.180734] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.001s)
[660.260381] [132/134] (362s left) kms_getfb (getfb2-handle-not-fb)
[660.362616] Starting subtest: getfb2-handle-not-fb
[660.364740] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[660.504070] [133/134] (362s left) syncobj_wait (wait-for-submit-snapshot)
[660.567336] Starting subtest: wait-for-submit-snapshot
[660.646434] Subtest wait-for-submit-snapshot: SUCCESS (0.081s)
[660.736133] [134/134] (362s left) kms_addfb_basic (size-max)
[660.834797] Starting subtest: size-max
[660.836981] Subtest size-max: SUCCESS (0.000s)
[660.951752] Closing watchdogs
results: parsing output: 0/ for test: kms_getfb
results: parsing output: 1/ for test: gem_close_race
results: parsing output: 2/ for test: gem_pxp
results: parsing output: 3/ for test: kms_psr2_sf
results: parsing output: 4/ for test: gem_exec_flush
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: sw_sync
results: parsing output: 7/ for test: gem_exec_params
results: parsing output: 8/ for test: gem_mmap_gtt
results: parsing output: 9/ for test: kms_universal_plane
results: parsing output: 10/ for test: syncobj_eventfd
results: parsing output: 11/ for test: gen9_exec_parse
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_cursor_crc
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: kms_flip
results: parsing output: 16/ for test: kms_flip
results: parsing output: 17/ for test: kms_force_connector_basic
results: parsing output: 18/ for test: kms_dirtyfb
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: gem_ctx_exec
results: parsing output: 21/ for test: syncobj_timeline
results: parsing output: 22/ for test: gem_tiled_pread_basic
results: parsing output: 23/ for test: kms_atomic_transition
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: vgem_basic
results: parsing output: 26/ for test: gem_close_race
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: gem_userptr_blits
results: parsing output: 29/ for test: gem_exec_schedule
results: parsing output: 30/ for test: kms_ccs
results: parsing output: 31/ for test: kms_cursor_legacy
results: parsing output: 32/ for test: gem_exec_params
results: parsing output: 33/ for test: kms_chamelium_edid
results: parsing output: 34/ for test: gem_spin_batch
results: parsing output: 35/ for test: kms_psr_stress_test
results: parsing output: 36/ for test: kms_plane
results: parsing output: 37/ for test: kms_dsc
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: i915_hangman
results: parsing output: 40/ for test: gem_exec_fence
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_plane_cursor
results: parsing output: 43/ for test: kms_cursor_crc
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: syncobj_timeline
results: parsing output: 46/ for test: gem_partial_pwrite_pread
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_blits
results: parsing output: 49/ for test: kms_psr
results: parsing output: 50/ for test: gem_madvise
results: parsing output: 51/ for test: gem_render_copy
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: api_intel_bb
results: parsing output: 54/ for test: kms_pm_rpm
results: parsing output: 55/ for test: kms_ccs
results: parsing output: 56/ for test: gem_mmap_gtt
results: parsing output: 57/ for test: dmabuf_sync_file
results: parsing output: 58/ for test: gem_eio
results: parsing output: 59/ for test: kms_psr
results: parsing output: 60/ for test: kms_big_fb
results: parsing output: 61/ for test: kms_3d
results: parsing output: 62/ for test: gem_exec_schedule
results: parsing output: 63/ for test: perf
results: parsing output: 64/ for test: kms_cursor_crc
results: parsing output: 65/ for test: gem_exec_reloc
results: parsing output: 66/ for test: kms_rotation_crc
results: parsing output: 67/ for test: kms_ccs
results: parsing output: 68/ for test: kms_psr2_sf
results: parsing output: 69/ for test: kms_rotation_crc
results: parsing output: 70/ for test: kms_psr2_sf
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_invalid_mode
results: parsing output: 74/ for test: syncobj_timeline
results: parsing output: 75/ for test: gem_mmap_offset
results: parsing output: 76/ for test: gem_wait
results: parsing output: 77/ for test: perf_pmu
results: parsing output: 78/ for test: kms_content_protection
results: parsing output: 79/ for test: api_intel_allocator
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_big_fb
results: parsing output: 82/ for test: prime_mmap
results: parsing output: 83/ for test: syncobj_wait
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_flip_scaled_crc
results: parsing output: 86/ for test: kms_flip_scaled_crc
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: gem_mmap_offset
results: parsing output: 89/ for test: perf
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_pm_rpm
results: parsing output: 92/ for test: kms_ccs
results: parsing output: 93/ for test: kms_lease
results: parsing output: 94/ for test: gem_exec_gttfill
results: parsing output: 95/ for test: gem_exec_store
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: syncobj_timeline
results: parsing output: 98/ for test: gem_exec_reloc
results: parsing output: 99/ for test: kms_plane_scaling
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_ctx_persistence
results: parsing output: 102/ for test: i915_query
results: parsing output: 103/ for test: prime_vgem
results: parsing output: 104/ for test: kms_plane_scaling
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: gem_exec_balancer
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_big_fb
results: parsing output: 111/ for test: gem_create
results: parsing output: 112/ for test: i915_drm_fdinfo
results: parsing output: 113/ for test: kms_cursor_legacy
results: parsing output: 114/ for test: gem_softpin
results: parsing output: 115/ for test: gem_set_tiling_vs_blt
results: parsing output: 116/ for test: kms_plane
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: kms_color
results: parsing output: 120/ for test: kms_chamelium_hpd
results: parsing output: 121/ for test: kms_rmfb
results: parsing output: 122/ for test: kms_busy
results: parsing output: 123/ for test: perf_pmu
results: parsing output: 124/ for test: gem_lmem_evict
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: i915_pm_rpm
results: parsing output: 127/ for test: syncobj_wait
results: parsing output: 128/ for test: kms_vblank
results: parsing output: 129/ for test: gem_exec_balancer
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: kms_getfb
results: parsing output: 132/ for test: syncobj_wait
results: parsing output: 133/ for test: kms_addfb_basic
Done.