[47.184566] Initializing watchdogs
[47.184629]   /dev/watchdog0
[47.202104] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:9a49 Intel Tigerlake (Gen12) TigerLake-LP GT2 [Iris Xe Graphics]
[47.208819] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[47.211467] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[47.213437] [001/155] (960s left) syncobj_timeline (single-wait-all-available-submitted)
[47.254162] Starting subtest: single-wait-all-available-submitted
[47.254936] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[47.329733] [002/155] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[47.429605] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[47.431130] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[47.516763] [003/155] (960s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-spr-indfb-fullscreen)
[47.611571] Starting subtest: psrhdr-1p-primscrn-spr-indfb-fullscreen
[47.613005] Subtest psrhdr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[47.708185] [004/155] (960s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[47.804412] Starting subtest: psrhdr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[47.805839] Subtest psrhdr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[47.913840] [005/155] (959s left) gem_pxp (create-protected-buffer)
[48.020426] Starting subtest: create-protected-buffer
[48.021391] Subtest create-protected-buffer: SUCCESS (0.000s)
[48.122858] [006/155] (959s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[48.218315] Starting subtest: fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[48.219760] Subtest fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[48.316870] [007/155] (959s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-shrfb-draw-pwrite)
[48.412288] Starting subtest: fbchdr-1p-primscrn-pri-shrfb-draw-pwrite
[48.413722] Subtest fbchdr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[48.516245] [008/155] (959s left) kms_frontbuffer_tracking (fbc-rgb565-draw-render)
[48.610235] Starting subtest: fbc-rgb565-draw-render
[49.922127] Subtest fbc-rgb565-draw-render: SUCCESS (1.281s)
[50.060952] [009/155] (957s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-indfb-draw-blt)
[50.157529] Starting subtest: fbchdr-2p-scndscrn-pri-indfb-draw-blt
[50.158980] Subtest fbchdr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[50.234512] [010/155] (957s left) kms_prop_blob (basic)
[50.268813] Starting subtest: basic
[50.269563] Subtest basic: SUCCESS (0.000s)
[50.321349] [011/155] (957s left) kms_chamelium_color (ctm-blue-to-red)
[50.413524] Subtest ctm-blue-to-red: SKIP (0.000s)
[50.471869] [012/155] (957s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[50.561492] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[50.562209] Starting dynamic subtest: pipe-A-HDMI-A-1
[50.568984] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[50.575563] Starting dynamic subtest: pipe-B-HDMI-A-1
[50.582316] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[50.588523] Starting dynamic subtest: pipe-C-HDMI-A-1
[50.595270] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[50.602074] Starting dynamic subtest: pipe-D-HDMI-A-1
[50.608978] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[50.610357] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SKIP (0.004s)
[50.812136] [013/155] (957s left) kms_plane (pixel-format-4-tiled-modifier-source-clamping)
[50.905828] Starting subtest: pixel-format-4-tiled-modifier-source-clamping
[50.907240] Subtest pixel-format-4-tiled-modifier-source-clamping: SKIP (0.000s)
[50.977214] [014/155] (957s left) gem_exec_whisper (basic-queues-priority-all)
[51.022552] Starting subtest: basic-queues-priority-all
[54.113452] Subtest basic-queues-priority-all: SUCCESS (3.044s)
[54.293336] [015/155] (953s left) i915_pm_freq_api (freq-basic-api)
[54.330528] Subtest freq-basic-api: SKIP (0.000s)
[54.370662] [016/155] (953s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-indfb-pgflip-blt)
[54.465356] Starting subtest: fbchdr-2p-primscrn-indfb-pgflip-blt
[54.466858] Subtest fbchdr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[54.552448] [017/155] (953s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[54.640842] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[54.642332] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.000s)
[54.693573] [018/155] (953s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[54.787187] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[54.788561] Subtest fbcpsr-rgb565-draw-mmap-wc: SKIP (0.000s)
[54.882625] [019/155] (953s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[54.973188] Subtest pr-cursor-plane-update-sf: SKIP (0.000s)
[55.008789] [020/155] (953s left) vgem_basic (setversion)
[55.083350] Starting subtest: setversion
[55.084942] Subtest setversion: SUCCESS (0.000s)
[55.137018] [FACT vgem_basic (setversion)] new: kernel.kmod_is_loaded.vgem: true
[55.138730] [021/155] (953s left) kms_flip (plain-flip-ts-check)
[55.226603] Starting subtest: plain-flip-ts-check
[55.228810] Starting dynamic subtest: A-HDMI-A1
[73.926073] Dynamic subtest A-HDMI-A1: SUCCESS (18.606s)
[73.933438] Starting dynamic subtest: B-HDMI-A1
[81.757627] Dynamic subtest B-HDMI-A1: SUCCESS (7.814s)
[81.764592] Starting dynamic subtest: C-HDMI-A1
[89.560887] Dynamic subtest C-HDMI-A1: SUCCESS (7.820s)
[89.572807] Starting dynamic subtest: D-HDMI-A1
[97.419631] Dynamic subtest D-HDMI-A1: SUCCESS (7.826s)
[97.420607] Subtest plain-flip-ts-check: SUCCESS (42.079s)
[97.584497] [022/155] (910s left) perf_pmu (gt-awake)
[97.624395] Starting subtest: gt-awake
[100.654502] Subtest gt-awake: SUCCESS (3.020s)
[100.747430] [023/155] (907s left) kms_fbcon_fbt (fbc)
[100.783421] Starting subtest: fbc
[104.195706] Subtest fbc: SUCCESS (3.406s)
[104.256094] [024/155] (904s left) dumb_buffer (map-uaf)
[104.289471] Starting subtest: map-uaf
[104.295364] Subtest map-uaf: SUCCESS (0.006s)
[104.380733] [025/155] (904s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[104.482316] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[104.483723] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[104.578576] [026/155] (904s left) gem_exec_reloc (basic-write-gtt)
[104.617532] Starting subtest: basic-write-gtt
[104.622432] Subtest basic-write-gtt: SUCCESS (0.006s)
[104.735478] [027/155] (903s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[104.832031] Starting subtest: 4-tiled-8bpp-rotate-270
[104.833465] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.000s)
[104.937224] [028/155] (903s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[105.029199] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[105.030586] Subtest psr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[105.128944] [029/155] (903s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[105.166709] Starting subtest: basic-cpu-gtt-noreloc
[105.169800] Subtest basic-cpu-gtt-noreloc: SUCCESS (0.003s)
[105.285533] [030/155] (903s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-sf)
[105.373993] Subtest fbc-pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[105.414175] [031/155] (903s left) kms_frontbuffer_tracking (pipe-fbc-rte)
[105.506319] Starting subtest: pipe-fbc-rte
[105.510367] Subtest pipe-fbc-rte: SKIP (0.000s)
[105.617452] [032/155] (903s left) i915_selftest (live)
[106.513709] Starting subtest: live
[106.514588] Starting dynamic subtest: sanitycheck
[107.704768] Dynamic subtest sanitycheck: SUCCESS (1.191s)
[107.711349] Starting dynamic subtest: uncore
[108.894695] Dynamic subtest uncore: SUCCESS (1.189s)
[108.903690] Starting dynamic subtest: workarounds
[110.414569] Dynamic subtest workarounds: SUCCESS (1.519s)
[110.421427] Starting dynamic subtest: gt_engines
[112.197556] Dynamic subtest gt_engines: SUCCESS (1.782s)
[112.204187] Starting dynamic subtest: gt_timelines
[120.809503] Dynamic subtest gt_timelines: SUCCESS (8.609s)
[120.819277] Starting dynamic subtest: gt_contexts
[122.113651] Dynamic subtest gt_contexts: SUCCESS (1.303s)
[122.120363] Starting dynamic subtest: gt_lrc
[126.327412] Dynamic subtest gt_lrc: SUCCESS (4.212s)
[126.334400] Starting dynamic subtest: gt_mocs
[127.684542] Dynamic subtest gt_mocs: SUCCESS (1.356s)
[127.691504] Starting dynamic subtest: gt_pm
[149.019713] Dynamic subtest gt_pm: SUCCESS (21.333s)
[149.026977] Starting dynamic subtest: gt_heartbeat
[150.240588] Dynamic subtest gt_heartbeat: SUCCESS (1.220s)
[150.250266] Starting dynamic subtest: gt_tlb
[153.701623] Dynamic subtest gt_tlb: SUCCESS (3.461s)
[153.709147] Starting dynamic subtest: requests
[162.275363] Dynamic subtest requests: SUCCESS (8.574s)
[162.283927] Starting dynamic subtest: migrate
[166.554609] Dynamic subtest migrate: SUCCESS (4.278s)
[166.561336] Starting dynamic subtest: active
[167.788618] Dynamic subtest active: SUCCESS (1.233s)
[167.798287] Starting dynamic subtest: objects
[169.487464] Dynamic subtest objects: SUCCESS (1.698s)
[169.493571] Starting dynamic subtest: mman
[174.157534] Dynamic subtest mman: SUCCESS (4.669s)
[174.164492] Starting dynamic subtest: dmabuf
[175.403634] Dynamic subtest dmabuf: SUCCESS (1.245s)
[175.409928] Starting dynamic subtest: vma
[176.616476] Dynamic subtest vma: SUCCESS (1.212s)
[176.623416] Starting dynamic subtest: coherency
[179.419612] Dynamic subtest coherency: SUCCESS (2.802s)
[179.426397] Starting dynamic subtest: gtt
[187.771593] Dynamic subtest gtt: SUCCESS (8.351s)
[187.781335] Starting dynamic subtest: gem
[189.921526] Dynamic subtest gem: SUCCESS (2.149s)
[189.932417] Starting dynamic subtest: evict
[192.192348] Dynamic subtest evict: SUCCESS (2.269s)
[192.199222] Starting dynamic subtest: hugepages
[199.926435] Dynamic subtest hugepages: SUCCESS (7.732s)
[199.932888] Starting dynamic subtest: gem_contexts
[215.444609] Dynamic subtest gem_contexts: SUCCESS (15.515s)
[215.451333] Starting dynamic subtest: client
[216.733642] Dynamic subtest client: SUCCESS (1.288s)
[216.740938] Starting dynamic subtest: gem_migrate
[217.921690] Dynamic subtest gem_migrate: SUCCESS (1.187s)
[217.929344] Starting dynamic subtest: reset
[222.842545] Dynamic subtest reset: SUCCESS (4.919s)
[222.848986] Starting dynamic subtest: memory_region
[224.005607] Dynamic subtest memory_region: SUCCESS (1.162s)
[224.012406] Starting dynamic subtest: hangcheck
[253.911490] Dynamic subtest hangcheck: SUCCESS (29.902s)
[253.917987] Starting dynamic subtest: execlists
[267.608696] Dynamic subtest execlists: SUCCESS (13.694s)
[267.615996] Starting dynamic subtest: ring_submission
[268.803322] Dynamic subtest ring_submission: SUCCESS (1.193s)
[268.810082] Starting dynamic subtest: perf
[270.097706] Dynamic subtest perf: SUCCESS (1.293s)
[270.107591] Starting dynamic subtest: slpc
[271.295660] Dynamic subtest slpc: SUCCESS (1.196s)
[271.303025] Starting dynamic subtest: guc
[272.501477] Dynamic subtest guc: SUCCESS (1.204s)
[272.508830] Starting dynamic subtest: guc_multi_lrc
[273.696474] Dynamic subtest guc_multi_lrc: SUCCESS (1.194s)
[273.703255] Starting dynamic subtest: guc_hang
[274.907907] Dynamic subtest guc_hang: SUCCESS (1.210s)
[274.914824] Starting dynamic subtest: late_gt_pm
[276.180615] Dynamic subtest late_gt_pm: SUCCESS (1.272s)
[276.181563] Subtest live: SUCCESS (169.657s)
[276.202983] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[276.203768] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[276.206951] [033/155] (732s left) gem_media_vme
[277.310168] [FACT gem_media_vme] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[277.311594] [FACT gem_media_vme] new: kernel.kmod_is_loaded.i915: true
[277.314382] [034/155] (731s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[277.414072] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[278.007753] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (0.594s)
[278.112489] [035/155] (730s left) gem_ccs (block-multicopy-compressed)
[278.157612] Starting subtest: block-multicopy-compressed
[278.159049] Subtest block-multicopy-compressed: SKIP (0.000s)
[278.235487] [036/155] (730s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-blt)
[278.333929] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-blt
[278.335351] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[278.485077] [037/155] (730s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[278.581382] Starting subtest: fbc-rgb101010-draw-render
[278.932597] Subtest fbc-rgb101010-draw-render: SUCCESS (0.352s)
[279.078711] [038/155] (730s left) kms_vblank (wait-forked-hang)
[279.168008] Starting subtest: wait-forked-hang
[279.168705] Starting dynamic subtest: pipe-A-HDMI-A-1
[292.503704] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (13.336s)
[292.516120] Starting dynamic subtest: pipe-D-HDMI-A-1
[306.824472] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (14.318s)
[306.826263] Subtest wait-forked-hang: SUCCESS (27.660s)
[306.983659] [039/155] (702s left) sw_sync (sync_merge_same)
[307.017078] Starting subtest: sync_merge_same
[307.017789] Subtest sync_merge_same: SUCCESS (0.000s)
[307.090419] [040/155] (702s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[307.186577] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[307.187945] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[307.281952] [041/155] (702s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[307.371656] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[307.373815] Starting dynamic subtest: pipe-A-HDMI-A-1
[307.380921] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[307.391403] Starting dynamic subtest: pipe-B-HDMI-A-1
[307.399097] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[307.409119] Starting dynamic subtest: pipe-C-HDMI-A-1
[307.416107] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[307.425526] Starting dynamic subtest: pipe-D-HDMI-A-1
[307.432352] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s)
[307.433698] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.010s)
[307.636548] [042/155] (701s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[307.727348] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[307.728798] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[307.810985] [043/155] (701s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-render)
[307.903782] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-render
[307.905222] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[308.009333] [044/155] (701s left) kms_rotation_crc (cursor-rotation-180)
[308.097145] Starting subtest: cursor-rotation-180
[308.449621] Subtest cursor-rotation-180: SUCCESS (0.353s)
[308.652023] [045/155] (700s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[308.686334] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[308.793820] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[308.878930] [046/155] (700s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-indfb-draw-mmap-wc)
[308.972906] Starting subtest: psrhdr-1p-primscrn-pri-indfb-draw-mmap-wc
[308.974462] Subtest psrhdr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[309.069468] [047/155] (700s left) gem_mmap_wc (write-cpu-read-wc)
[309.105867] Starting subtest: write-cpu-read-wc
[309.183423] Subtest write-cpu-read-wc: SUCCESS (0.079s)
[309.267228] [048/155] (700s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[309.357393] Subtest psr2-plane-move-sf-dmg-area: SKIP (0.000s)
[309.404197] [049/155] (700s left) kms_pm_backlight (bad-brightness)
[309.494709] Subtest bad-brightness: SKIP (0.000s)
[309.537575] [050/155] (700s left) kms_color (ctm-red-to-blue)
[309.628088] Starting subtest: ctm-red-to-blue
[309.628772] Starting dynamic subtest: pipe-A-HDMI-A-1
[309.922116] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.293s)
[309.930454] Starting dynamic subtest: pipe-B-HDMI-A-1
[310.207955] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.286s)
[310.215582] Starting dynamic subtest: pipe-C-HDMI-A-1
[310.512385] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.303s)
[310.520031] Starting dynamic subtest: pipe-D-HDMI-A-1
[310.804352] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.291s)
[310.805102] Subtest ctm-red-to-blue: SUCCESS (1.178s)
[310.951401] [051/155] (698s left) gem_softpin (zero)
[310.988933] Starting subtest: zero
[310.991707] Subtest zero: SUCCESS (0.003s)
[311.115619] [052/155] (698s left) gem_exec_reloc (basic-write-wc-noreloc)
[311.154839] Starting subtest: basic-write-wc-noreloc
[311.156785] Subtest basic-write-wc-noreloc: SUCCESS (0.003s)
[311.289261] [053/155] (698s left) kms_getfb (getfb-addfb-different-handles)
[311.377042] Starting subtest: getfb-addfb-different-handles
[311.377792] Subtest getfb-addfb-different-handles: SUCCESS (0.000s)
[311.489282] [054/155] (698s left) gem_mmap_gtt (basic-small-bo)
[311.524712] Starting subtest: basic-small-bo
[311.934774] Subtest basic-small-bo: SUCCESS (0.411s)
[312.044425] [055/155] (697s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc)
[312.193620] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc
[313.249723] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (1.057s)
[313.369844] [056/155] (696s left) gem_ctx_persistence (process)
[313.410663] Starting subtest: process
[313.505307] Subtest process: SUCCESS (0.092s)
[313.579092] [057/155] (696s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[313.619430] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[313.620193] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[313.698020] [058/155] (696s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[313.798108] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[313.799566] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[313.889569] [059/155] (696s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[313.979443] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[313.980188] Starting dynamic subtest: pipe-A-HDMI-A-1
[314.041157] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.061s)
[314.107180] Starting dynamic subtest: pipe-B-HDMI-A-1
[314.266818] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.167s)
[314.307970] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (0.329s)
[314.427927] [060/155] (695s left) kms_lease (page-flip-implicit-plane)
[314.517181] Starting subtest: page-flip-implicit-plane
[314.517881] Starting dynamic subtest: pipe-A-HDMI-A-1
[314.699939] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.182s)
[314.709373] Starting dynamic subtest: pipe-B-HDMI-A-1
[314.882687] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.181s)
[314.891968] Starting dynamic subtest: pipe-C-HDMI-A-1
[315.078506] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.193s)
[315.087960] Starting dynamic subtest: pipe-D-HDMI-A-1
[315.262875] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.183s)
[315.263636] Subtest page-flip-implicit-plane: SUCCESS (0.747s)
[315.381760] [061/155] (694s left) gem_exec_schedule (semaphore-power)
[315.551506] Starting subtest: semaphore-power
[316.609255] Subtest semaphore-power: SUCCESS (1.049s)
[316.775635] [062/155] (693s left) kms_cursor_legacy (torture-bo)
[316.869274] Starting subtest: torture-bo
[316.870056] Starting dynamic subtest: pipe-A
[322.420802] Dynamic subtest pipe-A: SUCCESS (5.542s)
[322.433061] Starting dynamic subtest: pipe-B
[327.917815] Dynamic subtest pipe-B: SUCCESS (5.471s)
[327.927112] Starting dynamic subtest: pipe-C
[333.400322] Dynamic subtest pipe-C: SUCCESS (5.481s)
[333.413134] Starting dynamic subtest: pipe-D
[338.884298] Dynamic subtest pipe-D: SUCCESS (5.481s)
[338.895182] Starting dynamic subtest: all-pipes
[344.380351] Dynamic subtest all-pipes: SUCCESS (5.496s)
[344.381170] Subtest torture-bo: SUCCESS (27.478s)
[344.441822] [063/155] (665s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[344.549116] Starting subtest: yf-tiled-16bpp-rotate-270
[344.550503] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s)
[344.626996] [064/155] (665s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180)
[344.726961] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180
[345.326913] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (0.600s)
[345.448570] [065/155] (664s left) gem_exec_balancer (sliced)
[345.492367] Starting subtest: sliced
[346.957116] Subtest sliced: SUCCESS (1.456s)
[347.135718] [066/155] (663s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-indfb-plflip-blt)
[347.232502] Starting subtest: psrhdr-2p-primscrn-indfb-plflip-blt
[347.233924] Subtest psrhdr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[347.321394] [067/155] (663s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[347.421041] Starting subtest: y-tiled-32bpp-rotate-180
[348.610819] Subtest y-tiled-32bpp-rotate-180: SUCCESS (1.190s)
[348.731138] [068/155] (661s left) i915_drm_fdinfo (all-busy-idle-check-all)
[348.768192] Starting subtest: all-busy-idle-check-all
[349.387207] Subtest all-busy-idle-check-all: SUCCESS (0.619s)
[349.462426] [069/155] (660s left) kms_psr (pr-suspend)
[349.554722] Subtest pr-suspend: SKIP (0.000s)
[349.601646] [070/155] (660s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[349.696697] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[349.698155] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[349.798537] [071/155] (660s left) kms_frontbuffer_tracking (fbcpsrhdr-shrfb-scaledprimary)
[349.896390] Starting subtest: fbcpsrhdr-shrfb-scaledprimary
[349.897970] Subtest fbcpsrhdr-shrfb-scaledprimary: SKIP (0.000s)
[350.000341] [072/155] (660s left) kms_cursor_crc (cursor-sliding-32x32)
[350.093406] Starting subtest: cursor-sliding-32x32
[350.148632] Subtest cursor-sliding-32x32: SKIP (0.054s)
[350.258342] [073/155] (660s left) gem_exec_balancer (full)
[350.300875] Starting subtest: full
[351.879372] Subtest full: SUCCESS (1.579s)
[352.072275] [074/155] (658s left) kms_plane (pixel-format-y-tiled-ccs-modifier-source-clamping)
[352.165050] Starting subtest: pixel-format-y-tiled-ccs-modifier-source-clamping
[352.166442] Subtest pixel-format-y-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[352.233094] [075/155] (658s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[352.268366] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[352.269073] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[352.334053] [076/155] (658s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-indfb-draw-blt)
[352.427145] Starting subtest: fbcpsrhdr-2p-primscrn-pri-indfb-draw-blt
[352.428587] Subtest fbcpsrhdr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[352.543716] [077/155] (658s left) gem_exec_flush (basic-wb-set-default)
[352.587199] Starting subtest: basic-wb-set-default
[358.016859] Subtest basic-wb-set-default: SUCCESS (5.430s)
[358.219737] [078/155] (652s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-render)
[358.316812] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-render
[358.318288] Subtest hdr-1p-offscreen-pri-shrfb-draw-render: SKIP (0.000s)
[358.427148] [079/155] (652s left) gem_madvise (dontneed-after-mmap)
[358.460447] Starting subtest: dontneed-after-mmap
[358.465561] Subtest dontneed-after-mmap: SUCCESS (0.006s)
[358.556132] [080/155] (652s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[358.590141] Starting subtest: invalid-multi-wait-all-unsubmitted
[358.590917] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[358.657217] [081/155] (652s left) gem_exec_schedule (preemptive-hang)
[358.820285] Starting subtest: preemptive-hang
[358.821906] Starting dynamic subtest: rcs0
[365.011857] Dynamic subtest rcs0: SUCCESS (6.166s)
[365.020425] Starting dynamic subtest: bcs0
[371.037365] Dynamic subtest bcs0: SUCCESS (6.021s)
[371.045458] Starting dynamic subtest: vcs0
[377.043946] Dynamic subtest vcs0: SUCCESS (6.006s)
[377.052384] Starting dynamic subtest: vcs1
[383.068704] Dynamic subtest vcs1: SUCCESS (6.020s)
[383.077128] Starting dynamic subtest: vecs0
[389.014446] Dynamic subtest vecs0: SUCCESS (5.942s)
[389.015393] Subtest preemptive-hang: SUCCESS (30.167s)
[389.173809] [082/155] (621s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[389.275787] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc
[389.277252] Subtest fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[389.372566] [083/155] (621s left) kms_flip (2x-flip-vs-rmfb)
[389.463282] Starting subtest: 2x-flip-vs-rmfb
[389.471849] Subtest 2x-flip-vs-rmfb: SKIP (0.009s)
[389.550387] [084/155] (621s left) gem_unref_active_buffers
[389.741745] [085/155] (621s left) api_intel_allocator (execbuf-with-allocator)
[389.774879] Starting subtest: execbuf-with-allocator
[389.778159] Subtest execbuf-with-allocator: SUCCESS (0.004s)
[389.882217] [086/155] (621s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[389.975306] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[389.984935] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.009s)
[390.059992] [087/155] (621s left) gem_mmap_gtt (pf-nonblock)
[390.092869] Starting subtest: pf-nonblock
[390.095060] Subtest pf-nonblock: SUCCESS (0.003s)
[390.197271] [088/155] (621s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-wc)
[390.290784] Starting subtest: fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-wc
[390.292267] Subtest fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[390.390052] [089/155] (620s left) syncobj_wait (single-wait-all-submitted)
[390.424712] Starting subtest: single-wait-all-submitted
[390.528681] Subtest single-wait-all-submitted: SUCCESS (0.104s)
[390.608110] [090/155] (620s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[390.642357] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[390.682863] [091/155] (620s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-move)
[390.776655] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-move
[390.778060] Subtest psrhdr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[390.874403] [092/155] (620s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[390.964866] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s)
[391.008873] [093/155] (620s left) kms_rotation_crc (primary-rotation-270)
[391.099146] Starting subtest: primary-rotation-270
[395.897149] Subtest primary-rotation-270: SUCCESS (4.798s)
[396.116173] [094/155] (615s left) gem_pxp (protected-raw-src-copy-not-readible)
[396.154696] Starting subtest: protected-raw-src-copy-not-readible
[396.195733] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.041s)
[396.300581] [095/155] (615s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-draw-blt)
[396.394044] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-draw-blt
[396.395398] Subtest fbchdr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[396.492123] [096/155] (615s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-pwrite)
[396.583523] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-pwrite
[396.584914] Subtest psr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[396.685304] [097/155] (614s left) gem_flink_basic (basic)
[396.720668] Starting subtest: basic
[396.721836] Subtest basic: SUCCESS (0.000s)
[396.842150] [098/155] (614s left) kms_pipe_stress (stress-xrgb8888-ytiled)
[396.941971] Starting subtest: stress-xrgb8888-ytiled
[404.079888] Subtest stress-xrgb8888-ytiled: SUCCESS (7.142s)
[404.235159] [099/155] (607s left) kms_chamelium_frames (hdmi-frame-dump)
[404.376390] Subtest hdmi-frame-dump: SKIP (0.000s)
[404.474352] [100/155] (607s left) kms_atomic_transition (modeset-transition)
[404.564023] Starting subtest: modeset-transition
[404.564748] Starting dynamic subtest: 1x-outputs
[405.828721] Dynamic subtest 1x-outputs: SUCCESS (1.265s)
[405.832767] Subtest modeset-transition: SUCCESS (1.267s)
[405.985405] [101/155] (605s left) kms_cursor_crc (cursor-onscreen-512x512)
[406.081502] Starting subtest: cursor-onscreen-512x512
[406.091313] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[406.179870] [102/155] (605s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[406.272564] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[407.543759] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (1.271s)
[407.664871] [103/155] (604s left) gem_userptr_blits (set-cache-level)
[407.703898] Starting subtest: set-cache-level
[407.704620] Subtest set-cache-level: SUCCESS (0.000s)
[407.833969] [104/155] (604s left) kms_getfb (getfb2-handle-not-fb)
[407.926068] Starting subtest: getfb2-handle-not-fb
[407.926801] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[408.033098] [105/155] (603s left) kms_async_flips (alternate-sync-async-flip-atomic)
[408.123085] Starting subtest: alternate-sync-async-flip-atomic
[408.234427] Starting dynamic subtest: pipe-A-HDMI-A-1
[410.352891] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.109s)
[410.479350] Starting dynamic subtest: pipe-B-HDMI-A-1
[412.563283] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.083s)
[412.683719] Starting dynamic subtest: pipe-C-HDMI-A-1
[414.768724] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.084s)
[414.893398] Starting dynamic subtest: pipe-D-HDMI-A-1
[416.986517] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (2.094s)
[416.987589] Subtest alternate-sync-async-flip-atomic: SUCCESS (8.856s)
[417.236793] [106/155] (594s left) syncobj_timeline (invalid-wait-bad-flags)
[417.272607] Starting subtest: invalid-wait-bad-flags
[417.273322] Subtest invalid-wait-bad-flags: SUCCESS (0.000s)
[417.340408] [107/155] (594s left) kms_scaling_modes (scaling-mode-full)
[417.430943] Starting subtest: scaling-mode-full
[417.435034] Subtest scaling-mode-full: SKIP (0.001s)
[417.509031] [108/155] (594s left) gen9_exec_parse (basic-rejected)
[417.546911] Subtest basic-rejected: SKIP (0.000s)
[417.589015] [109/155] (594s left) syncobj_wait (wait-delayed-signal)
[417.623959] Starting subtest: wait-delayed-signal
[417.725943] Subtest wait-delayed-signal: SUCCESS (0.102s)
[417.814831] [110/155] (594s left) gem_create (create-massive)
[417.848931] Starting subtest: create-massive
[417.849654] Subtest create-massive: SUCCESS (0.000s)
[418.040163] [111/155] (594s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[418.133441] Starting subtest: hdr-2p-scndscrn-pri-indfb-draw-mmap-wc
[418.134822] Subtest hdr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[418.247976] [112/155] (594s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[418.339219] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[418.339960] Starting dynamic subtest: pipe-A-HDMI-A-1
[418.357860] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.002s)
[418.366218] Starting dynamic subtest: pipe-B-HDMI-A-1
[418.383611] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.002s)
[418.392089] Starting dynamic subtest: pipe-C-HDMI-A-1
[418.408703] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.002s)
[418.416925] Starting dynamic subtest: pipe-D-HDMI-A-1
[418.434595] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.002s)
[418.435962] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.015s)
[418.600967] [113/155] (593s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[418.694351] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-cpu
[418.695882] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[418.798148] [114/155] (593s left) gem_caching (writes)
[418.835297] Starting subtest: writes
[428.157350] Subtest writes: SUCCESS (9.321s)
[428.266894] [115/155] (584s left) kms_invalid_mode (overflow-vrefresh)
[428.361733] Starting subtest: overflow-vrefresh
[428.363650] Starting dynamic subtest: pipe-A-HDMI-A-1
[428.417048] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.054s)
[428.427088] Starting dynamic subtest: pipe-B-HDMI-A-1
[428.427800] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[428.436095] Starting dynamic subtest: pipe-C-HDMI-A-1
[428.436796] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.001s)
[428.444827] Starting dynamic subtest: pipe-D-HDMI-A-1
[428.445525] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.001s)
[428.446218] Subtest overflow-vrefresh: SUCCESS (0.063s)
[428.570665] [116/155] (583s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-draw-mmap-wc)
[428.662445] Starting subtest: hdr-2p-primscrn-cur-indfb-draw-mmap-wc
[428.663849] Subtest hdr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[428.752819] [117/155] (583s left) perf (polling-small-buf)
[428.847197] Starting subtest: polling-small-buf
[428.939722] Subtest polling-small-buf: SUCCESS (0.093s)
[428.985578] [118/155] (583s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[429.077365] Starting subtest: hdr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[429.078727] Subtest hdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[429.169511] [119/155] (583s left) i915_pm_rpm (reg-read-ioctl)
[440.626102] Starting subtest: reg-read-ioctl
[443.073982] Subtest reg-read-ioctl: SUCCESS (2.449s)
[443.267086] [120/155] (569s left) api_intel_bb (intel-bb-blit-x)
[443.303185] Starting subtest: intel-bb-blit-x
[446.633533] Subtest intel-bb-blit-x: SUCCESS (3.296s)
[446.698854] [121/155] (565s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[446.794937] Starting subtest: cursor-rapid-movement-128x42
[446.799136] Starting dynamic subtest: pipe-A-HDMI-A-1
[447.038170] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.239s)
[447.072882] Starting dynamic subtest: pipe-D-HDMI-A-1
[447.293040] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.228s)
[447.293821] Subtest cursor-rapid-movement-128x42: SUCCESS (0.499s)
[447.467719] [122/155] (565s left) kms_flip (flip-vs-modeset-vs-hang)
[447.557680] Starting subtest: flip-vs-modeset-vs-hang
[447.559510] Starting dynamic subtest: A-HDMI-A1
[475.774806] Dynamic subtest A-HDMI-A1: SUCCESS (28.181s)
[475.785880] Starting dynamic subtest: D-HDMI-A1
[503.423450] Dynamic subtest D-HDMI-A1: SUCCESS (27.644s)
[503.424218] Subtest flip-vs-modeset-vs-hang: SUCCESS (55.831s)
[503.518172] [123/155] (509s left) syncobj_wait (multi-wait-for-submit-unsubmitted)
[503.554040] Starting subtest: multi-wait-for-submit-unsubmitted
[503.656653] Subtest multi-wait-for-submit-unsubmitted: SUCCESS (0.102s)
[503.748848] [124/155] (509s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted)
[503.782843] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted
[503.890679] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.106s)
[503.965068] [125/155] (508s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[504.004735] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[504.005437] Starting dynamic subtest: smem
[504.087368] Dynamic subtest smem: SUCCESS (0.082s)
[504.088118] Subtest y-tiled-ccs-to-yf-tiled-ccs: SUCCESS (0.083s)
[504.265133] [126/155] (508s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[504.361182] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-wc
[504.362661] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[504.453980] [127/155] (508s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite)
[504.551396] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite
[504.552784] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[504.638848] [128/155] (508s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[504.727086] Starting subtest: 2x-long-flip-vs-cursor-atomic
[504.728930] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.002s)
[504.788279] [129/155] (508s left) perf_pmu (busy)
[504.827208] Starting subtest: busy
[504.827944] Starting dynamic subtest: rcs0
[505.376055] Dynamic subtest rcs0: SUCCESS (0.549s)
[505.389329] Starting dynamic subtest: bcs0
[505.916398] Dynamic subtest bcs0: SUCCESS (0.538s)
[505.929877] Starting dynamic subtest: vcs0
[506.452417] Dynamic subtest vcs0: SUCCESS (0.534s)
[506.465011] Starting dynamic subtest: vcs1
[506.993311] Dynamic subtest vcs1: SUCCESS (0.539s)
[507.006836] Starting dynamic subtest: vecs0
[507.525364] Dynamic subtest vecs0: SUCCESS (0.530s)
[507.528318] Subtest busy: SUCCESS (2.700s)
[507.594331] [130/155] (505s left) kms_plane (plane-position-covered)
[507.686057] Starting subtest: plane-position-covered
[507.885530] Starting dynamic subtest: pipe-A-plane-1
[508.117938] Dynamic subtest pipe-A-plane-1: SUCCESS (0.232s)
[508.126805] Starting dynamic subtest: pipe-A-plane-2
[508.349535] Dynamic subtest pipe-A-plane-2: SUCCESS (0.231s)
[508.358629] Starting dynamic subtest: pipe-A-plane-3
[508.583346] Dynamic subtest pipe-A-plane-3: SUCCESS (0.232s)
[508.592202] Starting dynamic subtest: pipe-A-plane-4
[508.814843] Dynamic subtest pipe-A-plane-4: SUCCESS (0.231s)
[508.823787] Starting dynamic subtest: pipe-A-plane-5
[509.048904] Dynamic subtest pipe-A-plane-5: SUCCESS (0.233s)
[509.057794] Starting dynamic subtest: pipe-A-plane-6
[509.280482] Dynamic subtest pipe-A-plane-6: SUCCESS (0.231s)
[509.289399] Starting dynamic subtest: pipe-A-plane-7
[509.290756] Dynamic subtest pipe-A-plane-7: SUCCESS (0.002s)
[509.495236] Starting dynamic subtest: pipe-B-plane-1
[509.709721] Dynamic subtest pipe-B-plane-1: SUCCESS (0.226s)
[509.718589] Starting dynamic subtest: pipe-B-plane-2
[509.917540] Dynamic subtest pipe-B-plane-2: SUCCESS (0.207s)
[509.926564] Starting dynamic subtest: pipe-B-plane-3
[510.126740] Dynamic subtest pipe-B-plane-3: SUCCESS (0.208s)
[510.135962] Starting dynamic subtest: pipe-B-plane-4
[510.335692] Dynamic subtest pipe-B-plane-4: SUCCESS (0.208s)
[510.344949] Starting dynamic subtest: pipe-B-plane-5
[510.545341] Dynamic subtest pipe-B-plane-5: SUCCESS (0.209s)
[510.554314] Starting dynamic subtest: pipe-B-plane-6
[510.769712] Dynamic subtest pipe-B-plane-6: SUCCESS (0.224s)
[510.779885] Starting dynamic subtest: pipe-B-plane-7
[510.781258] Dynamic subtest pipe-B-plane-7: SUCCESS (0.002s)
[510.781940] Subtest plane-position-covered: SUCCESS (3.088s)
[510.935251] [131/155] (502s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[511.030478] Starting subtest: fbchdr-1p-offscreen-pri-shrfb-draw-mmap-wc
[511.031905] Subtest fbchdr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[511.124158] [132/155] (502s left) kms_content_protection (lic-type-1)
[511.216665] Starting subtest: lic-type-1
[511.222220] Subtest lic-type-1: SKIP (0.004s)
[511.328321] [133/155] (501s left) kms_feature_discovery (psr1)
[511.416543] Starting subtest: psr1
[511.417946] Subtest psr1: SKIP (0.000s)
[511.485884] [134/155] (501s left) kms_psr (psr2-sprite-mmap-gtt)
[511.575878] Subtest psr2-sprite-mmap-gtt: SKIP (0.000s)
[511.621208] [135/155] (501s left) kms_frontbuffer_tracking (fbchdr-tiling-y)
[511.714657] Starting subtest: fbchdr-tiling-y
[511.716065] Subtest fbchdr-tiling-y: SKIP (0.000s)
[511.819498] [136/155] (501s left) gem_userptr_blits (unsync-unmap-after-close)
[511.858361] Subtest unsync-unmap-after-close: SKIP (0.000s)
[511.978907] [137/155] (501s left) kms_chamelium_hpd (hdmi-hpd-storm)
[512.122061] Subtest hdmi-hpd-storm: SKIP (0.000s)
[512.219190] [138/155] (501s left) kms_psr (fbc-psr2-suspend)
[512.306680] Subtest fbc-psr2-suspend: SKIP (0.000s)
[512.350287] [139/155] (501s left) gem_exec_fence (syncobj-timeline-unused-fence)
[512.811246] Starting subtest: syncobj-timeline-unused-fence
[512.812320] Subtest syncobj-timeline-unused-fence: SUCCESS (0.004s)
[512.995303] [140/155] (500s left) perf (invalid-remove-userspace-config)
[513.075074] Starting subtest: invalid-remove-userspace-config
[513.085555] Subtest invalid-remove-userspace-config: SUCCESS (0.010s)
[513.127984] [141/155] (500s left) gem_exec_whisper (basic-contexts-forked)
[513.170693] Starting subtest: basic-contexts-forked
[515.904674] Subtest basic-contexts-forked: SUCCESS (2.724s)
[516.095796] [142/155] (497s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[516.200270] Starting subtest: hdr-2p-primscrn-pri-shrfb-draw-mmap-wc
[516.201638] Subtest hdr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[516.306242] [143/155] (497s left) kms_big_fb (linear-8bpp-rotate-270)
[516.406811] Starting subtest: linear-8bpp-rotate-270
[516.485400] Subtest linear-8bpp-rotate-270: SKIP (0.077s)
[516.616684] [144/155] (497s left) kms_flip (nonexisting-fb-interruptible)
[516.712380] Starting subtest: nonexisting-fb-interruptible
[516.715429] Starting dynamic subtest: A-HDMI-A1
[516.873931] Dynamic subtest A-HDMI-A1: SUCCESS (0.158s)
[516.887626] Starting dynamic subtest: B-HDMI-A1
[517.009628] Dynamic subtest B-HDMI-A1: SUCCESS (0.133s)
[517.021689] Starting dynamic subtest: C-HDMI-A1
[517.147825] Dynamic subtest C-HDMI-A1: SUCCESS (0.137s)
[517.161532] Starting dynamic subtest: D-HDMI-A1
[517.294243] Dynamic subtest D-HDMI-A1: SUCCESS (0.145s)
[517.297606] Subtest nonexisting-fb-interruptible: SUCCESS (0.585s)
[517.492224] [145/155] (496s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions-varying-size)
[517.586114] Starting subtest: cursorA-vs-flipA-atomic-transitions-varying-size
[528.453943] Subtest cursorA-vs-flipA-atomic-transitions-varying-size: SUCCESS (10.867s)
[528.606022] [146/155] (485s left) gem_exec_reloc (basic-wc-noreloc)
[528.653596] Starting subtest: basic-wc-noreloc
[528.655818] Subtest basic-wc-noreloc: SUCCESS (0.003s)
[528.779708] [147/155] (484s left) kms_vblank (query-busy)
[528.868263] Starting subtest: query-busy
[528.870157] Starting dynamic subtest: pipe-A-HDMI-A-1
[530.135676] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.266s)
[530.147618] Starting dynamic subtest: pipe-D-HDMI-A-1
[531.396012] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.256s)
[531.396756] Subtest query-busy: SUCCESS (2.528s)
[531.551919] [148/155] (482s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[531.644032] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[531.645839] Starting dynamic subtest: pipe-A-HDMI-A-1
[531.672424] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[531.681701] Starting dynamic subtest: pipe-B-HDMI-A-1
[531.688294] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[531.697311] Starting dynamic subtest: pipe-C-HDMI-A-1
[531.703853] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[531.712882] Starting dynamic subtest: pipe-D-HDMI-A-1
[531.720517] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[531.722394] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SKIP (0.007s)
[531.930358] [149/155] (481s left) kms_pm_dc (dc6-psr)
[543.071284] Starting subtest: dc6-psr
[543.072731] Subtest dc6-psr: SKIP (0.000s)
[543.147872] [150/155] (470s left) gem_eio (create-ext)
[543.192489] Starting subtest: create-ext
[543.234802] Subtest create-ext: SUCCESS (0.042s)
[543.352871] [151/155] (470s left) gem_ctx_persistence (engines-mixed-process)
[543.391055] Starting subtest: engines-mixed-process
[543.391815] Starting dynamic subtest: rcs0
[543.750624] Dynamic subtest rcs0: SUCCESS (0.359s)
[543.762197] Starting dynamic subtest: bcs0
[544.101586] Dynamic subtest bcs0: SUCCESS (0.350s)
[544.116460] Starting dynamic subtest: vcs0
[544.445195] Dynamic subtest vcs0: SUCCESS (0.342s)
[544.458727] Starting dynamic subtest: vcs1
[544.807668] Dynamic subtest vcs1: SUCCESS (0.361s)
[544.819773] Starting dynamic subtest: vecs0
[545.151488] Dynamic subtest vecs0: SUCCESS (0.342s)
[545.152521] Subtest engines-mixed-process: SUCCESS (1.761s)
[545.227930] [152/155] (468s left) gem_exec_fence (keep-in-fence)
[545.391305] Starting subtest: keep-in-fence
[545.392324] Starting dynamic subtest: rcs0
[545.420430] Dynamic subtest rcs0: SUCCESS (0.028s)
[545.441572] Starting dynamic subtest: bcs0
[545.457246] Dynamic subtest bcs0: SUCCESS (0.034s)
[545.471220] Starting dynamic subtest: vcs0
[545.483137] Dynamic subtest vcs0: SUCCESS (0.024s)
[545.495557] Starting dynamic subtest: vcs1
[545.507934] Dynamic subtest vcs1: SUCCESS (0.023s)
[545.519931] Starting dynamic subtest: vecs0
[545.534307] Dynamic subtest vecs0: SUCCESS (0.025s)
[545.535185] Subtest keep-in-fence: SUCCESS (0.144s)
[546.014108] [153/155] (468s left) prime_vgem (basic-fence-flip)
[546.054969] Starting subtest: basic-fence-flip
[546.339709] Subtest basic-fence-flip: SUCCESS (0.285s)
[546.465955] [154/155] (467s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu)
[546.561901] Starting subtest: fbc-rgb101010-draw-mmap-cpu
[546.940161] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (0.379s)
[547.044896] [155/155] (467s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[547.136362] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[547.138188] Starting dynamic subtest: pipe-A-valid-mode
[548.166893] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.030s)
[548.167599] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (1.031s)
[548.316431] Closing watchdogs
results: parsing output: 0/ for test: syncobj_timeline
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: gem_pxp
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: kms_prop_blob
results: parsing output: 10/ for test: kms_chamelium_color
results: parsing output: 11/ for test: kms_ccs
results: parsing output: 12/ for test: kms_plane
results: parsing output: 13/ for test: gem_exec_whisper
results: parsing output: 14/ for test: i915_pm_freq_api
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: kms_flip_scaled_crc
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_psr2_sf
results: parsing output: 19/ for test: vgem_basic
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: perf_pmu
results: parsing output: 22/ for test: kms_fbcon_fbt
results: parsing output: 23/ for test: dumb_buffer
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: gem_exec_reloc
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: gem_exec_reloc
results: parsing output: 29/ for test: kms_psr2_sf
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: i915_selftest
results: parsing output: 32/ for test: gem_media_vme
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: gem_ccs
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_vblank
results: parsing output: 38/ for test: sw_sync
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_ccs
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_rotation_crc
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: gem_mmap_wc
results: parsing output: 47/ for test: kms_psr2_sf
results: parsing output: 48/ for test: kms_pm_backlight
results: parsing output: 49/ for test: kms_color
results: parsing output: 50/ for test: gem_softpin
results: parsing output: 51/ for test: gem_exec_reloc
results: parsing output: 52/ for test: kms_getfb
results: parsing output: 53/ for test: gem_mmap_gtt
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_ctx_persistence
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_atomic_transition
results: parsing output: 59/ for test: kms_lease
results: parsing output: 60/ for test: gem_exec_schedule
results: parsing output: 61/ for test: kms_cursor_legacy
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: gem_exec_balancer
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: i915_drm_fdinfo
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: kms_cursor_crc
results: parsing output: 72/ for test: gem_exec_balancer
results: parsing output: 73/ for test: kms_plane
results: parsing output: 74/ for test: syncobj_wait
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: gem_exec_flush
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_madvise
results: parsing output: 79/ for test: syncobj_wait
results: parsing output: 80/ for test: gem_exec_schedule
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_flip
results: parsing output: 83/ for test: gem_unref_active_buffers
results: parsing output: 84/ for test: api_intel_allocator
results: parsing output: 85/ for test: kms_flip
results: parsing output: 86/ for test: gem_mmap_gtt
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: syncobj_wait
results: parsing output: 89/ for test: kms_pipe_b_c_ivb
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_psr
results: parsing output: 92/ for test: kms_rotation_crc
results: parsing output: 93/ for test: gem_pxp
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: gem_flink_basic
results: parsing output: 97/ for test: kms_pipe_stress
results: parsing output: 98/ for test: kms_chamelium_frames
results: parsing output: 99/ for test: kms_atomic_transition
results: parsing output: 100/ for test: kms_cursor_crc
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: gem_userptr_blits
results: parsing output: 103/ for test: kms_getfb
results: parsing output: 104/ for test: kms_async_flips
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_scaling_modes
results: parsing output: 107/ for test: gen9_exec_parse
results: parsing output: 108/ for test: syncobj_wait
results: parsing output: 109/ for test: gem_create
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_ccs
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_caching
results: parsing output: 114/ for test: kms_invalid_mode
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: perf
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: i915_pm_rpm
results: parsing output: 119/ for test: api_intel_bb
results: parsing output: 120/ for test: kms_cursor_crc
results: parsing output: 121/ for test: kms_flip
results: parsing output: 122/ for test: syncobj_wait
results: parsing output: 123/ for test: syncobj_timeline
results: parsing output: 124/ for test: gem_render_copy
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_cursor_legacy
results: parsing output: 128/ for test: perf_pmu
results: parsing output: 129/ for test: kms_plane
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: kms_content_protection
results: parsing output: 132/ for test: kms_feature_discovery
results: parsing output: 133/ for test: kms_psr
results: parsing output: 134/ for test: kms_frontbuffer_tracking
results: parsing output: 135/ for test: gem_userptr_blits
results: parsing output: 136/ for test: kms_chamelium_hpd
results: parsing output: 137/ for test: kms_psr
results: parsing output: 138/ for test: gem_exec_fence
results: parsing output: 139/ for test: perf
results: parsing output: 140/ for test: gem_exec_whisper
results: parsing output: 141/ for test: kms_frontbuffer_tracking
results: parsing output: 142/ for test: kms_big_fb
results: parsing output: 143/ for test: kms_flip
results: parsing output: 144/ for test: kms_cursor_legacy
results: parsing output: 145/ for test: gem_exec_reloc
results: parsing output: 146/ for test: kms_vblank
results: parsing output: 147/ for test: kms_ccs
results: parsing output: 148/ for test: kms_pm_dc
results: parsing output: 149/ for test: gem_eio
results: parsing output: 150/ for test: gem_ctx_persistence
results: parsing output: 151/ for test: gem_exec_fence
results: parsing output: 152/ for test: prime_vgem
results: parsing output: 153/ for test: kms_frontbuffer_tracking
results: parsing output: 154/ for test: kms_flip_scaled_crc
Done.