[60.225920] Initializing watchdogs
[60.225986]   /dev/watchdog0
[60.246439] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[60.257494] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card1
[60.261237] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.264641] [001/131] (960s left) gen9_exec_parse (bb-oversize)
[60.353280] Subtest bb-oversize: SKIP (0.000s)
[60.447323] [002/131] (960s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[60.636364] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[60.637268] Starting dynamic subtest: pipe-A-DP-3
[60.705016] Dynamic subtest pipe-A-DP-3: SUCCESS (0.068s)
[60.811848] Starting dynamic subtest: pipe-B-DP-3
[60.926547] Dynamic subtest pipe-B-DP-3: SUCCESS (0.142s)
[60.985779] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (0.342s)
[61.219403] [003/131] (959s left) gem_workarounds (reset-context)
[61.309177] Starting subtest: reset-context
[61.510838] Subtest reset-context: SUCCESS (0.202s)
[61.695747] [004/131] (959s left) gem_exec_reloc (basic-write-cpu)
[61.772417] Subtest basic-write-cpu: SKIP (0.000s)
[61.854361] [005/131] (959s left) kms_atomic_interruptible (legacy-dpms)
[62.046009] Starting subtest: legacy-dpms
[62.046916] Starting dynamic subtest: pipe-A-DP-3
[68.352841] Dynamic subtest pipe-A-DP-3: SUCCESS (6.312s)
[68.353689] Subtest legacy-dpms: SUCCESS (6.313s)
[68.556866] [006/131] (952s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs)
[68.742182] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs
[68.743111] Starting dynamic subtest: pipe-A-DP-3
[68.751600] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[68.759446] Starting dynamic subtest: pipe-B-DP-3
[68.768233] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[68.775873] Starting dynamic subtest: pipe-C-DP-3
[68.784288] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[68.791754] Starting dynamic subtest: pipe-D-DP-3
[68.801421] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[68.803542] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SKIP (0.006s)
[69.174019] [007/131] (952s left) syncobj_wait (single-wait-all-for-submit-submitted)
[69.245152] Starting subtest: single-wait-all-for-submit-submitted
[69.350047] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.104s)
[69.465598] [008/131] (951s left) dumb_buffer (map-invalid-size)
[69.541033] Starting subtest: map-invalid-size
[69.541969] Subtest map-invalid-size: SUCCESS (0.000s)
[69.707498] [009/131] (951s left) syncobj_wait (multi-wait-all-submitted)
[69.776866] Starting subtest: multi-wait-all-submitted
[69.892043] Subtest multi-wait-all-submitted: SUCCESS (0.108s)
[69.976302] [010/131] (951s left) api_intel_allocator (reserve-simple)
[70.043973] Starting subtest: reserve-simple
[70.076409] Subtest reserve-simple: SUCCESS (0.032s)
[70.252949] [011/131] (951s left) prime_mmap (test_correct)
[70.321602] Starting subtest: test_correct
[70.322470] Starting dynamic subtest: test_correct-smem
[70.369109] Dynamic subtest test_correct-smem: SUCCESS (0.047s)
[70.377132] Starting dynamic subtest: test_correct-lmem0
[70.575870] Dynamic subtest test_correct-lmem0: SUCCESS (0.199s)
[70.577230] Subtest test_correct: SUCCESS (0.246s)
[70.731258] [012/131] (950s left) gem_exec_fence (invalid-timeline-fence-array)
[71.380651] Starting subtest: invalid-timeline-fence-array
[71.386177] Subtest invalid-timeline-fence-array: SUCCESS (0.005s)
[71.667341] [FACT gem_exec_fence (invalid-timeline-fence-array)] new: kernel.kmod_is_loaded.vgem: true
[71.669069] [013/131] (949s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc)
[71.866172] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc
[71.867121] Starting dynamic subtest: pipe-A-DP-3
[71.875857] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[71.883968] Starting dynamic subtest: pipe-B-DP-3
[71.892525] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[71.900473] Starting dynamic subtest: pipe-C-DP-3
[71.908967] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[71.916886] Starting dynamic subtest: pipe-D-DP-3
[71.928114] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[71.930579] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s)
[72.328180] [014/131] (949s left) gem_render_linear_blits (basic)
[72.415335] Starting subtest: basic
[72.487409] Subtest basic: SUCCESS (0.072s)
[72.597969] [015/131] (949s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[72.799633] Starting subtest: fbcpsr-modesetfrombusy
[72.801292] Subtest fbcpsr-modesetfrombusy: SKIP (0.000s)
[72.936250] [016/131] (948s left) gem_exec_schedule (submit-late-slice)
[73.029392] Starting subtest: submit-late-slice
[73.030368] Starting dynamic subtest: rcs0
[73.112694] Dynamic subtest rcs0: SUCCESS (0.083s)
[73.121303] Starting dynamic subtest: bcs0
[73.164972] Dynamic subtest bcs0: SUCCESS (0.052s)
[73.174064] Starting dynamic subtest: vcs0
[73.225467] Dynamic subtest vcs0: SUCCESS (0.060s)
[73.233895] Starting dynamic subtest: vcs1
[73.276660] Dynamic subtest vcs1: SUCCESS (0.051s)
[73.285133] Starting dynamic subtest: vecs0
[73.328625] Dynamic subtest vecs0: SUCCESS (0.052s)
[73.337124] Starting dynamic subtest: vecs1
[73.380191] Dynamic subtest vecs1: SUCCESS (0.051s)
[73.388682] Starting dynamic subtest: ccs0
[73.432964] Dynamic subtest ccs0: SUCCESS (0.053s)
[73.434170] Subtest submit-late-slice: SUCCESS (0.404s)
[73.845174] [017/131] (948s left) i915_module_load (reload-no-display)
[73.891987] Starting subtest: reload-no-display
[77.773117] Subtest reload-no-display: SUCCESS (3.882s)
[77.802937] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card1
[77.803944] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[77.805499] [018/131] (944s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[79.477806] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[80.765942] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.288s)
[80.971651] [FACT kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card1
[80.973948] [FACT kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)] new: kernel.kmod_is_loaded.i915: true
[80.976762] [019/131] (941s left) tools_test (sysfs_l3_parity)
[81.029889] Starting subtest: sysfs_l3_parity
[81.099913] Subtest sysfs_l3_parity: SKIP (0.074s)
[81.182940] [020/131] (940s left) gem_softpin (allocator-fork)
[81.273633] Starting subtest: allocator-fork
[83.581805] Subtest allocator-fork: SUCCESS (2.308s)
[83.757464] [021/131] (938s left) kms_pm_backlight (fade-with-suspend)
[83.957068] Subtest fade-with-suspend: SKIP (0.000s)
[84.005673] [022/131] (938s left) gem_mmap_gtt (big-copy)
[84.087015] Subtest big-copy: SKIP (0.000s)
[84.157948] [023/131] (938s left) gem_exec_whisper (basic-fds)
[84.246005] Starting subtest: basic-fds
[92.428176] Subtest basic-fds: SUCCESS (8.181s)
[92.671640] [024/131] (929s left) kms_psr (fbc-pr-cursor-plane-onoff)
[92.867368] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s)
[92.952852] [025/131] (929s left) kms_rotation_crc (primary-yf-tiled-reflect-x-0)
[93.172159] Starting subtest: primary-yf-tiled-reflect-x-0
[93.266148] Subtest primary-yf-tiled-reflect-x-0: SKIP (0.093s)
[93.411074] [026/131] (929s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[93.609916] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[93.611631] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[93.767792] [027/131] (928s left) kms_psr (fbc-psr-primary-page-flip)
[93.967342] Subtest fbc-psr-primary-page-flip: SKIP (0.000s)
[94.022990] [028/131] (928s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-indfb-draw-render)
[94.227689] Starting subtest: fbc-1p-offscren-pri-indfb-draw-render
[96.570055] Subtest fbc-1p-offscren-pri-indfb-draw-render: SUCCESS (2.343s)
[96.738830] [029/131] (925s left) i915_pm_rpm (system-suspend)
[99.080322] Starting subtest: system-suspend
[119.141660] Subtest system-suspend: SUCCESS (4.779s)
[140.513695] [030/131] (903s left) kms_plane_alpha_blend (alpha-basic)
[140.714736] Starting subtest: alpha-basic
[140.971618] Starting dynamic subtest: pipe-A-DP-3
[143.558002] Dynamic subtest pipe-A-DP-3: SUCCESS (2.537s)
[143.589056] Starting dynamic subtest: pipe-D-DP-3
[146.271985] Dynamic subtest pipe-D-DP-3: SUCCESS (2.656s)
[146.272904] Subtest alpha-basic: SUCCESS (5.465s)
[146.518139] [031/131] (897s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-onoff)
[146.723519] Starting subtest: psr-2p-primscrn-cur-indfb-onoff
[146.725211] Subtest psr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[146.827012] [032/131] (897s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[147.044011] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[148.312218] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.255s)
[148.530281] [033/131] (895s left) perf (polling-small-buf)
[148.890494] Starting subtest: polling-small-buf
[148.988884] Subtest polling-small-buf: SUCCESS (0.098s)
[149.046410] [034/131] (894s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[149.241068] Starting subtest: 2x-long-flip-vs-cursor-atomic
[149.243892] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.002s)
[149.341300] [035/131] (894s left) kms_joiner (basic-ultra-joiner)
[149.538112] Starting subtest: basic-ultra-joiner
[149.539813] Subtest basic-ultra-joiner: SKIP (0.000s)
[149.649876] [036/131] (894s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[149.731848] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[149.732782] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[149.889441] [037/131] (894s left) syncobj_timeline (reset-signaled)
[149.969793] Starting subtest: reset-signaled
[149.970769] Subtest reset-signaled: SUCCESS (0.000s)
[150.146796] [038/131] (894s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[150.343873] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.000s)
[150.434358] [039/131] (893s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-sf)
[150.684750] Subtest fbc-psr2-overlay-plane-move-continuous-sf: SKIP (0.000s)
[150.741911] [040/131] (893s left) gem_mmap_gtt (fault-concurrent)
[150.821640] Subtest fault-concurrent: SKIP (0.000s)
[150.891294] [041/131] (893s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-blt)
[151.089563] Starting subtest: psr-1p-offscren-pri-indfb-draw-blt
[151.091339] Subtest psr-1p-offscren-pri-indfb-draw-blt: SKIP (0.000s)
[151.242389] [042/131] (893s left) gem_exec_flush (basic-batch-kernel-default-wb)
[151.331503] Subtest basic-batch-kernel-default-wb: SKIP (0.000s)
[151.416388] [043/131] (893s left) gem_softpin (softpin)
[151.504036] Starting subtest: softpin
[184.014555] Subtest softpin: SUCCESS (32.471s)
[184.172472] [044/131] (860s left) i915_hangman (engine-engine-hang)
[184.272728] Starting subtest: engine-engine-hang
[184.273668] Starting dynamic subtest: rcs0
[185.072959] Dynamic subtest rcs0: SUCCESS (0.800s)
[185.084558] Starting dynamic subtest: bcs0
[185.801965] Dynamic subtest bcs0: SUCCESS (0.728s)
[185.813643] Starting dynamic subtest: vcs0
[186.534067] Dynamic subtest vcs0: SUCCESS (0.732s)
[186.546101] Starting dynamic subtest: vcs1
[187.248941] Dynamic subtest vcs1: SUCCESS (0.714s)
[187.260126] Starting dynamic subtest: vecs0
[187.954939] Dynamic subtest vecs0: SUCCESS (0.705s)
[187.966707] Starting dynamic subtest: vecs1
[188.665408] Dynamic subtest vecs1: SUCCESS (0.710s)
[188.677183] Starting dynamic subtest: ccs0
[189.428506] Dynamic subtest ccs0: SUCCESS (0.762s)
[189.430559] Subtest engine-engine-hang: SUCCESS (5.155s)
[189.606519] [045/131] (855s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[189.695096] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[189.846488] [046/131] (854s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[190.049624] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[190.101119] [047/131] (854s left) perf (invalid-oa-metric-set-id)
[190.323713] Starting subtest: invalid-oa-metric-set-id
[190.340960] Subtest invalid-oa-metric-set-id: SUCCESS (0.017s)
[190.403030] [048/131] (854s left) kms_hdr (bpc-switch-dpms)
[190.595794] Starting subtest: bpc-switch-dpms
[193.875795] Starting dynamic subtest: pipe-A-DP-3
[195.111538] Dynamic subtest pipe-A-DP-3: SUCCESS (1.236s)
[195.112698] Subtest bpc-switch-dpms: SUCCESS (4.515s)
[195.461554] [049/131] (849s left) kms_color (ctm-0-25)
[195.660874] Starting subtest: ctm-0-25
[195.661805] Starting dynamic subtest: pipe-A-DP-3
[197.392781] Dynamic subtest pipe-A-DP-3: SUCCESS (1.730s)
[197.416961] Starting dynamic subtest: pipe-B-DP-3
[199.051010] Dynamic subtest pipe-B-DP-3: SUCCESS (1.658s)
[199.064004] Starting dynamic subtest: pipe-C-DP-3
[200.701975] Dynamic subtest pipe-C-DP-3: SUCCESS (1.650s)
[200.718776] Starting dynamic subtest: pipe-D-DP-3
[202.363142] Dynamic subtest pipe-D-DP-3: SUCCESS (1.660s)
[202.364229] Subtest ctm-0-25: SUCCESS (6.700s)
[202.648977] [050/131] (842s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[202.846959] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[202.847908] Starting dynamic subtest: pipe-A
[202.944696] Dynamic subtest pipe-A: SUCCESS (0.097s)
[202.959169] Starting dynamic subtest: pipe-B
[203.143302] Dynamic subtest pipe-B: SUCCESS (0.198s)
[203.160078] Starting dynamic subtest: pipe-C
[203.359124] Dynamic subtest pipe-C: SUCCESS (0.215s)
[203.378457] Starting dynamic subtest: pipe-D
[203.598241] Dynamic subtest pipe-D: SUCCESS (0.238s)
[203.599144] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (0.751s)
[203.904756] [051/131] (841s left) kms_cursor_crc (cursor-rapid-movement-512x170)
[204.389453] Starting subtest: cursor-rapid-movement-512x170
[204.391052] Subtest cursor-rapid-movement-512x170: SKIP (0.001s)
[204.629993] [052/131] (840s left) gem_eio (wait-wedge-10ms)
[204.923940] Starting subtest: wait-wedge-10ms
[206.195984] Subtest wait-wedge-10ms: SUCCESS (1.272s)
[206.433602] [053/131] (838s left) syncobj_wait (wait-all-for-submit-complex)
[206.515041] Starting subtest: wait-all-for-submit-complex
[206.734183] Subtest wait-all-for-submit-complex: SUCCESS (0.218s)
[206.862757] [054/131] (838s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render)
[207.064736] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render
[207.066372] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[207.182506] [055/131] (838s left) kms_rotation_crc (multiplane-rotation)
[207.380958] Starting subtest: multiplane-rotation
[219.325498] Subtest multiplane-rotation: SUCCESS (11.939s)
[219.510320] [056/131] (826s left) kms_dirtyfb (drrs-dirtyfb-ioctl)
[219.711197] Starting subtest: drrs-dirtyfb-ioctl
[219.716285] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s)
[219.864607] [057/131] (825s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[220.067755] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[220.069564] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[220.225831] [058/131] (825s left) device_reset (unbind-reset-rebind)
[220.310946] Starting subtest: unbind-reset-rebind
[222.862182] Subtest unbind-reset-rebind: SUCCESS (2.549s)
[222.925544] [059/131] (822s left) kms_cursor_crc (cursor-onscreen-256x85)
[223.371424] Starting subtest: cursor-onscreen-256x85
[223.385240] Starting dynamic subtest: pipe-A-DP-3
[226.104772] Dynamic subtest pipe-A-DP-3: SUCCESS (2.718s)
[226.152009] Starting dynamic subtest: pipe-D-DP-3
[228.859946] Dynamic subtest pipe-D-DP-3: SUCCESS (2.718s)
[228.860927] Subtest cursor-onscreen-256x85: SUCCESS (5.487s)
[229.212122] [060/131] (816s left) syncobj_timeline (etime-single-wait-all-for-submit-available-unsubmitted)
[229.296081] Starting subtest: etime-single-wait-all-for-submit-available-unsubmitted
[229.399220] Subtest etime-single-wait-all-for-submit-available-unsubmitted: SUCCESS (0.103s)
[229.496227] [061/131] (816s left) syncobj_timeline (wait-all-for-submit-snapshot)
[229.577052] Starting subtest: wait-all-for-submit-snapshot
[229.660297] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[229.813341] [062/131] (816s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-blt)
[230.014616] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-blt
[230.016394] Subtest fbc-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[230.180303] [063/131] (815s left) kms_big_fb (x-tiled-32bpp-rotate-270)
[230.387520] Starting subtest: x-tiled-32bpp-rotate-270
[230.441919] Subtest x-tiled-32bpp-rotate-270: SKIP (0.054s)
[230.629927] [064/131] (815s left) kms_flip (2x-plain-flip-fb-recreate)
[230.826568] Starting subtest: 2x-plain-flip-fb-recreate
[230.841526] Subtest 2x-plain-flip-fb-recreate: SKIP (0.014s)
[230.955314] [065/131] (815s left) kms_cursor_legacy (2x-long-cursor-vs-flip-legacy)
[231.157394] Starting subtest: 2x-long-cursor-vs-flip-legacy
[231.160548] Subtest 2x-long-cursor-vs-flip-legacy: SKIP (0.002s)
[231.270230] [066/131] (815s left) kms_big_fb (yf-tiled-addfb)
[231.475722] Starting subtest: yf-tiled-addfb
[231.477576] Subtest yf-tiled-addfb: SKIP (0.000s)
[231.632722] [067/131] (814s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[231.718956] Starting subtest: invalid-multi-wait-unsubmitted
[231.719921] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[231.890489] [068/131] (814s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-upscaling)
[232.083169] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-upscaling
[232.085499] Starting dynamic subtest: pipe-A-valid-mode
[232.167752] Dynamic subtest pipe-A-valid-mode: SKIP (0.083s)
[232.169665] Subtest flip-64bpp-ytile-to-32bpp-ytile-upscaling: SKIP (0.084s)
[232.387486] [069/131] (814s left) gem_exec_schedule (in-order)
[232.485200] Starting subtest: in-order
[232.486056] Starting dynamic subtest: rcs0
[232.773043] Dynamic subtest rcs0: SUCCESS (0.287s)
[232.785165] Starting dynamic subtest: bcs0
[232.975064] Dynamic subtest bcs0: SUCCESS (0.201s)
[232.987209] Starting dynamic subtest: vcs0
[233.193439] Dynamic subtest vcs0: SUCCESS (0.217s)
[233.205663] Starting dynamic subtest: vcs1
[233.418421] Dynamic subtest vcs1: SUCCESS (0.216s)
[233.430634] Starting dynamic subtest: vecs0
[233.634475] Dynamic subtest vecs0: SUCCESS (0.213s)
[233.646339] Starting dynamic subtest: vecs1
[233.836850] Dynamic subtest vecs1: SUCCESS (0.210s)
[233.848814] Starting dynamic subtest: ccs0
[234.047535] Dynamic subtest ccs0: SUCCESS (0.210s)
[234.048588] Subtest in-order: SUCCESS (1.563s)
[234.437335] [070/131] (812s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[234.633132] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[234.635665] Starting dynamic subtest: pipe-A-DP-3
[234.644359] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[234.656387] Starting dynamic subtest: pipe-B-DP-3
[234.665096] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[234.676895] Starting dynamic subtest: pipe-C-DP-3
[234.685511] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[234.697346] Starting dynamic subtest: pipe-D-DP-3
[234.707418] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[234.709146] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SKIP (0.007s)
[235.104495] [071/131] (811s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions)
[235.301550] Starting subtest: flip-vs-cursor-atomic-transitions
[245.877856] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (10.579s)
[246.128969] [072/131] (800s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[246.329622] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[246.331486] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[246.484436] [073/131] (800s left) kms_busy (extended-modeset-hang-newfb)
[246.689126] Starting subtest: extended-modeset-hang-newfb
[246.691580] Starting dynamic subtest: pipe-A
[262.381938] Dynamic subtest pipe-A: SUCCESS (15.691s)
[262.400187] Starting dynamic subtest: pipe-D
[278.086651] Dynamic subtest pipe-D: SUCCESS (15.698s)
[278.090035] Subtest extended-modeset-hang-newfb: SUCCESS (31.398s)
[278.373127] [074/131] (768s left) kms_vblank (ts-continuation-suspend)
[278.573071] Starting subtest: ts-continuation-suspend
[278.575604] Starting dynamic subtest: pipe-A-DP-3
[297.544168] Dynamic subtest pipe-A-DP-3: SUCCESS (3.928s)
[297.559334] Starting dynamic subtest: pipe-D-DP-3
[316.512484] Dynamic subtest pipe-D-DP-3: SUCCESS (3.610s)
[316.513381] Subtest ts-continuation-suspend: SUCCESS (7.544s)
[346.772757] [075/131] (730s left) gem_exec_reloc (basic-gtt-cpu)
[346.859890] Subtest basic-gtt-cpu: SKIP (0.000s)
[346.978961] [076/131] (730s left) kms_frontbuffer_tracking (psr-slowdraw)
[347.180684] Starting subtest: psr-slowdraw
[347.182392] Subtest psr-slowdraw: SKIP (0.000s)
[347.332767] [077/131] (729s left) kms_chamelium_audio (dp-audio-edid)
[347.623925] Subtest dp-audio-edid: SKIP (0.000s)
[347.805431] [078/131] (729s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted)
[347.886847] Starting subtest: etime-multi-wait-all-available-unsubmitted
[347.993195] Subtest etime-multi-wait-all-available-unsubmitted: SUCCESS (0.104s)
[348.104177] [079/131] (729s left) syncobj_timeline (wait-zero-handles)
[348.186951] Starting subtest: wait-zero-handles
[348.187864] Subtest wait-zero-handles: SUCCESS (0.000s)
[348.337925] [080/131] (729s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[348.534961] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[348.537371] Starting dynamic subtest: pipe-A-valid-mode
[350.249628] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.681s)
[350.251138] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SUCCESS (1.685s)
[350.555551] [081/131] (727s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt)
[350.761438] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt
[350.763148] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[350.898491] [082/131] (726s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[351.106644] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[351.108292] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[351.262165] [083/131] (726s left) gem_mmap_offset (oob-read)
[351.341759] Starting subtest: oob-read
[351.342599] Subtest oob-read: SUCCESS (0.000s)
[351.470614] [084/131] (726s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[351.672011] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[351.674565] Starting dynamic subtest: pipe-A-valid-mode
[353.544455] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.849s)
[353.545431] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (1.850s)
[353.796815] [085/131] (724s left) gem_exec_balancer (nohangcheck)
[354.175890] Starting subtest: nohangcheck
[355.755156] Subtest nohangcheck: SUCCESS (1.566s)
[355.896335] [086/131] (722s left) kms_properties (plane-properties-atomic)
[356.092892] Starting subtest: plane-properties-atomic
[356.095341] Starting dynamic subtest: pipe-A-DP-3
[356.591919] Dynamic subtest pipe-A-DP-3: SUCCESS (0.494s)
[356.615567] Starting dynamic subtest: pipe-B-DP-3
[357.124627] Dynamic subtest pipe-B-DP-3: SUCCESS (0.526s)
[357.139821] Starting dynamic subtest: pipe-C-DP-3
[357.615176] Dynamic subtest pipe-C-DP-3: SUCCESS (0.486s)
[357.629520] Starting dynamic subtest: pipe-D-DP-3
[358.139003] Dynamic subtest pipe-D-DP-3: SUCCESS (0.519s)
[358.139814] Subtest plane-properties-atomic: SUCCESS (2.033s)
[358.397861] [087/131] (719s left) kms_big_fb (y-tiled-64bpp-rotate-90)
[358.608583] Starting subtest: y-tiled-64bpp-rotate-90
[358.610297] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s)
[358.736331] [088/131] (719s left) kms_joiner (invalid-modeset-force-ultra-joiner)
[358.939872] Starting subtest: invalid-modeset-force-ultra-joiner
[358.941610] Subtest invalid-modeset-force-ultra-joiner: SKIP (0.000s)
[359.084134] [089/131] (719s left) gem_exec_reloc (basic-write-read-noreloc)
[359.171044] Subtest basic-write-read-noreloc: SKIP (0.000s)
[359.249006] [090/131] (718s left) gem_mmap_gtt (flink-race)
[359.328637] Subtest flink-race: SKIP (0.000s)
[359.405516] [091/131] (718s left) gen9_exec_parse (batch-zero-length)
[359.494910] Subtest batch-zero-length: SKIP (0.000s)
[359.570004] [092/131] (718s left) gem_unref_active_buffers
[359.893294] [093/131] (718s left) kms_flip (wf_vblank-ts-check-interruptible)
[360.100538] Starting subtest: wf_vblank-ts-check-interruptible
[360.105351] Starting dynamic subtest: A-DP3
[368.210784] Dynamic subtest A-DP3: SUCCESS (8.082s)
[368.233822] Starting dynamic subtest: B-DP3
[376.244529] Dynamic subtest B-DP3: SUCCESS (8.021s)
[376.258804] Starting dynamic subtest: C-DP3
[384.274579] Dynamic subtest C-DP3: SUCCESS (8.027s)
[384.288650] Starting dynamic subtest: D-DP3
[392.307095] Dynamic subtest D-DP3: SUCCESS (8.031s)
[392.309512] Subtest wf_vblank-ts-check-interruptible: SUCCESS (32.172s)
[392.628278] [094/131] (685s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[395.239233] Starting subtest: verify-pxp-key-change-after-suspend-resume
[395.241268] Subtest verify-pxp-key-change-after-suspend-resume: SKIP (0.000s)
[395.347477] [095/131] (683s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[395.632852] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[395.810593] [096/131] (682s left) kms_plane_scaling (planes-downscale-factor-0-25)
[396.015830] Starting subtest: planes-downscale-factor-0-25
[396.016738] Starting dynamic subtest: pipe-A
[396.757198] Dynamic subtest pipe-A: SKIP (0.738s)
[396.769201] Starting dynamic subtest: pipe-B
[397.870949] Dynamic subtest pipe-B: SKIP (1.113s)
[397.883035] Starting dynamic subtest: pipe-C
[398.984920] Dynamic subtest pipe-C: SKIP (1.113s)
[398.997005] Starting dynamic subtest: pipe-D
[400.097355] Dynamic subtest pipe-D: SKIP (1.112s)
[400.098964] Subtest planes-downscale-factor-0-25: SKIP (4.080s)
[400.217348] [097/131] (678s left) syncobj_basic (create-signaled)
[400.301728] Starting subtest: create-signaled
[400.302607] Subtest create-signaled: SUCCESS (0.000s)
[400.415833] [098/131] (678s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[400.612481] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[403.333673] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (2.720s)
[403.545823] [099/131] (675s left) sw_sync (timeline_closed)
[403.595153] Starting subtest: timeline_closed
[403.596054] Subtest timeline_closed: SUCCESS (0.000s)
[403.672000] [100/131] (675s left) kms_sequence (get-forked)
[403.866916] Starting subtest: get-forked
[403.869388] Starting dynamic subtest: pipe-A-DP-3
[406.290305] Dynamic subtest pipe-A-DP-3: SUCCESS (2.421s)
[406.306892] Starting dynamic subtest: pipe-B-DP-3
[408.664294] Dynamic subtest pipe-B-DP-3: SUCCESS (2.371s)
[408.678340] Starting dynamic subtest: pipe-C-DP-3
[411.035118] Dynamic subtest pipe-C-DP-3: SUCCESS (2.368s)
[411.052980] Starting dynamic subtest: pipe-D-DP-3
[413.392514] Dynamic subtest pipe-D-DP-3: SUCCESS (2.354s)
[413.393341] Subtest get-forked: SUCCESS (9.522s)
[413.685422] [101/131] (665s left) kms_vrr (seamless-rr-switch-vrr)
[413.879862] Starting subtest: seamless-rr-switch-vrr
[413.882535] Subtest seamless-rr-switch-vrr: SKIP (0.000s)
[413.968153] [102/131] (665s left) kms_addfb_basic (addfb25-4-tiled)
[414.164370] Starting subtest: addfb25-4-tiled
[414.165271] Subtest addfb25-4-tiled: SUCCESS (0.000s)
[414.314077] [103/131] (664s left) gem_render_copy (y-tiled-ccs-to-yf-tiled)
[414.401658] Starting subtest: y-tiled-ccs-to-yf-tiled
[414.403767] Subtest y-tiled-ccs-to-yf-tiled: SKIP (0.000s)
[414.652871] [104/131] (664s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[414.853433] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[414.855085] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[415.014000] [105/131] (664s left) gem_ctx_persistence (smoketest)
[415.101908] Starting subtest: smoketest
[453.736878] Subtest smoketest: SUCCESS (38.628s)
[453.902902] [106/131] (625s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite)
[454.103500] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite
[454.105289] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[454.259675] [107/131] (625s left) kms_plane (plane-panning-bottom-right)
[454.451845] Starting subtest: plane-panning-bottom-right
[454.454256] Starting dynamic subtest: pipe-A
[455.233172] Dynamic subtest pipe-A: SUCCESS (0.780s)
[455.247334] Starting dynamic subtest: pipe-B
[455.875341] Dynamic subtest pipe-B: SUCCESS (0.641s)
[455.876298] Subtest plane-panning-bottom-right: SUCCESS (1.424s)
[456.135566] [108/131] (623s left) gem_exec_schedule (u-fairslice-all)
[456.230641] Starting subtest: u-fairslice-all
[458.343548] Subtest u-fairslice-all: SUCCESS (2.113s)
[458.809145] [109/131] (620s left) kms_psr (psr2-primary-mmap-gtt)
[459.008572] Subtest psr2-primary-mmap-gtt: SKIP (0.000s)
[459.130951] [110/131] (620s left) gem_ctx_engines (execute-allforone)
[459.221895] Starting subtest: execute-allforone
[459.263131] Subtest execute-allforone: SUCCESS (0.041s)
[459.528968] [111/131] (620s left) gem_exec_fence (syncobj-timeline-invalid-wait)
[460.150121] Starting subtest: syncobj-timeline-invalid-wait
[460.152581] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.002s)
[460.444231] [112/131] (619s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[460.532773] Subtest writes-after-reads-snoop: SKIP (0.000s)
[460.619351] [113/131] (619s left) kms_pm_rpm (legacy-planes-dpms)
[462.748207] Starting subtest: legacy-planes-dpms
[462.750833] Starting dynamic subtest: plane-43
[465.274430] Dynamic subtest plane-43: SUCCESS (2.524s)
[465.328701] Starting dynamic subtest: plane-53
[467.971304] Dynamic subtest plane-53: SUCCESS (2.692s)
[468.029356] Starting dynamic subtest: plane-63
[470.667397] Dynamic subtest plane-63: SUCCESS (2.691s)
[470.721418] Starting dynamic subtest: plane-73
[473.244574] Dynamic subtest plane-73: SUCCESS (2.572s)
[473.246641] Subtest legacy-planes-dpms: SUCCESS (10.498s)
[473.621387] [114/131] (606s left) gem_create (create-ext-cpu-access-big)
[473.816754] Starting subtest: create-ext-cpu-access-big
[480.071731] Disk usage limit exceeded.
[536.510430] Warning: kernel log ringbuffer underflow, some records lost.
[600.072987] Timeout. Killing the current test with SIGKILL.
[600.074682] Child refuses to die, tainted 0x244. Aborting.
[600.074841] Closing watchdogs
[600.106082] [FACT gem_create (create-ext-cpu-access-big)] new: kernel.is_tainted.taint_warn: true
[600.107187] Closing watchdogs
results: parsing output: 0/ for test: gen9_exec_parse
results: parsing output: 1/ for test: kms_atomic_transition
results: parsing output: 2/ for test: gem_workarounds
results: parsing output: 3/ for test: gem_exec_reloc
results: parsing output: 4/ for test: kms_atomic_interruptible
results: parsing output: 5/ for test: kms_ccs
results: parsing output: 6/ for test: syncobj_wait
results: parsing output: 7/ for test: dumb_buffer
results: parsing output: 8/ for test: syncobj_wait
results: parsing output: 9/ for test: api_intel_allocator
results: parsing output: 10/ for test: prime_mmap
results: parsing output: 11/ for test: gem_exec_fence
results: parsing output: 12/ for test: kms_ccs
results: parsing output: 13/ for test: gem_render_linear_blits
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: gem_exec_schedule
results: parsing output: 16/ for test: i915_module_load
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: tools_test
results: parsing output: 19/ for test: gem_softpin
results: parsing output: 20/ for test: kms_pm_backlight
results: parsing output: 21/ for test: gem_mmap_gtt
results: parsing output: 22/ for test: gem_exec_whisper
results: parsing output: 23/ for test: kms_psr
results: parsing output: 24/ for test: kms_rotation_crc
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: i915_pm_rpm
results: parsing output: 29/ for test: kms_plane_alpha_blend
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: perf
results: parsing output: 33/ for test: kms_cursor_legacy
results: parsing output: 34/ for test: kms_joiner
results: parsing output: 35/ for test: syncobj_wait
results: parsing output: 36/ for test: syncobj_timeline
results: parsing output: 37/ for test: kms_psr
results: parsing output: 38/ for test: kms_psr2_sf
results: parsing output: 39/ for test: gem_mmap_gtt
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: gem_exec_flush
results: parsing output: 42/ for test: gem_softpin
results: parsing output: 43/ for test: i915_hangman
results: parsing output: 44/ for test: gem_userptr_blits
results: parsing output: 45/ for test: kms_psr2_sf
results: parsing output: 46/ for test: perf
results: parsing output: 47/ for test: kms_hdr
results: parsing output: 48/ for test: kms_color
results: parsing output: 49/ for test: kms_plane_scaling
results: parsing output: 50/ for test: kms_cursor_crc
results: parsing output: 51/ for test: gem_eio
results: parsing output: 52/ for test: syncobj_wait
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_rotation_crc
results: parsing output: 55/ for test: kms_dirtyfb
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: device_reset
results: parsing output: 58/ for test: kms_cursor_crc
results: parsing output: 59/ for test: syncobj_timeline
results: parsing output: 60/ for test: syncobj_timeline
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_flip
results: parsing output: 64/ for test: kms_cursor_legacy
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: syncobj_timeline
results: parsing output: 67/ for test: kms_flip_scaled_crc
results: parsing output: 68/ for test: gem_exec_schedule
results: parsing output: 69/ for test: kms_ccs
results: parsing output: 70/ for test: kms_cursor_legacy
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_busy
results: parsing output: 73/ for test: kms_vblank
results: parsing output: 74/ for test: gem_exec_reloc
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_chamelium_audio
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: syncobj_timeline
results: parsing output: 79/ for test: kms_flip_scaled_crc
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: gem_mmap_offset
results: parsing output: 83/ for test: kms_flip_scaled_crc
results: parsing output: 84/ for test: gem_exec_balancer
results: parsing output: 85/ for test: kms_properties
results: parsing output: 86/ for test: kms_big_fb
results: parsing output: 87/ for test: kms_joiner
results: parsing output: 88/ for test: gem_exec_reloc
results: parsing output: 89/ for test: gem_mmap_gtt
results: parsing output: 90/ for test: gen9_exec_parse
results: parsing output: 91/ for test: gem_unref_active_buffers
results: parsing output: 92/ for test: kms_flip
results: parsing output: 93/ for test: gem_pxp
results: parsing output: 94/ for test: kms_chamelium_hpd
results: parsing output: 95/ for test: kms_plane_scaling
results: parsing output: 96/ for test: syncobj_basic
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: sw_sync
results: parsing output: 99/ for test: kms_sequence
results: parsing output: 100/ for test: kms_vrr
results: parsing output: 101/ for test: kms_addfb_basic
results: parsing output: 102/ for test: gem_render_copy
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: gem_ctx_persistence
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_plane
results: parsing output: 107/ for test: gem_exec_schedule
results: parsing output: 108/ for test: kms_psr
results: parsing output: 109/ for test: gem_ctx_engines
results: parsing output: 110/ for test: gem_exec_fence
results: parsing output: 111/ for test: gem_partial_pwrite_pread
results: parsing output: 112/ for test: kms_pm_rpm
results: parsing output: 113/ for test: gem_create
results: parsing output: 114/ for test: prime_mmap
results: no output, setting notrun
results: parsing output: 115/ for test: kms_atomic
results: no output, setting notrun
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: no output, setting notrun
results: parsing output: 117/ for test: kms_psr
results: no output, setting notrun
results: parsing output: 118/ for test: kms_addfb_basic
results: no output, setting notrun
results: parsing output: 119/ for test: kms_cursor_edge_walk
results: no output, setting notrun
results: parsing output: 120/ for test: syncobj_wait
results: no output, setting notrun
results: parsing output: 121/ for test: perf_pmu
results: no output, setting notrun
results: parsing output: 122/ for test: kms_chamelium_edid
results: no output, setting notrun
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: no output, setting notrun
results: parsing output: 124/ for test: kms_ccs
results: no output, setting notrun
results: parsing output: 125/ for test: gem_eio
results: no output, setting notrun
results: parsing output: 126/ for test: kms_cursor_crc
results: no output, setting notrun
results: parsing output: 127/ for test: kms_atomic
results: no output, setting notrun
results: parsing output: 128/ for test: gem_ctx_persistence
results: no output, setting notrun
results: parsing output: 129/ for test: syncobj_wait
results: no output, setting notrun
results: parsing output: 130/ for test: gem_lmem_swapping
results: no output, setting notrun
Done.