[59.298352] Initializing watchdogs
[59.298399]   /dev/watchdog0
[59.312962] [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]
[59.317346] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.319570] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.322914] [001/131] (960s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-wc)
[59.452702] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-wc
[66.125414] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.675s)
[66.286059] [002/131] (953s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[66.391681] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[66.396217] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[66.516224] [003/131] (953s left) drm_read (invalid-buffer)
[66.705866] Starting subtest: invalid-buffer
[66.708430] Subtest invalid-buffer: SUCCESS (0.000s)
[66.989363] [004/131] (952s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[67.312221] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[74.846138] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.539s)
[75.026789] [005/131] (944s left) gem_close_race (multigpu-basic-process)
[75.102754] Starting subtest: multigpu-basic-process
[75.107364] Subtest multigpu-basic-process: SKIP (0.000s)
[75.373793] [006/131] (944s left) kms_big_fb (linear-8bpp-rotate-0)
[75.480856] Starting subtest: linear-8bpp-rotate-0
[76.693325] Subtest linear-8bpp-rotate-0: SUCCESS (1.213s)
[76.848759] [007/131] (943s left) gem_userptr_blits (forbidden-operations)
[76.925598] Starting subtest: forbidden-operations
[76.929026] Subtest forbidden-operations: SKIP (0.000s)
[77.097192] [008/131] (943s left) kms_pm_backlight (fade-with-dpms)
[77.195331] Starting subtest: fade-with-dpms
[79.464479] Starting dynamic subtest: eDP-1
[82.181139] Dynamic subtest eDP-1: SUCCESS (2.716s)
[82.183533] Subtest fade-with-dpms: SUCCESS (4.984s)
[83.080096] [009/131] (937s left) kms_atomic (plane-cursor-legacy)
[83.178175] Starting subtest: plane-cursor-legacy
[83.180476] Starting dynamic subtest: pipe-A-eDP-1
[83.544202] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.366s)
[83.546592] Subtest plane-cursor-legacy: SUCCESS (0.367s)
[84.408057] [010/131] (935s left) i915_hangman (engine-engine-hang)
[84.469370] Starting subtest: engine-engine-hang
[84.471711] Starting dynamic subtest: rcs0
[85.877845] Dynamic subtest rcs0: SUCCESS (1.407s)
[85.888606] Starting dynamic subtest: bcs0
[87.859521] Dynamic subtest bcs0: SUCCESS (1.980s)
[87.871456] Starting dynamic subtest: vcs0
[89.844542] Dynamic subtest vcs0: SUCCESS (1.984s)
[89.854354] Starting dynamic subtest: vcs1
[91.827971] Dynamic subtest vcs1: SUCCESS (1.982s)
[91.839382] Starting dynamic subtest: vecs0
[93.814567] Dynamic subtest vecs0: SUCCESS (1.985s)
[93.825822] Starting dynamic subtest: ccs0
[95.862378] Dynamic subtest ccs0: SUCCESS (2.046s)
[95.865242] Subtest engine-engine-hang: SUCCESS (11.393s)
[95.963748] [011/131] (924s left) gem_flink_race (flink_close)
[96.005116] Starting subtest: flink_close
[101.109184] Subtest flink_close: SUCCESS (5.104s)
[101.208613] [012/131] (919s left) kms_setmode (invalid-clone-single-crtc-stealing)
[101.275923] Starting subtest: invalid-clone-single-crtc-stealing
[101.282856] Subtest invalid-clone-single-crtc-stealing: SKIP (0.000s)
[101.416479] [013/131] (918s left) gem_pread (bench)
[101.476542] Subtest bench: SKIP (0.000s)
[101.540671] [014/131] (918s left) kms_pipe_stress (stress-xrgb8888-xtiled)
[101.642926] Starting subtest: stress-xrgb8888-xtiled
[107.458188] Subtest stress-xrgb8888-xtiled: SUCCESS (5.816s)
[107.512397] [015/131] (912s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[107.574578] Subtest basic-wc-cpu-noreloc: SKIP (0.000s)
[107.638783] [016/131] (912s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[107.696416] Starting subtest: etime-multi-wait-all-submitted-signaled
[107.802038] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[107.906912] [017/131] (912s left) i915_pm_rpm (gem-execbuf-stress-pc8)
[110.045386] Starting subtest: gem-execbuf-stress-pc8
[110.088070] Subtest gem-execbuf-stress-pc8: SKIP (0.041s)
[110.443886] [018/131] (910s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc)
[110.544446] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc
[110.546730] Starting dynamic subtest: pipe-A-eDP-1
[110.570019] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[110.579959] Starting dynamic subtest: pipe-B-eDP-1
[110.601212] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[110.608722] Starting dynamic subtest: pipe-C-eDP-1
[110.629642] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[110.637375] Starting dynamic subtest: pipe-D-eDP-1
[110.660037] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[110.664543] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.003s)
[112.734289] [019/131] (907s left) gem_ctx_shared (q-smoketest)
[112.804103] Starting subtest: Q-smoketest
[112.806475] Starting dynamic subtest: rcs0
[118.372915] Dynamic subtest rcs0: SUCCESS (5.518s)
[118.385740] Starting dynamic subtest: bcs0
[123.884295] Dynamic subtest bcs0: SUCCESS (5.508s)
[123.892348] Starting dynamic subtest: vcs0
[129.356856] Dynamic subtest vcs0: SUCCESS (5.477s)
[129.365157] Starting dynamic subtest: vcs1
[134.827129] Dynamic subtest vcs1: SUCCESS (5.473s)
[134.835353] Starting dynamic subtest: vecs0
[140.300111] Dynamic subtest vecs0: SUCCESS (5.468s)
[140.312444] Starting dynamic subtest: ccs0
[145.770603] Dynamic subtest ccs0: SUCCESS (5.469s)
[145.772824] Subtest Q-smoketest: SUCCESS (32.918s)
[145.929051] [020/131] (874s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[146.057709] Starting subtest: cursorA-vs-flipB-legacy
[146.062160] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[146.222255] [021/131] (874s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[146.328160] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu
[146.332164] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[146.473273] [022/131] (874s left) sysfs_heartbeat_interval (precise)
[146.535608] Starting subtest: precise
[146.538046] Starting dynamic subtest: vecs0
[153.891705] Dynamic subtest vecs0: SUCCESS (7.351s)
[153.902008] Starting dynamic subtest: ccs0
[155.056869] Dynamic subtest ccs0: SUCCESS (1.166s)
[155.066678] Starting dynamic subtest: vcs0
[162.903680] Dynamic subtest vcs0: SUCCESS (7.842s)
[162.913732] Starting dynamic subtest: bcs0
[164.130955] Dynamic subtest bcs0: SUCCESS (1.228s)
[164.141641] Starting dynamic subtest: rcs0
[166.923435] Dynamic subtest rcs0: SUCCESS (2.791s)
[166.932763] Starting dynamic subtest: vcs1
[174.959212] Dynamic subtest vcs1: SUCCESS (8.034s)
[174.962165] Subtest precise: SUCCESS (28.421s)
[175.067979] [023/131] (845s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[175.173671] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[175.177757] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[175.259628] [024/131] (845s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[175.353492] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[175.357808] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[175.461991] [025/131] (845s left) gen9_exec_parse (allowed-single)
[175.520541] Subtest allowed-single: SKIP (0.000s)
[175.598915] [026/131] (845s left) gem_ctx_persistence (smoketest)
[175.663740] Starting subtest: smoketest
[215.860380] Subtest smoketest: SUCCESS (40.192s)
[215.959496] [027/131] (804s left) kms_psr (fbc-psr-primary-render)
[216.095863] Starting subtest: fbc-psr-primary-render
[216.098095] Starting dynamic subtest: eDP-1
[216.102158] Dynamic subtest eDP-1: SKIP (0.000s)
[216.106183] Subtest fbc-psr-primary-render: SKIP (0.001s)
[216.186604] [028/131] (804s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs)
[216.290981] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs
[216.293181] Starting dynamic subtest: pipe-A-eDP-1
[218.507718] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.217s)
[218.516223] Starting dynamic subtest: pipe-B-eDP-1
[220.887915] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.380s)
[220.896059] Starting dynamic subtest: pipe-C-eDP-1
[223.102263] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.213s)
[223.111103] Starting dynamic subtest: pipe-D-eDP-1
[225.303237] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.199s)
[225.305070] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (9.013s)
[226.574158] [029/131] (794s left) fbdev (eof)
[226.622362] Starting subtest: eof
[226.624793] Subtest eof: SUCCESS (0.000s)
[226.714525] [030/131] (794s left) syncobj_timeline (wait-delayed-signal)
[226.778313] Starting subtest: wait-delayed-signal
[226.879710] Subtest wait-delayed-signal: SUCCESS (0.102s)
[226.978596] [031/131] (794s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted)
[227.040833] Starting subtest: multi-wait-all-for-submit-available-submitted
[227.043199] Subtest multi-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[227.167335] [032/131] (793s left) syncobj_timeline (host-signal-points)
[227.219000] Starting subtest: host-signal-points
[227.223936] Subtest host-signal-points: SUCCESS (0.004s)
[227.331181] [033/131] (793s left) syncobj_wait (wait-all-snapshot)
[227.380785] Starting subtest: wait-all-snapshot
[227.460988] Subtest wait-all-snapshot: SUCCESS (0.081s)
[227.559645] [034/131] (793s left) perf (non-zero-reason)
[227.689838] Starting subtest: non-zero-reason
[227.692090] Starting dynamic subtest: 0-rcs0
[233.097794] Dynamic subtest 0-rcs0: SUCCESS (5.406s)
[233.108505] Starting dynamic subtest: 1-vecs0
[237.020335] Dynamic subtest 1-vecs0: SUCCESS (3.922s)
[237.023200] Subtest non-zero-reason: SUCCESS (9.329s)
[237.071525] [035/131] (784s left) prime_mmap (test_dup)
[237.136754] Starting subtest: test_dup
[237.138801] Starting dynamic subtest: test_dup-smem
[237.166014] Dynamic subtest test_dup-smem: SUCCESS (0.031s)
[237.168444] Subtest test_dup: SUCCESS (0.032s)
[237.263873] [036/131] (783s left) syncobj_wait (wait-all-for-submit-complex)
[237.311013] Starting subtest: wait-all-for-submit-complex
[237.523940] Subtest wait-all-for-submit-complex: SUCCESS (0.213s)
[237.627404] [037/131] (783s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[237.691761] Subtest basic-cpu-gtt-noreloc: SKIP (0.000s)
[237.765715] [038/131] (783s left) gem_fence_thrash (bo-write-verify-threaded-y)
[237.800537] Starting subtest: bo-write-verify-threaded-y
[237.824218] Subtest bo-write-verify-threaded-y: SKIP (0.022s)
[237.891681] [039/131] (783s left) i915_selftest (live)
[241.348767] Starting subtest: live
[241.351853] Starting dynamic subtest: sanitycheck
[245.861595] Dynamic subtest sanitycheck: SUCCESS (4.512s)
[245.871400] Starting dynamic subtest: uncore
[250.340346] Dynamic subtest uncore: SUCCESS (4.477s)
[250.348104] Starting dynamic subtest: workarounds
[253.578753] Dynamic subtest workarounds: SUCCESS (3.235s)
[253.587710] Starting dynamic subtest: gt_engines
[258.308114] Dynamic subtest gt_engines: SUCCESS (4.727s)
[258.322687] Starting dynamic subtest: gt_timelines
[274.432062] Dynamic subtest gt_timelines: SUCCESS (16.121s)
[274.441822] Starting dynamic subtest: gt_contexts
[278.821038] Dynamic subtest gt_contexts: SUCCESS (4.387s)
[278.830747] Starting dynamic subtest: gt_lrc
[285.125512] Dynamic subtest gt_lrc: SUCCESS (6.302s)
[285.134940] Starting dynamic subtest: gt_mocs
[288.256333] Dynamic subtest gt_mocs: SUCCESS (3.128s)
[288.265472] Starting dynamic subtest: gt_pm
[295.147812] Dynamic subtest gt_pm: SUCCESS (6.889s)
[295.156994] Starting dynamic subtest: gt_heartbeat
[299.616910] Dynamic subtest gt_heartbeat: SUCCESS (4.467s)
[299.626565] Starting dynamic subtest: gt_tlb
[309.651367] Dynamic subtest gt_tlb: SUCCESS (10.032s)
[309.659744] Starting dynamic subtest: requests
[323.340499] Dynamic subtest requests: SUCCESS (13.686s)
[323.349673] Starting dynamic subtest: migrate
[329.418982] Dynamic subtest migrate: SUCCESS (6.077s)
[329.427681] Starting dynamic subtest: active
[333.824215] Dynamic subtest active: SUCCESS (4.403s)
[333.833408] Starting dynamic subtest: objects
[338.775634] Dynamic subtest objects: SUCCESS (4.950s)
[338.785173] Starting dynamic subtest: mman
[343.944071] Dynamic subtest mman: SUCCESS (5.166s)
[343.953056] Starting dynamic subtest: dmabuf
[348.390027] Dynamic subtest dmabuf: SUCCESS (4.443s)
[348.399562] Starting dynamic subtest: vma
[352.838387] Dynamic subtest vma: SUCCESS (4.421s)
[352.847081] Starting dynamic subtest: coherency
[357.960967] Dynamic subtest coherency: SUCCESS (5.145s)
[357.970046] Starting dynamic subtest: gtt
[370.061489] Dynamic subtest gtt: SUCCESS (12.098s)
[370.075403] Starting dynamic subtest: gem
[377.825775] Dynamic subtest gem: SUCCESS (7.762s)
[377.835261] Starting dynamic subtest: evict
[383.444100] Dynamic subtest evict: SUCCESS (5.615s)
[383.453641] Starting dynamic subtest: hugepages
[393.232522] Dynamic subtest hugepages: SUCCESS (9.786s)
[393.242350] Starting dynamic subtest: gem_contexts
[421.047771] Dynamic subtest gem_contexts: SUCCESS (27.812s)
[421.056950] Starting dynamic subtest: client
[425.513591] Dynamic subtest client: SUCCESS (4.465s)
[425.521738] Starting dynamic subtest: gem_migrate
[429.966601] Dynamic subtest gem_migrate: SUCCESS (4.450s)
[429.975980] Starting dynamic subtest: reset
[434.427223] Dynamic subtest reset: SUCCESS (4.458s)
[434.442084] Starting dynamic subtest: memory_region
[437.255775] Dynamic subtest memory_region: SUCCESS (2.826s)
[437.265123] Starting dynamic subtest: hangcheck
[451.196875] Dynamic subtest hangcheck: SUCCESS (13.938s)
[451.206359] Starting dynamic subtest: execlists
[455.687762] Dynamic subtest execlists: SUCCESS (4.490s)
[455.697100] Starting dynamic subtest: ring_submission
[460.166873] Dynamic subtest ring_submission: SUCCESS (4.476s)
[460.176456] Starting dynamic subtest: perf
[464.648019] Dynamic subtest perf: SUCCESS (4.479s)
[464.656815] Starting dynamic subtest: slpc
[479.381357] Dynamic subtest slpc: SUCCESS (14.730s)
[479.391247] Starting dynamic subtest: guc
[483.503342] Dynamic subtest guc: SUCCESS (4.120s)
[483.513026] Starting dynamic subtest: guc_multi_lrc
[487.977905] Dynamic subtest guc_multi_lrc: SUCCESS (4.472s)
[487.988039] Starting dynamic subtest: guc_hang
[493.044837] Dynamic subtest guc_hang: SUCCESS (5.064s)
[493.054192] Starting dynamic subtest: late_gt_pm
[495.865868] Dynamic subtest late_gt_pm: SUCCESS (2.818s)
[495.868920] Subtest live: SUCCESS (254.510s)
[495.898505] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[495.901116] [040/131] (525s left) i915_query (query-topology-matches-eu-total)
[497.482437] Starting subtest: query-topology-matches-eu-total
[497.484875] Subtest query-topology-matches-eu-total: SUCCESS (0.000s)
[497.576376] [FACT i915_query (query-topology-matches-eu-total)] new: kernel.kmod_is_loaded.i915: true
[497.580166] [041/131] (523s left) kms_vblank (query-forked-hang)
[497.679247] Starting subtest: query-forked-hang
[497.681386] Starting dynamic subtest: pipe-A-eDP-1
[523.686217] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.006s)
[523.698856] Starting dynamic subtest: pipe-D-eDP-1
[538.654564] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.964s)
[538.656855] Subtest query-forked-hang: SUCCESS (40.974s)
[539.487607] [042/131] (481s left) syncobj_timeline (multi-wait-for-submit-signaled)
[539.546080] Starting subtest: multi-wait-for-submit-signaled
[539.548403] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[539.660561] [043/131] (481s left) kms_rotation_crc (primary-y-tiled-reflect-x-180)
[539.767324] Starting subtest: primary-y-tiled-reflect-x-180
[539.828969] Subtest primary-y-tiled-reflect-x-180: SKIP (0.061s)
[539.948532] [044/131] (481s left) gem_exec_fence (basic-wait)
[540.130525] Starting subtest: basic-wait
[540.132946] Starting dynamic subtest: rcs0
[540.242607] Dynamic subtest rcs0: SUCCESS (0.112s)
[540.256847] Starting dynamic subtest: bcs0
[540.300175] Dynamic subtest bcs0: SUCCESS (0.055s)
[540.313017] Starting dynamic subtest: vcs0
[540.367529] Dynamic subtest vcs0: SUCCESS (0.064s)
[540.377832] Starting dynamic subtest: vcs1
[540.426490] Dynamic subtest vcs1: SUCCESS (0.057s)
[540.436292] Starting dynamic subtest: vecs0
[540.488988] Dynamic subtest vecs0: SUCCESS (0.061s)
[540.499508] Starting dynamic subtest: ccs0
[540.545350] Dynamic subtest ccs0: SUCCESS (0.054s)
[540.547688] Subtest basic-wait: SUCCESS (0.416s)
[541.996645] [FACT gem_exec_fence (basic-wait)] new: kernel.kmod_is_loaded.vgem: true
[542.000368] [045/131] (479s left) kms_flip (bo-too-big)
[542.087697] Starting subtest: bo-too-big
[542.090152] Starting dynamic subtest: A-eDP1
[543.416105] Dynamic subtest A-eDP1: SUCCESS (1.328s)
[543.427566] Starting dynamic subtest: B-eDP1
[544.735312] Dynamic subtest B-eDP1: SUCCESS (1.317s)
[544.746288] Starting dynamic subtest: C-eDP1
[546.073399] Dynamic subtest C-eDP1: SUCCESS (1.337s)
[546.084278] Starting dynamic subtest: D-eDP1
[547.398499] Dynamic subtest D-eDP1: SUCCESS (1.323s)
[547.400903] Subtest bo-too-big: SUCCESS (5.314s)
[548.634408] [046/131] (472s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[548.756251] Starting subtest: cursor-vs-flip-toggle
[579.552144] Subtest cursor-vs-flip-toggle: SUCCESS (30.794s)
[580.378169] [047/131] (441s left) gem_exec_schedule (fairslice)
[580.451637] Starting subtest: fairslice
[580.453893] Starting dynamic subtest: rcs0
[582.466575] Dynamic subtest rcs0: SUCCESS (2.021s)
[582.475445] Starting dynamic subtest: bcs0
[584.483673] Dynamic subtest bcs0: SUCCESS (2.016s)
[584.493632] Starting dynamic subtest: vcs0
[586.505452] Dynamic subtest vcs0: SUCCESS (2.021s)
[586.514433] Starting dynamic subtest: vcs1
[588.524783] Dynamic subtest vcs1: SUCCESS (2.018s)
[588.535020] Starting dynamic subtest: vecs0
[590.548348] Dynamic subtest vecs0: SUCCESS (2.021s)
[590.557840] Starting dynamic subtest: ccs0
[592.570072] Dynamic subtest ccs0: SUCCESS (2.023s)
[592.572064] Subtest fairslice: SUCCESS (12.126s)
[592.890878] [048/131] (428s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[592.994959] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc
[592.999531] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[593.136168] [049/131] (428s left) gem_spin_batch (legacy)
[593.192363] Starting subtest: legacy
[593.194840] Starting dynamic subtest: default
[596.431892] Dynamic subtest default: SUCCESS (3.234s)
[596.442494] Starting dynamic subtest: render
[599.666540] Dynamic subtest render: SUCCESS (3.232s)
[599.677947] Starting dynamic subtest: bsd
[602.901388] Dynamic subtest bsd: SUCCESS (3.231s)
[602.912917] Starting dynamic subtest: bsd1
[606.136654] Dynamic subtest bsd1: SUCCESS (3.233s)
[606.145858] Starting dynamic subtest: bsd2
[609.369147] Dynamic subtest bsd2: SUCCESS (3.229s)
[609.378259] Starting dynamic subtest: blt
[612.606970] Dynamic subtest blt: SUCCESS (3.234s)
[612.615921] Starting dynamic subtest: vebox
[615.841905] Dynamic subtest vebox: SUCCESS (3.232s)
[615.843961] Subtest legacy: SUCCESS (22.645s)
[616.045712] [050/131] (405s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs)
[616.156104] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs
[616.158341] Starting dynamic subtest: pipe-A-eDP-1
[616.216943] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[616.227408] Starting dynamic subtest: pipe-B-eDP-1
[616.285160] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[616.295200] Starting dynamic subtest: pipe-C-eDP-1
[616.353460] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[616.362616] Starting dynamic subtest: pipe-D-eDP-1
[616.419657] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[616.424041] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.009s)
[618.340080] [051/131] (403s left) gem_eio (suspend)
[618.545638] Starting subtest: suspend
[634.426771] Subtest suspend: SUCCESS (15.881s)
[634.599542] [052/131] (387s left) kms_vrr (flipline)
[634.710693] Starting subtest: flipline
[634.716686] Subtest flipline: SKIP (0.000s)
[634.807062] [053/131] (387s left) kms_flip (2x-flip-vs-blocking-wf-vblank)
[634.902714] Starting subtest: 2x-flip-vs-blocking-wf-vblank
[634.911864] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.011s)
[635.037823] [054/131] (386s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[635.131113] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[635.133273] Starting dynamic subtest: pipe-A-default-mode
[635.435497] Dynamic subtest pipe-A-default-mode: SKIP (0.301s)
[635.439879] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.303s)
[636.290478] [055/131] (385s left) kms_cursor_crc (cursor-offscreen-512x170)
[636.610661] Starting subtest: cursor-offscreen-512x170
[636.615066] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[636.781021] [056/131] (385s left) gem_exec_whisper (basic-fds-priority-all)
[636.835580] Starting subtest: basic-fds-priority-all
[660.853831] Subtest basic-fds-priority-all: SUCCESS (24.013s)
[661.062918] [057/131] (360s left) kms_psr (fbc-psr2-sprite-render)
[661.176201] Starting subtest: fbc-psr2-sprite-render
[661.178547] Starting dynamic subtest: eDP-1
[661.183105] Dynamic subtest eDP-1: SKIP (0.000s)
[661.187605] Subtest fbc-psr2-sprite-render: SKIP (0.001s)
[661.263931] [058/131] (360s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[661.365202] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[661.741763] Starting dynamic subtest: pipe-A-eDP-1
[664.533690] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.791s)
[664.904158] Starting dynamic subtest: pipe-B-eDP-1
[667.660582] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.765s)
[668.022593] Starting dynamic subtest: pipe-C-eDP-1
[670.789942] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.776s)
[671.149873] Starting dynamic subtest: pipe-D-eDP-1
[673.921062] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.778s)
[673.923542] Subtest async-flip-with-page-flip-events-linear-atomic: SUCCESS (12.557s)
[675.141369] [059/131] (346s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[675.249119] Starting subtest: x-tiled-8bpp-rotate-90
[675.273188] Subtest x-tiled-8bpp-rotate-90: SKIP (0.023s)
[675.425850] [060/131] (346s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset)
[675.529744] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset
[675.537534] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.011s)
[675.641271] [061/131] (346s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[675.707108] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[675.709384] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[675.839618] [062/131] (346s left) kms_chamelium_frames (hdmi-crc-single)
[676.221657] Subtest hdmi-crc-single: SKIP (0.000s)
[677.029387] [063/131] (345s left) gem_eio (wait-wedge-1us)
[677.276248] Starting subtest: wait-wedge-1us
[678.946962] Subtest wait-wedge-1us: SUCCESS (1.669s)
[679.136524] [064/131] (343s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[679.237534] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt
[679.241861] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[679.346447] [065/131] (342s left) gem_mmap_gtt (flink-race)
[679.407392] Subtest flink-race: SKIP (0.000s)
[679.476245] [066/131] (342s left) kms_big_fb (4-tiled-64bpp-rotate-0)
[679.581743] Starting subtest: 4-tiled-64bpp-rotate-0
[681.230820] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.648s)
[681.434540] [067/131] (340s left) gem_exec_schedule (noreorder)
[681.635663] Starting subtest: noreorder
[681.637629] Starting dynamic subtest: rcs0
[681.714055] Dynamic subtest rcs0: SUCCESS (0.081s)
[681.727289] Starting dynamic subtest: vcs0
[682.934237] Dynamic subtest vcs0: SUCCESS (1.217s)
[682.947054] Starting dynamic subtest: vcs1
[684.905084] Dynamic subtest vcs1: SUCCESS (1.969s)
[684.918049] Starting dynamic subtest: vecs0
[686.851587] Dynamic subtest vecs0: SUCCESS (1.943s)
[686.864200] Starting dynamic subtest: ccs0
[686.966100] Dynamic subtest ccs0: SUCCESS (0.113s)
[686.968696] Subtest noreorder: SUCCESS (5.335s)
[687.179916] [068/131] (335s left) kms_getfb (getfb-repeated-different-handles)
[687.280873] Starting subtest: getfb-repeated-different-handles
[687.283202] Subtest getfb-repeated-different-handles: SUCCESS (0.000s)
[687.419853] [069/131] (335s left) gem_mmap_gtt (cpuset-basic-small-copy)
[687.480227] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[687.546943] [070/131] (335s left) kms_color (gamma)
[687.645825] Starting subtest: gamma
[687.648030] Starting dynamic subtest: pipe-A-eDP-1
[688.418884] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.773s)
[688.431235] Starting dynamic subtest: pipe-B-eDP-1
[689.894694] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.472s)
[689.905532] Starting dynamic subtest: pipe-C-eDP-1
[691.237460] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.343s)
[691.248107] Starting dynamic subtest: pipe-D-eDP-1
[692.556950] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.320s)
[692.559363] Subtest gamma: SUCCESS (4.911s)
[693.397353] [071/131] (329s left) kms_cursor_edge_walk (128x128-top-bottom)
[693.564825] Starting subtest: 128x128-top-bottom
[693.567044] Starting dynamic subtest: pipe-A-eDP-1
[697.036203] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.471s)
[697.047073] Starting dynamic subtest: pipe-D-eDP-1
[700.167089] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.127s)
[700.169368] Subtest 128x128-top-bottom: SUCCESS (6.602s)
[701.001842] [072/131] (321s left) gem_exec_reloc (basic-write-cpu)
[701.066290] Subtest basic-write-cpu: SKIP (0.000s)
[701.129737] [073/131] (321s left) kms_psr (pr-primary-mmap-cpu)
[701.230166] Starting subtest: pr-primary-mmap-cpu
[701.234402] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[701.328554] [074/131] (321s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-pwrite)
[701.422563] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-pwrite
[701.426973] Subtest psr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[701.542411] [075/131] (321s left) api_intel_bb (simple-bb)
[701.601378] Starting subtest: simple-bb
[701.605061] Subtest simple-bb: SUCCESS (0.006s)
[701.754866] [076/131] (321s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[701.850316] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[701.852571] Starting dynamic subtest: pipe-A-eDP-1
[701.874557] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[701.886914] Starting dynamic subtest: pipe-B-eDP-1
[701.907105] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[701.917994] Starting dynamic subtest: pipe-C-eDP-1
[701.935187] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[701.944893] Starting dynamic subtest: pipe-D-eDP-1
[701.962528] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[701.965961] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.004s)
[704.152537] [077/131] (318s left) kms_flip (2x-modeset-vs-vblank-race)
[704.238858] Starting subtest: 2x-modeset-vs-vblank-race
[704.250888] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[704.390177] [078/131] (318s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[704.456989] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[704.461205] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[704.667602] [079/131] (318s left) gen9_exec_parse (unaligned-jump)
[704.735057] Subtest unaligned-jump: SKIP (0.000s)
[704.823182] [080/131] (318s left) gem_ctx_param (invalid-get-ringsize)
[704.879890] Starting subtest: invalid-get-ringsize
[704.882371] Subtest invalid-get-ringsize: SUCCESS (0.001s)
[705.009427] [081/131] (318s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[705.119583] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[705.123735] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[705.243608] [082/131] (317s left) gem_exec_suspend (basic-s4-devices)
[705.313689] Starting subtest: basic-S4-devices
[705.316084] Starting dynamic subtest: smem
[716.885673] Dynamic subtest smem: SUCCESS (11.570s)
[716.888300] Subtest basic-S4-devices: SUCCESS (11.572s)
[723.112460] [083/131] (306s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[723.237914] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[723.242260] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[723.369690] [084/131] (305s left) gem_exec_fence (syncobj-timeline-export)
[723.947792] Starting subtest: syncobj-timeline-export
[723.950873] Subtest syncobj-timeline-export: SUCCESS (0.007s)
[725.034947] [085/131] (304s left) kms_plane_multiple (tiling-yf)
[725.121354] Starting subtest: tiling-yf
[725.125367] Subtest tiling-yf: SKIP (0.000s)
[725.215367] [086/131] (304s left) kms_psr (psr-sprite-mmap-cpu)
[725.301485] Starting subtest: psr-sprite-mmap-cpu
[725.303751] Starting dynamic subtest: eDP-1
[727.283624] Dynamic subtest eDP-1: SUCCESS (1.981s)
[727.285964] Subtest psr-sprite-mmap-cpu: SUCCESS (1.982s)
[728.385650] [087/131] (300s left) syncobj_wait (reset-during-wait-for-submit)
[728.449503] Starting subtest: reset-during-wait-for-submit
[728.550380] Subtest reset-during-wait-for-submit: SUCCESS (0.102s)
[728.653785] [088/131] (300s left) kms_frontbuffer_tracking (fbcpsr-2p-indfb-fliptrack-mmap-gtt)
[728.744443] Starting subtest: fbcpsr-2p-indfb-fliptrack-mmap-gtt
[728.748466] Subtest fbcpsr-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[728.879234] [089/131] (300s left) kms_atomic_interruptible (legacy-pageflip)
[728.968338] Starting subtest: legacy-pageflip
[728.970691] Starting dynamic subtest: pipe-A-eDP-1
[736.580037] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.610s)
[736.582771] Subtest legacy-pageflip: SUCCESS (7.611s)
[737.419886] [090/131] (292s left) gem_exec_balancer (busy)
[737.495745] Starting subtest: busy
[738.918808] Subtest busy: SUCCESS (1.422s)
[739.283066] [091/131] (290s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[739.370053] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[739.372265] Starting dynamic subtest: pipe-A-default-mode
[739.657301] Dynamic subtest pipe-A-default-mode: SKIP (0.287s)
[739.661635] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.288s)
[740.548977] [092/131] (288s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[740.655955] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[741.645848] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (0.989s)
[741.819394] [093/131] (287s left) template (b)
[741.874385] Starting subtest: B
[741.876839] Subtest B: SUCCESS (0.000s)
[742.011820] [094/131] (287s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[742.118041] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[742.121519] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[742.238556] [095/131] (287s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180)
[742.352363] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180
[742.355830] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[742.486249] [096/131] (287s left) gem_mmap_gtt (basic-small-copy)
[742.542862] Subtest basic-small-copy: SKIP (0.000s)
[742.606295] [097/131] (287s left) kms_prime (d3hot)
[742.690472] Subtest D3hot: SKIP (0.000s)
[742.796740] [098/131] (286s left) i915_query (query-topology-coherent-slice-mask)
[742.855123] Starting subtest: query-topology-coherent-slice-mask
[742.858666] Subtest query-topology-coherent-slice-mask: SKIP (0.000s)
[742.977933] [099/131] (286s left) gem_exec_flush (basic-wb-ro-before-default)
[743.040515] Starting subtest: basic-wb-ro-before-default
[748.499569] Subtest basic-wb-ro-before-default: SUCCESS (5.458s)
[748.722291] [100/131] (281s left) gem_exec_reloc (basic-cpu-read-noreloc)
[748.790468] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[748.880151] [101/131] (281s left) kms_invalid_mode (bad-hsync-end)
[748.986354] Starting subtest: bad-hsync-end
[748.988619] Starting dynamic subtest: pipe-A-eDP-1
[749.271287] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[749.282643] Starting dynamic subtest: pipe-B-eDP-1
[749.284920] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[749.295180] Starting dynamic subtest: pipe-C-eDP-1
[749.297098] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[749.307139] Starting dynamic subtest: pipe-D-eDP-1
[749.309685] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[749.312122] Subtest bad-hsync-end: SUCCESS (0.291s)
[750.121855] [102/131] (279s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render)
[750.222829] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render
[750.226960] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[750.347029] [103/131] (279s left) kms_chamelium_hpd (hdmi-hpd-storm)
[750.738602] Subtest hdmi-hpd-storm: SKIP (0.000s)
[751.577480] [104/131] (278s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs)
[751.662057] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs
[751.664309] Starting dynamic subtest: pipe-A-eDP-1
[751.688887] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[751.700169] Starting dynamic subtest: pipe-B-eDP-1
[751.723665] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[751.734461] Starting dynamic subtest: pipe-C-eDP-1
[751.757457] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[751.767163] Starting dynamic subtest: pipe-D-eDP-1
[751.790967] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[751.795021] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[753.981693] [105/131] (276s left) gem_exec_reloc (basic-gtt-active)
[754.048483] Subtest basic-gtt-active: SKIP (0.000s)
[754.138062] [106/131] (276s left) kms_feature_discovery (display-3x)
[754.236423] Starting subtest: display-3x
[754.240714] Subtest display-3x: SKIP (0.000s)
[754.332637] [107/131] (275s left) kms_psr (fbc-pr-no-drrs)
[754.425969] Starting subtest: fbc-pr-no-drrs
[754.430466] Subtest fbc-pr-no-drrs: SKIP (0.000s)
[754.528430] [108/131] (275s left) gem_pxp (protected-raw-src-copy-not-readible)
[754.647182] Starting subtest: protected-raw-src-copy-not-readible
[754.722995] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.079s)
[754.934699] [109/131] (275s left) gem_wait (await)
[755.012473] Starting subtest: await
[755.014516] Starting dynamic subtest: all-engines
[756.135844] Dynamic subtest all-engines: SUCCESS (1.125s)
[756.154966] Starting dynamic subtest: rcs0
[757.194314] Dynamic subtest rcs0: SUCCESS (1.056s)
[757.213735] Starting dynamic subtest: bcs0
[758.252825] Dynamic subtest bcs0: SUCCESS (1.056s)
[758.272184] Starting dynamic subtest: vcs0
[759.309215] Dynamic subtest vcs0: SUCCESS (1.054s)
[759.328779] Starting dynamic subtest: vcs1
[760.361672] Dynamic subtest vcs1: SUCCESS (1.050s)
[760.383986] Starting dynamic subtest: vecs0
[761.414292] Dynamic subtest vecs0: SUCCESS (1.051s)
[761.432683] Starting dynamic subtest: ccs0
[762.471031] Dynamic subtest ccs0: SUCCESS (1.055s)
[762.473523] Subtest await: SUCCESS (7.462s)
[762.704223] [110/131] (267s left) kms_cursor_crc (cursor-onscreen-512x512)
[762.975854] Starting subtest: cursor-onscreen-512x512
[762.980128] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[763.170865] [111/131] (267s left) gem_lmem_swapping (basic)
[763.216589] Subtest basic: SKIP (0.000s)
[763.255634] [112/131] (267s left) kms_cursor_legacy (short-flip-after-cursor-toggle)
[763.386580] Starting subtest: short-flip-after-cursor-toggle
[764.319088] Subtest short-flip-after-cursor-toggle: SUCCESS (0.929s)
[765.235649] [113/131] (265s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff)
[765.339203] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff
[772.442982] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.106s)
[772.650330] [114/131] (257s left) kms_pm_rpm (drm-resources-equal)
[774.164543] Starting subtest: drm-resources-equal
[779.515406] Subtest drm-resources-equal: SUCCESS (5.352s)
[779.634785] [115/131] (250s left) perf_pmu (busy-start)
[779.676499] Starting subtest: busy-start
[779.678566] Starting dynamic subtest: rcs0
[782.227171] Dynamic subtest rcs0: SUCCESS (2.551s)
[782.241251] Starting dynamic subtest: bcs0
[784.777833] Dynamic subtest bcs0: SUCCESS (2.547s)
[784.791562] Starting dynamic subtest: vcs0
[787.925106] Dynamic subtest vcs0: SUCCESS (3.144s)
[787.939209] Starting dynamic subtest: vcs1
[791.892077] Dynamic subtest vcs1: SUCCESS (3.965s)
[791.905844] Starting dynamic subtest: vecs0
[795.925115] Dynamic subtest vecs0: SUCCESS (4.030s)
[795.939116] Starting dynamic subtest: ccs0
[798.474135] Dynamic subtest ccs0: SUCCESS (2.548s)
[798.476598] Subtest busy-start: SUCCESS (18.800s)
[798.603397] [116/131] (232s left) kms_draw_crc (draw-method-mmap-cpu)
[798.697896] Starting subtest: draw-method-mmap-cpu
[798.700029] Starting dynamic subtest: xrgb8888-untiled
[798.962599] Dynamic subtest xrgb8888-untiled: SUCCESS (0.266s)
[798.975666] Starting dynamic subtest: rgb565-untiled
[799.196206] Dynamic subtest rgb565-untiled: SUCCESS (0.233s)
[799.208522] Starting dynamic subtest: xrgb2101010-untiled
[799.407436] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.210s)
[799.418196] Starting dynamic subtest: xbgr16161616f-untiled
[799.629766] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.221s)
[799.646591] Starting dynamic subtest: xrgb8888-xtiled
[799.773814] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.142s)
[799.784920] Starting dynamic subtest: rgb565-xtiled
[799.895897] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[799.907313] Starting dynamic subtest: xrgb2101010-xtiled
[800.029399] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.133s)
[800.039782] Starting dynamic subtest: xbgr16161616f-xtiled
[800.151568] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.121s)
[800.169476] Starting dynamic subtest: xrgb8888-4tiled
[800.318137] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.165s)
[800.328811] Starting dynamic subtest: rgb565-4tiled
[800.462591] Dynamic subtest rgb565-4tiled: SUCCESS (0.144s)
[800.473342] Starting dynamic subtest: xrgb2101010-4tiled
[800.595976] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.133s)
[800.615126] Starting dynamic subtest: xbgr16161616f-4tiled
[800.729345] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.131s)
[800.731243] Subtest draw-method-mmap-cpu: SUCCESS (2.034s)
[800.884429] [117/131] (229s left) kms_psr (psr2-sprite-plane-onoff)
[800.983231] Starting subtest: psr2-sprite-plane-onoff
[800.984958] Starting dynamic subtest: eDP-1
[802.783089] Dynamic subtest eDP-1: SUCCESS (1.797s)
[802.787625] Subtest psr2-sprite-plane-onoff: SUCCESS (1.798s)
[803.642348] [118/131] (227s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[803.772153] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[810.445058] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.676s)
[810.594746] [119/131] (220s left) gem_exec_schedule (u-semaphore-resolve)
[810.677283] Starting subtest: u-semaphore-resolve
[810.706063] Subtest u-semaphore-resolve: SUCCESS (0.036s)
[811.083729] [120/131] (219s left) prime_vgem (basic-fence-blt)
[811.152650] Starting subtest: basic-fence-blt
[811.231222] Subtest basic-fence-blt: SUCCESS (0.078s)
[811.385358] [121/131] (219s left) kms_cursor_legacy (cursorb-vs-flipb-varying-size)
[811.519457] Starting subtest: cursorB-vs-flipB-varying-size
[811.524307] Subtest cursorB-vs-flipB-varying-size: SKIP (0.001s)
[811.692365] [122/131] (219s left) kms_psr2_sf (fbc-psr2-plane-move-sf-dmg-area)
[816.688325] Starting subtest: fbc-psr2-plane-move-sf-dmg-area
[816.690740] Starting dynamic subtest: pipe-A-eDP-1
[817.499533] Dynamic subtest pipe-A-eDP-1: SKIP (0.806s)
[817.511765] Starting dynamic subtest: pipe-B-eDP-1
[818.630596] Dynamic subtest pipe-B-eDP-1: SKIP (1.129s)
[818.635100] Subtest fbc-psr2-plane-move-sf-dmg-area: SKIP (1.940s)
[819.848263] [123/131] (211s left) kms_cursor_legacy (forked-bo)
[819.977315] Starting subtest: forked-bo
[819.979642] Starting dynamic subtest: pipe-A
[825.458128] Dynamic subtest pipe-A: SUCCESS (5.477s)
[825.473603] Starting dynamic subtest: pipe-B
[830.924760] Dynamic subtest pipe-B: SUCCESS (5.464s)
[830.939759] Starting dynamic subtest: pipe-C
[836.398725] Dynamic subtest pipe-C: SUCCESS (5.471s)
[836.414651] Starting dynamic subtest: pipe-D
[841.859401] Dynamic subtest pipe-D: SUCCESS (5.459s)
[841.871205] Starting dynamic subtest: all-pipes
[847.344900] Dynamic subtest all-pipes: SUCCESS (5.482s)
[847.347414] Subtest forked-bo: SUCCESS (27.364s)
[847.520748] [124/131] (183s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite)
[847.630964] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite
[855.261362] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.633s)
[855.422856] [125/131] (175s left) core_getstats (basic)
[855.496035] Starting subtest: basic
[855.498684] Subtest basic: SUCCESS (0.000s)
[855.631797] [126/131] (175s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[855.750378] Starting subtest: yf-tiled-8bpp-rotate-0
[855.754655] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[855.890506] [127/131] (175s left) api_intel_allocator (reopen)
[855.953353] Starting subtest: reopen
[855.955842] Subtest reopen: SUCCESS (0.004s)
[856.134058] [128/131] (175s left) kms_plane_scaling (plane-downscale-factor-0-5-with-pixel-format)
[856.236560] Starting subtest: plane-downscale-factor-0-5-with-pixel-format
[856.238502] Starting dynamic subtest: pipe-A
[856.255987] Dynamic subtest pipe-A: SKIP (0.017s)
[856.266813] Starting dynamic subtest: pipe-B
[856.289606] Dynamic subtest pipe-B: SKIP (0.033s)
[856.300744] Starting dynamic subtest: pipe-C
[856.322241] Dynamic subtest pipe-C: SKIP (0.030s)
[856.334916] Starting dynamic subtest: pipe-D
[856.353710] Dynamic subtest pipe-D: SKIP (0.031s)
[856.357213] Subtest plane-downscale-factor-0-5-with-pixel-format: SKIP (0.113s)
[856.496880] [129/131] (174s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[856.606576] Starting subtest: y-tiled-64bpp-rotate-0
[856.610441] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[856.752422] [130/131] (174s left) syncobj_wait (single-wait-for-submit-signaled)
[856.817710] Starting subtest: single-wait-for-submit-signaled
[856.819337] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[856.958360] [131/131] (174s left) kms_psr2_sf (fbc-pr-overlay-primary-update-sf-dmg-area)
[862.001086] Starting subtest: fbc-pr-overlay-primary-update-sf-dmg-area
[862.005757] Subtest fbc-pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[862.867022] 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: drm_read
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: gem_close_race
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: gem_userptr_blits
results: parsing output: 7/ for test: kms_pm_backlight
results: parsing output: 8/ for test: kms_atomic
results: parsing output: 9/ for test: i915_hangman
results: parsing output: 10/ for test: gem_flink_race
results: parsing output: 11/ for test: kms_setmode
results: parsing output: 12/ for test: gem_pread
results: parsing output: 13/ for test: kms_pipe_stress
results: parsing output: 14/ for test: gem_exec_reloc
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: i915_pm_rpm
results: parsing output: 17/ for test: kms_ccs
results: parsing output: 18/ for test: gem_ctx_shared
results: parsing output: 19/ for test: kms_cursor_legacy
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: sysfs_heartbeat_interval
results: parsing output: 22/ for test: kms_joiner
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: gen9_exec_parse
results: parsing output: 25/ for test: gem_ctx_persistence
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: kms_ccs
results: parsing output: 28/ for test: fbdev
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: syncobj_timeline
results: parsing output: 32/ for test: syncobj_wait
results: parsing output: 33/ for test: perf
results: parsing output: 34/ for test: prime_mmap
results: parsing output: 35/ for test: syncobj_wait
results: parsing output: 36/ for test: gem_exec_reloc
results: parsing output: 37/ for test: gem_fence_thrash
results: parsing output: 38/ for test: i915_selftest
results: parsing output: 39/ for test: i915_query
results: parsing output: 40/ for test: kms_vblank
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: kms_rotation_crc
results: parsing output: 43/ for test: gem_exec_fence
results: parsing output: 44/ for test: kms_flip
results: parsing output: 45/ for test: kms_cursor_legacy
results: parsing output: 46/ for test: gem_exec_schedule
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_spin_batch
results: parsing output: 49/ for test: kms_ccs
results: parsing output: 50/ for test: gem_eio
results: parsing output: 51/ for test: kms_vrr
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: kms_flip_scaled_crc
results: parsing output: 54/ for test: kms_cursor_crc
results: parsing output: 55/ for test: gem_exec_whisper
results: parsing output: 56/ for test: kms_psr
results: parsing output: 57/ for test: kms_async_flips
results: parsing output: 58/ for test: kms_big_fb
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: syncobj_wait
results: parsing output: 61/ for test: kms_chamelium_frames
results: parsing output: 62/ for test: gem_eio
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: gem_mmap_gtt
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: gem_exec_schedule
results: parsing output: 67/ for test: kms_getfb
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: kms_color
results: parsing output: 70/ for test: kms_cursor_edge_walk
results: parsing output: 71/ for test: gem_exec_reloc
results: parsing output: 72/ for test: kms_psr
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: api_intel_bb
results: parsing output: 75/ for test: kms_ccs
results: parsing output: 76/ for test: kms_flip
results: parsing output: 77/ for test: gem_render_copy
results: parsing output: 78/ for test: gen9_exec_parse
results: parsing output: 79/ for test: gem_ctx_param
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: gem_exec_suspend
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: gem_exec_fence
results: parsing output: 84/ for test: kms_plane_multiple
results: parsing output: 85/ for test: kms_psr
results: parsing output: 86/ for test: syncobj_wait
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_atomic_interruptible
results: parsing output: 89/ for test: gem_exec_balancer
results: parsing output: 90/ for test: kms_flip_scaled_crc
results: parsing output: 91/ for test: kms_big_fb
results: parsing output: 92/ for test: template
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_big_fb
results: parsing output: 95/ for test: gem_mmap_gtt
results: parsing output: 96/ for test: kms_prime
results: parsing output: 97/ for test: i915_query
results: parsing output: 98/ for test: gem_exec_flush
results: parsing output: 99/ for test: gem_exec_reloc
results: parsing output: 100/ for test: kms_invalid_mode
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_chamelium_hpd
results: parsing output: 103/ for test: kms_ccs
results: parsing output: 104/ for test: gem_exec_reloc
results: parsing output: 105/ for test: kms_feature_discovery
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: gem_pxp
results: parsing output: 108/ for test: gem_wait
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: gem_lmem_swapping
results: parsing output: 111/ for test: kms_cursor_legacy
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_pm_rpm
results: parsing output: 114/ for test: perf_pmu
results: parsing output: 115/ for test: kms_draw_crc
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: gem_exec_schedule
results: parsing output: 119/ for test: prime_vgem
results: parsing output: 120/ for test: kms_cursor_legacy
results: parsing output: 121/ for test: kms_psr2_sf
results: parsing output: 122/ for test: kms_cursor_legacy
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: core_getstats
results: parsing output: 125/ for test: kms_big_fb
results: parsing output: 126/ for test: api_intel_allocator
results: parsing output: 127/ for test: kms_plane_scaling
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: syncobj_wait
results: parsing output: 130/ for test: kms_psr2_sf
Done.