[58.483360] Initializing watchdogs
[58.483405]   /dev/watchdog0
[58.497501] [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]
[58.502154] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.504771] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.508202] [001/133] (960s left) kms_ccs (random-ccs-data-y-tiled-ccs)
[58.623669] Starting subtest: random-ccs-data-y-tiled-ccs
[58.625787] Starting dynamic subtest: pipe-A-eDP-1
[58.651064] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[58.660168] Starting dynamic subtest: pipe-B-eDP-1
[58.683777] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[58.691244] Starting dynamic subtest: pipe-C-eDP-1
[58.715720] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[58.726366] Starting dynamic subtest: pipe-D-eDP-1
[58.751080] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[58.755264] Subtest random-ccs-data-y-tiled-ccs: SKIP (0.003s)
[60.908340] [002/133] (958s left) gem_ctx_persistence (legacy-engines-hang)
[60.963769] Starting subtest: legacy-engines-hang
[60.966204] Starting dynamic subtest: render
[61.053464] Dynamic subtest render: SUCCESS (0.090s)
[61.063639] Starting dynamic subtest: bsd1
[61.150877] Dynamic subtest bsd1: SUCCESS (0.096s)
[61.160447] Starting dynamic subtest: bsd2
[61.239572] Dynamic subtest bsd2: SUCCESS (0.088s)
[61.249573] Starting dynamic subtest: blt
[61.338774] Dynamic subtest blt: SUCCESS (0.098s)
[61.351311] Starting dynamic subtest: vebox
[61.433032] Dynamic subtest vebox: SUCCESS (0.092s)
[61.435866] Subtest legacy-engines-hang: SUCCESS (0.471s)
[61.509041] [003/133] (957s left) prime_mmap_kms (buffer-sharing)
[61.600844] Starting subtest: buffer-sharing
[62.054760] Subtest buffer-sharing: SUCCESS (0.455s)
[62.861210] [004/133] (956s left) kms_pm_rpm (cursor-dpms)
[64.513615] Starting subtest: cursor-dpms
[64.518606] Subtest cursor-dpms: SKIP (0.000s)
[65.201297] [005/133] (953s left) kms_cursor_legacy (cursorb-vs-flipb-legacy)
[65.316960] Starting subtest: cursorB-vs-flipB-legacy
[65.321665] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s)
[65.458165] [006/133] (953s left) gem_workarounds (basic-read-context)
[65.525405] Starting subtest: basic-read-context
[65.536871] Subtest basic-read-context: SUCCESS (0.011s)
[65.665564] [007/133] (953s left) kms_chamelium_edid (hdmi-edid-stress-resolution-non-4k)
[66.048568] Subtest hdmi-edid-stress-resolution-non-4k: SKIP (0.000s)
[66.900390] [008/133] (952s left) syncobj_timeline (etime-multi-wait-all-submitted)
[66.951503] Starting subtest: etime-multi-wait-all-submitted
[67.054813] Subtest etime-multi-wait-all-submitted: SUCCESS (0.104s)
[67.143365] [009/133] (952s left) kms_vblank (ts-continuation-modeset-hang)
[67.229191] Starting subtest: ts-continuation-modeset-hang
[67.231190] Starting dynamic subtest: pipe-A-eDP-1
[94.074498] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.853s)
[94.087398] Starting dynamic subtest: pipe-D-eDP-1
[109.046490] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.969s)
[109.048679] Subtest ts-continuation-modeset-hang: SUCCESS (41.826s)
[109.856306] [010/133] (909s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0)
[109.968297] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0
[110.990117] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.024s)
[111.113243] [011/133] (908s left) gem_exec_balancer (full-late)
[111.175628] Starting subtest: full-late
[116.125222] Subtest full-late: SUCCESS (4.949s)
[116.439347] [012/133] (902s left) gem_exec_async (forked-writes)
[116.500985] Starting subtest: forked-writes
[116.503431] Starting dynamic subtest: rcs0
[116.535240] Dynamic subtest rcs0: SUCCESS (0.034s)
[116.544788] Starting dynamic subtest: bcs0
[116.564632] Dynamic subtest bcs0: SUCCESS (0.028s)
[116.575125] Starting dynamic subtest: vcs0
[116.587827] Dynamic subtest vcs0: SUCCESS (0.023s)
[116.596997] Starting dynamic subtest: vcs1
[116.610607] Dynamic subtest vcs1: SUCCESS (0.022s)
[116.620304] Starting dynamic subtest: vecs0
[116.633124] Dynamic subtest vecs0: SUCCESS (0.023s)
[116.643228] Starting dynamic subtest: ccs0
[116.654396] Dynamic subtest ccs0: SUCCESS (0.021s)
[116.656527] Subtest forked-writes: SUCCESS (0.154s)
[116.898251] [013/133] (902s left) gem_render_copy (yf-tiled-to-vebox-linear)
[116.948611] Starting subtest: yf-tiled-to-vebox-linear
[116.953373] Subtest yf-tiled-to-vebox-linear: SKIP (0.000s)
[117.129952] [014/133] (902s left) kms_cursor_crc (cursor-random-256x256)
[117.350872] Starting subtest: cursor-random-256x256
[117.353395] Starting dynamic subtest: pipe-A-eDP-1
[120.709071] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.354s)
[120.735285] Starting dynamic subtest: pipe-D-eDP-1
[124.762346] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.033s)
[124.764817] Subtest cursor-random-256x256: SUCCESS (7.412s)
[125.617974] [015/133] (893s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[125.756266] Starting subtest: 2x-cursor-vs-flip-atomic
[125.760801] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.001s)
[125.916793] [016/133] (893s left) kms_content_protection (lic-type-0)
[126.045788] Starting subtest: lic-type-0
[126.050214] Subtest lic-type-0: SKIP (0.000s)
[126.161073] [017/133] (893s left) kms_prop_blob (invalid-get-prop)
[126.215773] Starting subtest: invalid-get-prop
[126.217917] Subtest invalid-get-prop: SUCCESS (0.000s)
[126.299063] [018/133] (893s left) gem_mmap_wc (fault-concurrent)
[126.342061] Subtest fault-concurrent: SKIP (0.000s)
[126.397200] [019/133] (893s left) gem_exec_fence (syncobj-import)
[126.856930] Starting subtest: syncobj-import
[126.862058] Subtest syncobj-import: SUCCESS (0.005s)
[128.397548] [FACT gem_exec_fence (syncobj-import)] new: kernel.kmod_is_loaded.vgem: true
[128.400682] [020/133] (891s left) perf (gen12-mi-rpc)
[128.513274] Starting subtest: gen12-mi-rpc
[128.515480] Starting dynamic subtest: rcs0
[128.534926] Dynamic subtest rcs0: SUCCESS (0.020s)
[128.537248] Subtest gen12-mi-rpc: SUCCESS (0.021s)
[128.579831] [021/133] (891s left) gem_exec_params (readonly)
[128.637818] Starting subtest: readonly
[128.642338] Subtest readonly: SUCCESS (0.004s)
[128.769389] [022/133] (891s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite)
[128.865440] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite
[128.869818] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[128.965180] [023/133] (890s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-pwrite)
[129.066610] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-pwrite
[129.070623] Subtest psr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[129.163712] [024/133] (890s left) gem_userptr_blits (set-cache-level)
[129.227668] Starting subtest: set-cache-level
[129.231626] Subtest set-cache-level: SKIP (0.000s)
[129.351879] [025/133] (890s left) kms_plane_alpha_blend (alpha-transparent-fb)
[129.442106] Starting subtest: alpha-transparent-fb
[129.737172] Starting dynamic subtest: pipe-A-eDP-1
[130.381548] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.644s)
[130.392497] Starting dynamic subtest: pipe-D-eDP-1
[131.801272] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.419s)
[131.803681] Subtest alpha-transparent-fb: SUCCESS (2.360s)
[132.709073] [026/133] (887s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[132.810734] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[132.815135] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[132.907795] [027/133] (887s left) kms_big_fb (linear-32bpp-rotate-90)
[133.015436] Starting subtest: linear-32bpp-rotate-90
[133.036870] Subtest linear-32bpp-rotate-90: SKIP (0.021s)
[133.140242] [028/133] (886s left) i915_drm_fdinfo (all-busy-check-all)
[133.178280] Starting subtest: all-busy-check-all
[133.185420] Subtest all-busy-check-all: SKIP (0.005s)
[133.249867] [029/133] (886s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[133.381477] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[133.385668] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[133.461229] [030/133] (886s left) gem_softpin (reverse)
[133.510708] Starting subtest: reverse
[133.516967] Subtest reverse: SUCCESS (0.006s)
[133.636104] [031/133] (886s left) gem_mmap_gtt (isolation)
[133.693428] Subtest isolation: SKIP (0.000s)
[133.747939] [032/133] (886s left) gem_exec_params (invalid-bsd2-flag-on-vebox)
[133.802098] Starting subtest: invalid-bsd2-flag-on-vebox
[133.804136] Subtest invalid-bsd2-flag-on-vebox: SUCCESS (0.000s)
[133.911415] [033/133] (886s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[134.005489] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[134.007368] Starting dynamic subtest: pipe-A-eDP-1
[134.026349] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[134.036945] Starting dynamic subtest: pipe-B-eDP-1
[134.054302] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[134.062667] Starting dynamic subtest: pipe-C-eDP-1
[134.080692] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[134.089426] Starting dynamic subtest: pipe-D-eDP-1
[134.107800] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[134.111135] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.003s)
[136.272840] [034/133] (884s left) gem_reg_read (timestamp-moving)
[136.320963] Starting subtest: timestamp-moving
[137.323063] Subtest timestamp-moving: SUCCESS (1.001s)
[137.412637] [035/133] (882s left) kms_3d (basic)
[137.470501] Starting subtest: basic
[139.729414] Subtest basic: SUCCESS (2.262s)
[140.228378] [036/133] (880s left) gem_mmap_gtt (basic-write-read)
[140.281843] Subtest basic-write-read: SKIP (0.000s)
[140.335192] [037/133] (880s left) prime_mmap (test_errors)
[140.387867] Starting subtest: test_errors
[140.389796] Starting dynamic subtest: test_errors-smem
[140.482144] Dynamic subtest test_errors-smem: SUCCESS (0.096s)
[140.484637] Subtest test_errors: SUCCESS (0.096s)
[140.583661] [038/133] (879s left) gem_create (hog-create)
[140.647404] Starting subtest: hog-create
[140.649789] Starting dynamic subtest: smem0
[174.269476] Dynamic subtest smem0: SUCCESS (33.619s)
[174.272551] Subtest hog-create: SUCCESS (33.621s)
[174.469414] [039/133] (846s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[174.523307] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[174.631088] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.107s)
[174.707309] [040/133] (845s left) kms_flip (2x-wf_vblank-ts-check)
[174.808110] Starting subtest: 2x-wf_vblank-ts-check
[174.817202] Subtest 2x-wf_vblank-ts-check: SKIP (0.011s)
[174.895574] [041/133] (845s left) kms_color (invalid-degamma-lut-sizes)
[174.990962] Starting subtest: invalid-degamma-lut-sizes
[174.993610] Starting dynamic subtest: pipe-A
[175.282776] Dynamic subtest pipe-A: SUCCESS (0.292s)
[175.293204] Starting dynamic subtest: pipe-B
[175.295358] Dynamic subtest pipe-B: SUCCESS (0.000s)
[175.303629] Starting dynamic subtest: pipe-C
[175.305848] Dynamic subtest pipe-C: SUCCESS (0.000s)
[175.316973] Starting dynamic subtest: pipe-D
[175.319176] Dynamic subtest pipe-D: SUCCESS (0.000s)
[175.321289] Subtest invalid-degamma-lut-sizes: SUCCESS (0.295s)
[176.094580] [042/133] (844s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[176.200427] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[176.802263] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.603s)
[176.975169] [043/133] (843s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[177.079696] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[177.084156] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[177.178729] [044/133] (843s left) kms_plane (planar-pixel-format-settings)
[177.278257] Starting subtest: planar-pixel-format-settings
[177.346511] Subtest planar-pixel-format-settings: SUCCESS (0.069s)
[177.440889] [045/133] (843s left) kms_flip (blocking-absolute-wf_vblank)
[177.537213] Starting subtest: blocking-absolute-wf_vblank
[177.539437] Starting dynamic subtest: A-eDP1
[186.329893] Dynamic subtest A-eDP1: SUCCESS (8.795s)
[186.342074] Starting dynamic subtest: B-eDP1
[195.122508] Dynamic subtest B-eDP1: SUCCESS (8.790s)
[195.136371] Starting dynamic subtest: C-eDP1
[203.827375] Dynamic subtest C-eDP1: SUCCESS (8.702s)
[203.837872] Starting dynamic subtest: D-eDP1
[212.516803] Dynamic subtest D-eDP1: SUCCESS (8.687s)
[212.521590] Subtest blocking-absolute-wf_vblank: SUCCESS (34.987s)
[213.693752] [046/133] (807s left) kms_hdr (static-swap)
[213.792305] Starting subtest: static-swap
[213.794530] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[213.798642] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SKIP (0.000s)
[213.808896] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[213.813147] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SKIP (0.000s)
[213.817732] Subtest static-swap: SKIP (0.002s)
[213.877428] [047/133] (806s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[213.985174] Starting subtest: 4-tiled-16bpp-rotate-0
[215.232654] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.247s)
[215.345351] [048/133] (805s left) core_debugfs (read-all-entries)
[215.412728] Starting subtest: read-all-entries
[215.506687] Subtest read-all-entries: SUCCESS (0.095s)
[215.574496] [049/133] (805s left) drm_read (empty-block)
[215.717133] Starting subtest: empty-block
[216.721719] Subtest empty-block: SUCCESS (1.002s)
[216.871733] [050/133] (804s left) kms_joiner (basic-max-non-joiner)
[216.971313] Starting subtest: basic-max-non-joiner
[216.975862] Subtest basic-max-non-joiner: SKIP (0.000s)
[217.035237] [051/133] (803s left) kms_big_fb (yf-tiled-64bpp-rotate-180)
[217.133064] Starting subtest: yf-tiled-64bpp-rotate-180
[217.137110] Subtest yf-tiled-64bpp-rotate-180: SKIP (0.000s)
[217.251668] [052/133] (803s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[217.348273] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area
[217.350622] Starting dynamic subtest: pipe-A-eDP-1
[217.446262] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[217.456878] Starting dynamic subtest: pipe-B-eDP-1
[218.635931] Dynamic subtest pipe-B-eDP-1: SKIP (1.188s)
[218.640754] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.290s)
[219.908094] [053/133] (801s left) gem_sync (basic-many-each)
[219.980762] Starting subtest: basic-many-each
[222.260114] Subtest basic-many-each: SUCCESS (2.291s)
[222.455346] [054/133] (798s left) kms_flip (basic-plain-flip)
[222.560377] Starting subtest: basic-plain-flip
[222.562631] Starting dynamic subtest: A-eDP1
[224.260299] Dynamic subtest A-eDP1: SUCCESS (1.701s)
[224.270243] Starting dynamic subtest: B-eDP1
[225.978785] Dynamic subtest B-eDP1: SUCCESS (1.716s)
[225.994822] Starting dynamic subtest: C-eDP1
[227.645116] Dynamic subtest C-eDP1: SUCCESS (1.664s)
[227.655880] Starting dynamic subtest: D-eDP1
[229.349033] Dynamic subtest D-eDP1: SUCCESS (1.702s)
[229.354038] Subtest basic-plain-flip: SUCCESS (6.797s)
[230.589991] [055/133] (790s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[230.689462] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[230.693590] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[230.776636] [056/133] (790s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[230.882662] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[230.887294] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[230.985054] [057/133] (790s left) gem_mmap_gtt (fault-concurrent-y)
[231.038757] Subtest fault-concurrent-Y: SKIP (0.000s)
[231.102044] [058/133] (790s left) kms_psr (pr-cursor-plane-onoff)
[231.189966] Starting subtest: pr-cursor-plane-onoff
[231.194567] Subtest pr-cursor-plane-onoff: SKIP (0.000s)
[231.261716] [059/133] (790s left) gem_softpin (evict-active-interruptible)
[231.322351] Starting subtest: evict-active-interruptible
[231.328675] Subtest evict-active-interruptible: SUCCESS (0.007s)
[231.442238] [060/133] (789s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs)
[231.536447] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs
[231.538262] Starting dynamic subtest: pipe-A-eDP-1
[231.556974] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[231.566809] Starting dynamic subtest: pipe-B-eDP-1
[231.584214] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[231.592449] Starting dynamic subtest: pipe-C-eDP-1
[231.609459] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[231.618164] Starting dynamic subtest: pipe-D-eDP-1
[231.635516] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[231.638773] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[233.791050] [061/133] (787s left) kms_cursor_legacy (cursora-vs-flipa-varying-size)
[233.902888] Starting subtest: cursorA-vs-flipA-varying-size
[245.018043] Subtest cursorA-vs-flipA-varying-size: SUCCESS (11.116s)
[245.889723] [062/133] (775s left) prime_busy (before-wait)
[245.944766] Starting subtest: before-wait
[245.949562] Starting dynamic subtest: rcs0
[245.973580] Dynamic subtest rcs0: SUCCESS (0.026s)
[245.982312] Starting dynamic subtest: bcs0
[246.030791] Dynamic subtest bcs0: SUCCESS (0.056s)
[246.039507] Starting dynamic subtest: vcs0
[246.071034] Dynamic subtest vcs0: SUCCESS (0.039s)
[246.079272] Starting dynamic subtest: vcs1
[246.109963] Dynamic subtest vcs1: SUCCESS (0.039s)
[246.120946] Starting dynamic subtest: vecs0
[246.149808] Dynamic subtest vecs0: SUCCESS (0.039s)
[246.159209] Starting dynamic subtest: ccs0
[246.189233] Dynamic subtest ccs0: SUCCESS (0.039s)
[246.297546] Subtest before-wait: SUCCESS (0.351s)
[246.381996] [063/133] (775s left) kms_big_fb (y-tiled-64bpp-rotate-180)
[246.475130] Starting subtest: y-tiled-64bpp-rotate-180
[246.479391] Subtest y-tiled-64bpp-rotate-180: SKIP (0.000s)
[246.564794] [064/133] (774s left) kms_cursor_crc (cursor-onscreen-256x85)
[246.794650] Starting subtest: cursor-onscreen-256x85
[246.841271] Subtest cursor-onscreen-256x85: SKIP (0.043s)
[246.993987] [065/133] (774s left) gem_ctx_param (root-set)
[247.041794] Starting subtest: root-set
[247.044070] Subtest root-set: SUCCESS (0.001s)
[247.154900] [066/133] (774s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[247.242871] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[247.245030] Starting dynamic subtest: pipe-A-default-mode
[249.985644] Dynamic subtest pipe-A-default-mode: SUCCESS (2.742s)
[249.988114] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.744s)
[250.805021] [067/133] (770s left) gem_exec_params (cliprects_ptr-dirt)
[250.860291] Starting subtest: cliprects_ptr-dirt
[250.862471] Subtest cliprects_ptr-dirt: SUCCESS (0.001s)
[250.952548] [068/133] (770s left) prime_mmap_coherency (write)
[251.013894] Starting subtest: write
[256.396304] Subtest write: SUCCESS (5.380s)
[256.545068] [069/133] (765s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[256.643523] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[264.391270] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.751s)
[264.523745] [070/133] (757s left) kms_cursor_edge_walk (64x64-top-edge)
[264.618726] Starting subtest: 64x64-top-edge
[264.620954] Starting dynamic subtest: pipe-A-eDP-1
[268.129439] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.511s)
[268.139239] Starting dynamic subtest: pipe-D-eDP-1
[271.321303] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.190s)
[271.323704] Subtest 64x64-top-edge: SUCCESS (6.703s)
[272.183698] [071/133] (749s left) tools_test (sysfs_l3_parity)
[272.242687] Starting subtest: sysfs_l3_parity
[272.316352] Subtest sysfs_l3_parity: SKIP (0.082s)
[272.373955] [072/133] (749s left) gem_exec_schedule (u-submit-early-slice)
[272.448256] Starting subtest: u-submit-early-slice
[272.450623] Starting dynamic subtest: rcs0
[272.487187] Dynamic subtest rcs0: SUCCESS (0.043s)
[272.501792] Starting dynamic subtest: bcs0
[272.532411] Dynamic subtest bcs0: SUCCESS (0.043s)
[272.547980] Starting dynamic subtest: vcs0
[272.576616] Dynamic subtest vcs0: SUCCESS (0.043s)
[272.586700] Starting dynamic subtest: vcs1
[272.612804] Dynamic subtest vcs1: SUCCESS (0.035s)
[272.624577] Starting dynamic subtest: vecs0
[272.647630] Dynamic subtest vecs0: SUCCESS (0.034s)
[272.657081] Starting dynamic subtest: ccs0
[272.683203] Dynamic subtest ccs0: SUCCESS (0.035s)
[272.686145] Subtest u-submit-early-slice: SUCCESS (0.240s)
[274.384603] [073/133] (747s left) gem_ctx_exec (basic)
[274.452238] Starting subtest: basic
[274.455097] Subtest basic: SUCCESS (0.007s)
[274.595650] [074/133] (747s left) syncobj_wait (reset-during-wait-for-submit)
[274.655507] Starting subtest: reset-during-wait-for-submit
[274.757790] Subtest reset-during-wait-for-submit: SUCCESS (0.103s)
[274.837197] [075/133] (747s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[274.955416] Starting subtest: cursor-vs-flip-toggle
[306.060527] Subtest cursor-vs-flip-toggle: SUCCESS (31.105s)
[306.880139] [076/133] (715s left) gem_exec_balancer (parallel-out-fence)
[307.146638] Starting subtest: parallel-out-fence
[308.335386] Subtest parallel-out-fence: SUCCESS (1.192s)
[308.440033] [077/133] (713s left) kms_plane_cursor (primary)
[308.537008] Starting subtest: primary
[308.541433] Starting dynamic subtest: pipe-A-eDP-1-size-64
[311.121400] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.586s)
[311.147152] Starting dynamic subtest: pipe-A-eDP-1-size-128
[313.724331] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.583s)
[313.748721] Starting dynamic subtest: pipe-A-eDP-1-size-256
[316.347088] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.605s)
[316.666911] Starting dynamic subtest: pipe-B-eDP-1-size-64
[320.018311] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.361s)
[320.041078] Starting dynamic subtest: pipe-B-eDP-1-size-128
[322.629724] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.595s)
[322.653939] Starting dynamic subtest: pipe-B-eDP-1-size-256
[325.230675] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.583s)
[325.545070] Starting dynamic subtest: pipe-C-eDP-1-size-64
[328.523265] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.988s)
[328.549188] Starting dynamic subtest: pipe-C-eDP-1-size-128
[330.790260] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.247s)
[330.817096] Starting dynamic subtest: pipe-C-eDP-1-size-256
[333.012548] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.203s)
[333.337890] Starting dynamic subtest: pipe-D-eDP-1-size-64
[336.264286] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.939s)
[336.290839] Starting dynamic subtest: pipe-D-eDP-1-size-128
[338.475889] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.192s)
[338.501669] Starting dynamic subtest: pipe-D-eDP-1-size-256
[340.675395] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.181s)
[340.982619] Subtest primary: SUCCESS (32.445s)
[341.794517] [078/133] (680s left) gem_exec_schedule (pi-distinct-iova)
[341.978932] Starting subtest: pi-distinct-iova
[341.981357] Starting dynamic subtest: rcs0
[342.059245] Dynamic subtest rcs0: SUCCESS (0.083s)
[342.068229] Starting dynamic subtest: vcs0
[342.125571] Dynamic subtest vcs0: SUCCESS (0.063s)
[342.137244] Starting dynamic subtest: vcs1
[342.189592] Dynamic subtest vcs1: SUCCESS (0.062s)
[342.203388] Starting dynamic subtest: vecs0
[342.248217] Dynamic subtest vecs0: SUCCESS (0.058s)
[342.259526] Starting dynamic subtest: ccs0
[342.304834] Dynamic subtest ccs0: SUCCESS (0.055s)
[342.307926] Subtest pi-distinct-iova: SUCCESS (0.330s)
[343.373954] [079/133] (678s left) kms_chamelium_hpd (vga-hpd-without-ddc)
[343.762539] Subtest vga-hpd-without-ddc: SKIP (0.000s)
[344.557538] [080/133] (677s left) kms_busy (extended-modeset-hang-newfb)
[344.654622] Starting subtest: extended-modeset-hang-newfb
[344.656835] Starting dynamic subtest: pipe-A
[379.234630] Dynamic subtest pipe-A: SUCCESS (34.577s)
[379.244343] Starting dynamic subtest: pipe-D
[402.193945] Dynamic subtest pipe-D: SUCCESS (22.956s)
[402.196434] Subtest extended-modeset-hang-newfb: SUCCESS (57.538s)
[403.068555] [081/133] (619s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[403.178366] Starting subtest: basic-flip-before-cursor-varying-size
[404.135307] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.956s)
[404.969078] [082/133] (617s left) gem_ctx_param (invalid-ctx-get)
[405.015802] Starting subtest: invalid-ctx-get
[405.018150] Subtest invalid-ctx-get: SUCCESS (0.000s)
[405.078290] [083/133] (617s left) kms_dsc (dsc-with-output-formats)
[405.176079] Starting subtest: dsc-with-output-formats
[405.198185] Subtest dsc-with-output-formats: SKIP (0.000s)
[405.260136] [084/133] (617s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc)
[405.349805] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc
[409.584827] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.238s)
[410.786816] [085/133] (611s left) kms_pm_rpm (system-suspend-idle)
[412.405570] Starting subtest: system-suspend-idle
[432.400393] Subtest system-suspend-idle: SUCCESS (4.463s)
[432.801211] [086/133] (589s left) gem_exec_whisper (basic-fds-all)
[432.876813] Starting subtest: basic-fds-all
[444.816423] Subtest basic-fds-all: SUCCESS (11.968s)
[445.010558] [087/133] (577s left) kms_addfb_basic (invalid-get-prop-any)
[445.072816] Starting subtest: invalid-get-prop-any
[445.074786] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[445.219209] [088/133] (577s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[445.282759] Starting subtest: single-wait-for-submit-available-submitted
[445.285169] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s)
[445.394385] [089/133] (577s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[445.497996] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-gtt
[445.502311] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[445.608036] [090/133] (577s left) kms_selftest (drm_dp_mst_helper)
[445.646855] Starting subtest: drm_dp_mst_helper
[445.691716] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[445.793151] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.104s)
[445.805294] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[445.918772] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.121s)
[445.928402] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[446.020651] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.100s)
[446.022643] Subtest drm_dp_mst_helper: SUCCESS (0.373s)
[446.183655] [091/133] (576s left) gem_pxp (reject-modify-context-protection-off-3)
[446.303527] Starting subtest: reject-modify-context-protection-off-3
[446.306171] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s)
[446.428542] [092/133] (576s left) fbdev (write)
[446.465440] Starting subtest: write
[447.053378] Subtest write: SUCCESS (0.586s)
[447.127056] [093/133] (575s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping)
[447.223005] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping
[447.248886] Starting dynamic subtest: pipe-A-plane-0
[447.514692] Dynamic subtest pipe-A-plane-0: SUCCESS (0.266s)
[447.525394] Starting dynamic subtest: pipe-A-plane-3
[447.725726] Dynamic subtest pipe-A-plane-3: SUCCESS (0.210s)
[448.834695] Starting dynamic subtest: pipe-B-plane-0
[449.100532] Dynamic subtest pipe-B-plane-0: SUCCESS (0.277s)
[449.110837] Starting dynamic subtest: pipe-B-plane-3
[449.311761] Dynamic subtest pipe-B-plane-3: SUCCESS (0.210s)
[449.632342] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping: SUCCESS (2.412s)
[450.473292] [094/133] (572s left) i915_query (engine-info)
[450.526079] Starting subtest: engine-info
[450.530427] Subtest engine-info: SUCCESS (0.005s)
[450.647144] [095/133] (572s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[450.693150] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[450.781037] [096/133] (572s left) i915_pm_rc6_residency (rc6-accuracy)
[450.825777] Starting subtest: rc6-accuracy
[450.827652] Starting dynamic subtest: gt0
[453.997559] Dynamic subtest gt0: SUCCESS (3.172s)
[454.009827] Starting dynamic subtest: gt1
[457.169073] Dynamic subtest gt1: SUCCESS (3.170s)
[457.171565] Subtest rc6-accuracy: SUCCESS (6.348s)
[457.246995] [097/133] (565s left) gem_pipe_control_store_loop (reused-buffer)
[457.302025] Starting subtest: reused-buffer
[459.458779] Subtest reused-buffer: SUCCESS (2.157s)
[459.567840] [098/133] (563s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[459.668743] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[459.673130] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[459.780571] [099/133] (563s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[459.872480] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[466.850387] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.978s)
[467.014162] [100/133] (556s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-20x20)
[467.103812] Starting subtest: planes-downscale-factor-0-5-upscale-20x20
[467.106079] Starting dynamic subtest: pipe-A
[467.126351] Dynamic subtest pipe-A: SKIP (0.019s)
[467.137838] Starting dynamic subtest: pipe-B
[467.158665] Dynamic subtest pipe-B: SKIP (0.032s)
[467.169028] Starting dynamic subtest: pipe-C
[467.192192] Dynamic subtest pipe-C: SKIP (0.032s)
[467.202345] Starting dynamic subtest: pipe-D
[467.223565] Dynamic subtest pipe-D: SKIP (0.032s)
[467.227923] Subtest planes-downscale-factor-0-5-upscale-20x20: SKIP (0.118s)
[467.346163] [101/133] (555s left) kms_psr (fbc-psr2-basic)
[467.453888] Starting subtest: fbc-psr2-basic
[467.456252] Starting dynamic subtest: eDP-1
[467.460660] Dynamic subtest eDP-1: SKIP (0.000s)
[467.465031] Subtest fbc-psr2-basic: SKIP (0.001s)
[467.528190] [102/133] (555s left) gem_exec_nop (basic-parallel)
[467.598759] Starting subtest: basic-parallel
[483.762468] Subtest basic-parallel: SUCCESS (16.174s)
[483.996143] [103/133] (539s left) gen9_exec_parse (bb-start-far)
[484.049614] Subtest bb-start-far: SKIP (0.000s)
[484.121685] [104/133] (539s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[484.227561] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[485.352391] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.124s)
[485.497391] [105/133] (537s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[485.601422] Starting subtest: psr2-overlay-plane-update-continuous-sf
[485.603467] Starting dynamic subtest: pipe-A-eDP-1
[486.720796] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.123s)
[486.731951] Starting dynamic subtest: pipe-B-eDP-1
[488.473218] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.751s)
[488.475773] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (2.877s)
[489.355955] [106/133] (533s left) sysfs_timeslice_duration (duration)
[489.403297] Starting subtest: duration
[489.405727] Starting dynamic subtest: vecs0
[502.739222] Dynamic subtest vecs0: SUCCESS (13.337s)
[502.752617] Starting dynamic subtest: ccs0
[515.892452] Dynamic subtest ccs0: SUCCESS (13.157s)
[515.905749] Starting dynamic subtest: vcs0
[529.741121] Dynamic subtest vcs0: SUCCESS (13.845s)
[529.754050] Starting dynamic subtest: bcs0
[542.899299] Dynamic subtest bcs0: SUCCESS (13.152s)
[542.914507] Starting dynamic subtest: rcs0
[556.031939] Dynamic subtest rcs0: SUCCESS (13.128s)
[556.044568] Starting dynamic subtest: vcs1
[570.766832] Dynamic subtest vcs1: SUCCESS (14.731s)
[570.769553] Subtest duration: SUCCESS (81.366s)
[570.846634] [107/133] (452s left) i915_module_load (reload-no-display)
[570.884090] Starting subtest: reload-no-display
[578.222261] Subtest reload-no-display: SUCCESS (7.340s)
[578.252883] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[578.253694] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[578.257012] [108/133] (445s left) syncobj_wait (invalid-single-wait-all-unsubmitted)
[579.813118] Starting subtest: invalid-single-wait-all-unsubmitted
[579.815644] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s)
[579.906331] [FACT syncobj_wait (invalid-single-wait-all-unsubmitted)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[579.907667] [FACT syncobj_wait (invalid-single-wait-all-unsubmitted)] new: kernel.kmod_is_loaded.i915: true
[579.911382] [109/133] (443s left) kms_psr (psr2-cursor-plane-onoff)
[580.010392] Starting subtest: psr2-cursor-plane-onoff
[580.012534] Starting dynamic subtest: eDP-1
[581.778030] Dynamic subtest eDP-1: SUCCESS (1.766s)
[581.780485] Subtest psr2-cursor-plane-onoff: SUCCESS (1.767s)
[582.653982] [110/133] (440s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[582.755778] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[586.337446] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (3.586s)
[587.473934] [111/133] (436s left) kms_ccs (crc-primary-suspend-y-tiled-ccs)
[587.561971] Starting subtest: crc-primary-suspend-y-tiled-ccs
[587.564200] Starting dynamic subtest: pipe-A-eDP-1
[587.573162] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[587.583567] Starting dynamic subtest: pipe-B-eDP-1
[587.592640] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[587.604491] Starting dynamic subtest: pipe-C-eDP-1
[587.612802] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[587.621569] Starting dynamic subtest: pipe-D-eDP-1
[587.629927] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[587.633975] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.004s)
[589.834341] [112/133] (433s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[589.928766] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[597.018938] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.095s)
[597.153943] [113/133] (426s left) kms_psr (psr-sprite-plane-onoff)
[597.246754] Starting subtest: psr-sprite-plane-onoff
[597.248981] Starting dynamic subtest: eDP-1
[598.994636] Dynamic subtest eDP-1: SUCCESS (1.749s)
[598.996977] Subtest psr-sprite-plane-onoff: SUCCESS (1.750s)
[599.829518] [114/133] (423s left) gem_pread (exhaustion)
[599.885501] Subtest exhaustion: SKIP (0.000s)
[599.947115] [115/133] (423s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[600.003668] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[600.005558] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.001s)
[600.105785] [116/133] (423s left) kms_dirtyfb (default-dirtyfb-ioctl)
[600.200641] Starting subtest: default-dirtyfb-ioctl
[600.202634] Starting dynamic subtest: A-eDP-1
[601.800268] Dynamic subtest A-eDP-1: SUCCESS (1.597s)
[601.802396] Subtest default-dirtyfb-ioctl: SUCCESS (1.598s)
[602.661094] [117/133] (421s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[602.746848] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[602.751146] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[602.833157] [118/133] (420s left) api_intel_allocator (fork-simple-once)
[602.884524] Starting subtest: fork-simple-once
[602.903305] Subtest fork-simple-once: SUCCESS (0.020s)
[603.039012] [119/133] (420s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[603.131470] Starting subtest: fbc-psr-cursor-mmap-cpu
[603.133701] Starting dynamic subtest: eDP-1
[603.137666] Dynamic subtest eDP-1: SKIP (0.000s)
[603.141652] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.001s)
[603.204910] [120/133] (420s left) kms_addfb_basic (too-wide)
[603.291957] Starting subtest: too-wide
[603.294265] Subtest too-wide: SUCCESS (0.000s)
[603.401935] [121/133] (420s left) gem_reg_read (timestamp-monotonic)
[603.461383] Starting subtest: timestamp-monotonic
[607.582947] Subtest timestamp-monotonic: SUCCESS (4.124s)
[607.674599] [122/133] (416s left) gem_gpgpu_fill (offset-16x16)
[607.734836] Starting subtest: offset-16x16
[607.745264] Subtest offset-16x16: SUCCESS (0.010s)
[607.901177] [123/133] (416s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[607.990505] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling
[607.994766] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s)
[608.064146] [124/133] (415s left) gem_ctx_exec (basic-norecovery)
[608.120270] Starting subtest: basic-norecovery
[608.362617] Subtest basic-norecovery: SUCCESS (0.243s)
[608.497427] [125/133] (415s left) drm_mm (drm_mm)
[608.534613] Starting subtest: drm_mm
[608.541938] Starting dynamic subtest: drm_test_mm_init
[608.627213] Dynamic subtest drm_test_mm_init: SUCCESS (0.085s)
[608.638610] Starting dynamic subtest: drm_test_mm_debug
[608.739087] Dynamic subtest drm_test_mm_debug: SUCCESS (0.111s)
[608.750727] Starting dynamic subtest: drm_test_mm_align32
[608.846921] Dynamic subtest drm_test_mm_align32: SUCCESS (0.106s)
[608.857551] Starting dynamic subtest: drm_test_mm_align64
[608.942017] Dynamic subtest drm_test_mm_align64: SUCCESS (0.094s)
[608.953235] Starting dynamic subtest: drm_test_mm_lowest
[609.044618] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.101s)
[609.054031] Starting dynamic subtest: drm_test_mm_highest
[609.137860] Dynamic subtest drm_test_mm_highest: SUCCESS (0.092s)
[609.139767] Subtest drm_mm: SUCCESS (0.606s)
[609.284608] [126/133] (414s left) gem_exec_params (secure-non-master)
[609.341302] Starting subtest: secure-non-master
[609.344893] Subtest secure-non-master: SKIP (0.000s)
[609.437551] [127/133] (414s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-mc-ccs)
[609.533025] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-mc-ccs
[609.534840] Starting dynamic subtest: pipe-A-eDP-1
[609.584427] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[609.595882] Starting dynamic subtest: pipe-B-eDP-1
[609.642864] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[609.653068] Starting dynamic subtest: pipe-C-eDP-1
[609.699369] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[609.709425] Starting dynamic subtest: pipe-D-eDP-1
[609.756879] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[609.760424] Subtest crc-sprite-planes-basic-4-tiled-dg2-mc-ccs: SKIP (0.009s)
[611.854930] [128/133] (412s left) syncobj_timeline (invalid-transfer-bad-pad)
[611.916272] Starting subtest: invalid-transfer-bad-pad
[611.918647] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[612.015290] [129/133] (412s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[612.112495] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[612.116701] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[612.211430] [130/133] (412s left) perf_pmu (render-node-busy-idle)
[612.287791] Starting subtest: render-node-busy-idle
[612.290177] Starting dynamic subtest: rcs0
[612.949628] Dynamic subtest rcs0: SUCCESS (0.665s)
[612.962452] Starting dynamic subtest: bcs0
[613.611302] Dynamic subtest bcs0: SUCCESS (0.660s)
[613.624289] Starting dynamic subtest: vcs0
[614.833020] Dynamic subtest vcs0: SUCCESS (1.218s)
[614.845788] Starting dynamic subtest: vcs1
[616.816865] Dynamic subtest vcs1: SUCCESS (1.982s)
[616.829975] Starting dynamic subtest: vecs0
[618.801429] Dynamic subtest vecs0: SUCCESS (1.981s)
[618.814971] Starting dynamic subtest: ccs0
[619.460130] Dynamic subtest ccs0: SUCCESS (0.658s)
[619.462916] Subtest render-node-busy-idle: SUCCESS (7.179s)
[619.553483] [131/133] (404s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[619.611715] Starting subtest: y-tiled-ccs-to-y-tiled
[619.616314] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[619.812245] [132/133] (404s left) kms_lease (lease-unleased-crtc)
[619.912676] Starting subtest: lease-unleased-crtc
[619.914844] Starting dynamic subtest: pipe-A-eDP-1
[620.203541] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[620.214027] Starting dynamic subtest: pipe-B-eDP-1
[620.978405] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.774s)
[620.990868] Starting dynamic subtest: pipe-C-eDP-1
[620.992894] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.004s)
[621.001850] Starting dynamic subtest: pipe-D-eDP-1
[621.003777] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s)
[621.005635] Subtest lease-unleased-crtc: SUCCESS (1.078s)
[621.363717] [133/133] (403s left) syncobj_wait (wait-all-interrupted)
[621.423154] Starting subtest: wait-all-interrupted
[621.524173] Subtest wait-all-interrupted: SUCCESS (0.101s)
[621.598976] Closing watchdogs
results: parsing output: 0/ for test: kms_ccs
results: parsing output: 1/ for test: gem_ctx_persistence
results: parsing output: 2/ for test: prime_mmap_kms
results: parsing output: 3/ for test: kms_pm_rpm
results: parsing output: 4/ for test: kms_cursor_legacy
results: parsing output: 5/ for test: gem_workarounds
results: parsing output: 6/ for test: kms_chamelium_edid
results: parsing output: 7/ for test: syncobj_timeline
results: parsing output: 8/ for test: kms_vblank
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: gem_exec_balancer
results: parsing output: 11/ for test: gem_exec_async
results: parsing output: 12/ for test: gem_render_copy
results: parsing output: 13/ for test: kms_cursor_crc
results: parsing output: 14/ for test: kms_cursor_legacy
results: parsing output: 15/ for test: kms_content_protection
results: parsing output: 16/ for test: kms_prop_blob
results: parsing output: 17/ for test: gem_mmap_wc
results: parsing output: 18/ for test: gem_exec_fence
results: parsing output: 19/ for test: perf
results: parsing output: 20/ for test: gem_exec_params
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: gem_userptr_blits
results: parsing output: 24/ for test: kms_plane_alpha_blend
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: i915_drm_fdinfo
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_softpin
results: parsing output: 30/ for test: gem_mmap_gtt
results: parsing output: 31/ for test: gem_exec_params
results: parsing output: 32/ for test: kms_ccs
results: parsing output: 33/ for test: gem_reg_read
results: parsing output: 34/ for test: kms_3d
results: parsing output: 35/ for test: gem_mmap_gtt
results: parsing output: 36/ for test: prime_mmap
results: parsing output: 37/ for test: gem_create
results: parsing output: 38/ for test: syncobj_timeline
results: parsing output: 39/ for test: kms_flip
results: parsing output: 40/ for test: kms_color
results: parsing output: 41/ for test: kms_big_fb
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_plane
results: parsing output: 44/ for test: kms_flip
results: parsing output: 45/ for test: kms_hdr
results: parsing output: 46/ for test: kms_big_fb
results: parsing output: 47/ for test: core_debugfs
results: parsing output: 48/ for test: drm_read
results: parsing output: 49/ for test: kms_joiner
results: parsing output: 50/ for test: kms_big_fb
results: parsing output: 51/ for test: kms_psr2_sf
results: parsing output: 52/ for test: gem_sync
results: parsing output: 53/ for test: kms_flip
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: gem_mmap_gtt
results: parsing output: 57/ for test: kms_psr
results: parsing output: 58/ for test: gem_softpin
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_cursor_legacy
results: parsing output: 61/ for test: prime_busy
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_cursor_crc
results: parsing output: 64/ for test: gem_ctx_param
results: parsing output: 65/ for test: kms_flip_scaled_crc
results: parsing output: 66/ for test: gem_exec_params
results: parsing output: 67/ for test: prime_mmap_coherency
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_cursor_edge_walk
results: parsing output: 70/ for test: tools_test
results: parsing output: 71/ for test: gem_exec_schedule
results: parsing output: 72/ for test: gem_ctx_exec
results: parsing output: 73/ for test: syncobj_wait
results: parsing output: 74/ for test: kms_cursor_legacy
results: parsing output: 75/ for test: gem_exec_balancer
results: parsing output: 76/ for test: kms_plane_cursor
results: parsing output: 77/ for test: gem_exec_schedule
results: parsing output: 78/ for test: kms_chamelium_hpd
results: parsing output: 79/ for test: kms_busy
results: parsing output: 80/ for test: kms_cursor_legacy
results: parsing output: 81/ for test: gem_ctx_param
results: parsing output: 82/ for test: kms_dsc
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_pm_rpm
results: parsing output: 85/ for test: gem_exec_whisper
results: parsing output: 86/ for test: kms_addfb_basic
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_selftest
results: parsing output: 90/ for test: gem_pxp
results: parsing output: 91/ for test: fbdev
results: parsing output: 92/ for test: kms_plane
results: parsing output: 93/ for test: i915_query
results: parsing output: 94/ for test: kms_pipe_b_c_ivb
results: parsing output: 95/ for test: i915_pm_rc6_residency
results: parsing output: 96/ for test: gem_pipe_control_store_loop
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_plane_scaling
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: gem_exec_nop
results: parsing output: 102/ for test: gen9_exec_parse
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: kms_psr2_sf
results: parsing output: 105/ for test: sysfs_timeslice_duration
results: parsing output: 106/ for test: i915_module_load
results: parsing output: 107/ for test: syncobj_wait
results: parsing output: 108/ for test: kms_psr
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_ccs
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_psr
results: parsing output: 113/ for test: gem_pread
results: parsing output: 114/ for test: syncobj_timeline
results: parsing output: 115/ for test: kms_dirtyfb
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: api_intel_allocator
results: parsing output: 118/ for test: kms_psr
results: parsing output: 119/ for test: kms_addfb_basic
results: parsing output: 120/ for test: gem_reg_read
results: parsing output: 121/ for test: gem_gpgpu_fill
results: parsing output: 122/ for test: kms_flip_scaled_crc
results: parsing output: 123/ for test: gem_ctx_exec
results: parsing output: 124/ for test: drm_mm
results: parsing output: 125/ for test: gem_exec_params
results: parsing output: 126/ for test: kms_ccs
results: parsing output: 127/ for test: syncobj_timeline
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: perf_pmu
results: parsing output: 130/ for test: gem_render_copy
results: parsing output: 131/ for test: kms_lease
results: parsing output: 132/ for test: syncobj_wait
Done.