[58.257281] Initializing watchdogs
[58.257368]   /dev/watchdog0
[58.272491] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7dd5 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Graphics]
[58.276373] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.278433] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.281863] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[58.394617] Starting subtest: fbcpsr-indfb-scaledprimary
[64.130272] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.750s)
[64.251249] [002/133] (954s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[64.340647] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[71.615623] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (7.284s)
[71.757925] [003/133] (947s left) prime_mmap (test_correct)
[71.813745] Starting subtest: test_correct
[71.816159] Starting dynamic subtest: test_correct-smem
[71.844480] Dynamic subtest test_correct-smem: SUCCESS (0.031s)
[71.847202] Subtest test_correct: SUCCESS (0.031s)
[71.933221] [004/133] (946s left) gem_exec_reloc (basic-write-read)
[72.003324] Subtest basic-write-read: SKIP (0.000s)
[72.072306] [005/133] (946s left) gem_ctx_isolation (preservation)
[72.127232] Starting subtest: preservation
[72.129796] Starting dynamic subtest: rcs0
[72.258347] Dynamic subtest rcs0: SUCCESS (0.131s)
[72.273120] Starting dynamic subtest: bcs0
[72.419036] Dynamic subtest bcs0: SUCCESS (0.159s)
[72.429446] Starting dynamic subtest: vcs0
[72.574233] Dynamic subtest vcs0: SUCCESS (0.156s)
[72.585438] Starting dynamic subtest: vcs1
[73.928504] Dynamic subtest vcs1: SUCCESS (1.354s)
[73.939341] Starting dynamic subtest: vecs0
[75.975860] Dynamic subtest vecs0: SUCCESS (2.048s)
[75.986591] Starting dynamic subtest: ccs0
[77.983527] Dynamic subtest ccs0: SUCCESS (2.009s)
[77.985881] Subtest preservation: SUCCESS (5.858s)
[78.217515] [006/133] (940s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[78.308289] Starting subtest: x-tiled-16bpp-rotate-270
[78.327973] Subtest x-tiled-16bpp-rotate-270: SKIP (0.019s)
[78.438024] [007/133] (940s left) gem_exec_fence (long-history)
[78.864217] Starting subtest: long-history
[85.625186] Subtest long-history: SUCCESS (6.761s)
[86.327185] [FACT gem_exec_fence (long-history)] new: kernel.kmod_is_loaded.vgem: true
[86.330087] [008/133] (932s left) kms_rotation_crc (primary-yf-tiled-reflect-x-180)
[86.422664] Starting subtest: primary-yf-tiled-reflect-x-180
[86.483510] Subtest primary-yf-tiled-reflect-x-180: SKIP (0.059s)
[86.586441] [009/133] (932s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[86.656880] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[86.659212] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.001s)
[86.752887] [010/133] (932s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-fully-sf)
[86.828537] Starting subtest: pr-cursor-plane-move-continuous-exceed-fully-sf
[86.832813] Subtest pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[86.895178] [011/133] (932s left) gem_exec_flush (basic-uc-set-default)
[86.950407] Starting subtest: basic-uc-set-default
[92.436828] Subtest basic-uc-set-default: SUCCESS (5.455s)
[92.581142] [012/133] (926s left) gem_ctx_bad_destroy (double-destroy)
[92.627599] Starting subtest: double-destroy
[92.629979] Subtest double-destroy: SUCCESS (0.000s)
[92.692989] [013/133] (926s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[92.781084] Starting subtest: y-tiled-32bpp-rotate-0
[92.785344] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[92.872040] [014/133] (926s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy)
[92.960978] Starting subtest: 2x-flip-vs-cursor-legacy
[92.965656] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s)
[93.119563] [015/133] (926s left) kms_cursor_crc (cursor-random-256x256)
[93.331779] Starting subtest: cursor-random-256x256
[93.336581] Starting dynamic subtest: pipe-A-eDP-1
[96.680565] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.344s)
[96.713120] Starting dynamic subtest: pipe-D-eDP-1
[100.717130] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.010s)
[100.719858] Subtest cursor-random-256x256: SUCCESS (7.383s)
[101.578894] [016/133] (917s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[101.944072] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[102.817460] [017/133] (916s left) gem_ctx_shared (q-independent)
[102.870653] Starting subtest: Q-independent
[102.873050] Starting dynamic subtest: rcs0
[102.935397] Dynamic subtest rcs0: SUCCESS (0.063s)
[102.946467] Starting dynamic subtest: vcs0
[102.977136] Dynamic subtest vcs0: SUCCESS (0.042s)
[102.986073] Starting dynamic subtest: vcs1
[103.021060] Dynamic subtest vcs1: SUCCESS (0.044s)
[103.032810] Starting dynamic subtest: vecs0
[103.055757] Dynamic subtest vecs0: SUCCESS (0.034s)
[103.064061] Starting dynamic subtest: ccs0
[103.104429] Dynamic subtest ccs0: SUCCESS (0.048s)
[103.107047] Subtest Q-independent: SUCCESS (0.234s)
[104.952864] [018/133] (914s left) gem_ctx_param (basic-default)
[105.012825] Starting subtest: basic-default
[105.015242] Subtest basic-default: SUCCESS (0.000s)
[105.090252] [019/133] (914s left) gem_exec_schedule (preempt-queue-contexts-chain)
[105.169289] Subtest preempt-queue-contexts-chain: SKIP (0.000s)
[105.459030] [020/133] (914s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs)
[105.547470] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs
[105.551072] Starting dynamic subtest: pipe-A-eDP-1
[105.575304] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[105.583098] Starting dynamic subtest: pipe-B-eDP-1
[105.605167] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[105.612664] Starting dynamic subtest: pipe-C-eDP-1
[105.634887] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[105.641794] Starting dynamic subtest: pipe-D-eDP-1
[105.663731] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[105.668707] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.003s)
[107.776468] [021/133] (911s left) kms_addfb_basic (tile-pitch-mismatch)
[107.834035] Starting subtest: tile-pitch-mismatch
[107.839488] Subtest tile-pitch-mismatch: SKIP (0.000s)
[107.936241] [022/133] (911s left) kms_cursor_crc (cursor-suspend)
[108.032132] Starting subtest: cursor-suspend
[108.034444] Starting dynamic subtest: pipe-A-eDP-1
[140.611479] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.354s)
[140.621898] Starting dynamic subtest: pipe-D-eDP-1
[174.564454] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.802s)
[174.566718] Subtest cursor-suspend: SUCCESS (7.158s)
[175.384327] [023/133] (844s left) core_getversion (basic)
[175.436032] Starting subtest: basic
[175.440367] Subtest basic: SUCCESS (0.000s)
[175.500194] [024/133] (844s left) gem_pread (bench)
[175.570810] Subtest bench: SKIP (0.000s)
[175.634376] [025/133] (844s left) gen9_exec_parse (bb-start-far)
[175.693577] Subtest bb-start-far: SKIP (0.000s)
[175.764671] [026/133] (844s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-onoff)
[175.849163] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-onoff
[175.853223] Subtest fbcpsr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[175.957338] [027/133] (843s left) gem_ctx_param (get-priority-new-ctx)
[176.011266] Starting subtest: get-priority-new-ctx
[176.013453] Subtest get-priority-new-ctx: SUCCESS (0.001s)
[176.109661] [028/133] (843s left) kms_big_fb (linear-8bpp-rotate-90)
[176.202393] Starting subtest: linear-8bpp-rotate-90
[176.228362] Subtest linear-8bpp-rotate-90: SKIP (0.026s)
[176.327530] [029/133] (843s left) kms_async_flips (basic-modeset-with-all-modifiers-formats)
[176.407916] Starting subtest: basic-modeset-with-all-modifiers-formats
[176.777559] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB8888
[177.539187] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB8888: SUCCESS (0.770s)
[177.548993] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB2101010
[177.559526] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB2101010: SUCCESS (0.020s)
[177.567922] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB16161616F
[177.581933] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB16161616F: SUCCESS (0.022s)
[177.593045] Starting dynamic subtest: pipe-A-eDP-1-4-RGB565
[177.735809] Dynamic subtest pipe-A-eDP-1-4-RGB565: SUCCESS (0.155s)
[177.744374] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB8888
[177.757882] Dynamic subtest pipe-A-eDP-1-4-XRGB8888: SUCCESS (0.022s)
[177.766279] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB2101010
[177.781918] Dynamic subtest pipe-A-eDP-1-4-XRGB2101010: SUCCESS (0.024s)
[177.793488] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB16161616F
[177.801897] Dynamic subtest pipe-A-eDP-1-4-XRGB16161616F: SUCCESS (0.018s)
[177.810017] Starting dynamic subtest: pipe-A-eDP-1-4-YUYV
[177.823942] Dynamic subtest pipe-A-eDP-1-4-YUYV: SUCCESS (0.022s)
[177.831988] Starting dynamic subtest: pipe-A-eDP-1-4-Y210
[177.845922] Dynamic subtest pipe-A-eDP-1-4-Y210: SUCCESS (0.022s)
[177.853862] Starting dynamic subtest: pipe-A-eDP-1-4-XYUV8888
[177.867881] Dynamic subtest pipe-A-eDP-1-4-XYUV8888: SUCCESS (0.022s)
[177.875967] Starting dynamic subtest: pipe-A-eDP-1-4-XV30
[177.889978] Dynamic subtest pipe-A-eDP-1-4-XV30: SUCCESS (0.022s)
[177.898059] Starting dynamic subtest: pipe-A-eDP-1-4-XV36
[177.911950] Dynamic subtest pipe-A-eDP-1-4-XV36: SUCCESS (0.022s)
[177.919969] Starting dynamic subtest: pipe-A-eDP-1-x-RGB565
[178.088192] Dynamic subtest pipe-A-eDP-1-x-RGB565: SUCCESS (0.177s)
[178.100838] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB8888
[178.110078] Dynamic subtest pipe-A-eDP-1-x-XRGB8888: SUCCESS (0.022s)
[178.118863] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB2101010
[178.133384] Dynamic subtest pipe-A-eDP-1-x-XRGB2101010: SUCCESS (0.022s)
[178.142114] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB16161616F
[178.153801] Dynamic subtest pipe-A-eDP-1-x-XRGB16161616F: SUCCESS (0.022s)
[178.164078] Starting dynamic subtest: pipe-A-eDP-1-x-YUYV
[178.176158] Dynamic subtest pipe-A-eDP-1-x-YUYV: SUCCESS (0.022s)
[178.185267] Starting dynamic subtest: pipe-A-eDP-1-x-Y210
[178.198252] Dynamic subtest pipe-A-eDP-1-x-Y210: SUCCESS (0.022s)
[178.206720] Starting dynamic subtest: pipe-A-eDP-1-x-XYUV8888
[178.220576] Dynamic subtest pipe-A-eDP-1-x-XYUV8888: SUCCESS (0.022s)
[178.230428] Starting dynamic subtest: pipe-A-eDP-1-x-XV30
[178.242215] Dynamic subtest pipe-A-eDP-1-x-XV30: SUCCESS (0.021s)
[178.250670] Starting dynamic subtest: pipe-A-eDP-1-x-XV36
[178.264198] Dynamic subtest pipe-A-eDP-1-x-XV36: SUCCESS (0.022s)
[178.275404] Starting dynamic subtest: pipe-A-eDP-1-linear-RGB565
[178.418506] Dynamic subtest pipe-A-eDP-1-linear-RGB565: SUCCESS (0.156s)
[178.428595] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB8888
[178.440286] Dynamic subtest pipe-A-eDP-1-linear-XRGB8888: SUCCESS (0.020s)
[178.448255] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB2101010
[178.462388] Dynamic subtest pipe-A-eDP-1-linear-XRGB2101010: SUCCESS (0.021s)
[178.471390] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB16161616F
[178.484584] Dynamic subtest pipe-A-eDP-1-linear-XRGB16161616F: SUCCESS (0.022s)
[178.494579] Starting dynamic subtest: pipe-A-eDP-1-linear-YUYV
[178.506331] Dynamic subtest pipe-A-eDP-1-linear-YUYV: SUCCESS (0.022s)
[178.514372] Starting dynamic subtest: pipe-A-eDP-1-linear-Y210
[178.528394] Dynamic subtest pipe-A-eDP-1-linear-Y210: SUCCESS (0.022s)
[178.536369] Starting dynamic subtest: pipe-A-eDP-1-linear-XYUV8888
[178.550404] Dynamic subtest pipe-A-eDP-1-linear-XYUV8888: SUCCESS (0.022s)
[178.558248] Starting dynamic subtest: pipe-A-eDP-1-linear-XV30
[178.572489] Dynamic subtest pipe-A-eDP-1-linear-XV30: SUCCESS (0.022s)
[178.580274] Starting dynamic subtest: pipe-A-eDP-1-linear-XV36
[178.594268] Dynamic subtest pipe-A-eDP-1-linear-XV36: SUCCESS (0.022s)
[178.979311] Subtest basic-modeset-with-all-modifiers-formats: SUCCESS (2.597s)
[179.800408] [030/133] (840s left) gem_exec_balancer (persistence)
[180.070619] Starting subtest: persistence
[180.960068] Subtest persistence: SUCCESS (0.895s)
[181.081089] [031/133] (838s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[181.172042] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[181.176463] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[181.285611] [032/133] (838s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[181.366934] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[181.370939] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[181.473656] [033/133] (838s left) i915_pm_rpm (gem-pread)
[183.470990] Starting subtest: gem-pread
[185.204528] Subtest gem-pread: SUCCESS (1.744s)
[185.318545] [034/133] (834s left) kms_pm_rpm (dpms-mode-unset-lpsp)
[187.440473] Starting subtest: dpms-mode-unset-lpsp
[191.172926] Subtest dpms-mode-unset-lpsp: SUCCESS (3.745s)
[191.524687] [035/133] (828s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[191.578948] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[191.583644] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[191.759754] [036/133] (828s left) gem_exec_whisper (basic-queues-priority)
[191.830807] Starting subtest: basic-queues-priority
[215.353684] Subtest basic-queues-priority: SUCCESS (23.528s)
[215.539020] [037/133] (804s left) kms_addfb_basic (addfb25-modifier-no-flag)
[215.620722] Starting subtest: addfb25-modifier-no-flag
[215.623130] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[215.736155] [038/133] (804s left) kms_flip (dpms-off-confusion-interruptible)
[215.807788] Starting subtest: dpms-off-confusion-interruptible
[215.810088] Starting dynamic subtest: A-eDP1
[224.544034] Dynamic subtest A-eDP1: SUCCESS (8.700s)
[224.555202] Starting dynamic subtest: B-eDP1
[233.187520] Dynamic subtest B-eDP1: SUCCESS (8.642s)
[233.198825] Starting dynamic subtest: C-eDP1
[241.819222] Dynamic subtest C-eDP1: SUCCESS (8.620s)
[241.831338] Starting dynamic subtest: D-eDP1
[250.405934] Dynamic subtest D-eDP1: SUCCESS (8.632s)
[250.410643] Subtest dpms-off-confusion-interruptible: SUCCESS (34.606s)
[251.574099] [039/133] (768s left) kms_flip (flip-vs-panning-vs-hang)
[251.658421] Starting subtest: flip-vs-panning-vs-hang
[251.660929] Starting dynamic subtest: A-eDP1
[302.783690] Dynamic subtest A-eDP1: SUCCESS (51.126s)
[302.793939] Starting dynamic subtest: D-eDP1
[342.821259] Dynamic subtest D-eDP1: SUCCESS (40.040s)
[342.823701] Subtest flip-vs-panning-vs-hang: SUCCESS (91.170s)
[344.061785] [040/133] (676s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc)
[344.145890] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc
[350.693106] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.552s)
[350.804656] [041/133] (669s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[350.884148] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[358.339636] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.462s)
[358.488944] [042/133] (661s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area)
[358.568378] Starting subtest: fbc-pr-plane-move-sf-dmg-area
[358.572544] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.000s)
[358.634887] [043/133] (661s left) gem_userptr_blits (create-destroy-unsync)
[358.699845] Subtest create-destroy-unsync: SKIP (0.000s)
[358.828589] [044/133] (661s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-gtt)
[358.910181] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-gtt
[358.914312] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[359.007167] [045/133] (661s left) kms_psr (fbc-pr-sprite-render)
[359.078576] Starting subtest: fbc-pr-sprite-render
[359.083067] Subtest fbc-pr-sprite-render: SKIP (0.000s)
[359.151931] [046/133] (661s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[359.241405] Starting subtest: psr2-plane-move-sf-dmg-area
[359.243711] Starting dynamic subtest: pipe-A-eDP-1
[363.754967] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.521s)
[363.765532] Starting dynamic subtest: pipe-B-eDP-1
[369.071353] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.315s)
[369.073828] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.838s)
[369.961380] [047/133] (650s left) kms_psr (psr-primary-blt)
[370.050803] Starting subtest: psr-primary-blt
[370.053155] Starting dynamic subtest: eDP-1
[371.758978] Dynamic subtest eDP-1: SUCCESS (1.709s)
[371.761526] Subtest psr-primary-blt: SUCCESS (1.710s)
[372.624016] [048/133] (648s left) kms_psr (fbc-psr-sprite-mmap-cpu)
[372.707111] Starting subtest: fbc-psr-sprite-mmap-cpu
[372.709403] Starting dynamic subtest: eDP-1
[372.713471] Dynamic subtest eDP-1: SKIP (0.000s)
[372.717561] Subtest fbc-psr-sprite-mmap-cpu: SKIP (0.001s)
[372.782413] [049/133] (647s left) i915_drm_fdinfo (memory-info-idle)
[372.826025] Starting subtest: memory-info-idle
[372.828608] Starting dynamic subtest: smem0
[372.888970] Dynamic subtest smem0: SUCCESS (0.064s)
[372.891557] Subtest memory-info-idle: SUCCESS (0.064s)
[372.962466] [050/133] (647s left) kms_plane_scaling (invalid-parameters)
[373.032960] Starting subtest: invalid-parameters
[373.035152] Starting dynamic subtest: less-than-1-height-src
[373.046694] Dynamic subtest less-than-1-height-src: SUCCESS (0.013s)
[373.056956] Starting dynamic subtest: less-than-1-width-src
[373.062084] Dynamic subtest less-than-1-width-src: SUCCESS (0.015s)
[373.063908] Subtest invalid-parameters: SUCCESS (0.030s)
[373.154143] [051/133] (647s left) gem_exec_reloc (basic-gtt-active)
[373.209444] Subtest basic-gtt-active: SKIP (0.000s)
[373.284441] [052/133] (647s left) gem_mmap_gtt (close-race)
[373.337924] Subtest close-race: SKIP (0.000s)
[373.394370] [053/133] (647s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[373.459210] Starting subtest: compare-crc-sanitycheck-nv12
[373.461443] Starting dynamic subtest: pipe-A-eDP-1
[374.176918] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.716s)
[374.187001] Starting dynamic subtest: pipe-B-eDP-1
[375.477116] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.299s)
[375.489421] Starting dynamic subtest: pipe-C-eDP-1
[376.670896] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.193s)
[376.684222] Starting dynamic subtest: pipe-D-eDP-1
[377.962555] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.292s)
[377.965016] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.505s)
[378.762727] [054/133] (642s left) api_intel_allocator (fork-simple-once)
[378.827335] Starting subtest: fork-simple-once
[378.842676] Subtest fork-simple-once: SUCCESS (0.018s)
[378.967906] [055/133] (642s left) kms_vrr (max-min)
[379.041062] Starting subtest: max-min
[379.047792] Subtest max-min: SKIP (0.000s)
[379.116704] [056/133] (641s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[379.187980] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling
[379.192558] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s)
[379.260813] [057/133] (641s left) gem_exec_params (sol-reset-invalid)
[379.315980] Starting subtest: sol-reset-invalid
[379.318393] Subtest sol-reset-invalid: SUCCESS (0.003s)
[381.376723] [058/133] (639s left) kms_lease (invalid-create-leases)
[381.454047] Starting subtest: invalid-create-leases
[381.459298] Subtest invalid-create-leases: SUCCESS (0.008s)
[381.579829] [059/133] (639s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted)
[381.637708] Starting subtest: multi-wait-for-submit-unsubmitted-submitted
[381.742881] Subtest multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.105s)
[381.820006] [060/133] (639s left) kms_psr (pr-primary-page-flip)
[381.890443] Starting subtest: pr-primary-page-flip
[381.894932] Subtest pr-primary-page-flip: SKIP (0.000s)
[381.966724] [061/133] (639s left) gem_exec_params (readonly)
[382.026977] Starting subtest: readonly
[382.029223] Subtest readonly: SUCCESS (0.003s)
[382.165629] [062/133] (639s left) gem_mmap_gtt (basic-copy)
[382.214863] Subtest basic-copy: SKIP (0.000s)
[382.266837] [063/133] (639s left) kms_psr (psr2-sprite-mmap-cpu)
[382.329005] Starting subtest: psr2-sprite-mmap-cpu
[382.331083] Starting dynamic subtest: eDP-1
[384.050190] Dynamic subtest eDP-1: SUCCESS (1.721s)
[384.052475] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.722s)
[384.924710] [064/133] (636s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[385.014238] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[391.791877] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.783s)
[391.896870] [065/133] (629s left) drm_read (empty-nonblock)
[392.036593] Starting subtest: empty-nonblock
[392.039045] Subtest empty-nonblock: SUCCESS (0.000s)
[392.150622] [066/133] (629s left) perf_pmu (busy-no-semaphores)
[392.190953] Starting subtest: busy-no-semaphores
[392.193315] Starting dynamic subtest: rcs0
[392.739826] Dynamic subtest rcs0: SUCCESS (0.549s)
[392.752767] Starting dynamic subtest: bcs0
[393.289514] Dynamic subtest bcs0: SUCCESS (0.547s)
[393.302244] Starting dynamic subtest: vcs0
[393.839525] Dynamic subtest vcs0: SUCCESS (0.548s)
[393.853219] Starting dynamic subtest: vcs1
[395.775423] Dynamic subtest vcs1: SUCCESS (1.932s)
[395.787892] Starting dynamic subtest: vecs0
[397.757807] Dynamic subtest vecs0: SUCCESS (1.980s)
[397.770544] Starting dynamic subtest: ccs0
[399.806423] Dynamic subtest ccs0: SUCCESS (2.045s)
[399.809251] Subtest busy-no-semaphores: SUCCESS (7.619s)
[399.925286] [067/133] (621s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs)
[400.000608] Starting subtest: crc-primary-suspend-yf-tiled-ccs
[400.003406] Starting dynamic subtest: pipe-A-eDP-1
[400.014029] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[400.030740] Starting dynamic subtest: pipe-B-eDP-1
[400.039651] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[400.056415] Starting dynamic subtest: pipe-C-eDP-1
[400.065410] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[400.075282] Starting dynamic subtest: pipe-D-eDP-1
[400.083774] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[400.087965] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.005s)
[402.245826] [068/133] (619s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[402.315814] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[402.317992] Starting dynamic subtest: pipe-A-eDP-1
[402.340537] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[402.352492] Starting dynamic subtest: pipe-B-eDP-1
[402.373872] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[402.384056] Starting dynamic subtest: pipe-C-eDP-1
[402.405255] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[402.415046] Starting dynamic subtest: pipe-D-eDP-1
[402.436800] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[402.441074] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[404.607921] [069/133] (617s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[404.687987] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[404.690363] Starting dynamic subtest: pipe-A
[404.915396] Dynamic subtest pipe-A: SUCCESS (0.229s)
[404.925823] Starting dynamic subtest: pipe-B
[406.216230] Dynamic subtest pipe-B: SUCCESS (1.298s)
[406.227686] Starting dynamic subtest: pipe-C
[407.526486] Dynamic subtest pipe-C: SUCCESS (1.309s)
[407.536612] Starting dynamic subtest: pipe-D
[408.852824] Dynamic subtest pipe-D: SUCCESS (1.325s)
[408.855007] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.166s)
[410.055375] [070/133] (611s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt)
[410.127409] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt
[410.132048] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[410.221031] [071/133] (611s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[410.348815] Starting subtest: protected-encrypted-src-copy-not-readible
[410.457959] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.110s)
[410.592082] [072/133] (611s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-onoff)
[410.672126] Starting subtest: fbc-1p-primscrn-cur-indfb-onoff
[414.497164] Subtest fbc-1p-primscrn-cur-indfb-onoff: SUCCESS (3.830s)
[415.641304] [073/133] (606s left) fbdev (read)
[415.679409] Starting subtest: read
[416.199302] Subtest read: SUCCESS (0.517s)
[416.261652] [074/133] (605s left) gem_exec_parallel (basic)
[416.322847] Starting subtest: basic
[416.324847] Starting dynamic subtest: rcs0
[417.748840] Dynamic subtest rcs0: SUCCESS (1.425s)
[417.759189] Starting dynamic subtest: bcs0
[419.193714] Dynamic subtest bcs0: SUCCESS (1.442s)
[419.210106] Starting dynamic subtest: vcs0
[421.242808] Dynamic subtest vcs0: SUCCESS (2.044s)
[421.257587] Starting dynamic subtest: vcs1
[423.290186] Dynamic subtest vcs1: SUCCESS (2.043s)
[423.301811] Starting dynamic subtest: vecs0
[425.210793] Dynamic subtest vecs0: SUCCESS (1.917s)
[425.224118] Starting dynamic subtest: ccs0
[426.731423] Dynamic subtest ccs0: SUCCESS (1.519s)
[426.733880] Subtest basic: SUCCESS (10.407s)
[426.917890] [075/133] (594s left) kms_dsc (dsc-with-formats)
[426.992588] Starting subtest: dsc-with-formats
[427.030913] Subtest dsc-with-formats: SKIP (0.001s)
[427.068835] [076/133] (594s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier)
[427.138689] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier
[427.143142] Subtest pixel-format-4-tiled-lnl-ccs-modifier: SKIP (0.000s)
[427.214101] [077/133] (594s left) kms_cursor_crc (cursor-onscreen-512x512)
[427.454568] Starting subtest: cursor-onscreen-512x512
[427.459053] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[427.611246] [078/133] (594s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4)
[427.686489] Starting subtest: plane-lut1d-pre-ctm3x4
[427.811579] Starting dynamic subtest: pipe-A-plane-0
[427.954667] Dynamic subtest pipe-A-plane-0: SUCCESS (0.144s)
[427.964476] Starting dynamic subtest: pipe-A-plane-1
[428.088114] Dynamic subtest pipe-A-plane-1: SUCCESS (0.133s)
[428.097928] Starting dynamic subtest: pipe-A-plane-2
[428.221311] Dynamic subtest pipe-A-plane-2: SUCCESS (0.132s)
[429.411118] Starting dynamic subtest: pipe-B-plane-0
[429.548388] Dynamic subtest pipe-B-plane-0: SUCCESS (0.144s)
[429.562453] Starting dynamic subtest: pipe-B-plane-1
[429.680764] Dynamic subtest pipe-B-plane-1: SUCCESS (0.133s)
[429.690680] Starting dynamic subtest: pipe-B-plane-2
[429.825104] Dynamic subtest pipe-B-plane-2: SUCCESS (0.144s)
[431.040041] Starting dynamic subtest: pipe-C-plane-0
[431.164554] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s)
[431.174896] Starting dynamic subtest: pipe-C-plane-1
[431.309147] Dynamic subtest pipe-C-plane-1: SUCCESS (0.144s)
[431.318930] Starting dynamic subtest: pipe-C-plane-2
[431.475732] Dynamic subtest pipe-C-plane-2: SUCCESS (0.166s)
[432.672192] Starting dynamic subtest: pipe-D-plane-0
[432.797012] Dynamic subtest pipe-D-plane-0: SUCCESS (0.133s)
[432.806925] Starting dynamic subtest: pipe-D-plane-1
[432.930793] Dynamic subtest pipe-D-plane-1: SUCCESS (0.133s)
[432.941039] Starting dynamic subtest: pipe-D-plane-2
[433.074965] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[433.368389] Subtest plane-lut1d-pre-ctm3x4: SUCCESS (5.683s)
[434.260581] [079/133] (587s left) kms_invalid_mode (overflow-vrefresh)
[434.342470] Starting subtest: overflow-vrefresh
[434.344787] Starting dynamic subtest: pipe-A-eDP-1
[434.629606] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[434.639310] Starting dynamic subtest: pipe-B-eDP-1
[434.641249] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[434.650299] Starting dynamic subtest: pipe-C-eDP-1
[434.652666] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[434.661951] Starting dynamic subtest: pipe-D-eDP-1
[434.664246] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[434.666533] Subtest overflow-vrefresh: SUCCESS (0.293s)
[435.476721] [080/133] (586s left) kms_async_flips (invalid-async-flip-atomic)
[435.558600] Starting subtest: invalid-async-flip-atomic
[435.935930] Starting dynamic subtest: pipe-A-eDP-1
[436.796801] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.861s)
[437.160023] Starting dynamic subtest: pipe-B-eDP-1
[437.934242] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.782s)
[438.291576] Starting dynamic subtest: pipe-C-eDP-1
[439.047071] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.763s)
[439.406804] Starting dynamic subtest: pipe-D-eDP-1
[440.180604] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.779s)
[440.182908] Subtest invalid-async-flip-atomic: SUCCESS (4.621s)
[441.345630] [081/133] (580s left) kms_content_protection (dp-mst-type-0)
[441.476536] Starting subtest: dp-mst-type-0
[441.481052] Subtest dp-mst-type-0: SKIP (0.000s)
[441.612792] [082/133] (580s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[441.687928] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[441.692436] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[441.768184] [083/133] (580s left) kms_getfb (getfb2-into-addfb2)
[441.860813] Starting subtest: getfb2-into-addfb2
[441.863116] Subtest getfb2-into-addfb2: SUCCESS (0.000s)
[441.976621] [084/133] (580s left) i915_module_load (resize-bar)
[442.013666] Starting subtest: resize-bar
[442.020361] Subtest resize-bar: SKIP (0.007s)
[442.073681] [085/133] (580s left) kms_flip (plain-flip-fb-recreate-interruptible)
[442.143978] Starting subtest: plain-flip-fb-recreate-interruptible
[442.146215] Starting dynamic subtest: A-eDP1
[451.027219] Dynamic subtest A-eDP1: SUCCESS (8.881s)
[451.038504] Starting dynamic subtest: B-eDP1
[459.861272] Dynamic subtest B-eDP1: SUCCESS (8.832s)
[459.876570] Starting dynamic subtest: C-eDP1
[468.675491] Dynamic subtest C-eDP1: SUCCESS (8.811s)
[468.686306] Starting dynamic subtest: D-eDP1
[477.503828] Dynamic subtest D-eDP1: SUCCESS (8.827s)
[477.508165] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.363s)
[478.692683] [086/133] (543s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[478.774024] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[479.386682] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.614s)
[479.558613] [087/133] (542s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[479.611338] Starting subtest: single-wait-for-submit-available-signaled
[479.613787] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[479.709959] [088/133] (542s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[479.788122] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[479.790403] Starting dynamic subtest: pipe-A-default-mode
[480.959789] Dynamic subtest pipe-A-default-mode: SKIP (1.168s)
[480.964199] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.169s)
[481.114260] [089/133] (541s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[481.213470] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[481.218120] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[481.384394] [090/133] (541s left) gem_exec_schedule (preempt-queue)
[481.458636] Subtest preempt-queue: SKIP (0.000s)
[481.743882] [091/133] (540s left) kms_cdclk (mode-transition-all-outputs)
[481.809629] Starting subtest: mode-transition-all-outputs
[482.117244] Subtest mode-transition-all-outputs: SKIP (0.306s)
[482.960011] [092/133] (539s left) gem_workarounds (reset-fd)
[483.028989] Starting subtest: reset-fd
[483.207043] Subtest reset-fd: SUCCESS (0.178s)
[483.325224] [093/133] (539s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[483.412863] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[483.416983] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[483.535140] [094/133] (539s left) gem_close_race (multigpu-basic-threads)
[483.596855] Starting subtest: multigpu-basic-threads
[483.601329] Subtest multigpu-basic-threads: SKIP (0.000s)
[483.836080] [095/133] (538s left) gem_exec_params (no-bsd)
[483.898412] Starting subtest: no-bsd
[483.903133] Subtest no-bsd: SUCCESS (0.003s)
[485.388717] [096/133] (537s left) kms_plane_multiple (2x-tiling-yf)
[485.459787] Starting subtest: 2x-tiling-yf
[485.464425] Subtest 2x-tiling-yf: SKIP (0.000s)
[485.532139] [097/133] (537s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[485.591826] Starting subtest: invalid-bsd2-flag-on-blt
[485.594184] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.000s)
[485.698118] [098/133] (537s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-pwrite)
[485.789490] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-pwrite
[490.532662] Subtest fbc-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (4.747s)
[491.695768] [099/133] (531s left) kms_pm_rpm (pm-tiling)
[493.411685] Starting subtest: pm-tiling
[493.416404] Subtest pm-tiling: SKIP (0.000s)
[493.905183] [100/133] (528s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[493.966143] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[494.071842] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.104s)
[494.154153] [101/133] (528s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[494.212515] Starting subtest: invalid-multi-wait-unsubmitted
[494.214808] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[494.308650] [102/133] (528s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[494.387737] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu
[494.391841] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[494.487469] [103/133] (528s left) kms_chamelium_frames (hdmi-crc-single)
[494.857210] Subtest hdmi-crc-single: SKIP (0.000s)
[495.705921] [104/133] (527s left) syncobj_wait (multi-wait-submitted-signaled)
[495.771101] Starting subtest: multi-wait-submitted-signaled
[495.773451] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[495.887721] [105/133] (527s left) gem_userptr_blits (coherency-sync)
[495.950700] Starting subtest: coherency-sync
[496.401604] Subtest coherency-sync: SKIP (0.414s)
[496.513579] [106/133] (526s left) kms_vblank (ts-continuation-idle-hang)
[496.647535] Starting subtest: ts-continuation-idle-hang
[496.649846] Starting dynamic subtest: pipe-A-eDP-1
[523.069818] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.421s)
[523.087787] Starting dynamic subtest: pipe-D-eDP-1
[538.119143] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.048s)
[538.121298] Subtest ts-continuation-idle-hang: SUCCESS (41.474s)
[538.985546] [107/133] (484s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[539.060953] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[539.064947] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[539.153208] [108/133] (484s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[539.249163] Starting subtest: 2x-cursor-vs-flip-legacy
[539.253504] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[539.393256] [109/133] (483s left) gem_exec_balancer (parallel-balancer)
[539.650427] Starting subtest: parallel-balancer
[540.515118] Subtest parallel-balancer: SUCCESS (0.865s)
[540.632308] [110/133] (482s left) perf (stress-open-close)
[540.785821] Starting subtest: stress-open-close
[540.787993] Starting dynamic subtest: 0-rcs0
[542.953687] Dynamic subtest 0-rcs0: SUCCESS (2.168s)
[542.965812] Starting dynamic subtest: 1-vcs1
[545.116191] Dynamic subtest 1-vcs1: SUCCESS (2.162s)
[545.118206] Subtest stress-open-close: SUCCESS (4.332s)
[545.163930] [111/133] (478s left) gem_ctx_shared (create-shared-gtt)
[545.216479] Starting subtest: create-shared-gtt
[547.434370] Subtest create-shared-gtt: SUCCESS (2.154s)
[547.800311] [112/133] (475s left) kms_addfb_basic (small-bo)
[547.878077] Starting subtest: small-bo
[547.880394] Subtest small-bo: SUCCESS (0.000s)
[547.974345] [113/133] (475s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs)
[548.051663] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs
[548.054145] Starting dynamic subtest: pipe-A-eDP-1
[548.074163] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[548.084739] Starting dynamic subtest: pipe-B-eDP-1
[548.103144] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[548.112937] Starting dynamic subtest: pipe-C-eDP-1
[548.131970] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[548.141573] Starting dynamic subtest: pipe-D-eDP-1
[548.160390] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[548.162277] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs: SUCCESS (0.005s)
[550.338164] [114/133] (473s left) syncobj_timeline (wait-delayed-signal)
[550.390945] Starting subtest: wait-delayed-signal
[550.492541] Subtest wait-delayed-signal: SUCCESS (0.102s)
[550.571875] [115/133] (472s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[550.659362] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[550.663506] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[550.762134] [116/133] (472s left) gem_mmap_gtt (hang-user)
[550.821368] Subtest hang-user: SKIP (0.000s)
[550.887768] [117/133] (472s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted-signaled)
[550.944125] Starting subtest: etime-multi-wait-all-for-submit-submitted-signaled
[551.044809] Subtest etime-multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.102s)
[551.124296] [118/133] (472s left) gem_tiled_wc
[551.240611] [119/133] (472s left) i915_pm_rps (thresholds-park)
[551.293424] Starting subtest: thresholds-park
[551.297225] Subtest thresholds-park: SKIP (0.001s)
[551.395352] [120/133] (472s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[551.470451] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[551.474071] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[551.560469] [121/133] (472s left) kms_busy (extended-pageflip-hang-newfb)
[551.641937] Starting subtest: extended-pageflip-hang-newfb
[551.643895] Starting dynamic subtest: pipe-A
[578.086627] Dynamic subtest pipe-A: SUCCESS (26.444s)
[578.101354] Starting dynamic subtest: pipe-D
[603.128707] Dynamic subtest pipe-D: SUCCESS (25.044s)
[603.131204] Subtest extended-pageflip-hang-newfb: SUCCESS (51.495s)
[603.999355] [122/133] (419s left) gem_spin_batch (engines)
[604.054239] Starting subtest: engines
[604.056540] Starting dynamic subtest: rcs0
[607.296960] Dynamic subtest rcs0: SUCCESS (3.238s)
[607.310146] Starting dynamic subtest: bcs0
[610.585512] Dynamic subtest bcs0: SUCCESS (3.235s)
[610.598230] Starting dynamic subtest: vcs0
[613.823828] Dynamic subtest vcs0: SUCCESS (3.235s)
[613.837730] Starting dynamic subtest: vcs1
[617.059613] Dynamic subtest vcs1: SUCCESS (3.234s)
[617.072817] Starting dynamic subtest: vecs0
[620.295121] Dynamic subtest vecs0: SUCCESS (3.234s)
[620.308194] Starting dynamic subtest: ccs0
[623.532398] Dynamic subtest ccs0: SUCCESS (3.235s)
[623.534943] Subtest engines: SUCCESS (19.427s)
[623.726616] [123/133] (400s left) kms_sequence (get-busy)
[623.808778] Starting subtest: get-busy
[623.810950] Starting dynamic subtest: pipe-A-eDP-1
[625.736181] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.927s)
[625.749323] Starting dynamic subtest: pipe-B-eDP-1
[628.304198] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.568s)
[628.318134] Starting dynamic subtest: pipe-C-eDP-1
[630.920150] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.611s)
[630.931606] Starting dynamic subtest: pipe-D-eDP-1
[633.462865] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.541s)
[633.464803] Subtest get-busy: SUCCESS (9.656s)
[634.272692] [124/133] (389s left) gem_exec_reloc (basic-cpu-read)
[634.347149] Subtest basic-cpu-read: SKIP (0.000s)
[634.421936] [125/133] (389s left) gem_exec_whisper (basic-forked-all)
[634.490074] Starting subtest: basic-forked-all
[648.399104] Subtest basic-forked-all: SUCCESS (13.908s)
[648.583159] [126/133] (375s left) kms_flip (basic-flip-vs-wf_vblank)
[648.663223] Starting subtest: basic-flip-vs-wf_vblank
[648.665484] Starting dynamic subtest: A-eDP1
[650.597559] Dynamic subtest A-eDP1: SUCCESS (1.937s)
[650.608353] Starting dynamic subtest: B-eDP1
[652.540647] Dynamic subtest B-eDP1: SUCCESS (1.942s)
[652.554146] Starting dynamic subtest: C-eDP1
[654.464399] Dynamic subtest C-eDP1: SUCCESS (1.922s)
[654.477865] Starting dynamic subtest: D-eDP1
[656.394457] Dynamic subtest D-eDP1: SUCCESS (1.927s)
[656.396626] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.736s)
[657.620022] [127/133] (366s left) core_auth (getclient-simple)
[657.655140] Starting subtest: getclient-simple
[657.670477] Subtest getclient-simple: SUCCESS (0.015s)
[657.785609] [128/133] (366s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180)
[657.867935] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180
[657.872476] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[657.960385] [129/133] (366s left) perf (low-oa-exponent-permissions)
[658.062378] Starting subtest: low-oa-exponent-permissions
[658.097881] Subtest low-oa-exponent-permissions: SUCCESS (0.036s)
[658.147845] [130/133] (365s left) gem_vm_create (execbuf)
[658.190478] Starting subtest: execbuf
[658.199206] Subtest execbuf: SUCCESS (0.009s)
[658.336592] [131/133] (365s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[658.412930] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[659.480941] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.068s)
[659.606102] [132/133] (364s left) gem_mmap_gtt (basic-small-bo)
[659.668601] Subtest basic-small-bo: SKIP (0.000s)
[659.731424] [133/133] (364s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-blt)
[659.805997] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-blt
[659.809588] Subtest psr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[659.899139] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: prime_mmap
results: parsing output: 3/ for test: gem_exec_reloc
results: parsing output: 4/ for test: gem_ctx_isolation
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: gem_exec_fence
results: parsing output: 7/ for test: kms_rotation_crc
results: parsing output: 8/ for test: syncobj_timeline
results: parsing output: 9/ for test: kms_psr2_sf
results: parsing output: 10/ for test: gem_exec_flush
results: parsing output: 11/ for test: gem_ctx_bad_destroy
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: kms_cursor_legacy
results: parsing output: 14/ for test: kms_cursor_crc
results: parsing output: 15/ for test: kms_chamelium_hpd
results: parsing output: 16/ for test: gem_ctx_shared
results: parsing output: 17/ for test: gem_ctx_param
results: parsing output: 18/ for test: gem_exec_schedule
results: parsing output: 19/ for test: kms_ccs
results: parsing output: 20/ for test: kms_addfb_basic
results: parsing output: 21/ for test: kms_cursor_crc
results: parsing output: 22/ for test: core_getversion
results: parsing output: 23/ for test: gem_pread
results: parsing output: 24/ for test: gen9_exec_parse
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: gem_ctx_param
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: kms_async_flips
results: parsing output: 29/ for test: gem_exec_balancer
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: i915_pm_rpm
results: parsing output: 33/ for test: kms_pm_rpm
results: parsing output: 34/ for test: gem_render_copy
results: parsing output: 35/ for test: gem_exec_whisper
results: parsing output: 36/ for test: kms_addfb_basic
results: parsing output: 37/ for test: kms_flip
results: parsing output: 38/ for test: kms_flip
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_psr2_sf
results: parsing output: 42/ for test: gem_userptr_blits
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_psr
results: parsing output: 45/ for test: kms_psr2_sf
results: parsing output: 46/ for test: kms_psr
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: i915_drm_fdinfo
results: parsing output: 49/ for test: kms_plane_scaling
results: parsing output: 50/ for test: gem_exec_reloc
results: parsing output: 51/ for test: gem_mmap_gtt
results: parsing output: 52/ for test: kms_pipe_crc_basic
results: parsing output: 53/ for test: api_intel_allocator
results: parsing output: 54/ for test: kms_vrr
results: parsing output: 55/ for test: kms_flip_scaled_crc
results: parsing output: 56/ for test: gem_exec_params
results: parsing output: 57/ for test: kms_lease
results: parsing output: 58/ for test: syncobj_wait
results: parsing output: 59/ for test: kms_psr
results: parsing output: 60/ for test: gem_exec_params
results: parsing output: 61/ for test: gem_mmap_gtt
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: drm_read
results: parsing output: 65/ for test: perf_pmu
results: parsing output: 66/ for test: kms_ccs
results: parsing output: 67/ for test: kms_ccs
results: parsing output: 68/ for test: kms_plane_scaling
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_pxp
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: fbdev
results: parsing output: 73/ for test: gem_exec_parallel
results: parsing output: 74/ for test: kms_dsc
results: parsing output: 75/ for test: kms_plane
results: parsing output: 76/ for test: kms_cursor_crc
results: parsing output: 77/ for test: kms_color_pipeline
results: parsing output: 78/ for test: kms_invalid_mode
results: parsing output: 79/ for test: kms_async_flips
results: parsing output: 80/ for test: kms_content_protection
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_getfb
results: parsing output: 83/ for test: i915_module_load
results: parsing output: 84/ for test: kms_flip
results: parsing output: 85/ for test: kms_big_fb
results: parsing output: 86/ for test: syncobj_timeline
results: parsing output: 87/ for test: kms_flip_scaled_crc
results: parsing output: 88/ for test: kms_cursor_legacy
results: parsing output: 89/ for test: gem_exec_schedule
results: parsing output: 90/ for test: kms_cdclk
results: parsing output: 91/ for test: gem_workarounds
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: gem_close_race
results: parsing output: 94/ for test: gem_exec_params
results: parsing output: 95/ for test: kms_plane_multiple
results: parsing output: 96/ for test: gem_exec_params
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_pm_rpm
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: syncobj_timeline
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_chamelium_frames
results: parsing output: 103/ for test: syncobj_wait
results: parsing output: 104/ for test: gem_userptr_blits
results: parsing output: 105/ for test: kms_vblank
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_cursor_legacy
results: parsing output: 108/ for test: gem_exec_balancer
results: parsing output: 109/ for test: perf
results: parsing output: 110/ for test: gem_ctx_shared
results: parsing output: 111/ for test: kms_addfb_basic
results: parsing output: 112/ for test: kms_ccs
results: parsing output: 113/ for test: syncobj_timeline
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: gem_mmap_gtt
results: parsing output: 116/ for test: syncobj_timeline
results: parsing output: 117/ for test: gem_tiled_wc
results: parsing output: 118/ for test: i915_pm_rps
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: kms_busy
results: parsing output: 121/ for test: gem_spin_batch
results: parsing output: 122/ for test: kms_sequence
results: parsing output: 123/ for test: gem_exec_reloc
results: parsing output: 124/ for test: gem_exec_whisper
results: parsing output: 125/ for test: kms_flip
results: parsing output: 126/ for test: core_auth
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: perf
results: parsing output: 129/ for test: gem_vm_create
results: parsing output: 130/ for test: kms_big_fb
results: parsing output: 131/ for test: gem_mmap_gtt
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.