[62.829699] Initializing watchdogs
[62.829745]   /dev/watchdog0
[62.843396] [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]
[62.847615] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[62.849766] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[62.852978] [001/133] (960s left) gem_ctx_param (invalid-size-get)
[62.934787] Starting subtest: invalid-size-get
[62.937177] Subtest invalid-size-get: SUCCESS (0.001s)
[63.044170] [002/133] (960s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[63.146692] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[63.151221] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[63.242480] [003/133] (960s left) template (a)
[63.289165] Starting subtest: A
[63.291607] Subtest A: SUCCESS (0.000s)
[63.389875] [004/133] (960s left) kms_plane_alpha_blend (constant-alpha-mid)
[63.483477] Starting subtest: constant-alpha-mid
[63.772525] Starting dynamic subtest: pipe-A-eDP-1
[64.589483] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.814s)
[64.597664] Starting dynamic subtest: pipe-D-eDP-1
[66.064267] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.475s)
[66.066559] Subtest constant-alpha-mid: SUCCESS (2.583s)
[66.966446] [005/133] (956s left) gem_exec_fence (syncobj-timeline-signal)
[67.757455] Starting subtest: syncobj-timeline-signal
[67.765127] Subtest syncobj-timeline-signal: SUCCESS (0.009s)
[68.942513] [FACT gem_exec_fence (syncobj-timeline-signal)] new: kernel.kmod_is_loaded.vgem: true
[68.945707] [006/133] (954s left) kms_invalid_mode (zero-hdisplay)
[69.043321] Starting subtest: zero-hdisplay
[69.045748] Starting dynamic subtest: pipe-A-eDP-1
[69.331609] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.289s)
[69.340343] Starting dynamic subtest: pipe-B-eDP-1
[69.342331] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[69.349130] Starting dynamic subtest: pipe-C-eDP-1
[69.351487] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[69.358172] Starting dynamic subtest: pipe-D-eDP-1
[69.360042] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[69.361919] Subtest zero-hdisplay: SUCCESS (0.294s)
[70.176620] [007/133] (953s left) kms_psr (fbc-pr-primary-mmap-gtt)
[70.268435] Starting subtest: fbc-pr-primary-mmap-gtt
[70.273084] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s)
[70.337627] [008/133] (953s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[70.459111] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[70.463623] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[70.616152] [009/133] (953s left) gem_exec_schedule (preempt)
[70.682105] Starting subtest: preempt
[70.684083] Starting dynamic subtest: rcs0
[70.701630] Dynamic subtest rcs0: SUCCESS (0.027s)
[70.711710] Starting dynamic subtest: bcs0
[70.720928] Dynamic subtest bcs0: SUCCESS (0.018s)
[70.732509] Starting dynamic subtest: vcs0
[70.742095] Dynamic subtest vcs0: SUCCESS (0.021s)
[70.749291] Starting dynamic subtest: vcs1
[70.763657] Dynamic subtest vcs1: SUCCESS (0.021s)
[70.774190] Starting dynamic subtest: vecs0
[70.782807] Dynamic subtest vecs0: SUCCESS (0.019s)
[70.789733] Starting dynamic subtest: ccs0
[70.802449] Dynamic subtest ccs0: SUCCESS (0.019s)
[70.804808] Subtest preempt: SUCCESS (0.128s)
[71.983783] [010/133] (951s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[72.086736] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[72.089773] Starting dynamic subtest: pipe-A-default-mode
[74.819840] Dynamic subtest pipe-A-default-mode: SUCCESS (2.736s)
[74.822200] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (2.737s)
[75.648903] [011/133] (948s left) kms_psr2_su (page_flip-nv12)
[75.720967] Subtest page_flip-NV12: SKIP (0.000s)
[75.778673] [012/133] (948s left) kms_rotation_crc (primary-rotation-270)
[75.875858] Starting subtest: primary-rotation-270
[75.880261] Subtest primary-rotation-270: SKIP (0.001s)
[75.959114] [013/133] (947s left) kms_cursor_edge_walk (256x256-left-edge)
[76.051276] Starting subtest: 256x256-left-edge
[76.054578] Starting dynamic subtest: pipe-A-eDP-1
[79.525731] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.473s)
[79.534214] Starting dynamic subtest: pipe-D-eDP-1
[82.637350] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.113s)
[82.639699] Subtest 256x256-left-edge: SUCCESS (6.587s)
[83.461349] [014/133] (940s left) gem_mmap_gtt (cpuset-big-copy-xy)
[83.523220] Subtest cpuset-big-copy-XY: SKIP (0.000s)
[83.591913] [015/133] (940s left) gem_exec_reloc (basic-gtt)
[83.661940] Subtest basic-gtt: SKIP (0.000s)
[83.734401] [016/133] (940s left) kms_feature_discovery (psr2)
[83.834954] Starting subtest: psr2
[83.837074] Subtest psr2: SUCCESS (0.000s)
[83.901489] [017/133] (940s left) kms_feature_discovery (chamelium)
[83.996886] Starting subtest: chamelium
[84.001477] Subtest chamelium: SKIP (0.000s)
[84.075979] [018/133] (939s left) gem_exec_params (sol-reset-not-gen7)
[84.129445] Starting subtest: sol-reset-not-gen7
[84.134057] Subtest sol-reset-not-gen7: SUCCESS (0.003s)
[84.253413] [019/133] (939s left) kms_content_protection (suspend-resume)
[84.404709] Starting subtest: suspend-resume
[84.408832] Subtest suspend-resume: SKIP (0.000s)
[84.539387] [020/133] (939s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite)
[84.644880] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite
[84.648458] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[84.738430] [021/133] (939s left) kms_flip (2x-blocking-wf_vblank)
[84.828500] Starting subtest: 2x-blocking-wf_vblank
[84.839840] Subtest 2x-blocking-wf_vblank: SKIP (0.011s)
[84.914652] [022/133] (939s left) gem_pread (display)
[84.974682] Subtest display: SKIP (0.000s)
[85.025761] [023/133] (939s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[85.113119] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[85.115131] Starting dynamic subtest: pipe-A
[85.350830] Dynamic subtest pipe-A: SUCCESS (0.240s)
[85.359138] Starting dynamic subtest: pipe-B
[86.642138] Dynamic subtest pipe-B: SUCCESS (1.291s)
[86.650878] Starting dynamic subtest: pipe-C
[87.986749] Dynamic subtest pipe-C: SUCCESS (1.344s)
[87.994700] Starting dynamic subtest: pipe-D
[89.313661] Dynamic subtest pipe-D: SUCCESS (1.326s)
[89.316198] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.204s)
[90.498452] [024/133] (933s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs)
[90.564228] Starting subtest: mixed-tiled-to-yf-tiled-ccs
[90.568331] Subtest mixed-tiled-to-yf-tiled-ccs: SKIP (0.000s)
[90.748073] [025/133] (933s left) prime_vgem (fence-wait)
[90.834620] Starting subtest: fence-wait
[90.836618] Starting dynamic subtest: rcs0
[91.888621] Dynamic subtest rcs0: SUCCESS (1.053s)
[91.898794] Starting dynamic subtest: bcs0
[92.954517] Dynamic subtest bcs0: SUCCESS (1.065s)
[92.964845] Starting dynamic subtest: vcs0
[93.997412] Dynamic subtest vcs0: SUCCESS (1.043s)
[94.007556] Starting dynamic subtest: vcs1
[95.043112] Dynamic subtest vcs1: SUCCESS (1.045s)
[95.053243] Starting dynamic subtest: vecs0
[96.085604] Dynamic subtest vecs0: SUCCESS (1.041s)
[96.095866] Starting dynamic subtest: ccs0
[97.130220] Dynamic subtest ccs0: SUCCESS (1.044s)
[97.132911] Subtest fence-wait: SUCCESS (6.297s)
[97.241429] [026/133] (927s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc)
[97.334576] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc
[103.920250] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.589s)
[104.040828] [027/133] (920s left) api_intel_allocator (gem-pool)
[104.097263] Starting subtest: gem-pool
[104.111887] Subtest gem-pool: SUCCESS (0.017s)
[104.257925] [028/133] (920s left) i915_pm_rps (reset)
[104.314549] Starting subtest: reset
[112.795935] Subtest reset: SUCCESS (8.478s)
[112.911562] [029/133] (911s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[113.014601] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[113.018801] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[113.108455] [030/133] (911s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-signaled)
[113.170928] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[113.172865] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.001s)
[113.269492] [031/133] (911s left) vgem_basic (dmabuf-mmap)
[113.312936] Starting subtest: dmabuf-mmap
[113.332571] Subtest dmabuf-mmap: SUCCESS (0.023s)
[113.390143] [032/133] (911s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[113.490646] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[113.494690] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[113.588925] [033/133] (911s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[113.676478] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[113.680331] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[113.779349] [034/133] (910s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[113.880206] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[113.883931] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[114.969041] [035/133] (909s left) kms_flip (2x-dpms-vs-vblank-race)
[115.060515] Starting subtest: 2x-dpms-vs-vblank-race
[115.071223] Subtest 2x-dpms-vs-vblank-race: SKIP (0.010s)
[115.155171] [036/133] (909s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs-cc)
[115.251449] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs-cc
[115.253824] Starting dynamic subtest: pipe-A-eDP-1
[115.274686] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[115.288846] Starting dynamic subtest: pipe-B-eDP-1
[115.308079] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[115.316130] Starting dynamic subtest: pipe-C-eDP-1
[115.335443] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[115.343195] Starting dynamic subtest: pipe-D-eDP-1
[115.362523] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[115.364421] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.004s)
[117.549362] [037/133] (907s left) perf_pmu (invalid-open)
[117.593617] Starting subtest: invalid-open
[117.595996] Subtest invalid-open: SUCCESS (0.000s)
[117.699249] [038/133] (907s left) gem_spin_batch (engines)
[117.764353] Starting subtest: engines
[117.766590] Starting dynamic subtest: rcs0
[121.003354] Dynamic subtest rcs0: SUCCESS (3.234s)
[121.013040] Starting dynamic subtest: bcs0
[124.242080] Dynamic subtest bcs0: SUCCESS (3.237s)
[124.253576] Starting dynamic subtest: vcs0
[127.477880] Dynamic subtest vcs0: SUCCESS (3.234s)
[127.487755] Starting dynamic subtest: vcs1
[130.715305] Dynamic subtest vcs1: SUCCESS (3.236s)
[130.725283] Starting dynamic subtest: vecs0
[133.953778] Dynamic subtest vecs0: SUCCESS (3.237s)
[133.963442] Starting dynamic subtest: ccs0
[137.191958] Dynamic subtest ccs0: SUCCESS (3.237s)
[137.194099] Subtest engines: SUCCESS (19.425s)
[137.425721] [039/133] (887s left) kms_color_pipeline (plane-lut1d-ctm3x4-lut1d)
[137.540744] Starting subtest: plane-lut1d-ctm3x4-lut1d
[137.675993] Starting dynamic subtest: pipe-A-plane-0
[137.831400] Dynamic subtest pipe-A-plane-0: SUCCESS (0.155s)
[137.842505] Starting dynamic subtest: pipe-A-plane-1
[137.986723] Dynamic subtest pipe-A-plane-1: SUCCESS (0.155s)
[137.995817] Starting dynamic subtest: pipe-A-plane-2
[138.120176] Dynamic subtest pipe-A-plane-2: SUCCESS (0.133s)
[139.303800] Starting dynamic subtest: pipe-B-plane-0
[139.453458] Dynamic subtest pipe-B-plane-0: SUCCESS (0.155s)
[139.461342] Starting dynamic subtest: pipe-B-plane-1
[139.609121] Dynamic subtest pipe-B-plane-1: SUCCESS (0.155s)
[139.617125] Starting dynamic subtest: pipe-B-plane-2
[139.753577] Dynamic subtest pipe-B-plane-2: SUCCESS (0.144s)
[140.964070] Starting dynamic subtest: pipe-C-plane-0
[141.102097] Dynamic subtest pipe-C-plane-0: SUCCESS (0.144s)
[141.110826] Starting dynamic subtest: pipe-C-plane-1
[141.257883] Dynamic subtest pipe-C-plane-1: SUCCESS (0.155s)
[141.266074] Starting dynamic subtest: pipe-C-plane-2
[141.401905] Dynamic subtest pipe-C-plane-2: SUCCESS (0.143s)
[142.581748] Starting dynamic subtest: pipe-D-plane-0
[142.708759] Dynamic subtest pipe-D-plane-0: SUCCESS (0.133s)
[142.717459] Starting dynamic subtest: pipe-D-plane-1
[142.853508] Dynamic subtest pipe-D-plane-1: SUCCESS (0.144s)
[142.861200] Starting dynamic subtest: pipe-D-plane-2
[143.020224] Dynamic subtest pipe-D-plane-2: SUCCESS (0.166s)
[143.306713] Subtest plane-lut1d-ctm3x4-lut1d: SUCCESS (5.764s)
[144.171191] [040/133] (880s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[144.275196] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[144.279616] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[144.363391] [041/133] (880s left) gem_ctx_persistence (hang)
[144.432420] Starting subtest: hang
[144.436977] Subtest hang: SKIP (0.000s)
[144.546338] [042/133] (880s left) gem_barrier_race (remote-request)
[144.612332] Starting subtest: remote-request
[144.614385] Starting dynamic subtest: rcs0
[149.794965] Dynamic subtest rcs0: SUCCESS (5.179s)
[149.801109] Subtest remote-request: SUCCESS (5.182s)
[149.928277] [043/133] (875s left) gem_mmap_wc (pf-nonblock)
[149.984118] Subtest pf-nonblock: SKIP (0.000s)
[150.042485] [044/133] (875s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[150.162286] Starting subtest: flip-vs-cursor-toggle
[158.967731] Subtest flip-vs-cursor-toggle: SUCCESS (8.802s)
[159.798494] [045/133] (865s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[160.180279] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[161.002523] [046/133] (864s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0)
[161.107362] Starting subtest: linear-max-hw-stride-32bpp-rotate-0
[162.218582] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.111s)
[162.351117] [047/133] (862s left) perf (mi-rpc)
[162.458523] Starting subtest: mi-rpc
[162.462371] Subtest mi-rpc: SKIP (0.000s)
[162.506412] [048/133] (862s left) i915_getparams_basic (basic-subslice-total)
[162.554166] Starting subtest: basic-subslice-total
[162.557672] Subtest basic-subslice-total: SUCCESS (0.000s)
[162.643395] [049/133] (862s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[162.693459] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[162.697131] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[162.875134] [050/133] (862s left) gem_exec_whisper (basic-queues-priority-all)
[162.934935] Starting subtest: basic-queues-priority-all
[185.305035] Subtest basic-queues-priority-all: SUCCESS (22.362s)
[185.481958] [051/133] (839s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[185.533659] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[185.588709] [052/133] (839s left) gem_userptr_blits (forbidden-operations)
[185.656508] Starting subtest: forbidden-operations
[185.660627] Subtest forbidden-operations: SKIP (0.000s)
[185.783991] [053/133] (839s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions)
[185.894866] Starting subtest: cursor-vs-flip-atomic-transitions
[216.013190] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (30.113s)
[216.862791] [054/133] (808s left) gem_exec_flush (basic-wb-rw-default)
[216.916345] Starting subtest: basic-wb-rw-default
[222.377639] Subtest basic-wb-rw-default: SUCCESS (5.462s)
[222.576867] [055/133] (802s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[222.688097] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[222.692618] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[222.796209] [056/133] (802s left) kms_async_flips (test-time-stamp)
[222.887820] Starting subtest: test-time-stamp
[223.261775] Starting dynamic subtest: pipe-A-eDP-1
[224.050638] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.787s)
[224.430440] Starting dynamic subtest: pipe-B-eDP-1
[225.187076] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.761s)
[225.552179] Starting dynamic subtest: pipe-C-eDP-1
[226.303124] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.755s)
[226.665777] Starting dynamic subtest: pipe-D-eDP-1
[227.437366] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.775s)
[227.439986] Subtest test-time-stamp: SUCCESS (4.550s)
[228.584580] [057/133] (797s left) gem_wait (wait)
[228.653428] Starting subtest: wait
[228.655904] Starting dynamic subtest: all-engines
[229.909253] Dynamic subtest all-engines: SUCCESS (1.253s)
[229.921796] Starting dynamic subtest: rcs0
[230.955211] Dynamic subtest rcs0: SUCCESS (1.044s)
[230.965960] Starting dynamic subtest: bcs0
[232.006642] Dynamic subtest bcs0: SUCCESS (1.049s)
[232.016676] Starting dynamic subtest: vcs0
[233.052761] Dynamic subtest vcs0: SUCCESS (1.044s)
[233.064033] Starting dynamic subtest: vcs1
[234.098871] Dynamic subtest vcs1: SUCCESS (1.044s)
[234.109915] Starting dynamic subtest: vecs0
[235.143885] Dynamic subtest vecs0: SUCCESS (1.043s)
[235.154516] Starting dynamic subtest: ccs0
[236.191770] Dynamic subtest ccs0: SUCCESS (1.046s)
[236.194656] Subtest wait: SUCCESS (7.538s)
[236.388917] [058/133] (789s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted)
[236.443260] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted
[236.546050] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.102s)
[236.620794] [059/133] (789s left) kms_pm_rpm (dpms-lpsp)
[238.146685] Starting subtest: dpms-lpsp
[238.859308] Subtest dpms-lpsp: SUCCESS (0.715s)
[238.956810] [060/133] (786s left) gem_exec_fence (syncobj-timeline-repeat)
[239.498041] Starting subtest: syncobj-timeline-repeat
[239.731457] Subtest syncobj-timeline-repeat: SUCCESS (0.233s)
[240.992703] [061/133] (784s left) kms_psr (fbc-psr-dpms)
[241.083110] Starting subtest: fbc-psr-dpms
[241.085114] Starting dynamic subtest: eDP-1
[241.089280] Dynamic subtest eDP-1: SKIP (0.000s)
[241.093599] Subtest fbc-psr-dpms: SKIP (0.001s)
[241.152977] [062/133] (784s left) kms_setmode (invalid-clone-single-crtc)
[241.213948] Starting subtest: invalid-clone-single-crtc
[241.220769] Subtest invalid-clone-single-crtc: SKIP (0.000s)
[241.344659] [063/133] (784s left) gem_mmap_offset (clear-via-pagefault)
[241.410040] Starting subtest: clear-via-pagefault
[241.412292] Starting dynamic subtest: smem0
[287.451307] [064/133] (738s left) kms_atomic_interruptible (universal-setplane-cursor)
[287.636521] Starting subtest: universal-setplane-cursor
[287.638844] Starting dynamic subtest: pipe-A-eDP-1
[295.034099] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.394s)
[295.036481] Subtest universal-setplane-cursor: SUCCESS (7.396s)
[295.881742] [065/133] (730s left) gem_exec_balancer (parallel-contexts)
[296.152563] Starting subtest: parallel-contexts
[299.377427] Subtest parallel-contexts: SUCCESS (3.225s)
[300.096036] [066/133] (725s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-plflip-blt)
[300.211680] Starting subtest: fbcpsr-2p-scndscrn-shrfb-plflip-blt
[300.215852] Subtest fbcpsr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[300.323511] [067/133] (725s left) gem_eio (context-create)
[300.541737] Starting subtest: context-create
[300.901308] Subtest context-create: SUCCESS (0.360s)
[301.013861] [068/133] (725s left) kms_big_fb (y-tiled-8bpp-rotate-90)
[301.118580] Starting subtest: y-tiled-8bpp-rotate-90
[301.122169] Subtest y-tiled-8bpp-rotate-90: SKIP (0.000s)
[301.213788] [069/133] (724s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[301.313681] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip
[302.352550] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.039s)
[302.485293] [070/133] (723s left) kms_vblank (ts-continuation-dpms-suspend)
[302.572336] Starting subtest: ts-continuation-dpms-suspend
[302.573977] Starting dynamic subtest: pipe-A-eDP-1
[320.068899] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.965s)
[320.086236] Starting dynamic subtest: pipe-D-eDP-1
[338.060123] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.490s)
[338.062539] Subtest ts-continuation-dpms-suspend: SUCCESS (4.459s)
[338.858561] [071/133] (687s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-wc)
[338.955096] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-wc
[343.185939] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (4.232s)
[344.367790] [072/133] (681s left) vgem_basic (dmabuf-export)
[344.420063] Starting subtest: dmabuf-export
[344.446424] Subtest dmabuf-export: SUCCESS (0.028s)
[344.572543] [073/133] (681s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-fully-sf)
[344.665538] Starting subtest: pr-cursor-plane-move-continuous-exceed-fully-sf
[344.669674] Subtest pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[344.740957] [074/133] (681s left) drm_read (empty-block)
[344.884407] Starting subtest: empty-block
[345.888007] Subtest empty-block: SUCCESS (1.001s)
[346.010886] [075/133] (680s left) syncobj_wait (reset-during-wait-for-submit)
[346.062402] Starting subtest: reset-during-wait-for-submit
[346.167457] Subtest reset-during-wait-for-submit: SUCCESS (0.103s)
[346.255471] [076/133] (680s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[346.355726] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[346.979388] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.625s)
[347.147129] [077/133] (679s left) gem_exec_balancer (full)
[347.214016] Starting subtest: full
[351.757582] Subtest full: SUCCESS (4.542s)
[352.067595] [078/133] (674s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[352.164515] Starting subtest: psr-indfb-scaledprimary
[357.941767] Subtest psr-indfb-scaledprimary: SUCCESS (5.780s)
[358.037588] [079/133] (668s left) gem_exec_schedule (semaphore-codependency)
[358.116602] Starting subtest: semaphore-codependency
[358.123675] Subtest semaphore-codependency: SUCCESS (0.012s)
[358.473620] [080/133] (668s left) syncobj_timeline (wait-all-complex)
[358.529094] Starting subtest: wait-all-complex
[358.745104] Subtest wait-all-complex: SUCCESS (0.216s)
[358.836686] [081/133] (667s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs)
[358.926723] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs
[358.929073] Starting dynamic subtest: pipe-A-eDP-1
[358.952230] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[358.964937] Starting dynamic subtest: pipe-B-eDP-1
[358.986847] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[358.996516] Starting dynamic subtest: pipe-C-eDP-1
[359.017852] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[359.026878] Starting dynamic subtest: pipe-D-eDP-1
[359.048607] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[359.052912] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[361.140613] [082/133] (665s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[361.241059] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[362.032291] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.792s)
[362.207264] [083/133] (664s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-modifier-source-clamping)
[362.292713] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-modifier-source-clamping
[362.296793] Subtest pixel-format-4-tiled-dg2-rc-ccs-modifier-source-clamping: SKIP (0.000s)
[362.364608] [084/133] (664s left) gem_create (create-ext-placement-all)
[362.536351] Starting subtest: create-ext-placement-all
[362.539224] Subtest create-ext-placement-all: SUCCESS (0.000s)
[362.642129] [085/133] (664s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[362.758697] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[380.464391] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (17.706s)
[381.343897] [086/133] (645s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[381.448850] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu
[381.452947] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[381.538701] [087/133] (645s left) gen7_exec_parse (bitmasks)
[381.603675] Subtest bitmasks: SKIP (0.000s)
[381.675881] [088/133] (645s left) gem_eio (in-flight-contexts-1us)
[381.891001] Starting subtest: in-flight-contexts-1us
[395.946080] Subtest in-flight-contexts-1us: SUCCESS (14.054s)
[396.125378] [089/133] (630s left) gem_exec_suspend (basic-s3-devices)
[396.189246] Starting subtest: basic-S3-devices
[396.191688] Starting dynamic subtest: smem
[407.884233] Dynamic subtest smem: SUCCESS (11.692s)
[407.887512] Subtest basic-S3-devices: SUCCESS (11.694s)
[408.067273] [090/133] (618s left) gem_exec_params (invalid-ring2)
[408.131197] Starting subtest: invalid-ring2
[408.133567] Subtest invalid-ring2: SUCCESS (0.000s)
[408.228963] [091/133] (618s left) i915_query (test-query-geometry-subslices)
[408.280574] Starting subtest: test-query-geometry-subslices
[408.282775] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[408.370066] [092/133] (618s left) kms_universal_plane (disable-primary-vs-flip)
[408.470493] Starting subtest: disable-primary-vs-flip
[408.472387] Starting dynamic subtest: pipe-A-eDP-1
[410.022991] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.552s)
[410.039929] Starting dynamic subtest: pipe-B-eDP-1
[412.284696] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.260s)
[412.298335] Starting dynamic subtest: pipe-C-eDP-1
[414.528646] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.241s)
[414.539403] Starting dynamic subtest: pipe-D-eDP-1
[416.716156] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.188s)
[416.718510] Subtest disable-primary-vs-flip: SUCCESS (8.248s)
[417.604388] [093/133] (609s left) kms_vrr (seamless-rr-switch-drrs)
[417.700612] Starting subtest: seamless-rr-switch-drrs
[417.707253] Subtest seamless-rr-switch-drrs: SKIP (0.000s)
[417.776815] [094/133] (609s left) gem_exec_params (dr4-dirt)
[417.837642] Starting subtest: DR4-dirt
[417.840021] Subtest DR4-dirt: SUCCESS (0.000s)
[417.944729] [095/133] (609s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[418.034329] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[418.038513] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[418.135384] [096/133] (609s left) kms_plane_scaling (plane-scaler-unity-scaling-with-rotation)
[418.230578] Starting subtest: plane-scaler-unity-scaling-with-rotation
[418.232708] Starting dynamic subtest: pipe-A
[418.455610] Dynamic subtest pipe-A: SUCCESS (0.228s)
[418.465621] Starting dynamic subtest: pipe-B
[419.811461] Dynamic subtest pipe-B: SUCCESS (1.354s)
[419.824804] Starting dynamic subtest: pipe-C
[421.132811] Dynamic subtest pipe-C: SUCCESS (1.319s)
[421.146488] Starting dynamic subtest: pipe-D
[422.451526] Dynamic subtest pipe-D: SUCCESS (1.318s)
[422.453743] Subtest plane-scaler-unity-scaling-with-rotation: SUCCESS (4.225s)
[423.685653] [097/133] (603s left) i915_drm_fdinfo (context-close-stress)
[423.729993] Starting subtest: context-close-stress
[434.472800] Subtest context-close-stress: SUCCESS (10.745s)
[434.547117] [098/133] (592s left) kms_chamelium_hpd (dp-hpd-storm)
[435.149377] Subtest dp-hpd-storm: SKIP (0.000s)
[435.933010] [099/133] (591s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[436.027651] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc
[443.256792] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (7.232s)
[443.383438] [100/133] (584s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[443.444007] Starting subtest: etime-multi-wait-for-submit-submitted
[443.551709] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.107s)
[443.646739] [101/133] (583s left) perf_pmu (all-busy-idle-check-all)
[443.691719] Starting subtest: all-busy-idle-check-all
[444.875382] Subtest all-busy-idle-check-all: SUCCESS (1.184s)
[444.982581] [102/133] (582s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-blt)
[445.093557] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-blt
[452.411823] Subtest psr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (7.322s)
[452.539614] [103/133] (575s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[452.642892] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[460.010401] Subtest psr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.370s)
[460.134810] [104/133] (567s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[460.224823] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[460.228831] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[460.294294] [105/133] (567s left) kms_cursor_crc (cursor-offscreen-256x256)
[460.533324] Starting subtest: cursor-offscreen-256x256
[460.541125] Starting dynamic subtest: pipe-A-eDP-1
[462.485020] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.944s)
[462.515484] Starting dynamic subtest: pipe-D-eDP-1
[465.155144] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.650s)
[465.157331] Subtest cursor-offscreen-256x256: SUCCESS (4.622s)
[466.015821] [106/133] (561s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu)
[466.122582] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu
[466.126520] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[466.224040] [107/133] (561s left) kms_async_flips (alternate-sync-async-flip-atomic)
[466.320528] Starting subtest: alternate-sync-async-flip-atomic
[466.692528] Starting dynamic subtest: pipe-A-eDP-1
[469.493663] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.802s)
[469.875136] Starting dynamic subtest: pipe-B-eDP-1
[472.624021] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.758s)
[473.005150] Starting dynamic subtest: pipe-C-eDP-1
[475.758358] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.761s)
[476.137633] Starting dynamic subtest: pipe-D-eDP-1
[478.896462] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.768s)
[478.898510] Subtest alternate-sync-async-flip-atomic: SUCCESS (12.579s)
[480.069400] [108/133] (547s left) syncobj_eventfd (invalid-bad-flags)
[480.132872] Starting subtest: invalid-bad-flags
[480.135311] Subtest invalid-bad-flags: SUCCESS (0.000s)
[480.244285] [109/133] (547s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[480.339320] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[480.341537] Starting dynamic subtest: pipe-A-eDP-1
[480.361251] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[480.375087] Starting dynamic subtest: pipe-B-eDP-1
[480.394076] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[480.404248] Starting dynamic subtest: pipe-C-eDP-1
[480.423508] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[480.433516] Starting dynamic subtest: pipe-D-eDP-1
[480.452913] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[480.455094] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.007s)
[482.562741] [110/133] (545s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render)
[482.659043] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render
[482.663377] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[482.748687] [111/133] (545s left) kms_getfb (getfb-reject-nv12)
[482.834742] Starting subtest: getfb-reject-nv12
[482.836995] Subtest getfb-reject-nv12: SUCCESS (0.001s)
[482.946709] [112/133] (545s left) kms_chamelium_color (ctm-blue-to-red)
[483.045534] Subtest ctm-blue-to-red: SKIP (0.000s)
[483.090697] [113/133] (544s left) syncobj_timeline (multi-wait-all-available-submitted-signaled)
[483.146063] Starting subtest: multi-wait-all-available-submitted-signaled
[483.148304] Subtest multi-wait-all-available-submitted-signaled: SUCCESS (0.000s)
[483.226222] [114/133] (544s left) gem_caching (writes)
[483.302730] Subtest writes: SKIP (0.000s)
[483.367796] [115/133] (544s left) kms_psr (psr-suspend)
[483.456610] Starting subtest: psr-suspend
[483.458813] Starting dynamic subtest: eDP-1
[500.932146] Dynamic subtest eDP-1: SUCCESS (2.853s)
[500.934540] Subtest psr-suspend: SUCCESS (2.854s)
[501.803882] [116/133] (526s left) kms_psr (psr2-cursor-blt)
[501.897285] Starting subtest: psr2-cursor-blt
[501.899992] Starting dynamic subtest: eDP-1
[503.592342] Dynamic subtest eDP-1: SUCCESS (1.693s)
[503.595171] Subtest psr2-cursor-blt: SUCCESS (1.694s)
[504.376941] [117/133] (523s left) kms_psr (psr-basic)
[504.471383] Starting subtest: psr-basic
[504.474093] Starting dynamic subtest: eDP-1
[506.059191] Dynamic subtest eDP-1: SUCCESS (1.588s)
[506.062018] Subtest psr-basic: SUCCESS (1.589s)
[506.940055] [118/133] (521s left) gem_exec_reloc (basic-write-gtt)
[507.002907] Subtest basic-write-gtt: SKIP (0.000s)
[507.063175] [119/133] (521s left) kms_flip (2x-flip-vs-fences)
[507.163896] Starting subtest: 2x-flip-vs-fences
[507.169113] Subtest 2x-flip-vs-fences: SKIP (0.000s)
[507.257880] [120/133] (521s left) kms_atomic_transition (plane-all-transition)
[507.341526] Starting subtest: plane-all-transition
[507.344153] Starting dynamic subtest: pipe-A-eDP-1
[509.835364] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.494s)
[510.154394] Starting dynamic subtest: pipe-B-eDP-1
[513.362267] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.216s)
[513.670896] Subtest plane-all-transition: SUCCESS (6.329s)
[514.490203] [121/133] (513s left) gem_ctx_persistence (engines-hostile)
[514.557397] Starting subtest: engines-hostile
[514.560381] Starting dynamic subtest: rcs0
[514.647370] Dynamic subtest rcs0: SUCCESS (0.090s)
[514.659254] Starting dynamic subtest: bcs0
[514.691449] Dynamic subtest bcs0: SUCCESS (0.042s)
[514.702507] Starting dynamic subtest: vcs0
[514.785466] Dynamic subtest vcs0: SUCCESS (0.091s)
[514.799366] Starting dynamic subtest: vcs1
[514.844015] Dynamic subtest vcs1: SUCCESS (0.056s)
[514.856471] Starting dynamic subtest: vecs0
[514.936759] Dynamic subtest vecs0: SUCCESS (0.090s)
[514.950488] Starting dynamic subtest: ccs0
[515.015384] Dynamic subtest ccs0: SUCCESS (0.077s)
[515.018231] Subtest engines-hostile: SUCCESS (0.460s)
[515.143400] [122/133] (513s left) kms_plane_cursor (primary)
[515.248278] Starting subtest: primary
[515.253610] Starting dynamic subtest: pipe-A-eDP-1-size-64
[517.825384] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.579s)
[517.849314] Starting dynamic subtest: pipe-A-eDP-1-size-128
[520.402254] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.561s)
[520.428021] Starting dynamic subtest: pipe-A-eDP-1-size-256
[522.992991] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.574s)
[523.323489] Starting dynamic subtest: pipe-B-eDP-1-size-64
[526.566915] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.268s)
[526.593950] Starting dynamic subtest: pipe-B-eDP-1-size-128
[529.167316] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.583s)
[529.192377] Starting dynamic subtest: pipe-B-eDP-1-size-256
[531.811896] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.628s)
[532.135611] Starting dynamic subtest: pipe-C-eDP-1-size-64
[535.075355] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.954s)
[535.103226] Starting dynamic subtest: pipe-C-eDP-1-size-128
[537.310075] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.214s)
[537.337374] Starting dynamic subtest: pipe-C-eDP-1-size-256
[539.509426] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.180s)
[539.829506] Starting dynamic subtest: pipe-D-eDP-1-size-64
[542.778808] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.963s)
[542.805495] Starting dynamic subtest: pipe-D-eDP-1-size-128
[545.000509] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.203s)
[545.027350] Starting dynamic subtest: pipe-D-eDP-1-size-256
[547.201337] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.181s)
[547.510289] Subtest primary: SUCCESS (32.262s)
[548.327674] [123/133] (480s left) gem_exec_params (no-blt)
[548.382487] Starting subtest: no-blt
[548.385301] Subtest no-blt: SUCCESS (0.002s)
[548.493338] [124/133] (479s left) kms_cursor_crc (cursor-size-hints)
[548.623223] Starting subtest: cursor-size-hints
[548.626034] Starting dynamic subtest: pipe-A-eDP-1
[549.233488] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.607s)
[549.244776] Starting dynamic subtest: pipe-D-eDP-1
[550.491388] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.256s)
[550.493896] Subtest cursor-size-hints: SUCCESS (1.867s)
[551.295421] [125/133] (477s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling)
[551.393311] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-upscaling
[551.398383] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SKIP (0.000s)
[551.494009] [126/133] (477s left) gem_exec_reloc (basic-gtt-wc-noreloc)
[551.552947] Subtest basic-gtt-wc-noreloc: SKIP (0.000s)
[551.630171] [127/133] (476s left) sysfs_timeslice_duration (idempotent)
[551.691244] Starting subtest: idempotent
[551.693918] Starting dynamic subtest: vecs0
[551.696364] Dynamic subtest vecs0: SUCCESS (0.000s)
[551.707628] Starting dynamic subtest: ccs0
[551.710306] Dynamic subtest ccs0: SUCCESS (0.000s)
[551.720473] Starting dynamic subtest: vcs0
[551.723137] Dynamic subtest vcs0: SUCCESS (0.001s)
[551.734388] Starting dynamic subtest: bcs0
[551.737206] Dynamic subtest bcs0: SUCCESS (0.000s)
[551.747270] Starting dynamic subtest: rcs0
[551.750034] Dynamic subtest rcs0: SUCCESS (0.000s)
[551.760133] Starting dynamic subtest: vcs1
[551.762735] Dynamic subtest vcs1: SUCCESS (0.000s)
[551.765268] Subtest idempotent: SUCCESS (0.013s)
[551.803712] [128/133] (476s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[551.889799] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[551.892022] Starting dynamic subtest: pipe-A-eDP-1
[552.353125] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.436s)
[552.365081] Starting dynamic subtest: pipe-B-eDP-1
[553.881020] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.525s)
[553.893350] Starting dynamic subtest: pipe-C-eDP-1
[555.258177] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.375s)
[555.268867] Starting dynamic subtest: pipe-D-eDP-1
[556.723204] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.462s)
[556.725938] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.803s)
[557.847839] [129/133] (470s left) api_intel_bb (object-reloc-purge-cache)
[557.913533] Starting subtest: object-reloc-purge-cache
[557.919264] Subtest object-reloc-purge-cache: SKIP (0.003s)
[558.031186] [130/133] (470s left) device_reset (unbind-cold-reset-rebind)
[558.084286] Starting subtest: unbind-cold-reset-rebind
[558.090015] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[558.156184] [131/133] (470s left) gem_exec_whisper (basic-contexts-forked)
[558.224466] Starting subtest: basic-contexts-forked
[582.975527] Subtest basic-contexts-forked: SUCCESS (24.746s)
[583.162250] [132/133] (445s left) kms_prop_blob (invalid-get-prop)
[583.216871] Starting subtest: invalid-get-prop
[583.219475] Subtest invalid-get-prop: SUCCESS (0.000s)
[583.342113] [133/133] (445s left) kms_pm_rpm (modeset-non-lpsp)
[584.885528] Starting subtest: modeset-non-lpsp
[586.030946] Subtest modeset-non-lpsp: SKIP (1.145s)
[586.420564] Closing watchdogs
results: parsing output: 0/ for test: gem_ctx_param
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: template
results: parsing output: 3/ for test: kms_plane_alpha_blend
results: parsing output: 4/ for test: gem_exec_fence
results: parsing output: 5/ for test: kms_invalid_mode
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: kms_cursor_legacy
results: parsing output: 8/ for test: gem_exec_schedule
results: parsing output: 9/ for test: kms_flip_scaled_crc
results: parsing output: 10/ for test: kms_psr2_su
results: parsing output: 11/ for test: kms_rotation_crc
results: parsing output: 12/ for test: kms_cursor_edge_walk
results: parsing output: 13/ for test: gem_mmap_gtt
results: parsing output: 14/ for test: gem_exec_reloc
results: parsing output: 15/ for test: kms_feature_discovery
results: parsing output: 16/ for test: kms_feature_discovery
results: parsing output: 17/ for test: gem_exec_params
results: parsing output: 18/ for test: kms_content_protection
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: gem_pread
results: parsing output: 22/ for test: kms_plane_scaling
results: parsing output: 23/ for test: gem_render_copy
results: parsing output: 24/ for test: prime_vgem
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: api_intel_allocator
results: parsing output: 27/ for test: i915_pm_rps
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: vgem_basic
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_ccs
results: parsing output: 34/ for test: kms_flip
results: parsing output: 35/ for test: kms_ccs
results: parsing output: 36/ for test: perf_pmu
results: parsing output: 37/ for test: gem_spin_batch
results: parsing output: 38/ for test: kms_color_pipeline
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_ctx_persistence
results: parsing output: 41/ for test: gem_barrier_race
results: parsing output: 42/ for test: gem_mmap_wc
results: parsing output: 43/ for test: kms_cursor_legacy
results: parsing output: 44/ for test: kms_chamelium_edid
results: parsing output: 45/ for test: kms_big_fb
results: parsing output: 46/ for test: perf
results: parsing output: 47/ for test: i915_getparams_basic
results: parsing output: 48/ for test: gem_render_copy
results: parsing output: 49/ for test: gem_exec_whisper
results: parsing output: 50/ for test: kms_pipe_b_c_ivb
results: parsing output: 51/ for test: gem_userptr_blits
results: parsing output: 52/ for test: kms_cursor_legacy
results: parsing output: 53/ for test: gem_exec_flush
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: kms_async_flips
results: parsing output: 56/ for test: gem_wait
results: parsing output: 57/ for test: syncobj_wait
results: parsing output: 58/ for test: kms_pm_rpm
results: parsing output: 59/ for test: gem_exec_fence
results: parsing output: 60/ for test: kms_psr
results: parsing output: 61/ for test: kms_setmode
results: parsing output: 62/ for test: gem_mmap_offset
results: parsing output: 63/ for test: kms_atomic_interruptible
results: parsing output: 64/ for test: gem_exec_balancer
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: gem_eio
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: kms_big_fb
results: parsing output: 69/ for test: kms_vblank
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: vgem_basic
results: parsing output: 72/ for test: kms_psr2_sf
results: parsing output: 73/ for test: drm_read
results: parsing output: 74/ for test: syncobj_wait
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: gem_exec_balancer
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_exec_schedule
results: parsing output: 79/ for test: syncobj_timeline
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: kms_big_fb
results: parsing output: 82/ for test: kms_plane
results: parsing output: 83/ for test: gem_create
results: parsing output: 84/ for test: kms_cursor_legacy
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gen7_exec_parse
results: parsing output: 87/ for test: gem_eio
results: parsing output: 88/ for test: gem_exec_suspend
results: parsing output: 89/ for test: gem_exec_params
results: parsing output: 90/ for test: i915_query
results: parsing output: 91/ for test: kms_universal_plane
results: parsing output: 92/ for test: kms_vrr
results: parsing output: 93/ for test: gem_exec_params
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_plane_scaling
results: parsing output: 96/ for test: i915_drm_fdinfo
results: parsing output: 97/ for test: kms_chamelium_hpd
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: perf_pmu
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_joiner
results: parsing output: 104/ for test: kms_cursor_crc
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_async_flips
results: parsing output: 107/ for test: syncobj_eventfd
results: parsing output: 108/ for test: kms_ccs
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_getfb
results: parsing output: 111/ for test: kms_chamelium_color
results: parsing output: 112/ for test: syncobj_timeline
results: parsing output: 113/ for test: gem_caching
results: parsing output: 114/ for test: kms_psr
results: parsing output: 115/ for test: kms_psr
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: gem_exec_reloc
results: parsing output: 118/ for test: kms_flip
results: parsing output: 119/ for test: kms_atomic_transition
results: parsing output: 120/ for test: gem_ctx_persistence
results: parsing output: 121/ for test: kms_plane_cursor
results: parsing output: 122/ for test: gem_exec_params
results: parsing output: 123/ for test: kms_cursor_crc
results: parsing output: 124/ for test: kms_flip_scaled_crc
results: parsing output: 125/ for test: gem_exec_reloc
results: parsing output: 126/ for test: sysfs_timeslice_duration
results: parsing output: 127/ for test: kms_ccs
results: parsing output: 128/ for test: api_intel_bb
results: parsing output: 129/ for test: device_reset
results: parsing output: 130/ for test: gem_exec_whisper
results: parsing output: 131/ for test: kms_prop_blob
results: parsing output: 132/ for test: kms_pm_rpm
Done.