[57.313923] Initializing watchdogs
[57.313973]   /dev/watchdog0
[57.328743] [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.333457] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.335773] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.339410] [001/133] (960s left) kms_flip (2x-flip-vs-rmfb)
[57.457635] Starting subtest: 2x-flip-vs-rmfb
[57.466483] Subtest 2x-flip-vs-rmfb: SKIP (0.011s)
[57.588937] [002/133] (960s left) kms_properties (connector-properties-atomic)
[57.684795] Starting subtest: connector-properties-atomic
[57.686993] Starting dynamic subtest: pipe-A-eDP-1
[65.455292] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.769s)
[65.465282] Starting dynamic subtest: pipe-None-DP-1
[65.469789] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s)
[65.476053] Starting dynamic subtest: pipe-None-HDMI-A-1
[65.480085] Dynamic subtest pipe-None-HDMI-A-1: SUCCESS (0.001s)
[65.486598] Starting dynamic subtest: pipe-None-DP-2
[65.490627] Dynamic subtest pipe-None-DP-2: SUCCESS (0.001s)
[65.496923] Starting dynamic subtest: pipe-None-HDMI-A-2
[65.502653] Dynamic subtest pipe-None-HDMI-A-2: SUCCESS (0.001s)
[65.511925] Starting dynamic subtest: pipe-None-DP-3
[65.516456] Dynamic subtest pipe-None-DP-3: SUCCESS (0.001s)
[65.523682] Starting dynamic subtest: pipe-None-DP-4
[65.528249] Dynamic subtest pipe-None-DP-4: SUCCESS (0.001s)
[65.530448] Subtest connector-properties-atomic: SUCCESS (7.777s)
[66.315169] [003/133] (951s left) gem_userptr_blits (userfault)
[66.371021] Starting subtest: userfault
[66.374028] Subtest userfault: SUCCESS (0.005s)
[66.516577] [004/133] (951s left) kms_flip (2x-plain-flip-ts-check)
[66.611287] Starting subtest: 2x-plain-flip-ts-check
[66.623551] Subtest 2x-plain-flip-ts-check: SKIP (0.011s)
[66.702817] [005/133] (951s left) gen9_exec_parse (batch-zero-length)
[66.767774] Subtest batch-zero-length: SKIP (0.000s)
[66.918670] [006/133] (951s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[67.149729] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[67.152377] Starting dynamic subtest: pipe-A-default-mode
[68.280974] Dynamic subtest pipe-A-default-mode: SKIP (1.128s)
[68.286169] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.131s)
[68.420990] [007/133] (949s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[68.517350] Starting subtest: psr-shrfb-scaledprimary
[74.320816] Subtest psr-shrfb-scaledprimary: SUCCESS (5.808s)
[74.452453] [008/133] (943s left) kms_pm_rpm (basic-pci-d3-state)
[75.986990] Starting subtest: basic-pci-d3-state
[77.483147] Subtest basic-pci-d3-state: SUCCESS (1.499s)
[77.592161] [009/133] (940s left) kms_ccs (random-ccs-data-y-tiled-gen12-mc-ccs)
[77.690115] Starting subtest: random-ccs-data-y-tiled-gen12-mc-ccs
[77.692648] Starting dynamic subtest: pipe-A-eDP-1
[77.718891] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[77.728392] Starting dynamic subtest: pipe-B-eDP-1
[77.752622] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[77.760298] Starting dynamic subtest: pipe-C-eDP-1
[77.784079] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[77.794209] Starting dynamic subtest: pipe-D-eDP-1
[77.818841] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[77.823498] Subtest random-ccs-data-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[80.016453] [010/133] (938s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-75)
[80.100686] Starting subtest: planes-unity-scaling-downscale-factor-0-75
[80.102970] Starting dynamic subtest: pipe-A
[80.163101] Dynamic subtest pipe-A: SUCCESS (0.064s)
[80.172245] Starting dynamic subtest: pipe-B
[81.334650] Dynamic subtest pipe-B: SUCCESS (1.169s)
[81.344691] Starting dynamic subtest: pipe-C
[82.447586] Dynamic subtest pipe-C: SUCCESS (1.113s)
[82.458275] Starting dynamic subtest: pipe-D
[83.592763] Dynamic subtest pipe-D: SUCCESS (1.145s)
[83.595303] Subtest planes-unity-scaling-downscale-factor-0-75: SUCCESS (3.494s)
[84.742703] [011/133] (933s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[84.840991] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[84.843332] Starting dynamic subtest: pipe-A-eDP-1
[84.984189] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.135s)
[84.993470] Starting dynamic subtest: pipe-B-eDP-1
[85.015119] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[85.027115] Starting dynamic subtest: pipe-C-eDP-1
[85.046647] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s)
[85.057063] Starting dynamic subtest: pipe-D-eDP-1
[85.076373] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[85.078588] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.143s)
[87.226436] [012/133] (931s left) kms_getfb (getfb-handle-not-fb)
[87.315780] Starting subtest: getfb-handle-not-fb
[87.318167] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[87.411336] [013/133] (930s left) sysfs_timeslice_duration (idempotent)
[87.468724] Starting subtest: idempotent
[87.471097] Starting dynamic subtest: vecs0
[87.473457] Dynamic subtest vecs0: SUCCESS (0.000s)
[87.483591] Starting dynamic subtest: ccs0
[87.485483] Dynamic subtest ccs0: SUCCESS (0.001s)
[87.493789] Starting dynamic subtest: vcs0
[87.495720] Dynamic subtest vcs0: SUCCESS (0.001s)
[87.502951] Starting dynamic subtest: bcs0
[87.504879] Dynamic subtest bcs0: SUCCESS (0.001s)
[87.512145] Starting dynamic subtest: rcs0
[87.514304] Dynamic subtest rcs0: SUCCESS (0.000s)
[87.522308] Starting dynamic subtest: vcs1
[87.524142] Dynamic subtest vcs1: SUCCESS (0.000s)
[87.525932] Subtest idempotent: SUCCESS (0.007s)
[87.579526] [014/133] (930s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[87.680358] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu
[87.684541] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[87.789998] [015/133] (930s left) gem_exec_balancer (smoke)
[87.844312] Starting subtest: smoke
[110.415111] Subtest smoke: SUCCESS (22.568s)
[111.994201] [016/133] (906s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)
[112.098646] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible
[112.103427] Starting dynamic subtest: A-eDP1
[115.634967] Dynamic subtest A-eDP1: SUCCESS (3.531s)
[115.644163] Starting dynamic subtest: B-eDP1
[118.850333] Dynamic subtest B-eDP1: SUCCESS (3.216s)
[118.858902] Starting dynamic subtest: C-eDP1
[121.980225] Dynamic subtest C-eDP1: SUCCESS (3.128s)
[121.992856] Starting dynamic subtest: D-eDP1
[125.080568] Dynamic subtest D-eDP1: SUCCESS (3.100s)
[125.083051] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (12.982s)
[125.876444] [017/133] (892s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal
[125.934831] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled
[126.042427] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.105s)
[126.127244] [018/133] (892s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[126.253491] Starting subtest: protected-encrypted-src-copy-not-readible
[126.363982] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.113s)
[126.468881] [019/133] (892s left) kms_cursor_crc (cursor-onscreen-64x64)
[126.632815] Starting subtest: cursor-onscreen-64x64
[126.636996] Starting dynamic subtest: pipe-A-eDP-1
[128.747434] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.109s)
[128.772887] Starting dynamic subtest: pipe-D-eDP-1
[131.548653] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.781s)
[131.550994] Subtest cursor-onscreen-64x64: SUCCESS (4.914s)
[132.343933] [020/133] (886s left) kms_plane_scaling (invalid-num-scalers)
[132.438253] Starting subtest: invalid-num-scalers
[132.440334] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[132.456584] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.018s)
[132.464555] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[132.487577] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.030s)
[132.494964] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[132.517543] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.030s)
[132.525037] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[132.551263] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.031s)
[132.553268] Subtest invalid-num-scalers: SUCCESS (0.113s)
[132.645805] [021/133] (885s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[132.736828] Starting subtest: psr-farfromfence-mmap-gtt
[132.741078] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[132.818643] [022/133] (885s left) gem_request_retire (retire-vma-not-inactive)
[132.870744] Starting subtest: retire-vma-not-inactive
[132.931295] Subtest retire-vma-not-inactive: SUCCESS (0.059s)
[133.050454] [023/133] (885s left) syncobj_wait (single-wait-for-submit-submitted)
[133.102065] Starting subtest: single-wait-for-submit-submitted
[133.209468] Subtest single-wait-for-submit-submitted: SUCCESS (0.107s)
[133.280899] [024/133] (885s left) kms_plane_alpha_blend (alpha-transparent-fb)
[133.383886] Starting subtest: alpha-transparent-fb
[133.672412] Starting dynamic subtest: pipe-A-eDP-1
[134.299776] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.626s)
[134.308079] Starting dynamic subtest: pipe-D-eDP-1
[135.631292] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.330s)
[135.633665] Subtest alpha-transparent-fb: SUCCESS (2.247s)
[136.435909] [025/133] (882s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[136.536867] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[144.066995] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.534s)
[144.189326] [026/133] (874s left) sw_sync (timeline_closed)
[144.225242] Starting subtest: timeline_closed
[144.227818] Subtest timeline_closed: SUCCESS (0.000s)
[144.279133] [027/133] (874s left) gem_exec_whisper (basic-contexts-priority-all)
[144.351166] Starting subtest: basic-contexts-priority-all
[166.764032] Subtest basic-contexts-priority-all: SUCCESS (22.409s)
[166.961078] [028/133] (851s left) kms_joiner (invalid-modeset-big-joiner)
[167.078908] Starting subtest: invalid-modeset-big-joiner
[167.082760] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[167.156669] [029/133] (851s left) syncobj_timeline (single-wait-available-submitted)
[167.203640] Starting subtest: single-wait-available-submitted
[167.205942] Subtest single-wait-available-submitted: SUCCESS (0.000s)
[167.319339] [030/133] (851s left) gem_exec_schedule (preempt-engines)
[167.388235] Starting subtest: preempt-engines
[167.390268] Starting dynamic subtest: rcs0
[169.643579] Dynamic subtest rcs0: SUCCESS (2.263s)
[169.652412] Starting dynamic subtest: bcs0
[171.946350] Dynamic subtest bcs0: SUCCESS (2.300s)
[171.957799] Starting dynamic subtest: vcs0
[174.228320] Dynamic subtest vcs0: SUCCESS (2.280s)
[174.242022] Starting dynamic subtest: vcs1
[176.566875] Dynamic subtest vcs1: SUCCESS (2.337s)
[176.579065] Starting dynamic subtest: vecs0
[178.895544] Dynamic subtest vecs0: SUCCESS (2.327s)
[178.906046] Starting dynamic subtest: ccs0
[181.255236] Dynamic subtest ccs0: SUCCESS (2.358s)
[181.258038] Subtest preempt-engines: SUCCESS (13.873s)
[181.555730] [031/133] (837s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[181.622046] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[181.624273] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[181.707343] [032/133] (837s left) gem_exec_fence (basic-wait-all)
[181.762660] Starting subtest: basic-wait-all
[181.867132] Subtest basic-wait-all: SUCCESS (0.105s)
[183.964663] [FACT gem_exec_fence (basic-wait-all)] new: kernel.kmod_is_loaded.vgem: true
[183.970532] [033/133] (835s left) gem_ctx_persistence (engines-hostile)
[184.034394] Starting subtest: engines-hostile
[184.036701] Starting dynamic subtest: rcs0
[184.087277] Dynamic subtest rcs0: SUCCESS (0.053s)
[184.095542] Starting dynamic subtest: bcs0
[184.227922] Dynamic subtest bcs0: SUCCESS (0.138s)
[184.238691] Starting dynamic subtest: vcs0
[184.325909] Dynamic subtest vcs0: SUCCESS (0.097s)
[184.337071] Starting dynamic subtest: vcs1
[184.430949] Dynamic subtest vcs1: SUCCESS (0.103s)
[184.442542] Starting dynamic subtest: vecs0
[184.539231] Dynamic subtest vecs0: SUCCESS (0.106s)
[184.550196] Starting dynamic subtest: ccs0
[184.637644] Dynamic subtest ccs0: SUCCESS (0.097s)
[184.640237] Subtest engines-hostile: SUCCESS (0.604s)
[184.730650] [034/133] (834s left) kms_rotation_crc (multiplane-rotation)
[184.820665] Starting subtest: multiplane-rotation
[202.189782] Subtest multiplane-rotation: SUCCESS (17.371s)
[202.306042] [035/133] (816s left) kms_getfb (getfb-handle-valid)
[202.414116] Starting subtest: getfb-handle-valid
[202.415917] Subtest getfb-handle-valid: SUCCESS (0.000s)
[202.514930] [036/133] (816s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[202.605159] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[209.505056] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.900s)
[209.632462] [037/133] (809s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[209.757644] Starting subtest: flip-vs-cursor-legacy
[217.257461] Subtest flip-vs-cursor-legacy: SUCCESS (7.502s)
[218.121372] [038/133] (801s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[218.225966] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[218.230119] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[218.324585] [039/133] (801s left) kms_plane_multiple (2x-tiling-yf)
[218.419272] Starting subtest: 2x-tiling-yf
[218.423391] Subtest 2x-tiling-yf: SKIP (0.000s)
[218.500051] [040/133] (800s left) dmabuf_sync_file (export-basic)
[218.543732] Starting subtest: export-basic
[218.546108] Subtest export-basic: SUCCESS (0.001s)
[218.613459] [041/133] (800s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf)
[218.712299] Starting subtest: pr-overlay-plane-move-continuous-sf
[218.716304] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[218.776967] [042/133] (800s left) gem_exec_async (concurrent-writes)
[218.834058] Starting subtest: concurrent-writes
[218.836346] Starting dynamic subtest: rcs0
[218.849412] Dynamic subtest rcs0: SUCCESS (0.015s)
[218.859352] Starting dynamic subtest: bcs0
[218.861622] Dynamic subtest bcs0: SUCCESS (0.008s)
[218.870701] Starting dynamic subtest: vcs0
[218.872599] Dynamic subtest vcs0: SUCCESS (0.005s)
[218.881299] Starting dynamic subtest: vcs1
[218.883544] Dynamic subtest vcs1: SUCCESS (0.008s)
[218.891985] Starting dynamic subtest: vecs0
[218.894182] Dynamic subtest vecs0: SUCCESS (0.006s)
[218.902472] Starting dynamic subtest: ccs0
[218.904670] Dynamic subtest ccs0: SUCCESS (0.006s)
[218.906845] Subtest concurrent-writes: SUCCESS (0.053s)
[219.136326] [043/133] (800s left) i915_pciid
[219.315505] [044/133] (800s left) kms_flip (plain-flip-ts-check-interruptible)
[219.413921] Starting subtest: plain-flip-ts-check-interruptible
[219.417927] Starting dynamic subtest: A-eDP1
[228.228352] Dynamic subtest A-eDP1: SUCCESS (8.812s)
[228.238647] Starting dynamic subtest: B-eDP1
[237.058707] Dynamic subtest B-eDP1: SUCCESS (8.829s)
[237.069720] Starting dynamic subtest: C-eDP1
[245.879032] Dynamic subtest C-eDP1: SUCCESS (8.819s)
[245.889508] Starting dynamic subtest: D-eDP1
[254.711244] Dynamic subtest D-eDP1: SUCCESS (8.831s)
[254.716115] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.301s)
[255.899684] [045/133] (763s left) gem_exec_gttfill (all-engines)
[255.972517] Starting subtest: all-engines
[279.096985] Subtest all-engines: SUCCESS (23.126s)
[279.290149] [046/133] (740s left) gem_exec_balancer (hog)
[279.386358] Starting subtest: hog
[279.391125] Subtest hog: SKIP (0.000s)
[279.723042] [047/133] (739s left) gem_exec_reloc (basic-gtt-read-noreloc)
[279.784244] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[279.849043] [048/133] (739s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs)
[279.964833] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs
[279.967156] Starting dynamic subtest: pipe-A-eDP-1
[279.986785] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[279.996926] Starting dynamic subtest: pipe-B-eDP-1
[280.014674] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[280.023098] Starting dynamic subtest: pipe-C-eDP-1
[280.041117] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[280.050039] Starting dynamic subtest: pipe-D-eDP-1
[280.068826] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[280.070702] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.008s)
[282.159778] [049/133] (737s left) kms_big_fb (linear-64bpp-rotate-0)
[282.260052] Starting subtest: linear-64bpp-rotate-0
[283.995925] Subtest linear-64bpp-rotate-0: SUCCESS (1.737s)
[284.167531] [050/133] (735s left) gem_exec_params (invalid-flag)
[284.228331] Starting subtest: invalid-flag
[284.230123] Subtest invalid-flag: SUCCESS (0.000s)
[284.332780] [051/133] (735s left) api_intel_bb (blit-noreloc-purge-cache)
[284.379402] Starting subtest: blit-noreloc-purge-cache
[284.392670] Subtest blit-noreloc-purge-cache: SUCCESS (0.014s)
[284.508256] [052/133] (735s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-cpu)
[284.612055] Starting subtest: fbcpsr-rgb565-draw-mmap-cpu
[291.431876] Subtest fbcpsr-rgb565-draw-mmap-cpu: SUCCESS (6.825s)
[291.553597] [053/133] (728s left) gem_mmap_offset (bad-flags)
[291.616066] Starting subtest: bad-flags
[291.618331] Subtest bad-flags: SUCCESS (0.000s)
[291.729451] [054/133] (728s left) core_auth (getclient-simple)
[291.775918] Starting subtest: getclient-simple
[291.783565] Subtest getclient-simple: SUCCESS (0.013s)
[291.905090] [055/133] (728s left) kms_vblank (ts-continuation-modeset-rpm)
[291.995606] Starting subtest: ts-continuation-modeset-rpm
[291.997691] Starting dynamic subtest: pipe-A-eDP-1
[294.476793] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.479s)
[294.491045] Starting dynamic subtest: pipe-D-eDP-1
[296.719438] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.242s)
[296.721973] Subtest ts-continuation-modeset-rpm: SUCCESS (4.726s)
[297.519441] [056/133] (722s left) kms_async_flips (async-flip-suspend-resume)
[297.612747] Starting subtest: async-flip-suspend-resume
[297.994881] Starting dynamic subtest: pipe-A-eDP-1
[316.568206] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.502s)
[316.949868] Starting dynamic subtest: pipe-B-eDP-1
[335.589592] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.295s)
[335.981694] Starting dynamic subtest: pipe-C-eDP-1
[354.554560] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.235s)
[354.931567] Starting dynamic subtest: pipe-D-eDP-1
[373.585347] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.307s)
[373.587599] Subtest async-flip-suspend-resume: SUCCESS (14.855s)
[384.787021] [057/133] (645s left) gem_mmap_wc (write)
[384.844483] Subtest write: SKIP (0.000s)
[384.906433] [058/133] (645s left) syncobj_timeline (multi-wait-all-available-submitted)
[384.964109] Starting subtest: multi-wait-all-available-submitted
[384.966596] Subtest multi-wait-all-available-submitted: SUCCESS (0.000s)
[385.064340] [059/133] (645s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[385.168510] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[385.172631] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[385.289826] [060/133] (644s left) gem_busy (parallel)
[385.489272] Starting subtest: parallel
[385.491715] Starting dynamic subtest: rcs0
[387.028239] Dynamic subtest rcs0: SUCCESS (1.536s)
[387.041658] Starting dynamic subtest: bcs0
[389.012353] Dynamic subtest bcs0: SUCCESS (1.979s)
[389.029465] Starting dynamic subtest: vcs0
[391.062229] Dynamic subtest vcs0: SUCCESS (2.046s)
[391.079754] Starting dynamic subtest: vcs1
[393.043945] Dynamic subtest vcs1: SUCCESS (1.978s)
[393.056456] Starting dynamic subtest: vecs0
[395.028256] Dynamic subtest vecs0: SUCCESS (1.981s)
[395.041250] Starting dynamic subtest: ccs0
[397.012191] Dynamic subtest ccs0: SUCCESS (1.981s)
[397.014952] Subtest parallel: SUCCESS (11.517s)
[397.245452] [061/133] (633s left) i915_pm_rpm (reg-read-ioctl)
[399.174621] Starting subtest: reg-read-ioctl
[401.456074] Subtest reg-read-ioctl: SUCCESS (2.281s)
[401.841541] [062/133] (628s left) kms_feature_discovery (display-2x)
[401.936150] Starting subtest: display-2x
[401.940401] Subtest display-2x: SKIP (0.000s)
[402.008574] [063/133] (628s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[402.101737] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[402.106156] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[402.201919] [064/133] (628s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[402.310570] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[402.315070] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[402.408860] [065/133] (628s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[402.490598] Starting subtest: fbc-pr-cursor-mmap-cpu
[402.494727] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[402.565708] [066/133] (627s left) gem_softpin (allocator-basic)
[402.640417] Starting subtest: allocator-basic
[402.712942] Subtest allocator-basic: SUCCESS (0.073s)
[402.833959] [067/133] (627s left) core_auth (basic-auth)
[402.883357] Starting subtest: basic-auth
[402.885144] Subtest basic-auth: SUCCESS (0.001s)
[402.988168] [068/133] (627s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite)
[403.078177] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite
[403.081627] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[403.191489] [069/133] (627s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180)
[403.289886] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180
[404.314180] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.023s)
[404.441893] [070/133] (626s left) gem_exec_schedule (semaphore-power)
[404.638879] Subtest semaphore-power: SKIP (0.000s)
[404.822555] [071/133] (625s left) prime_mmap (test_forked_cpu_write)
[404.882810] Starting subtest: test_forked_cpu_write
[404.884822] Starting dynamic subtest: test_forked_cpu_write-smem
[404.890337] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.010s)
[404.892669] Subtest test_forked_cpu_write: SUCCESS (0.011s)
[405.001174] [072/133] (625s left) gem_exec_fence (nb-await)
[405.187132] Starting subtest: nb-await
[405.189177] Starting dynamic subtest: rcs0
[405.256340] Dynamic subtest rcs0: SUCCESS (0.072s)
[405.269338] Starting dynamic subtest: bcs0
[405.314689] Dynamic subtest bcs0: SUCCESS (0.056s)
[405.326629] Starting dynamic subtest: vcs0
[405.377029] Dynamic subtest vcs0: SUCCESS (0.059s)
[405.388465] Starting dynamic subtest: vcs1
[405.438280] Dynamic subtest vcs1: SUCCESS (0.059s)
[405.454017] Starting dynamic subtest: vecs0
[405.498416] Dynamic subtest vecs0: SUCCESS (0.058s)
[405.512678] Starting dynamic subtest: ccs0
[405.556906] Dynamic subtest ccs0: SUCCESS (0.057s)
[405.559681] Subtest nb-await: SUCCESS (0.374s)
[407.083118] [073/133] (623s left) sriov_basic (enable-vfs-bind-unbind-each)
[407.153965] Starting subtest: enable-vfs-bind-unbind-each
[407.156368] Starting dynamic subtest: numvfs-1
[407.238159] Dynamic subtest numvfs-1: FAIL (0.030s)
[407.249694] Starting dynamic subtest: numvfs-2
[407.321971] Dynamic subtest numvfs-2: FAIL (0.004s)
[407.333726] Starting dynamic subtest: numvfs-3
[407.405846] Dynamic subtest numvfs-3: FAIL (0.004s)
[407.416824] Starting dynamic subtest: numvfs-4
[407.488685] Dynamic subtest numvfs-4: FAIL (0.004s)
[407.499337] Starting dynamic subtest: numvfs-5
[407.570519] Dynamic subtest numvfs-5: FAIL (0.004s)
[407.581966] Starting dynamic subtest: numvfs-6
[407.653931] Dynamic subtest numvfs-6: FAIL (0.004s)
[407.664440] Starting dynamic subtest: numvfs-7
[407.737467] Dynamic subtest numvfs-7: FAIL (0.004s)
[407.748552] Starting dynamic subtest: numvfs-random
[407.820912] Dynamic subtest numvfs-random: FAIL (0.004s)
[407.823230] Subtest enable-vfs-bind-unbind-each: FAIL (0.062s)
[407.863430] [074/133] (623s left) gem_ctx_persistence (heartbeat-hostile)
[407.920425] Starting subtest: heartbeat-hostile
[407.924401] Subtest heartbeat-hostile: SKIP (0.000s)
[408.016247] [075/133] (622s left) i915_drm_fdinfo (all-busy-idle-check-all)
[408.054549] Starting subtest: all-busy-idle-check-all
[408.060739] Subtest all-busy-idle-check-all: SKIP (0.005s)
[408.132485] [076/133] (622s left) kms_big_fb (y-tiled-addfb)
[408.240714] Starting subtest: y-tiled-addfb
[408.244329] Subtest y-tiled-addfb: SKIP (0.000s)
[408.359056] [077/133] (622s left) kms_rotation_crc (sprite-rotation-90-pos-100-0)
[408.455585] Starting subtest: sprite-rotation-90-pos-100-0
[408.459190] Subtest sprite-rotation-90-pos-100-0: SKIP (0.001s)
[408.529634] [078/133] (622s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled)
[408.586688] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[408.588486] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s)
[408.682690] [079/133] (622s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs-cc)
[408.777563] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs-cc
[408.779461] Starting dynamic subtest: pipe-A-eDP-1
[408.786771] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[408.796410] Starting dynamic subtest: pipe-B-eDP-1
[408.803601] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[408.813843] Starting dynamic subtest: pipe-C-eDP-1
[408.820015] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[408.829339] Starting dynamic subtest: pipe-D-eDP-1
[408.836324] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[408.839700] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[411.096644] [080/133] (620s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[411.187358] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip
[412.155165] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (0.968s)
[412.291188] [081/133] (618s left) kms_lease (lease-get)
[412.385248] Starting subtest: lease-get
[412.387576] Starting dynamic subtest: pipe-A-eDP-1
[412.389871] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[412.403798] Starting dynamic subtest: pipe-B-eDP-1
[412.405715] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[412.414913] Starting dynamic subtest: pipe-C-eDP-1
[412.416795] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[412.426059] Starting dynamic subtest: pipe-D-eDP-1
[412.428053] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[412.430056] Subtest lease-get: SUCCESS (0.009s)
[412.501859] [082/133] (618s left) gem_mmap_gtt (cpuset-medium-copy-odd)
[412.559785] Subtest cpuset-medium-copy-odd: SKIP (0.000s)
[412.618108] [083/133] (618s left) i915_selftest (mock)
[415.991335] Starting subtest: mock
[415.993893] Starting dynamic subtest: sanitycheck
[416.670553] Dynamic subtest sanitycheck: SUCCESS (0.683s)
[416.689014] Starting dynamic subtest: shmem
[417.380813] Dynamic subtest shmem: SUCCESS (0.708s)
[417.391395] Starting dynamic subtest: fence
[425.176840] Dynamic subtest fence: SUCCESS (7.792s)
[425.187354] Starting dynamic subtest: scatterlist
[426.831523] Dynamic subtest scatterlist: SUCCESS (1.653s)
[426.842100] Starting dynamic subtest: syncmap
[429.954364] Dynamic subtest syncmap: SUCCESS (3.120s)
[429.965031] Starting dynamic subtest: uncore
[430.613425] Dynamic subtest uncore: SUCCESS (0.657s)
[430.627469] Starting dynamic subtest: ring
[431.311719] Dynamic subtest ring: SUCCESS (0.696s)
[431.322295] Starting dynamic subtest: engine
[431.995364] Dynamic subtest engine: SUCCESS (0.682s)
[432.006018] Starting dynamic subtest: timelines
[435.821311] Dynamic subtest timelines: SUCCESS (3.823s)
[435.831880] Starting dynamic subtest: requests
[439.348301] Dynamic subtest requests: SUCCESS (3.525s)
[439.358682] Starting dynamic subtest: objects
[440.101152] Dynamic subtest objects: SUCCESS (0.751s)
[440.113347] Starting dynamic subtest: phys
[440.858238] Dynamic subtest phys: SUCCESS (0.755s)
[440.868663] Starting dynamic subtest: dmabuf
[441.625610] Dynamic subtest dmabuf: SUCCESS (0.766s)
[441.634611] Starting dynamic subtest: vma
[447.414929] Dynamic subtest vma: SUCCESS (5.786s)
[447.425086] Starting dynamic subtest: evict
[448.837327] Dynamic subtest evict: SUCCESS (1.422s)
[448.846321] Starting dynamic subtest: gtt
[452.136671] Dynamic subtest gtt: SUCCESS (3.296s)
[452.146550] Starting dynamic subtest: hugepages
[453.009350] Dynamic subtest hugepages: SUCCESS (0.871s)
[453.019461] Starting dynamic subtest: memory_region
[455.518481] Dynamic subtest memory_region: SUCCESS (2.507s)
[455.521082] Subtest mock: SUCCESS (39.526s)
[455.551591] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[455.552532] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[455.555682] [084/133] (575s left) kms_chamelium_hpd (hdmi-hpd)
[457.334611] Subtest hdmi-hpd: SKIP (0.000s)
[458.200839] [FACT kms_chamelium_hpd (hdmi-hpd)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[458.202195] [FACT kms_chamelium_hpd (hdmi-hpd)] new: kernel.kmod_is_loaded.i915: true
[458.206658] [085/133] (573s left) prime_mmap (test_correct_cpu_write)
[458.263369] Starting subtest: test_correct_cpu_write
[458.265705] Starting dynamic subtest: test_correct_cpu_write-smem
[458.267955] Dynamic subtest test_correct_cpu_write-smem: SUCCESS (0.000s)
[458.269870] Subtest test_correct_cpu_write: SUCCESS (0.001s)
[458.383443] [086/133] (572s left) kms_pm_rpm (modeset-non-lpsp-stress)
[460.235842] Starting subtest: modeset-non-lpsp-stress
[461.394220] Subtest modeset-non-lpsp-stress: SKIP (1.159s)
[461.767070] [087/133] (569s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[461.865384] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[461.870033] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[461.952967] [088/133] (569s left) kms_psr (psr2-sprite-blt)
[462.052937] Starting subtest: psr2-sprite-blt
[462.055199] Starting dynamic subtest: eDP-1
[463.753232] Dynamic subtest eDP-1: SUCCESS (1.700s)
[463.755652] Subtest psr2-sprite-blt: SUCCESS (1.701s)
[464.625120] [089/133] (566s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[464.726830] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[464.731274] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[464.818257] [090/133] (566s left) gem_userptr_blits (dmabuf-sync)
[464.884014] Starting subtest: dmabuf-sync
[464.888509] Subtest dmabuf-sync: SKIP (0.002s)
[465.039956] [091/133] (566s left) syncobj_timeline (etime-multi-wait-available-unsubmitted)
[465.097698] Starting subtest: etime-multi-wait-available-unsubmitted
[465.200586] Subtest etime-multi-wait-available-unsubmitted: SUCCESS (0.102s)
[465.276981] [092/133] (566s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[465.527908] Starting subtest: cursor-rapid-movement-512x512
[465.531580] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[465.686780] [093/133] (565s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt)
[465.782961] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt
[465.787224] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[465.868267] [094/133] (565s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[465.928657] Starting subtest: multi-wait-all-for-submit-signaled
[465.931001] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[466.037403] [095/133] (565s left) kms_atomic (test-only)
[466.125297] Starting subtest: test-only
[466.175606] Starting dynamic subtest: pipe-A-eDP-1
[468.716729] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.541s)
[468.719145] Subtest test-only: SUCCESS (2.594s)
[469.530378] [096/133] (562s left) testdisplay
[469.823662] [097/133] (562s left) syncobj_wait (wait-for-submit-complex)
[469.886268] Starting subtest: wait-for-submit-complex
[469.947992] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[470.027491] [098/133] (561s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[470.137988] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[470.142169] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[470.219418] [099/133] (561s left) kms_big_fb (x-tiled-32bpp-rotate-0)
[470.314731] Starting subtest: x-tiled-32bpp-rotate-0
[471.793985] Subtest x-tiled-32bpp-rotate-0: SUCCESS (1.480s)
[471.925452] [100/133] (560s left) kms_content_protection (mei-interface)
[472.064028] Starting subtest: mei-interface
[472.068061] Subtest mei-interface: SKIP (0.001s)
[472.190786] [101/133] (559s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[472.283404] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[472.287066] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s)
[472.368057] [102/133] (559s left) gem_ctx_param (invalid-param-get)
[472.414712] Starting subtest: invalid-param-get
[472.416649] Subtest invalid-param-get: SUCCESS (0.001s)
[472.503625] [103/133] (559s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt)
[472.607009] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt
[472.610400] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[472.705790] [104/133] (559s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs)
[472.812271] Starting subtest: crc-primary-suspend-yf-tiled-ccs
[472.814186] Starting dynamic subtest: pipe-A-eDP-1
[472.821814] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[472.831389] Starting dynamic subtest: pipe-B-eDP-1
[472.838918] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[472.847616] Starting dynamic subtest: pipe-C-eDP-1
[472.854555] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[472.862843] Starting dynamic subtest: pipe-D-eDP-1
[472.869771] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[472.873082] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.005s)
[475.014668] [105/133] (557s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt)
[475.125806] Starting subtest: psr-rgb565-draw-blt
[482.341698] Subtest psr-rgb565-draw-blt: SUCCESS (7.218s)
[482.482254] [106/133] (549s left) kms_psr (fbc-psr-cursor-plane-onoff)
[482.569311] Starting subtest: fbc-psr-cursor-plane-onoff
[482.571597] Starting dynamic subtest: eDP-1
[482.575917] Dynamic subtest eDP-1: SKIP (0.000s)
[482.580324] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.001s)
[482.643175] [107/133] (549s left) kms_vrr (lobf)
[482.744553] Starting subtest: lobf
[482.748519] Subtest lobf: SKIP (0.000s)
[482.816553] [108/133] (549s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[482.918664] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[482.923055] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[483.014679] [109/133] (549s left) kms_dirtyfb (default-dirtyfb-ioctl)
[483.107170] Starting subtest: default-dirtyfb-ioctl
[483.109341] Starting dynamic subtest: A-eDP-1
[484.683933] Dynamic subtest A-eDP-1: SUCCESS (1.575s)
[484.686101] Subtest default-dirtyfb-ioctl: SUCCESS (1.577s)
[485.511016] [110/133] (546s left) kms_big_fb (yf-tiled-addfb)
[485.609411] Starting subtest: yf-tiled-addfb
[485.613930] Subtest yf-tiled-addfb: SKIP (0.000s)
[485.710361] [111/133] (546s left) kms_vblank (query-busy-hang)
[485.802254] Starting subtest: query-busy-hang
[485.804551] Starting dynamic subtest: pipe-A-eDP-1
[511.838165] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.036s)
[511.853194] Starting dynamic subtest: pipe-D-eDP-1
[536.795310] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.957s)
[536.797694] Subtest query-busy-hang: SUCCESS (50.998s)
[537.680017] [112/133] (494s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs)
[537.742519] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs
[537.746956] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s)
[537.959405] [113/133] (494s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[538.114156] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[538.136680] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[538.226547] [114/133] (494s left) kms_flip (2x-dpms-vs-vblank-race-interruptible)
[538.364520] Starting subtest: 2x-dpms-vs-vblank-race-interruptible
[538.388335] Subtest 2x-dpms-vs-vblank-race-interruptible: SKIP (0.011s)
[538.483179] [115/133] (494s left) vgem_basic (sysfs)
[538.576772] Starting subtest: sysfs
[538.587188] Subtest sysfs: SUCCESS (0.000s)
[538.680970] [116/133] (494s left) gem_exec_reloc (basic-write-cpu-noreloc)
[538.786325] Subtest basic-write-cpu-noreloc: SKIP (0.000s)
[538.875271] [117/133] (494s left) gem_mmap_gtt (basic-write)
[538.969695] Subtest basic-write: SKIP (0.000s)
[539.044427] [118/133] (493s left) gem_exec_whisper (basic-queues-forked-all)
[539.155150] Starting subtest: basic-queues-forked-all
[559.246666] Subtest basic-queues-forked-all: SUCCESS (20.106s)
[559.431734] [119/133] (473s left) kms_chamelium_edid (dp-edid-stress-resolution-4k)
[559.858700] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s)
[560.688204] [120/133] (472s left) kms_psr (fbc-pr-sprite-mmap-cpu)
[560.787686] Starting subtest: fbc-pr-sprite-mmap-cpu
[560.792771] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s)
[560.866092] [121/133] (472s left) kms_cursor_crc (cursor-sliding-32x32)
[561.015057] Starting subtest: cursor-sliding-32x32
[561.069057] Subtest cursor-sliding-32x32: SKIP (0.048s)
[561.366374] [122/133] (471s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-move)
[561.456772] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-move
[561.461138] Subtest fbcpsr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[561.554897] [123/133] (471s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[561.661803] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[569.081694] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.421s)
[569.195548] [124/133] (464s left) perf_pmu (idle)
[569.235096] Starting subtest: idle
[569.237432] Starting dynamic subtest: rcs0
[569.785122] Dynamic subtest rcs0: SUCCESS (0.549s)
[569.798048] Starting dynamic subtest: bcs0
[570.299451] Dynamic subtest bcs0: SUCCESS (0.512s)
[570.312336] Starting dynamic subtest: vcs0
[570.831980] Dynamic subtest vcs0: SUCCESS (0.529s)
[570.845521] Starting dynamic subtest: vcs1
[571.352315] Dynamic subtest vcs1: SUCCESS (0.518s)
[571.364951] Starting dynamic subtest: vecs0
[571.879978] Dynamic subtest vecs0: SUCCESS (0.525s)
[571.892850] Starting dynamic subtest: ccs0
[572.403360] Dynamic subtest ccs0: SUCCESS (0.520s)
[572.406375] Subtest idle: SUCCESS (3.169s)
[572.497264] [125/133] (460s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[572.548105] Starting subtest: invalid-multi-wait-unsubmitted
[572.550758] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[572.660063] [126/133] (460s left) gem_ccs (suspend-resume)
[572.708836] Starting subtest: suspend-resume
[572.713200] Subtest suspend-resume: SKIP (0.000s)
[572.820680] [127/133] (460s left) kms_color (ctm-0-50)
[572.923054] Starting subtest: ctm-0-50
[572.925353] Starting dynamic subtest: pipe-A-eDP-1
[576.464275] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.541s)
[576.474830] Starting dynamic subtest: pipe-B-eDP-1
[580.755750] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.287s)
[580.765739] Starting dynamic subtest: pipe-C-eDP-1
[584.808260] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.053s)
[584.818839] Starting dynamic subtest: pipe-D-eDP-1
[588.816931] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.008s)
[588.818800] Subtest ctm-0-50: SUCCESS (15.892s)
[589.648144] [128/133] (443s left) gem_close (many-handles-one-vma)
[589.717675] Starting subtest: many-handles-one-vma
[589.739443] Subtest many-handles-one-vma: SUCCESS (0.022s)
[589.860453] [129/133] (443s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[589.966312] Starting subtest: extended-pageflip-modeset-hang-oldfb
[589.968318] Starting dynamic subtest: pipe-A
[597.879165] Dynamic subtest pipe-A: SUCCESS (7.910s)
[597.889644] Starting dynamic subtest: pipe-D
[606.466907] Dynamic subtest pipe-D: SUCCESS (8.586s)
[606.469344] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (16.501s)
[607.312792] [130/133] (426s left) gem_mmap_wc (write-prefaulted)
[607.378922] Subtest write-prefaulted: SKIP (0.000s)
[607.449111] [131/133] (426s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping)
[607.539316] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping
[607.565163] Starting dynamic subtest: pipe-A-plane-0
[607.865125] Dynamic subtest pipe-A-plane-0: SUCCESS (0.300s)
[607.877865] Starting dynamic subtest: pipe-A-plane-3
[608.098575] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[609.204160] Starting dynamic subtest: pipe-B-plane-0
[609.495328] Dynamic subtest pipe-B-plane-0: SUCCESS (0.300s)
[609.505582] Starting dynamic subtest: pipe-B-plane-3
[609.728818] Dynamic subtest pipe-B-plane-3: SUCCESS (0.232s)
[610.048967] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping: SUCCESS (2.511s)
[610.902594] [132/133] (422s left) kms_psr (psr2-basic)
[610.997613] Starting subtest: psr2-basic
[610.999963] Starting dynamic subtest: eDP-1
[612.566526] Dynamic subtest eDP-1: SUCCESS (1.567s)
[612.568391] Subtest psr2-basic: SUCCESS (1.568s)
[613.393583] [133/133] (420s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[613.487908] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[617.937909] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.453s)
[619.064657] Closing watchdogs
results: parsing output: 0/ for test: kms_flip
results: parsing output: 1/ for test: kms_properties
results: parsing output: 2/ for test: gem_userptr_blits
results: parsing output: 3/ for test: kms_flip
results: parsing output: 4/ for test: gen9_exec_parse
results: parsing output: 5/ for test: kms_flip_scaled_crc
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_pm_rpm
results: parsing output: 8/ for test: kms_ccs
results: parsing output: 9/ for test: kms_plane_scaling
results: parsing output: 10/ for test: kms_ccs
results: parsing output: 11/ for test: kms_getfb
results: parsing output: 12/ for test: sysfs_timeslice_duration
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: gem_exec_balancer
results: parsing output: 15/ for test: kms_flip
results: parsing output: 16/ for test: syncobj_timeline
results: parsing output: 17/ for test: gem_pxp
results: parsing output: 18/ for test: kms_cursor_crc
results: parsing output: 19/ for test: kms_plane_scaling
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: gem_request_retire
results: parsing output: 22/ for test: syncobj_wait
results: parsing output: 23/ for test: kms_plane_alpha_blend
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: sw_sync
results: parsing output: 26/ for test: gem_exec_whisper
results: parsing output: 27/ for test: kms_joiner
results: parsing output: 28/ for test: syncobj_timeline
results: parsing output: 29/ for test: gem_exec_schedule
results: parsing output: 30/ for test: syncobj_wait
results: parsing output: 31/ for test: gem_exec_fence
results: parsing output: 32/ for test: gem_ctx_persistence
results: parsing output: 33/ for test: kms_rotation_crc
results: parsing output: 34/ for test: kms_getfb
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_cursor_legacy
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_plane_multiple
results: parsing output: 39/ for test: dmabuf_sync_file
results: parsing output: 40/ for test: kms_psr2_sf
results: parsing output: 41/ for test: gem_exec_async
results: parsing output: 42/ for test: i915_pciid
results: parsing output: 43/ for test: kms_flip
results: parsing output: 44/ for test: gem_exec_gttfill
results: parsing output: 45/ for test: gem_exec_balancer
results: parsing output: 46/ for test: gem_exec_reloc
results: parsing output: 47/ for test: kms_ccs
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: gem_exec_params
results: parsing output: 50/ for test: api_intel_bb
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: gem_mmap_offset
results: parsing output: 53/ for test: core_auth
results: parsing output: 54/ for test: kms_vblank
results: parsing output: 55/ for test: kms_async_flips
results: parsing output: 56/ for test: gem_mmap_wc
results: parsing output: 57/ for test: syncobj_timeline
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: gem_busy
results: parsing output: 60/ for test: i915_pm_rpm
results: parsing output: 61/ for test: kms_feature_discovery
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_psr
results: parsing output: 65/ for test: gem_softpin
results: parsing output: 66/ for test: core_auth
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_big_fb
results: parsing output: 69/ for test: gem_exec_schedule
results: parsing output: 70/ for test: prime_mmap
results: parsing output: 71/ for test: gem_exec_fence
results: parsing output: 72/ for test: sriov_basic
results: parsing output: 73/ for test: gem_ctx_persistence
results: parsing output: 74/ for test: i915_drm_fdinfo
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: kms_rotation_crc
results: parsing output: 77/ for test: syncobj_wait
results: parsing output: 78/ for test: kms_ccs
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: kms_lease
results: parsing output: 81/ for test: gem_mmap_gtt
results: parsing output: 82/ for test: i915_selftest
results: parsing output: 83/ for test: kms_chamelium_hpd
results: parsing output: 84/ for test: prime_mmap
results: parsing output: 85/ for test: kms_pm_rpm
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_psr
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: gem_userptr_blits
results: parsing output: 90/ for test: syncobj_timeline
results: parsing output: 91/ for test: kms_cursor_crc
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: kms_atomic
results: parsing output: 95/ for test: testdisplay
results: parsing output: 96/ for test: syncobj_wait
results: parsing output: 97/ for test: kms_psr2_sf
results: parsing output: 98/ for test: kms_big_fb
results: parsing output: 99/ for test: kms_content_protection
results: parsing output: 100/ for test: kms_flip_scaled_crc
results: parsing output: 101/ for test: gem_ctx_param
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_ccs
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_psr
results: parsing output: 106/ for test: kms_vrr
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_dirtyfb
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: kms_vblank
results: parsing output: 111/ for test: gem_render_copy
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_flip
results: parsing output: 114/ for test: vgem_basic
results: parsing output: 115/ for test: gem_exec_reloc
results: parsing output: 116/ for test: gem_mmap_gtt
results: parsing output: 117/ for test: gem_exec_whisper
results: parsing output: 118/ for test: kms_chamelium_edid
results: parsing output: 119/ for test: kms_psr
results: parsing output: 120/ for test: kms_cursor_crc
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: perf_pmu
results: parsing output: 124/ for test: syncobj_wait
results: parsing output: 125/ for test: gem_ccs
results: parsing output: 126/ for test: kms_color
results: parsing output: 127/ for test: gem_close
results: parsing output: 128/ for test: kms_busy
results: parsing output: 129/ for test: gem_mmap_wc
results: parsing output: 130/ for test: kms_plane
results: parsing output: 131/ for test: kms_psr
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.