[57.088443] Initializing watchdogs
[57.088495]   /dev/watchdog0
[57.103498] [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.108632] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.111037] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.114559] [001/133] (960s left) kms_atomic (atomic-invalid-params)
[57.229870] Starting subtest: atomic-invalid-params
[57.232285] Starting dynamic subtest: pipe-A-eDP-1
[57.673351] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.441s)
[57.675638] Subtest atomic-invalid-params: SUCCESS (0.442s)
[58.519615] [002/133] (959s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[58.616133] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[58.618415] Starting dynamic subtest: pipe-A-eDP-1
[58.680607] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.064s)
[58.988815] Starting dynamic subtest: pipe-B-eDP-1
[59.830634] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.849s)
[60.148298] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.524s)
[60.987010] [003/133] (956s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[61.105801] Starting subtest: cursor-vs-flip-atomic
[90.935908] Subtest cursor-vs-flip-atomic: SUCCESS (29.802s)
[91.739172] [004/133] (925s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[91.870462] Starting subtest: cursorA-vs-flipB-legacy
[91.875072] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[92.026682] [005/133] (925s left) gem_pxp (verify-pxp-execution-after-suspend-resume)
[92.150727] Starting subtest: verify-pxp-execution-after-suspend-resume
[99.324681] Subtest verify-pxp-execution-after-suspend-resume: SUCCESS (7.175s)
[99.477490] [006/133] (918s left) kms_big_fb (y-tiled-16bpp-rotate-270)
[99.581372] Starting subtest: y-tiled-16bpp-rotate-270
[99.585218] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s)
[99.679627] [007/133] (918s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[99.771683] Starting subtest: compare-crc-sanitycheck-nv12
[99.774492] Starting dynamic subtest: pipe-A-eDP-1
[100.496063] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.722s)
[100.506107] Starting dynamic subtest: pipe-B-eDP-1
[101.779492] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.284s)
[101.790611] Starting dynamic subtest: pipe-C-eDP-1
[103.059088] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.278s)
[103.072996] Starting dynamic subtest: pipe-D-eDP-1
[104.291210] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.231s)
[104.293734] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.519s)
[105.094835] [008/133] (912s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format)
[105.190170] Starting subtest: plane-scaler-unity-scaling-with-pixel-format
[105.192594] Starting dynamic subtest: pipe-A
[106.349414] Dynamic subtest pipe-A: SUCCESS (1.162s)
[106.359901] Starting dynamic subtest: pipe-B
[108.580998] Dynamic subtest pipe-B: SUCCESS (2.231s)
[108.592469] Starting dynamic subtest: pipe-C
[109.791874] Dynamic subtest pipe-C: SUCCESS (1.210s)
[109.802154] Starting dynamic subtest: pipe-D
[111.011836] Dynamic subtest pipe-D: SUCCESS (1.219s)
[111.014218] Subtest plane-scaler-unity-scaling-with-pixel-format: SUCCESS (5.824s)
[112.200999] [009/133] (905s left) kms_pm_rpm (basic-rte)
[112.241058] Starting subtest: basic-rte
[115.879161] Subtest basic-rte: SUCCESS (3.637s)
[117.714701] [010/133] (900s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[117.813506] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[117.815656] Starting dynamic subtest: pipe-A-eDP-1
[117.873903] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[117.884065] Starting dynamic subtest: pipe-B-eDP-1
[117.942081] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[117.952087] Starting dynamic subtest: pipe-C-eDP-1
[118.010190] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[118.021249] Starting dynamic subtest: pipe-D-eDP-1
[118.078569] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[118.082801] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.008s)
[120.072756] [011/133] (897s left) gem_mmap (bad-size)
[120.133243] Subtest bad-size: SKIP (0.000s)
[120.191276] [012/133] (897s left) gem_ccs (block-multicopy-inplace)
[120.240326] Starting subtest: block-multicopy-inplace
[120.244615] Subtest block-multicopy-inplace: SKIP (0.000s)
[120.350143] [013/133] (897s left) i915_pm_rpm (debugfs-forcewake-user)
[122.483213] Starting subtest: debugfs-forcewake-user
[133.880290] Subtest debugfs-forcewake-user: SUCCESS (11.401s)
[134.255363] [014/133] (883s left) gem_ctx_shared (exec-shared-gtt)
[134.322669] Starting subtest: exec-shared-gtt
[134.324520] Starting dynamic subtest: rcs0
[134.332498] Dynamic subtest rcs0: SUCCESS (0.013s)
[134.343712] Starting dynamic subtest: bcs0
[134.345842] Dynamic subtest bcs0: SUCCESS (0.008s)
[134.354880] Starting dynamic subtest: vcs0
[134.357132] Dynamic subtest vcs0: SUCCESS (0.008s)
[134.366760] Starting dynamic subtest: vcs1
[134.369096] Dynamic subtest vcs1: SUCCESS (0.006s)
[134.378070] Starting dynamic subtest: vecs0
[134.379962] Dynamic subtest vecs0: SUCCESS (0.005s)
[134.388809] Starting dynamic subtest: ccs0
[134.390855] Dynamic subtest ccs0: SUCCESS (0.005s)
[134.392888] Subtest exec-shared-gtt: SUCCESS (0.047s)
[136.409712] [015/133] (881s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[136.511793] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[136.516329] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[136.611391] [016/133] (881s left) gem_exec_schedule (preempt-contexts)
[136.679326] Starting subtest: preempt-contexts
[136.681346] Starting dynamic subtest: rcs0
[136.734528] Dynamic subtest rcs0: SUCCESS (0.062s)
[136.747778] Starting dynamic subtest: bcs0
[136.793100] Dynamic subtest bcs0: SUCCESS (0.058s)
[136.802852] Starting dynamic subtest: vcs0
[136.838052] Dynamic subtest vcs0: SUCCESS (0.044s)
[136.850878] Starting dynamic subtest: vcs1
[136.882664] Dynamic subtest vcs1: SUCCESS (0.044s)
[136.895436] Starting dynamic subtest: vecs0
[136.925317] Dynamic subtest vecs0: SUCCESS (0.042s)
[136.934512] Starting dynamic subtest: ccs0
[136.976286] Dynamic subtest ccs0: SUCCESS (0.051s)
[136.978463] Subtest preempt-contexts: SUCCESS (0.305s)
[138.401166] [017/133] (879s left) gem_exec_whisper (basic-contexts-forked-all)
[138.473716] Starting subtest: basic-contexts-forked-all
[159.201722] Subtest basic-contexts-forked-all: SUCCESS (20.725s)
[159.383109] [018/133] (858s left) gem_spin_batch (user-each)
[159.444394] Starting subtest: user-each
[162.809974] Subtest user-each: SUCCESS (3.366s)
[163.345764] [019/133] (854s left) kms_flip (wf_vblank-ts-check)
[163.437437] Starting subtest: wf_vblank-ts-check
[163.439428] Starting dynamic subtest: A-eDP1
[172.420684] Dynamic subtest A-eDP1: SUCCESS (8.952s)
[172.431065] Starting dynamic subtest: B-eDP1
[181.355641] Dynamic subtest B-eDP1: SUCCESS (8.935s)
[181.365803] Starting dynamic subtest: C-eDP1
[190.293250] Dynamic subtest C-eDP1: SUCCESS (8.923s)
[190.305679] Starting dynamic subtest: D-eDP1
[199.229804] Dynamic subtest D-eDP1: SUCCESS (8.937s)
[199.232093] Subtest wf_vblank-ts-check: SUCCESS (35.755s)
[200.418128] [020/133] (817s left) syncobj_timeline (multi-wait-all-available-signaled)
[200.477339] Starting subtest: multi-wait-all-available-signaled
[200.479791] Subtest multi-wait-all-available-signaled: SUCCESS (0.001s)
[200.586880] [021/133] (817s left) gem_exec_fence (basic-wait)
[200.766788] Starting subtest: basic-wait
[200.769261] Starting dynamic subtest: rcs0
[200.821491] Dynamic subtest rcs0: SUCCESS (0.054s)
[200.832690] Starting dynamic subtest: bcs0
[200.874504] Dynamic subtest bcs0: SUCCESS (0.052s)
[200.885685] Starting dynamic subtest: vcs0
[200.936781] Dynamic subtest vcs0: SUCCESS (0.060s)
[200.948319] Starting dynamic subtest: vcs1
[200.989431] Dynamic subtest vcs1: SUCCESS (0.051s)
[200.998801] Starting dynamic subtest: vecs0
[201.038125] Dynamic subtest vecs0: SUCCESS (0.048s)
[201.050727] Starting dynamic subtest: ccs0
[201.087937] Dynamic subtest ccs0: SUCCESS (0.049s)
[201.090422] Subtest basic-wait: SUCCESS (0.322s)
[203.413106] [FACT gem_exec_fence (basic-wait)] new: kernel.kmod_is_loaded.vgem: true
[203.416871] [022/133] (815s left) gen9_exec_parse (basic-rejected-ctx-param)
[203.474204] Subtest basic-rejected-ctx-param: SKIP (0.000s)
[203.557668] [023/133] (814s left) kms_ccs (bad-pixel-format-yf-tiled-ccs)
[203.659738] Starting subtest: bad-pixel-format-yf-tiled-ccs
[203.662059] Starting dynamic subtest: pipe-A-eDP-1
[203.685195] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[203.697756] Starting dynamic subtest: pipe-B-eDP-1
[203.719217] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[203.728615] Starting dynamic subtest: pipe-C-eDP-1
[203.750035] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[203.759205] Starting dynamic subtest: pipe-D-eDP-1
[203.780785] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[203.785182] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.003s)
[205.980463] [024/133] (812s left) kms_prime (d3hot)
[206.060896] Subtest D3hot: SKIP (0.000s)
[206.165610] [025/133] (812s left) kms_cursor_crc (cursor-offscreen-256x85)
[206.418066] Starting subtest: cursor-offscreen-256x85
[206.467050] Subtest cursor-offscreen-256x85: SKIP (0.044s)
[206.645505] [026/133] (811s left) gem_userptr_blits (mmap-offset-banned)
[206.718284] Starting subtest: mmap-offset-banned
[206.720531] Starting dynamic subtest: wb
[206.722755] Dynamic subtest wb: SUCCESS (0.000s)
[206.732597] Starting dynamic subtest: wc
[206.734513] Dynamic subtest wc: SUCCESS (0.000s)
[206.743700] Starting dynamic subtest: uc
[206.745591] Dynamic subtest uc: SUCCESS (0.000s)
[206.747498] Subtest mmap-offset-banned: SUCCESS (0.002s)
[206.837530] [027/133] (811s left) kms_cursor_crc (cursor-random-32x32)
[206.986020] Starting subtest: cursor-random-32x32
[207.036458] Subtest cursor-random-32x32: SKIP (0.047s)
[207.318180] [028/133] (811s left) kms_properties (connector-properties-legacy)
[207.402826] Starting subtest: connector-properties-legacy
[207.404734] Starting dynamic subtest: pipe-A-eDP-1
[215.301943] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.898s)
[215.313051] Starting dynamic subtest: pipe-None-DP-1
[215.317654] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s)
[215.326732] Starting dynamic subtest: pipe-None-HDMI-A-1
[215.331369] Dynamic subtest pipe-None-HDMI-A-1: SUCCESS (0.001s)
[215.340120] Starting dynamic subtest: pipe-None-DP-2
[215.344255] Dynamic subtest pipe-None-DP-2: SUCCESS (0.001s)
[215.353961] Starting dynamic subtest: pipe-None-HDMI-A-2
[215.358578] Dynamic subtest pipe-None-HDMI-A-2: SUCCESS (0.001s)
[215.368489] Starting dynamic subtest: pipe-None-DP-3
[215.372844] Dynamic subtest pipe-None-DP-3: SUCCESS (0.001s)
[215.382071] Starting dynamic subtest: pipe-None-DP-4
[215.386288] Dynamic subtest pipe-None-DP-4: SUCCESS (0.001s)
[215.388342] Subtest connector-properties-legacy: SUCCESS (7.908s)
[216.179074] [029/133] (802s left) gem_exec_flush (basic-wb-pro-default)
[216.237572] Starting subtest: basic-wb-pro-default
[221.723670] Subtest basic-wb-pro-default: SUCCESS (5.473s)
[221.901187] [030/133] (796s left) kms_psr2_su (page_flip-nv12)
[221.958326] Subtest page_flip-NV12: SKIP (0.000s)
[222.021099] [031/133] (796s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[222.117526] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[228.697344] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.583s)
[228.825992] [032/133] (790s left) syncobj_timeline (single-wait-all-available-submitted)
[228.888548] Starting subtest: single-wait-all-available-submitted
[228.890526] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[228.981796] [033/133] (789s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-sf)
[229.086847] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-sf
[229.090800] Subtest fbc-pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[229.154750] [034/133] (789s left) drm_buddy (drm_buddy)
[229.191043] Starting subtest: drm_buddy
[229.195716] Subtest drm_buddy: SKIP (0.001s)
[229.243233] [035/133] (789s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[229.338289] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf
[229.342797] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[229.407899] [036/133] (789s left) kms_psr (fbc-pr-primary-render)
[229.492278] Starting subtest: fbc-pr-primary-render
[229.496618] Subtest fbc-pr-primary-render: SKIP (0.000s)
[229.565239] [037/133] (789s left) kms_selftest (drm_format_helper)
[229.597755] Starting subtest: drm_format_helper
[229.615054] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[229.692548] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.079s)
[229.702199] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[229.818042] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.123s)
[229.827809] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[229.922607] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.105s)
[229.932236] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[230.026723] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.102s)
[230.036560] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[230.136183] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.106s)
[230.145977] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[230.238459] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.103s)
[230.248629] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[230.365101] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.123s)
[230.374991] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[230.455549] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.092s)
[230.465308] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[230.567063] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.107s)
[230.576693] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[230.660849] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.094s)
[230.672645] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[230.771952] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.110s)
[230.781643] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[230.864935] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.093s)
[230.876446] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[230.975860] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.109s)
[230.985660] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[231.076913] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.101s)
[231.087048] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[231.165725] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.088s)
[231.177275] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[231.283060] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.116s)
[231.294362] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[231.385324] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.102s)
[231.387274] Subtest drm_format_helper: SUCCESS (1.789s)
[231.549808] [038/133] (787s left) kms_color_pipeline (plane-ctm3x4-lut1d)
[231.648702] Starting subtest: plane-ctm3x4-lut1d
[231.794905] Starting dynamic subtest: pipe-A-plane-0
[231.974555] Dynamic subtest pipe-A-plane-0: SUCCESS (0.178s)
[231.984322] Starting dynamic subtest: pipe-A-plane-1
[232.139393] Dynamic subtest pipe-A-plane-1: SUCCESS (0.166s)
[232.150472] Starting dynamic subtest: pipe-A-plane-2
[232.328255] Dynamic subtest pipe-A-plane-2: SUCCESS (0.188s)
[233.543881] Starting dynamic subtest: pipe-B-plane-0
[233.713637] Dynamic subtest pipe-B-plane-0: SUCCESS (0.178s)
[233.724461] Starting dynamic subtest: pipe-B-plane-1
[233.902523] Dynamic subtest pipe-B-plane-1: SUCCESS (0.188s)
[233.914979] Starting dynamic subtest: pipe-B-plane-2
[234.090881] Dynamic subtest pipe-B-plane-2: SUCCESS (0.188s)
[235.330608] Starting dynamic subtest: pipe-C-plane-0
[235.489064] Dynamic subtest pipe-C-plane-0: SUCCESS (0.166s)
[235.499555] Starting dynamic subtest: pipe-C-plane-1
[235.645192] Dynamic subtest pipe-C-plane-1: SUCCESS (0.155s)
[235.657736] Starting dynamic subtest: pipe-C-plane-2
[235.788865] Dynamic subtest pipe-C-plane-2: SUCCESS (0.144s)
[236.995209] Starting dynamic subtest: pipe-D-plane-0
[237.149883] Dynamic subtest pipe-D-plane-0: SUCCESS (0.166s)
[237.160609] Starting dynamic subtest: pipe-D-plane-1
[237.305432] Dynamic subtest pipe-D-plane-1: SUCCESS (0.155s)
[237.315789] Starting dynamic subtest: pipe-D-plane-2
[237.450607] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[237.738077] Subtest plane-ctm3x4-lut1d: SUCCESS (6.087s)
[238.538646] [039/133] (780s left) kms_cdclk (mode-transition-all-outputs)
[238.630755] Starting subtest: mode-transition-all-outputs
[238.918923] Subtest mode-transition-all-outputs: SKIP (0.288s)
[239.765914] [040/133] (779s left) gem_lmem_swapping (heavy-verify-multi)
[239.808159] Subtest heavy-verify-multi: SKIP (0.000s)
[239.848472] [041/133] (779s left) kms_feature_discovery (display-3x)
[239.930993] Starting subtest: display-3x
[239.935332] Subtest display-3x: SKIP (0.000s)
[240.004419] [042/133] (779s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[240.103048] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[240.107623] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[240.209361] [043/133] (779s left) kms_plane_scaling (planes-scaler-unity-scaling)
[240.309979] Starting subtest: planes-scaler-unity-scaling
[240.312263] Starting dynamic subtest: pipe-A
[240.370730] Dynamic subtest pipe-A: SUCCESS (0.064s)
[240.382459] Starting dynamic subtest: pipe-B
[241.493904] Dynamic subtest pipe-B: SUCCESS (1.122s)
[241.505889] Starting dynamic subtest: pipe-C
[242.591286] Dynamic subtest pipe-C: SUCCESS (1.096s)
[242.602067] Starting dynamic subtest: pipe-D
[243.720048] Dynamic subtest pipe-D: SUCCESS (1.128s)
[243.722451] Subtest planes-scaler-unity-scaling: SUCCESS (3.414s)
[244.881199] [044/133] (774s left) kms_addfb_basic (bad-pitch-256)
[244.938829] Starting subtest: bad-pitch-256
[244.941079] Subtest bad-pitch-256: SUCCESS (0.000s)
[245.069752] [045/133] (774s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-pwrite)
[245.170796] Starting subtest: psr-1p-primscrn-pri-indfb-draw-pwrite
[252.964284] Subtest psr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.796s)
[253.070955] [046/133] (766s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[253.173057] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[253.175400] Starting dynamic subtest: pipe-A-eDP-1
[253.233377] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.061s)
[253.245516] Starting dynamic subtest: pipe-B-eDP-1
[253.292468] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.060s)
[253.303630] Starting dynamic subtest: pipe-C-eDP-1
[253.353975] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.060s)
[253.365508] Starting dynamic subtest: pipe-D-eDP-1
[253.416946] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.061s)
[253.419133] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SUCCESS (0.247s)
[255.714555] [047/133] (763s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[255.812391] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[256.592391] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.782s)
[256.769619] [048/133] (762s left) kms_psr (psr2-cursor-blt)
[256.871680] Starting subtest: psr2-cursor-blt
[256.874087] Starting dynamic subtest: eDP-1
[258.603655] Dynamic subtest eDP-1: SUCCESS (1.732s)
[258.605876] Subtest psr2-cursor-blt: SUCCESS (1.733s)
[259.417090] [049/133] (760s left) gem_exec_schedule (smoketest-all)
[259.487505] Starting subtest: smoketest-all
[291.864669] Subtest smoketest-all: SUCCESS (32.332s)
[293.378458] [050/133] (726s left) core_auth (getclient-master-drop)
[293.413397] Starting subtest: getclient-master-drop
[293.426495] Subtest getclient-master-drop: SUCCESS (0.015s)
[293.540820] [051/133] (726s left) kms_content_protection (dp-mst-type-1)
[293.677475] Starting subtest: dp-mst-type-1
[293.682170] Subtest dp-mst-type-1: SKIP (0.000s)
[293.809925] [052/133] (725s left) i915_hangman (engine-engine-error)
[293.870397] Starting subtest: engine-engine-error
[293.872702] Starting dynamic subtest: rcs0
[295.269180] Dynamic subtest rcs0: SUCCESS (1.397s)
[295.280408] Starting dynamic subtest: bcs0
[297.252125] Dynamic subtest bcs0: SUCCESS (1.980s)
[297.265774] Starting dynamic subtest: vcs0
[299.300583] Dynamic subtest vcs0: SUCCESS (2.045s)
[299.312955] Starting dynamic subtest: vcs1
[301.283510] Dynamic subtest vcs1: SUCCESS (1.980s)
[301.295709] Starting dynamic subtest: vecs0
[303.269312] Dynamic subtest vecs0: SUCCESS (1.983s)
[303.283198] Starting dynamic subtest: ccs0
[305.254973] Dynamic subtest ccs0: SUCCESS (1.983s)
[305.258497] Subtest engine-engine-error: SUCCESS (11.384s)
[305.409303] [053/133] (714s left) gem_exec_fence (submit)
[305.589074] Starting subtest: submit
[305.593452] Subtest submit: SKIP (0.000s)
[307.356110] [054/133] (712s left) perf (invalid-oa-exponent)
[307.479335] Starting subtest: invalid-oa-exponent
[307.494246] Subtest invalid-oa-exponent: SUCCESS (0.015s)
[307.541296] [055/133] (712s left) gem_eio (wait-10ms)
[307.757790] Starting subtest: wait-10ms
[308.082773] Subtest wait-10ms: SUCCESS (0.326s)
[308.246013] [056/133] (711s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[308.339704] Starting subtest: 4-tiled-8bpp-rotate-90
[308.361057] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s)
[308.486393] [057/133] (711s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[308.538040] Starting subtest: invalid-multi-wait-unsubmitted
[308.540022] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[308.644215] [058/133] (711s left) gem_exec_suspend (basic-s3-devices)
[308.705426] Starting subtest: basic-S3-devices
[308.707708] Starting dynamic subtest: smem
[320.263962] Dynamic subtest smem: SUCCESS (11.556s)
[320.267220] Subtest basic-S3-devices: SUCCESS (11.558s)
[320.452467] [059/133] (699s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[320.519895] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[320.522250] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[320.643553] [060/133] (699s left) kms_chamelium_hpd (vga-hpd)
[321.029403] Subtest vga-hpd: SKIP (0.000s)
[321.818104] [061/133] (698s left) kms_atomic_transition (plane-all-transition)
[321.912226] Starting subtest: plane-all-transition
[321.914499] Starting dynamic subtest: pipe-A-eDP-1
[324.406096] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.496s)
[324.718310] Starting dynamic subtest: pipe-B-eDP-1
[327.966492] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.257s)
[328.276040] Subtest plane-all-transition: SUCCESS (6.363s)
[329.101446] [062/133] (691s left) gem_ctx_param (invalid-ctx-get)
[329.165735] Starting subtest: invalid-ctx-get
[329.167979] Subtest invalid-ctx-get: SUCCESS (0.000s)
[329.252173] [063/133] (690s left) kms_psr (psr-cursor-blt)
[329.342927] Starting subtest: psr-cursor-blt
[329.345143] Starting dynamic subtest: eDP-1
[331.099216] Dynamic subtest eDP-1: SUCCESS (1.755s)
[331.101713] Subtest psr-cursor-blt: SUCCESS (1.756s)
[331.971979] [064/133] (688s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted)
[332.031940] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted
[332.139663] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.104s)
[332.216752] [065/133] (688s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[332.271738] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[332.274070] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[332.370443] [066/133] (687s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[332.465673] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[332.470037] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[332.574618] [067/133] (687s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[332.676373] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[332.680407] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[332.766798] [068/133] (687s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[332.864057] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[333.666133] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.804s)
[333.829337] [069/133] (686s left) kms_cursor_crc (cursor-suspend)
[333.957296] Starting subtest: cursor-suspend
[333.959467] Starting dynamic subtest: pipe-A-eDP-1
[366.697264] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.216s)
[366.708033] Starting dynamic subtest: pipe-D-eDP-1
[400.682664] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.727s)
[400.684544] Subtest cursor-suspend: SUCCESS (6.946s)
[401.518502] [070/133] (618s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[401.622425] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[401.626357] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[401.742654] [071/133] (618s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc)
[401.836025] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc
[405.935398] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (4.074s)
[407.162175] [072/133] (613s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-upscaling)
[407.256117] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-upscaling
[407.260596] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-upscaling: SKIP (0.000s)
[407.334485] [073/133] (613s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[407.400507] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[407.404662] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[407.583945] [074/133] (613s left) kms_async_flips (async-flip-with-page-flip-events-tiled)
[407.684307] Starting subtest: async-flip-with-page-flip-events-tiled
[408.064199] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[410.840168] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.765s)
[410.850957] Starting dynamic subtest: pipe-A-eDP-1-4
[413.032269] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.185s)
[413.043265] Starting dynamic subtest: pipe-A-eDP-1-4
[415.035941] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (1.998s)
[415.056694] Starting dynamic subtest: pipe-A-eDP-1-x
[417.221275] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.179s)
[417.600265] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[420.397563] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.803s)
[420.409508] Starting dynamic subtest: pipe-B-eDP-1-4
[422.597667] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.196s)
[422.611157] Starting dynamic subtest: pipe-B-eDP-1-4
[424.608286] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.009s)
[424.620342] Starting dynamic subtest: pipe-B-eDP-1-x
[426.801991] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.189s)
[427.169008] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[429.928670] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.766s)
[429.942383] Starting dynamic subtest: pipe-C-eDP-1-4
[432.104115] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.174s)
[432.115554] Starting dynamic subtest: pipe-C-eDP-1-4
[434.113598] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[434.127234] Starting dynamic subtest: pipe-C-eDP-1-x
[436.292142] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.178s)
[436.661502] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[439.453686] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.801s)
[439.464981] Starting dynamic subtest: pipe-D-eDP-1-4
[441.650838] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.194s)
[441.664791] Starting dynamic subtest: pipe-D-eDP-1-4
[443.660649] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s)
[443.674500] Starting dynamic subtest: pipe-D-eDP-1-x
[445.827372] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.166s)
[445.829656] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (38.110s)
[447.034787] [075/133] (573s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-upscaling)
[447.140568] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-upscaling
[447.144761] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-upscaling: SKIP (0.000s)
[447.212697] [076/133] (573s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[447.304935] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[447.309453] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[447.423595] [077/133] (573s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[447.536572] Starting subtest: flip-vs-cursor-legacy
[455.116808] Subtest flip-vs-cursor-legacy: SUCCESS (7.577s)
[455.965508] [078/133] (564s left) kms_big_fb (x-tiled-16bpp-rotate-0)
[456.071538] Starting subtest: x-tiled-16bpp-rotate-0
[457.372812] Subtest x-tiled-16bpp-rotate-0: SUCCESS (1.301s)
[457.519460] [079/133] (563s left) perf_pmu (rc6)
[457.555332] Starting subtest: rc6
[457.557247] Starting dynamic subtest: gt0
[463.975610] Dynamic subtest gt0: SUCCESS (6.366s)
[463.987491] Starting dynamic subtest: runtime-pm-gt0
[471.648278] Dynamic subtest runtime-pm-gt0: SUCCESS (7.719s)
[471.662959] Starting dynamic subtest: runtime-pm-long-gt0
[484.134793] Dynamic subtest runtime-pm-long-gt0: SUCCESS (12.480s)
[484.148711] Starting dynamic subtest: other-idle-gt0
[490.479030] Dynamic subtest other-idle-gt0: SUCCESS (6.340s)
[490.493995] Starting dynamic subtest: gt1
[496.823305] Dynamic subtest gt1: SUCCESS (6.339s)
[496.835928] Starting dynamic subtest: runtime-pm-gt1
[504.328121] Dynamic subtest runtime-pm-gt1: SUCCESS (7.506s)
[504.343012] Starting dynamic subtest: runtime-pm-long-gt1
[516.778659] Dynamic subtest runtime-pm-long-gt1: SUCCESS (12.450s)
[516.793065] Starting dynamic subtest: other-idle-gt1
[523.121965] Dynamic subtest other-idle-gt1: SUCCESS (6.341s)
[523.125546] Subtest rc6: SUCCESS (65.559s)
[524.274924] [080/133] (496s left) i915_drm_fdinfo (busy-idle-check-all)
[524.313549] Starting subtest: busy-idle-check-all
[524.315934] Starting dynamic subtest: rcs0
[524.320540] Dynamic subtest rcs0: SKIP (0.005s)
[524.331986] Starting dynamic subtest: bcs0
[524.336292] Dynamic subtest bcs0: SKIP (0.000s)
[524.347367] Starting dynamic subtest: vcs0
[524.351324] Dynamic subtest vcs0: SKIP (0.000s)
[524.361791] Starting dynamic subtest: vcs1
[524.365753] Dynamic subtest vcs1: SKIP (0.000s)
[524.376741] Starting dynamic subtest: vecs0
[524.380795] Dynamic subtest vecs0: SKIP (0.000s)
[524.391452] Starting dynamic subtest: ccs0
[524.395554] Dynamic subtest ccs0: SKIP (0.000s)
[524.399640] Subtest busy-idle-check-all: SKIP (0.012s)
[524.439716] [081/133] (496s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[524.510914] Starting subtest: saturated-hostile-nopreempt
[524.512844] Starting dynamic subtest: rcs0
[524.567701] Dynamic subtest rcs0: SKIP (0.054s)
[524.579719] Starting dynamic subtest: bcs0
[524.583632] Dynamic subtest bcs0: SKIP (0.011s)
[524.594138] Starting dynamic subtest: vcs0
[524.598021] Dynamic subtest vcs0: SKIP (0.012s)
[524.608727] Starting dynamic subtest: vcs1
[524.612324] Dynamic subtest vcs1: SKIP (0.012s)
[524.623040] Starting dynamic subtest: vecs0
[524.626493] Dynamic subtest vecs0: SKIP (0.011s)
[524.637301] Starting dynamic subtest: ccs0
[524.640935] Dynamic subtest ccs0: SKIP (0.011s)
[524.644540] Subtest saturated-hostile-nopreempt: SKIP (0.119s)
[524.683252] [082/133] (496s left) prime_busy (before)
[524.742390] Starting subtest: before
[524.746449] Starting dynamic subtest: rcs0
[524.774011] Dynamic subtest rcs0: SUCCESS (0.028s)
[524.786469] Starting dynamic subtest: bcs0
[524.813730] Dynamic subtest bcs0: SUCCESS (0.039s)
[524.824504] Starting dynamic subtest: vcs0
[524.854705] Dynamic subtest vcs0: SUCCESS (0.040s)
[524.865222] Starting dynamic subtest: vcs1
[524.895960] Dynamic subtest vcs1: SUCCESS (0.040s)
[524.906874] Starting dynamic subtest: vecs0
[524.937226] Dynamic subtest vecs0: SUCCESS (0.041s)
[524.948037] Starting dynamic subtest: ccs0
[524.977893] Dynamic subtest ccs0: SUCCESS (0.040s)
[525.086919] Subtest before: SUCCESS (0.342s)
[525.141937] [083/133] (495s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[525.243459] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[531.985706] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.744s)
[532.103611] [084/133] (488s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[532.203880] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[539.723459] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.521s)
[539.841049] [085/133] (481s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[540.232729] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[541.072019] [086/133] (480s left) kms_vblank (ts-continuation-modeset)
[541.158877] Starting subtest: ts-continuation-modeset
[541.161167] Starting dynamic subtest: pipe-A-eDP-1
[542.658640] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.500s)
[542.675485] Starting dynamic subtest: pipe-D-eDP-1
[544.826606] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.166s)
[544.829026] Subtest ts-continuation-modeset: SUCCESS (3.670s)
[545.618349] [087/133] (475s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-mc-ccs)
[545.713645] Starting subtest: crc-primary-suspend-4-tiled-dg2-mc-ccs
[545.716060] Starting dynamic subtest: pipe-A-eDP-1
[545.725550] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[545.738667] Starting dynamic subtest: pipe-B-eDP-1
[545.747753] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[545.759562] Starting dynamic subtest: pipe-C-eDP-1
[545.768411] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[545.779542] Starting dynamic subtest: pipe-D-eDP-1
[545.788321] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[545.792723] Subtest crc-primary-suspend-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[547.988410] [088/133] (473s left) i915_suspend (basic-s2idle-without-i915)
[548.023832] Starting subtest: basic-s2idle-without-i915
[568.625237] Subtest basic-s2idle-without-i915: SUCCESS (5.587s)
[568.725171] [089/133] (452s left) syncobj_wait (wait-for-submit-complex)
[568.795332] Starting subtest: wait-for-submit-complex
[568.856855] Subtest wait-for-submit-complex: SUCCESS (0.061s)
[568.922775] [090/133] (452s left) gem_cs_tlb (engines)
[568.978865] Starting subtest: engines
[568.981253] Starting dynamic subtest: rcs0
[571.155628] Dynamic subtest rcs0: SUCCESS (2.156s)
[571.166941] Starting dynamic subtest: bcs0
[573.374097] Dynamic subtest bcs0: SUCCESS (2.151s)
[573.387011] Starting dynamic subtest: vcs0
[575.535301] Dynamic subtest vcs0: SUCCESS (2.152s)
[575.548283] Starting dynamic subtest: vcs1
[577.697326] Dynamic subtest vcs1: SUCCESS (2.153s)
[577.709905] Starting dynamic subtest: vecs0
[579.857939] Dynamic subtest vecs0: SUCCESS (2.154s)
[579.870793] Starting dynamic subtest: ccs0
[582.018257] Dynamic subtest ccs0: SUCCESS (2.156s)
[582.020808] Subtest engines: SUCCESS (12.929s)
[582.075000] [091/133] (439s left) gem_render_copy_redux (flink)
[582.137520] Starting subtest: flink
[583.267909] Subtest flink: SUCCESS (1.131s)
[583.385870] [092/133] (438s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs)
[583.481683] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs
[583.483446] Starting dynamic subtest: pipe-A-eDP-1
[583.502123] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[583.512158] Starting dynamic subtest: pipe-B-eDP-1
[583.530021] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[583.539229] Starting dynamic subtest: pipe-C-eDP-1
[583.556519] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[583.566382] Starting dynamic subtest: pipe-D-eDP-1
[583.585175] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[583.589079] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[585.781909] [093/133] (435s left) prime_vgem (fence-flip-hang)
[585.848918] Subtest fence-flip-hang: SKIP (0.000s)
[585.923186] [094/133] (435s left) gem_pxp (create-regular-context-2)
[586.044444] Starting subtest: create-regular-context-2
[586.047188] Subtest create-regular-context-2: SUCCESS (0.002s)
[586.135698] [095/133] (435s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[586.231227] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[586.235824] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[586.313622] [096/133] (435s left) gem_linear_blits (basic)
[586.721645] Starting subtest: basic
[586.727628] Subtest basic: SUCCESS (0.007s)
[586.841248] [097/133] (434s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[586.988302] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[586.992791] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[587.076605] [098/133] (434s left) kms_cursor_legacy (torture-bo)
[587.195084] Starting subtest: torture-bo
[587.197362] Starting dynamic subtest: pipe-A
[593.669333] Dynamic subtest pipe-A: SUCCESS (6.464s)
[593.686287] Starting dynamic subtest: pipe-B
[600.428003] Dynamic subtest pipe-B: SUCCESS (6.753s)
[600.450855] Starting dynamic subtest: pipe-C
[606.302843] Dynamic subtest pipe-C: SUCCESS (5.870s)
[606.326727] Starting dynamic subtest: pipe-D
[613.783312] Dynamic subtest pipe-D: SUCCESS (7.476s)
[613.799562] Starting dynamic subtest: all-pipes
[620.321591] Dynamic subtest all-pipes: SUCCESS (6.532s)
[620.324416] Subtest torture-bo: SUCCESS (33.107s)
[620.461779] [099/133] (401s left) sysfs_timeslice_duration (invalid)
[620.527762] Starting subtest: invalid
[620.530136] Starting dynamic subtest: vecs0
[620.532459] Dynamic subtest vecs0: SUCCESS (0.000s)
[620.544075] Starting dynamic subtest: ccs0
[620.545939] Dynamic subtest ccs0: SUCCESS (0.000s)
[620.556307] Starting dynamic subtest: vcs0
[620.558184] Dynamic subtest vcs0: SUCCESS (0.000s)
[620.568309] Starting dynamic subtest: bcs0
[620.570200] Dynamic subtest bcs0: SUCCESS (0.000s)
[620.580138] Starting dynamic subtest: rcs0
[620.582564] Dynamic subtest rcs0: SUCCESS (0.000s)
[620.592563] Starting dynamic subtest: vcs1
[620.594753] Dynamic subtest vcs1: SUCCESS (0.000s)
[620.597002] Subtest invalid: SUCCESS (0.007s)
[620.636825] [100/133] (401s left) perf (global-sseu-config)
[620.756177] Starting subtest: global-sseu-config
[620.759835] Subtest global-sseu-config: SKIP (0.000s)
[620.807297] [101/133] (401s left) gem_exec_capture (userptr)
[620.861834] Starting subtest: userptr
[621.701214] Subtest userptr: SUCCESS (0.838s)
[621.786256] [102/133] (400s left) gem_reg_read (bad-register)
[621.836580] Starting subtest: bad-register
[621.838694] Subtest bad-register: SUCCESS (0.000s)
[621.912633] [103/133] (400s left) syncobj_basic (bad-pad-handle-to-fd)
[621.962095] Starting subtest: bad-pad-handle-to-fd
[621.964485] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[622.046615] [104/133] (399s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[622.168261] Starting subtest: basic-flip-after-cursor-legacy
[623.159198] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.989s)
[623.970822] [105/133] (398s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[624.031187] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[624.033576] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s)
[624.099074] [106/133] (398s left) syncobj_wait (invalid-reset-one-illegal-handle)
[624.153740] Starting subtest: invalid-reset-one-illegal-handle
[624.155650] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[624.216410] [107/133] (397s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy)
[624.350097] Starting subtest: flip-vs-cursor-crc-legacy
[625.045022] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.692s)
[625.900385] [108/133] (396s left) gem_mmap_gtt (hang-user)
[625.966236] Subtest hang-user: SKIP (0.000s)
[626.030112] [109/133] (396s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[626.133108] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[626.137177] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[626.217247] [110/133] (396s left) kms_plane (pixel-format-4-tiled-modifier)
[626.309947] Starting subtest: pixel-format-4-tiled-modifier
[626.335965] Starting dynamic subtest: pipe-A-plane-0
[626.991417] Dynamic subtest pipe-A-plane-0: SUCCESS (0.655s)
[627.004385] Starting dynamic subtest: pipe-A-plane-3
[627.391377] Dynamic subtest pipe-A-plane-3: SUCCESS (0.399s)
[627.402440] Starting dynamic subtest: pipe-A-plane-5
[627.406439] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[628.512057] Starting dynamic subtest: pipe-B-plane-0
[629.184065] Dynamic subtest pipe-B-plane-0: SUCCESS (0.677s)
[629.198756] Starting dynamic subtest: pipe-B-plane-3
[629.591278] Dynamic subtest pipe-B-plane-3: SUCCESS (0.410s)
[629.601875] Starting dynamic subtest: pipe-B-plane-5
[629.606031] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[629.921813] Subtest pixel-format-4-tiled-modifier: SUCCESS (3.611s)
[630.775173] [111/133] (391s left) kms_plane_multiple (2x-tiling-4)
[630.878946] Starting subtest: 2x-tiling-4
[630.882906] Subtest 2x-tiling-4: SKIP (0.000s)
[630.934551] [112/133] (391s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite)
[631.028426] Starting subtest: psr-rgb101010-draw-pwrite
[638.788998] Subtest psr-rgb101010-draw-pwrite: SUCCESS (7.760s)
[638.897155] [113/133] (383s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[638.992795] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[638.997023] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[639.074164] [114/133] (383s left) gem_exec_params (rs-invalid)
[639.135059] Starting subtest: rs-invalid
[639.137319] Subtest rs-invalid: SUCCESS (0.003s)
[639.243432] [115/133] (383s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[639.340034] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[646.034950] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.694s)
[646.142786] [116/133] (376s left) perf_pmu (busy-no-semaphores)
[646.188403] Starting subtest: busy-no-semaphores
[646.191047] Starting dynamic subtest: rcs0
[646.752587] Dynamic subtest rcs0: SUCCESS (0.563s)
[646.764754] Starting dynamic subtest: bcs0
[647.302051] Dynamic subtest bcs0: SUCCESS (0.547s)
[647.322547] Starting dynamic subtest: vcs0
[647.853900] Dynamic subtest vcs0: SUCCESS (0.547s)
[647.870065] Starting dynamic subtest: vcs1
[649.538827] Dynamic subtest vcs1: SUCCESS (1.681s)
[649.555408] Starting dynamic subtest: vecs0
[651.583452] Dynamic subtest vecs0: SUCCESS (2.041s)
[651.596182] Starting dynamic subtest: ccs0
[653.567762] Dynamic subtest ccs0: SUCCESS (1.980s)
[653.570581] Subtest busy-no-semaphores: SUCCESS (7.377s)
[653.666633] [117/133] (368s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen)
[653.768024] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen
[653.772121] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[653.841457] [118/133] (368s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[653.939987] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[658.421541] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.484s)
[659.593720] [119/133] (363s left) sw_sync (sync_multi_producer_single_consumer)
[659.628231] Starting subtest: sync_multi_producer_single_consumer
[660.704595] Subtest sync_multi_producer_single_consumer: SUCCESS (1.075s)
[660.747808] [120/133] (361s left) api_intel_allocator (reserve-simple)
[660.805533] Starting subtest: reserve-simple
[660.807915] Subtest reserve-simple: SUCCESS (0.003s)
[660.906598] [121/133] (361s left) gem_exec_balancer (hog)
[660.971846] Starting subtest: hog
[660.976099] Subtest hog: SKIP (0.000s)
[661.250397] [122/133] (361s left) gem_partial_pwrite_pread (reads-uncached)
[661.306178] Subtest reads-uncached: SKIP (0.000s)
[661.384885] [123/133] (361s left) kms_cursor_legacy (cursor-vs-flip-legacy)
[661.502386] Starting subtest: cursor-vs-flip-legacy
[691.276467] Subtest cursor-vs-flip-legacy: SUCCESS (29.789s)
[692.094152] [124/133] (330s left) gem_ctx_param (invalid-param-get)
[692.173271] Starting subtest: invalid-param-get
[692.175553] Subtest invalid-param-get: SUCCESS (0.001s)
[692.256201] [125/133] (330s left) kms_invalid_mode (uint-max-clock)
[692.338444] Starting subtest: uint-max-clock
[692.340721] Starting dynamic subtest: pipe-A-eDP-1
[692.629628] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.289s)
[692.642834] Starting dynamic subtest: pipe-B-eDP-1
[692.645100] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[692.656147] Starting dynamic subtest: pipe-C-eDP-1
[692.658113] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[692.668803] Starting dynamic subtest: pipe-D-eDP-1
[692.671181] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[692.673573] Subtest uint-max-clock: SUCCESS (0.295s)
[693.433234] [126/133] (329s left) gem_pwrite_snooped
[693.590416] [127/133] (329s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-blt)
[693.686229] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-blt
[693.690228] Subtest psr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[693.761987] [128/133] (329s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[693.810124] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[693.812090] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[693.888586] [129/133] (329s left) gem_exec_schedule (u-semaphore-noskip)
[693.950044] Starting subtest: u-semaphore-noskip
[694.348991] Subtest u-semaphore-noskip: SUCCESS (0.402s)
[694.657911] [130/133] (328s left) gem_ctx_persistence (engines-mixed-process)
[694.712017] Starting subtest: engines-mixed-process
[694.714212] Starting dynamic subtest: rcs0
[696.082302] Dynamic subtest rcs0: SUCCESS (1.373s)
[696.098421] Starting dynamic subtest: bcs0
[698.026989] Dynamic subtest bcs0: SUCCESS (1.943s)
[698.038596] Starting dynamic subtest: vcs0
[700.054482] Dynamic subtest vcs0: SUCCESS (2.027s)
[700.067799] Starting dynamic subtest: vcs1
[702.028405] Dynamic subtest vcs1: SUCCESS (1.972s)
[702.042088] Starting dynamic subtest: vecs0
[704.073588] Dynamic subtest vecs0: SUCCESS (2.044s)
[704.086945] Starting dynamic subtest: ccs0
[706.051917] Dynamic subtest ccs0: SUCCESS (1.976s)
[706.054861] Subtest engines-mixed-process: SUCCESS (11.345s)
[706.112972] [131/133] (317s left) kms_psr (fbc-psr2-suspend)
[706.206663] Starting subtest: fbc-psr2-suspend
[706.209080] Starting dynamic subtest: eDP-1
[706.213158] Dynamic subtest eDP-1: SKIP (0.000s)
[706.217274] Subtest fbc-psr2-suspend: SKIP (0.002s)
[706.262076] [132/133] (316s left) kms_psr (psr-primary-page-flip)
[706.361488] Starting subtest: psr-primary-page-flip
[706.363777] Starting dynamic subtest: eDP-1
[708.150679] Dynamic subtest eDP-1: SUCCESS (1.788s)
[708.152828] Subtest psr-primary-page-flip: SUCCESS (1.790s)
[708.994581] [133/133] (314s left) kms_mmap_write_crc (main)
[709.084130] Starting subtest: main
[709.086568] Starting dynamic subtest: pipe-A-eDP-1
[712.632853] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.545s)
[712.635083] Subtest main: SUCCESS (3.546s)
[713.424965] Closing watchdogs
results: parsing output: 0/ for test: kms_atomic
results: parsing output: 1/ for test: kms_atomic_transition
results: parsing output: 2/ for test: kms_cursor_legacy
results: parsing output: 3/ for test: kms_cursor_legacy
results: parsing output: 4/ for test: gem_pxp
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: kms_pipe_crc_basic
results: parsing output: 7/ for test: kms_plane_scaling
results: parsing output: 8/ for test: kms_pm_rpm
results: parsing output: 9/ for test: kms_ccs
results: parsing output: 10/ for test: gem_mmap
results: parsing output: 11/ for test: gem_ccs
results: parsing output: 12/ for test: i915_pm_rpm
results: parsing output: 13/ for test: gem_ctx_shared
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: gem_exec_schedule
results: parsing output: 16/ for test: gem_exec_whisper
results: parsing output: 17/ for test: gem_spin_batch
results: parsing output: 18/ for test: kms_flip
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: gem_exec_fence
results: parsing output: 21/ for test: gen9_exec_parse
results: parsing output: 22/ for test: kms_ccs
results: parsing output: 23/ for test: kms_prime
results: parsing output: 24/ for test: kms_cursor_crc
results: parsing output: 25/ for test: gem_userptr_blits
results: parsing output: 26/ for test: kms_cursor_crc
results: parsing output: 27/ for test: kms_properties
results: parsing output: 28/ for test: gem_exec_flush
results: parsing output: 29/ for test: kms_psr2_su
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: syncobj_timeline
results: parsing output: 32/ for test: kms_psr2_sf
results: parsing output: 33/ for test: drm_buddy
results: parsing output: 34/ for test: kms_psr2_sf
results: parsing output: 35/ for test: kms_psr
results: parsing output: 36/ for test: kms_selftest
results: parsing output: 37/ for test: kms_color_pipeline
results: parsing output: 38/ for test: kms_cdclk
results: parsing output: 39/ for test: gem_lmem_swapping
results: parsing output: 40/ for test: kms_feature_discovery
results: parsing output: 41/ for test: kms_big_fb
results: parsing output: 42/ for test: kms_plane_scaling
results: parsing output: 43/ for test: kms_addfb_basic
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: kms_big_fb
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: gem_exec_schedule
results: parsing output: 49/ for test: core_auth
results: parsing output: 50/ for test: kms_content_protection
results: parsing output: 51/ for test: i915_hangman
results: parsing output: 52/ for test: gem_exec_fence
results: parsing output: 53/ for test: perf
results: parsing output: 54/ for test: gem_eio
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: syncobj_wait
results: parsing output: 57/ for test: gem_exec_suspend
results: parsing output: 58/ for test: syncobj_wait
results: parsing output: 59/ for test: kms_chamelium_hpd
results: parsing output: 60/ for test: kms_atomic_transition
results: parsing output: 61/ for test: gem_ctx_param
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: syncobj_timeline
results: parsing output: 64/ for test: syncobj_timeline
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: kms_cursor_crc
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: kms_flip_scaled_crc
results: parsing output: 72/ for test: gem_render_copy
results: parsing output: 73/ for test: kms_async_flips
results: parsing output: 74/ for test: kms_flip_scaled_crc
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_cursor_legacy
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: perf_pmu
results: parsing output: 79/ for test: i915_drm_fdinfo
results: parsing output: 80/ for test: gem_ctx_persistence
results: parsing output: 81/ for test: prime_busy
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_chamelium_frames
results: parsing output: 85/ for test: kms_vblank
results: parsing output: 86/ for test: kms_ccs
results: parsing output: 87/ for test: i915_suspend
results: parsing output: 88/ for test: syncobj_wait
results: parsing output: 89/ for test: gem_cs_tlb
results: parsing output: 90/ for test: gem_render_copy_redux
results: parsing output: 91/ for test: kms_ccs
results: parsing output: 92/ for test: prime_vgem
results: parsing output: 93/ for test: gem_pxp
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: gem_linear_blits
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: sysfs_timeslice_duration
results: parsing output: 99/ for test: perf
results: parsing output: 100/ for test: gem_exec_capture
results: parsing output: 101/ for test: gem_reg_read
results: parsing output: 102/ for test: syncobj_basic
results: parsing output: 103/ for test: kms_cursor_legacy
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: syncobj_wait
results: parsing output: 106/ for test: kms_cursor_legacy
results: parsing output: 107/ for test: gem_mmap_gtt
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_plane
results: parsing output: 110/ for test: kms_plane_multiple
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_exec_params
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: perf_pmu
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: sw_sync
results: parsing output: 119/ for test: api_intel_allocator
results: parsing output: 120/ for test: gem_exec_balancer
results: parsing output: 121/ for test: gem_partial_pwrite_pread
results: parsing output: 122/ for test: kms_cursor_legacy
results: parsing output: 123/ for test: gem_ctx_param
results: parsing output: 124/ for test: kms_invalid_mode
results: parsing output: 125/ for test: gem_pwrite_snooped
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: syncobj_wait
results: parsing output: 128/ for test: gem_exec_schedule
results: parsing output: 129/ for test: gem_ctx_persistence
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: kms_psr
results: parsing output: 132/ for test: kms_mmap_write_crc
Done.