[845.290949] Initializing watchdogs
[845.291005]   /dev/watchdog0
[845.310723] [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]
[845.317447] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[845.319779] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[845.320206] [FACT before any test] new: kernel.kmod_is_loaded.vgem: true
[845.324507] [001/133] (960s left) gem_exec_gttfill (engines)
[845.421874] Starting subtest: engines
[845.424660] Starting dynamic subtest: rcs0
[869.000647] Dynamic subtest rcs0: SUCCESS (23.580s)
[869.015084] Starting dynamic subtest: bcs0
[892.325074] Dynamic subtest bcs0: SUCCESS (23.318s)
[892.336512] Starting dynamic subtest: vcs0
[915.681239] Dynamic subtest vcs0: SUCCESS (23.347s)
[915.694640] Starting dynamic subtest: vcs1
[939.003273] Dynamic subtest vcs1: SUCCESS (23.314s)
[939.014359] Starting dynamic subtest: vecs0
[962.327323] Dynamic subtest vecs0: SUCCESS (23.323s)
[962.341226] Starting dynamic subtest: ccs0
[985.668379] Dynamic subtest ccs0: SUCCESS (23.343s)
[985.671246] Subtest engines: SUCCESS (140.239s)
[985.862125] [002/133] (820s left) perf (gen12-unprivileged-single-ctx-counters)
[986.037546] Starting subtest: gen12-unprivileged-single-ctx-counters
[986.040246] Starting dynamic subtest: rcs0
[986.336252] Dynamic subtest rcs0: SUCCESS (0.298s)
[986.339325] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.300s)
[986.395736] [003/133] (819s left) kms_joiner (basic-ultra-joiner)
[986.529338] Starting subtest: basic-ultra-joiner
[986.534069] Subtest basic-ultra-joiner: SKIP (0.000s)
[986.596335] [004/133] (819s left) prime_mmap (test_aperture_limit)
[986.646949] Starting subtest: test_aperture_limit
[986.649778] Starting dynamic subtest: test_aperture_limit-smem
[986.658383] Dynamic subtest test_aperture_limit-smem: SKIP (0.010s)
[986.664001] Subtest test_aperture_limit: SKIP (0.011s)
[986.753409] [005/133] (819s left) kms_plane (plane-position-hole)
[986.845079] Starting subtest: plane-position-hole
[987.365970] Starting dynamic subtest: pipe-A-plane-1
[988.662274] Dynamic subtest pipe-A-plane-1: SUCCESS (1.293s)
[988.675040] Starting dynamic subtest: pipe-A-plane-2
[989.932566] Dynamic subtest pipe-A-plane-2: SUCCESS (1.271s)
[989.945606] Starting dynamic subtest: pipe-A-plane-3
[991.190588] Dynamic subtest pipe-A-plane-3: SUCCESS (1.258s)
[991.203309] Starting dynamic subtest: pipe-A-plane-4
[992.445103] Dynamic subtest pipe-A-plane-4: SUCCESS (1.251s)
[992.457155] Starting dynamic subtest: pipe-A-plane-5
[992.470134] Dynamic subtest pipe-A-plane-5: SUCCESS (0.026s)
[993.628346] Starting dynamic subtest: pipe-B-plane-1
[994.983952] Dynamic subtest pipe-B-plane-1: SUCCESS (1.364s)
[994.995052] Starting dynamic subtest: pipe-B-plane-2
[996.275834] Dynamic subtest pipe-B-plane-2: SUCCESS (1.292s)
[996.298385] Starting dynamic subtest: pipe-B-plane-3
[997.611023] Dynamic subtest pipe-B-plane-3: SUCCESS (1.334s)
[997.622327] Starting dynamic subtest: pipe-B-plane-4
[998.930999] Dynamic subtest pipe-B-plane-4: SUCCESS (1.318s)
[998.942362] Starting dynamic subtest: pipe-B-plane-5
[998.957031] Dynamic subtest pipe-B-plane-5: SUCCESS (0.024s)
[998.959370] Subtest plane-position-hole: SUCCESS (12.112s)
[999.731677] [006/133] (806s left) kms_async_flips (alternate-sync-async-flip-atomic)
[999.831157] Starting subtest: alternate-sync-async-flip-atomic
[1000.210092] Starting dynamic subtest: pipe-A-eDP-1
[1003.025692] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.817s)
[1003.413762] Starting dynamic subtest: pipe-B-eDP-1
[1006.163263] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.758s)
[1006.535102] Starting dynamic subtest: pipe-C-eDP-1
[1009.297112] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.773s)
[1009.665334] Starting dynamic subtest: pipe-D-eDP-1
[1012.417473] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.761s)
[1012.419797] Subtest alternate-sync-async-flip-atomic: SUCCESS (12.589s)
[1013.607930] [007/133] (792s left) kms_cursor_crc (cursor-random-64x21)
[1013.827068] Starting subtest: cursor-random-64x21
[1013.878817] Subtest cursor-random-64x21: SKIP (0.048s)
[1014.129727] [008/133] (792s left) gem_exec_flush (basic-batch-kernel-default-cmd)
[1014.191250] Starting subtest: basic-batch-kernel-default-cmd
[1014.196807] Subtest basic-batch-kernel-default-cmd: SKIP (0.000s)
[1014.400811] [009/133] (791s left) gem_userptr_blits (map-fixed-invalidate)
[1014.469315] Starting subtest: map-fixed-invalidate
[1014.474623] Subtest map-fixed-invalidate: SKIP (0.000s)
[1014.589335] [010/133] (791s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[1014.648918] Starting subtest: multi-wait-for-submit-submitted-signaled
[1014.651535] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[1014.748025] [011/133] (791s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[1014.852360] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[1015.743085] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.892s)
[1015.896263] [012/133] (790s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions-varying-size)
[1016.021008] Starting subtest: cursor-vs-flip-atomic-transitions-varying-size
[1047.483922] Subtest cursor-vs-flip-atomic-transitions-varying-size: SUCCESS (31.459s)
[1048.321554] [013/133] (758s left) kms_psr (psr2-basic)
[1048.410701] Starting subtest: psr2-basic
[1048.413044] Starting dynamic subtest: eDP-1
[1049.978393] Dynamic subtest eDP-1: SUCCESS (1.567s)
[1049.980689] Subtest psr2-basic: SUCCESS (1.568s)
[1050.792848] [014/133] (755s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[1050.931192] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[1050.935699] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[1051.124495] [015/133] (755s left) kms_big_fb (linear-16bpp-rotate-180)
[1051.233709] Starting subtest: linear-16bpp-rotate-180
[1052.646372] Subtest linear-16bpp-rotate-180: SUCCESS (1.412s)
[1052.767997] [016/133] (753s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[1052.862788] Starting subtest: bad-pixel-format-y-tiled-ccs
[1052.864876] Starting dynamic subtest: pipe-A-eDP-1
[1052.884479] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[1052.897517] Starting dynamic subtest: pipe-B-eDP-1
[1052.917336] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[1052.927064] Starting dynamic subtest: pipe-C-eDP-1
[1052.947621] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[1052.957905] Starting dynamic subtest: pipe-D-eDP-1
[1052.978596] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[1052.982928] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.005s)
[1055.062006] [017/133] (751s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier-source-clamping)
[1055.166216] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier-source-clamping
[1055.171076] Subtest pixel-format-4-tiled-lnl-ccs-modifier-source-clamping: SKIP (0.000s)
[1055.241399] [018/133] (751s left) i915_drm_fdinfo (most-busy-idle-check-all)
[1055.288311] Starting subtest: most-busy-idle-check-all
[1055.290372] Starting dynamic subtest: rcs0
[1055.295057] Dynamic subtest rcs0: SKIP (0.004s)
[1055.306111] Starting dynamic subtest: bcs0
[1055.311309] Dynamic subtest bcs0: SKIP (0.000s)
[1055.322233] Starting dynamic subtest: vcs0
[1055.327712] Dynamic subtest vcs0: SKIP (0.000s)
[1055.337924] Starting dynamic subtest: vcs1
[1055.343056] Dynamic subtest vcs1: SKIP (0.000s)
[1055.353269] Starting dynamic subtest: vecs0
[1055.358163] Dynamic subtest vecs0: SKIP (0.000s)
[1055.368223] Starting dynamic subtest: ccs0
[1055.373100] Dynamic subtest ccs0: SKIP (0.000s)
[1055.377946] Subtest most-busy-idle-check-all: SKIP (0.009s)
[1055.419399] [019/133] (751s left) perf_pmu (rc6-suspend)
[1055.462061] Starting subtest: rc6-suspend
[1078.303330] Subtest rc6-suspend: SUCCESS (7.508s)
[1079.328328] [020/133] (727s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[1079.424437] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[1079.428300] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[1079.526710] [021/133] (727s left) kms_psr (fbc-psr2-sprite-plane-onoff)
[1079.618491] Starting subtest: fbc-psr2-sprite-plane-onoff
[1079.620574] Starting dynamic subtest: eDP-1
[1079.624196] Dynamic subtest eDP-1: SKIP (0.000s)
[1079.627724] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.001s)
[1079.692709] [022/133] (727s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[1079.794275] Starting subtest: 4-tiled-16bpp-rotate-0
[1081.044173] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.245s)
[1081.170193] [023/133] (725s left) gem_workarounds (reset-fd)
[1081.243559] Starting subtest: reset-fd
[1081.428788] Subtest reset-fd: SUCCESS (0.185s)
[1081.553593] [024/133] (725s left) kms_fence_pin_leak
[1081.722976] [025/133] (725s left) gem_render_copy (y-tiled-to-vebox-y-tiled)
[1081.772235] Starting subtest: y-tiled-to-vebox-y-tiled
[1081.777032] Subtest y-tiled-to-vebox-y-tiled: SKIP (0.000s)
[1081.960524] [026/133] (724s left) kms_cdclk (mode-transition)
[1082.047915] Starting subtest: mode-transition
[1082.050349] Starting dynamic subtest: pipe-A-eDP-1
[1082.355770] Dynamic subtest pipe-A-eDP-1: SKIP (0.304s)
[1082.366809] Starting dynamic subtest: pipe-B-eDP-1
[1082.371594] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[1082.382676] Starting dynamic subtest: pipe-C-eDP-1
[1082.387764] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[1082.398957] Starting dynamic subtest: pipe-D-eDP-1
[1082.403893] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[1082.408735] Subtest mode-transition: SKIP (0.312s)
[1083.154161] [027/133] (723s left) gem_exec_params (dr4-dirt)
[1083.216675] Starting subtest: DR4-dirt
[1083.219347] Subtest DR4-dirt: SUCCESS (0.000s)
[1083.306748] [028/133] (723s left) syncobj_wait (multi-wait-all-submitted)
[1083.365190] Starting subtest: multi-wait-all-submitted
[1083.470292] Subtest multi-wait-all-submitted: SUCCESS (0.104s)
[1083.549240] [029/133] (723s left) gem_exec_store (basic)
[1083.611091] Starting subtest: basic
[1083.719767] Subtest basic: SUCCESS (0.109s)
[1083.905820] [030/133] (723s left) gem_ctx_persistence (saturated-hostile)
[1083.965811] Starting subtest: saturated-hostile
[1083.968738] Starting dynamic subtest: rcs0
[1084.780924] Dynamic subtest rcs0: SUCCESS (0.813s)
[1084.796466] Starting dynamic subtest: bcs0
[1085.565810] Dynamic subtest bcs0: SUCCESS (0.781s)
[1085.579041] Starting dynamic subtest: vcs0
[1086.363466] Dynamic subtest vcs0: SUCCESS (0.795s)
[1086.376821] Starting dynamic subtest: vcs1
[1087.171485] Dynamic subtest vcs1: SUCCESS (0.805s)
[1087.184943] Starting dynamic subtest: vecs0
[1087.972257] Dynamic subtest vecs0: SUCCESS (0.797s)
[1087.986496] Starting dynamic subtest: ccs0
[1088.809510] Dynamic subtest ccs0: SUCCESS (0.834s)
[1088.812515] Subtest saturated-hostile: SUCCESS (4.838s)
[1088.942314] [031/133] (718s left) kms_psr (psr-cursor-plane-onoff)
[1089.036548] Starting subtest: psr-cursor-plane-onoff
[1089.038801] Starting dynamic subtest: eDP-1
[1090.769898] Dynamic subtest eDP-1: SUCCESS (1.731s)
[1090.772466] Subtest psr-cursor-plane-onoff: SUCCESS (1.732s)
[1091.614774] [032/133] (715s left) i915_hangman (detector)
[1091.689505] Starting subtest: detector
[1091.691805] Starting dynamic subtest: rcs0
[1102.785010] Dynamic subtest rcs0: SUCCESS (11.088s)
[1102.801230] Starting dynamic subtest: bcs0
[1114.816029] Dynamic subtest bcs0: SUCCESS (12.030s)
[1114.834636] Starting dynamic subtest: vcs0
[1126.720156] Dynamic subtest vcs0: SUCCESS (11.902s)
[1126.739448] Starting dynamic subtest: vcs1
[1138.751847] Dynamic subtest vcs1: SUCCESS (12.027s)
[1138.765645] Starting dynamic subtest: vecs0
[1150.720873] Dynamic subtest vecs0: SUCCESS (11.962s)
[1150.734162] Starting dynamic subtest: ccs0
[1160.768901] Dynamic subtest ccs0: SUCCESS (10.042s)
[1160.772168] Subtest detector: SUCCESS (69.068s)
[1160.868436] [033/133] (646s left) kms_force_connector_basic (force-connector-state)
[1160.955254] Starting subtest: force-connector-state
[1161.575731] Subtest force-connector-state: SUCCESS (0.620s)
[1162.484428] [034/133] (644s left) kms_universal_plane (universal-plane-sanity)
[1162.583679] Starting subtest: universal-plane-sanity
[1162.586221] Starting dynamic subtest: pipe-A-eDP-1
[1163.192151] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.608s)
[1163.204006] Starting dynamic subtest: pipe-B-eDP-1
[1164.373584] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.181s)
[1164.386292] Starting dynamic subtest: pipe-C-eDP-1
[1165.587611] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.214s)
[1165.599391] Starting dynamic subtest: pipe-D-eDP-1
[1166.818562] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.228s)
[1166.821434] Subtest universal-plane-sanity: SUCCESS (4.236s)
[1167.673034] [035/133] (639s left) dmabuf_sync_file (import-multiple-read-write)
[1167.723070] Starting subtest: import-multiple-read-write
[1167.725511] Subtest import-multiple-read-write: SUCCESS (0.003s)
[1167.788064] [036/133] (639s left) kms_pm_dc (dc5-dpms-negative)
[1168.896400] Starting subtest: dc5-dpms-negative
[1168.901591] Subtest dc5-dpms-negative: SKIP (0.000s)
[1168.973321] [037/133] (638s left) gem_render_copy_redux (flink)
[1169.021697] Starting subtest: flink
[1169.879073] Subtest flink: SUCCESS (0.858s)
[1170.012827] [038/133] (637s left) kms_cursor_crc (cursor-onscreen-64x64)
[1170.188061] Starting subtest: cursor-onscreen-64x64
[1170.192594] Starting dynamic subtest: pipe-A-eDP-1
[1172.282668] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.088s)
[1172.312469] Starting dynamic subtest: pipe-D-eDP-1
[1175.042233] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.741s)
[1175.044610] Subtest cursor-onscreen-64x64: SUCCESS (4.854s)
[1175.844985] [039/133] (631s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[1175.948603] Starting subtest: fbc-pr-cursor-plane-move-continuous-sf
[1175.953305] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[1176.020208] [040/133] (631s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite)
[1176.119640] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite
[1184.812725] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.699s)
[1184.931438] [041/133] (622s left) gem_mmap_wc (bad-offset)
[1184.989336] Subtest bad-offset: SKIP (0.000s)
[1185.049338] [042/133] (622s left) gem_softpin (evict-single-offset)
[1185.110748] Starting subtest: evict-single-offset
[1210.426402] Subtest evict-single-offset: SUCCESS (25.316s)
[1210.511167] [043/133] (597s left) kms_content_protection (dp-mst-type-1-suspend-resume)
[1210.724834] Starting subtest: dp-mst-type-1-suspend-resume
[1210.729630] Subtest dp-mst-type-1-suspend-resume: SKIP (0.000s)
[1210.856050] [044/133] (596s left) gem_ctx_shared (q-out-order)
[1210.925943] Starting subtest: Q-out-order
[1210.928480] Starting dynamic subtest: rcs0
[1211.038357] Dynamic subtest rcs0: SUCCESS (0.116s)
[1211.058892] Starting dynamic subtest: vcs0
[1211.129654] Dynamic subtest vcs0: SUCCESS (0.092s)
[1211.147967] Starting dynamic subtest: vcs1
[1211.222996] Dynamic subtest vcs1: SUCCESS (0.092s)
[1211.242513] Starting dynamic subtest: vecs0
[1211.306828] Dynamic subtest vecs0: SUCCESS (0.083s)
[1211.323681] Starting dynamic subtest: ccs0
[1211.408330] Dynamic subtest ccs0: SUCCESS (0.098s)
[1211.411488] Subtest Q-out-order: SUCCESS (0.489s)
[1212.918397] [045/133] (594s left) gem_softpin (softpin)
[1212.978847] Starting subtest: softpin
[1245.248754] Subtest softpin: SUCCESS (32.263s)
[1245.383827] [046/133] (562s left) kms_plane_alpha_blend (coverage-7efc)
[1245.493064] Starting subtest: coverage-7efc
[1245.790619] Starting dynamic subtest: pipe-A-eDP-1
[1246.365953] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.573s)
[1246.396568] Starting dynamic subtest: pipe-D-eDP-1
[1247.686440] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.297s)
[1247.689206] Subtest coverage-7efc: SUCCESS (2.195s)
[1248.537636] [047/133] (559s left) kms_busy (extended-pageflip-hang-oldfb)
[1248.640099] Starting subtest: extended-pageflip-hang-oldfb
[1248.642478] Starting dynamic subtest: pipe-A
[1249.064113] Dynamic subtest pipe-A: SUCCESS (0.425s)
[1249.075612] Starting dynamic subtest: pipe-D
[1250.154566] Dynamic subtest pipe-D: SUCCESS (1.087s)
[1250.157433] Subtest extended-pageflip-hang-oldfb: SUCCESS (1.517s)
[1251.007426] [048/133] (556s left) kms_big_fb (y-tiled-addfb)
[1251.108838] Starting subtest: y-tiled-addfb
[1251.113946] Subtest y-tiled-addfb: SKIP (0.000s)
[1251.222594] [049/133] (556s left) kms_plane_multiple (tiling-none)
[1251.315690] Starting subtest: tiling-none
[1251.318509] Starting dynamic subtest: pipe-A-eDP-1
[1255.167576] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.851s)
[1255.180825] Starting dynamic subtest: pipe-B-eDP-1
[1259.641795] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.473s)
[1259.654622] Starting dynamic subtest: pipe-C-eDP-1
[1263.981742] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.336s)
[1263.994559] Starting dynamic subtest: pipe-D-eDP-1
[1268.325208] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.342s)
[1268.327462] Subtest tiling-none: SUCCESS (17.007s)
[1269.137412] [050/133] (538s left) kms_chamelium_frames (dp-crc-fast)
[1269.514430] Subtest dp-crc-fast: SKIP (0.000s)
[1270.348172] [051/133] (537s left) i915_suspend (fence-restore-tiled2untiled)
[1270.411759] Starting subtest: fence-restore-tiled2untiled
[1270.416765] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[1270.521207] [052/133] (537s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[1270.621048] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[1277.130553] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.510s)
[1277.234186] [053/133] (530s left) kms_chamelium_hpd (hdmi-hpd-fast)
[1277.617016] Subtest hdmi-hpd-fast: SKIP (0.000s)
[1278.434136] [054/133] (529s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[1278.525387] Starting subtest: fbc-psr2-primary-mmap-cpu
[1278.527780] Starting dynamic subtest: eDP-1
[1278.532830] Dynamic subtest eDP-1: SKIP (0.000s)
[1278.537768] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.001s)
[1278.598247] [055/133] (529s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[1278.690799] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[1278.693749] Starting dynamic subtest: pipe-A-eDP-1
[1295.173358] Dynamic subtest pipe-A-eDP-1: SUCCESS (16.485s)
[1295.185754] Starting dynamic subtest: pipe-B-eDP-1
[1312.337842] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.163s)
[1312.340805] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (33.651s)
[1313.222465] [056/133] (495s left) api_intel_bb (object-reloc-keep-cache)
[1313.284347] Starting subtest: object-reloc-keep-cache
[1313.289727] Subtest object-reloc-keep-cache: SKIP (0.003s)
[1313.407027] [057/133] (494s left) kms_flip (absolute-wf_vblank)
[1313.501903] Starting subtest: absolute-wf_vblank
[1313.504528] Starting dynamic subtest: A-eDP1
[1322.252574] Dynamic subtest A-eDP1: SUCCESS (8.751s)
[1322.263963] Starting dynamic subtest: B-eDP1
[1330.978087] Dynamic subtest B-eDP1: SUCCESS (8.724s)
[1330.992897] Starting dynamic subtest: C-eDP1
[1339.704983] Dynamic subtest C-eDP1: SUCCESS (8.723s)
[1339.721709] Starting dynamic subtest: D-eDP1
[1348.451920] Dynamic subtest D-eDP1: SUCCESS (8.747s)
[1348.457272] Subtest absolute-wf_vblank: SUCCESS (34.957s)
[1349.660063] [058/133] (458s left) gem_exec_schedule (preempt-other-chain)
[1349.735559] Starting subtest: preempt-other-chain
[1349.737802] Starting dynamic subtest: rcs0
[1349.814827] Dynamic subtest rcs0: SUCCESS (0.087s)
[1349.826672] Starting dynamic subtest: bcs0
[1349.903646] Dynamic subtest bcs0: SUCCESS (0.088s)
[1349.916441] Starting dynamic subtest: vcs0
[1349.989417] Dynamic subtest vcs0: SUCCESS (0.084s)
[1350.001945] Starting dynamic subtest: vcs1
[1350.079648] Dynamic subtest vcs1: SUCCESS (0.089s)
[1350.090985] Starting dynamic subtest: vecs0
[1350.162403] Dynamic subtest vecs0: SUCCESS (0.082s)
[1350.174299] Starting dynamic subtest: ccs0
[1350.243502] Dynamic subtest ccs0: SUCCESS (0.080s)
[1350.246547] Subtest preempt-other-chain: SUCCESS (0.517s)
[1350.925435] [059/133] (457s left) gem_exec_schedule (u-fairslice)
[1351.003402] Starting subtest: u-fairslice
[1351.005883] Starting dynamic subtest: rcs0
[1353.020589] Dynamic subtest rcs0: SUCCESS (2.026s)
[1353.032229] Starting dynamic subtest: bcs0
[1355.048142] Dynamic subtest bcs0: SUCCESS (2.027s)
[1355.060337] Starting dynamic subtest: vcs0
[1357.072961] Dynamic subtest vcs0: SUCCESS (2.021s)
[1357.085433] Starting dynamic subtest: vcs1
[1359.094884] Dynamic subtest vcs1: SUCCESS (2.021s)
[1359.106897] Starting dynamic subtest: vecs0
[1361.119716] Dynamic subtest vecs0: SUCCESS (2.023s)
[1361.132632] Starting dynamic subtest: ccs0
[1363.145777] Dynamic subtest ccs0: SUCCESS (2.025s)
[1363.148724] Subtest u-fairslice: SUCCESS (12.150s)
[1363.448578] [060/133] (445s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[1363.555373] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt
[1363.560407] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[1363.648701] [061/133] (444s left) kms_cursor_crc (cursor-sliding-256x85)
[1363.926946] Starting subtest: cursor-sliding-256x85
[1363.975205] Subtest cursor-sliding-256x85: SKIP (0.041s)
[1364.146902] [062/133] (444s left) gem_shrink (reclaim)
[1364.211771] Starting subtest: reclaim
[1366.643018] Subtest reclaim: SUCCESS (2.426s)
[1366.765831] [063/133] (441s left) syncobj_timeline (wait-for-submit-complex)
[1366.819907] Starting subtest: wait-for-submit-complex
[1366.880903] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[1366.968276] [064/133] (441s left) kms_dsc (dsc-with-formats)
[1367.059568] Starting subtest: dsc-with-formats
[1367.101525] Subtest dsc-with-formats: SKIP (0.001s)
[1367.141806] [065/133] (441s left) kms_cursor_legacy (flip-vs-cursor-atomic)
[1367.264656] Starting subtest: flip-vs-cursor-atomic
[1374.495277] Subtest flip-vs-cursor-atomic: SUCCESS (7.226s)
[1375.294483] [066/133] (433s left) kms_vblank (query-forked-busy)
[1375.390893] Starting subtest: query-forked-busy
[1375.393135] Starting dynamic subtest: pipe-A-eDP-1
[1377.264923] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[1377.283417] Starting dynamic subtest: pipe-D-eDP-1
[1379.840391] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.572s)
[1379.842934] Subtest query-forked-busy: SUCCESS (4.451s)
[1380.663581] [067/133] (428s left) kms_lease (lease-unleased-connector)
[1380.774694] Starting subtest: lease-unleased-connector
[1380.777147] Starting dynamic subtest: pipe-A-eDP-1
[1380.779457] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.006s)
[1380.794134] Starting dynamic subtest: pipe-B-eDP-1
[1380.796536] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.006s)
[1380.808725] Starting dynamic subtest: pipe-C-eDP-1
[1380.811339] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.006s)
[1380.822367] Starting dynamic subtest: pipe-D-eDP-1
[1380.824834] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.009s)
[1380.827549] Subtest lease-unleased-connector: SUCCESS (0.032s)
[1380.909459] [068/133] (427s left) kms_addfb_basic (bad-pitch-63)
[1380.963611] Starting subtest: bad-pitch-63
[1380.966489] Subtest bad-pitch-63: SUCCESS (0.000s)
[1381.092308] [069/133] (427s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[1381.193708] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[1381.198833] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[1381.292928] [070/133] (427s left) gem_exec_params (dr1-dirt)
[1381.347502] Starting subtest: DR1-dirt
[1381.350052] Subtest DR1-dirt: SUCCESS (0.000s)
[1381.444031] [071/133] (427s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[1381.549396] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[1381.554683] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[1381.646691] [072/133] (427s left) kms_rmfb (rmfb-ioctl)
[1381.739616] Starting subtest: rmfb-ioctl
[1381.741646] Starting dynamic subtest: pipe-A-eDP-1
[1381.844086] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.105s)
[1381.855725] Starting dynamic subtest: pipe-B-eDP-1
[1383.003887] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.158s)
[1383.015796] Starting dynamic subtest: pipe-C-eDP-1
[1384.130584] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.125s)
[1384.142100] Starting dynamic subtest: pipe-D-eDP-1
[1385.261609] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.130s)
[1385.264571] Subtest rmfb-ioctl: SUCCESS (3.524s)
[1386.478101] [073/133] (422s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-wc)
[1386.583457] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-wc
[1393.259619] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.678s)
[1393.379480] [074/133] (415s left) kms_frontbuffer_tracking (fbc-rgb565-draw-blt)
[1393.481961] Starting subtest: fbc-rgb565-draw-blt
[1397.696933] Subtest fbc-rgb565-draw-blt: SUCCESS (4.218s)
[1398.926085] [075/133] (410s left) kms_ccs (crc-primary-basic-yf-tiled-ccs)
[1399.016700] Starting subtest: crc-primary-basic-yf-tiled-ccs
[1399.019490] Starting dynamic subtest: pipe-A-eDP-1
[1399.045739] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[1399.058465] Starting dynamic subtest: pipe-B-eDP-1
[1399.084449] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[1399.095435] Starting dynamic subtest: pipe-C-eDP-1
[1399.122611] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[1399.137794] Starting dynamic subtest: pipe-D-eDP-1
[1399.164241] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[1399.168831] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.006s)
[1401.174065] [076/133] (408s left) i915_pm_rpm (sysfs-read)
[1403.010061] Starting subtest: sysfs-read
[1404.165772] Subtest sysfs-read: SUCCESS (1.156s)
[1404.540703] [077/133] (404s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[1404.626476] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[1404.629051] Starting dynamic subtest: pipe-A-default-mode
[1407.341934] Dynamic subtest pipe-A-default-mode: SUCCESS (2.715s)
[1407.344774] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SUCCESS (2.717s)
[1408.211791] [078/133] (401s left) gem_unfence_active_buffers
[1408.378670] [079/133] (400s left) gem_exec_suspend (basic)
[1408.431942] Starting subtest: basic
[1408.434703] Starting dynamic subtest: smem
[1409.826650] Dynamic subtest smem: SUCCESS (1.392s)
[1409.829979] Subtest basic: SUCCESS (1.394s)
[1410.014564] [080/133] (399s left) gem_exec_whisper (basic-sync)
[1410.079307] Starting subtest: basic-sync
[1421.269456] Subtest basic-sync: SUCCESS (11.186s)
[1421.457894] [081/133] (387s left) gem_exec_params (invalid-bsd-ring)
[1421.522716] Starting subtest: invalid-bsd-ring
[1421.525810] Subtest invalid-bsd-ring: SUCCESS (0.000s)
[1421.626477] [082/133] (387s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[1421.739586] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[1421.744672] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.000s)
[1421.818195] [083/133] (387s left) gem_fenced_exec_thrash (no-spare-fences-busy-interruptible)
[1421.873421] Subtest no-spare-fences-busy-interruptible: SKIP (0.000s)
[1421.938445] [084/133] (387s left) gem_exec_fence (syncobj-signal)
[1422.372154] Starting subtest: syncobj-signal
[1422.380357] Subtest syncobj-signal: SUCCESS (0.008s)
[1423.897573] [085/133] (385s left) i915_query (query-topology-coherent-slice-mask)
[1423.955698] Starting subtest: query-topology-coherent-slice-mask
[1423.961065] Subtest query-topology-coherent-slice-mask: SKIP (0.000s)
[1424.036083] [086/133] (385s left) syncobj_eventfd (invalid-illegal-handle)
[1424.096920] Starting subtest: invalid-illegal-handle
[1424.099222] Subtest invalid-illegal-handle: SUCCESS (0.000s)
[1424.184312] [087/133] (385s left) kms_psr2_sf (psr2-cursor-plane-update-sf)
[1424.281746] Starting subtest: psr2-cursor-plane-update-sf
[1424.284603] Starting dynamic subtest: pipe-A-eDP-1
[1424.851078] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.572s)
[1424.864928] Starting dynamic subtest: pipe-B-eDP-1
[1426.208555] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.354s)
[1426.210679] Subtest psr2-cursor-plane-update-sf: SUCCESS (1.930s)
[1427.067109] [088/133] (382s left) kms_flip (flip-vs-expired-vblank)
[1427.166934] Starting subtest: flip-vs-expired-vblank
[1427.169623] Starting dynamic subtest: A-eDP1
[1435.870328] Dynamic subtest A-eDP1: SUCCESS (8.702s)
[1435.884947] Starting dynamic subtest: B-eDP1
[1444.509830] Dynamic subtest B-eDP1: SUCCESS (8.636s)
[1444.522905] Starting dynamic subtest: C-eDP1
[1453.144261] Dynamic subtest C-eDP1: SUCCESS (8.631s)
[1453.156969] Starting dynamic subtest: D-eDP1
[1461.783401] Dynamic subtest D-eDP1: SUCCESS (8.635s)
[1461.788954] Subtest flip-vs-expired-vblank: SUCCESS (34.615s)
[1462.955588] [089/133] (346s left) gem_create (create-massive)
[1463.018632] Starting subtest: create-massive
[1463.021459] Subtest create-massive: SUCCESS (0.000s)
[1463.218282] [090/133] (346s left) kms_flip (flip-vs-wf_vblank-interruptible)
[1463.312523] Starting subtest: flip-vs-wf_vblank-interruptible
[1463.315175] Starting dynamic subtest: A-eDP1
[1465.181958] Dynamic subtest A-eDP1: SUCCESS (1.869s)
[1465.194174] Starting dynamic subtest: B-eDP1
[1467.120436] Dynamic subtest B-eDP1: SUCCESS (1.935s)
[1467.132619] Starting dynamic subtest: C-eDP1
[1469.039198] Dynamic subtest C-eDP1: SUCCESS (1.916s)
[1469.052904] Starting dynamic subtest: D-eDP1
[1470.965767] Dynamic subtest D-eDP1: SUCCESS (1.925s)
[1470.972131] Subtest flip-vs-wf_vblank-interruptible: SUCCESS (7.658s)
[1472.197492] [091/133] (337s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[1472.288735] Starting subtest: psr-rgb101010-draw-mmap-cpu
[1479.363355] Subtest psr-rgb101010-draw-mmap-cpu: SUCCESS (7.077s)
[1479.468657] [092/133] (330s left) gem_mmap_gtt (cpuset-medium-copy-xy)
[1479.528669] Subtest cpuset-medium-copy-XY: SKIP (0.000s)
[1479.585413] [093/133] (330s left) gem_mmap_gtt (isolation)
[1479.646829] Subtest isolation: SKIP (0.000s)
[1479.708388] [094/133] (330s left) kms_color_pipeline (plane-lut1d-post-ctm3x4)
[1479.799013] Starting subtest: plane-lut1d-post-ctm3x4
[1479.978634] Starting dynamic subtest: pipe-A-plane-0
[1480.323953] Dynamic subtest pipe-A-plane-0: FAIL (0.161s)
[1480.334385] Starting dynamic subtest: pipe-A-plane-1
[1480.529397] Dynamic subtest pipe-A-plane-1: FAIL (0.168s)
[1480.540717] Starting dynamic subtest: pipe-A-plane-2
[1480.787234] Dynamic subtest pipe-A-plane-2: FAIL (0.169s)
[1481.716735] Starting dynamic subtest: pipe-B-plane-0
[1482.195545] Dynamic subtest pipe-B-plane-0: FAIL (0.175s)
[1482.210057] Starting dynamic subtest: pipe-B-plane-1
[1482.542882] Dynamic subtest pipe-B-plane-1: FAIL (0.156s)
[1482.553763] Starting dynamic subtest: pipe-B-plane-2
[1482.856536] Dynamic subtest pipe-B-plane-2: FAIL (0.662s)
[1483.953783] Starting dynamic subtest: pipe-C-plane-0
[1484.562273] Dynamic subtest pipe-C-plane-0: FAIL (0.180s)
[1484.575155] Starting dynamic subtest: pipe-C-plane-1
[1485.001923] Dynamic subtest pipe-C-plane-1: FAIL (0.711s)
[1485.013595] Starting dynamic subtest: pipe-C-plane-2
[1485.436962] Dynamic subtest pipe-C-plane-2: FAIL (0.160s)
[1486.201937] Starting dynamic subtest: pipe-D-plane-0
[1486.868336] Dynamic subtest pipe-D-plane-0: FAIL (0.142s)
[1486.884030] Starting dynamic subtest: pipe-D-plane-1
[1487.406927] Dynamic subtest pipe-D-plane-1: FAIL (0.706s)
[1487.419543] Starting dynamic subtest: pipe-D-plane-2
[1487.923544] Dynamic subtest pipe-D-plane-2: FAIL (0.611s)
[1487.948460] Subtest plane-lut1d-post-ctm3x4: FAIL (8.148s)
[1488.750107] [095/133] (321s left) kms_prime (d3hot)
[1488.841793] Subtest D3hot: SKIP (0.000s)
[1488.937299] [096/133] (321s left) gem_exec_reloc (basic-wc-gtt)
[1489.003310] Subtest basic-wc-gtt: SKIP (0.000s)
[1489.076102] [097/133] (321s left) gem_exec_balancer (parallel)
[1489.336687] Starting subtest: parallel
[1490.298211] Subtest parallel: SUCCESS (0.961s)
[1490.894769] [098/133] (319s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[1490.992294] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[1490.997516] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[1492.090902] [099/133] (318s left) kms_flip (plain-flip-interruptible)
[1492.185756] Starting subtest: plain-flip-interruptible
[1492.188700] Starting dynamic subtest: A-eDP1
[1493.883811] Dynamic subtest A-eDP1: SUCCESS (1.696s)
[1493.896855] Starting dynamic subtest: B-eDP1
[1495.508465] Dynamic subtest B-eDP1: SUCCESS (1.621s)
[1495.520931] Starting dynamic subtest: C-eDP1
[1497.127637] Dynamic subtest C-eDP1: SUCCESS (1.616s)
[1497.146690] Starting dynamic subtest: D-eDP1
[1498.758519] Dynamic subtest D-eDP1: SUCCESS (1.628s)
[1498.764056] Subtest plain-flip-interruptible: SUCCESS (6.576s)
[1499.936241] [100/133] (310s left) kms_ccs (missing-ccs-buffer-y-tiled-ccs)
[1500.052760] Starting subtest: missing-ccs-buffer-y-tiled-ccs
[1500.055617] Starting dynamic subtest: pipe-A-eDP-1
[1500.081909] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[1500.094471] Starting dynamic subtest: pipe-B-eDP-1
[1500.120701] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[1500.131771] Starting dynamic subtest: pipe-C-eDP-1
[1500.157687] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[1500.168481] Starting dynamic subtest: pipe-D-eDP-1
[1500.194739] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[1500.199738] Subtest missing-ccs-buffer-y-tiled-ccs: SKIP (0.005s)
[1502.206422] [101/133] (308s left) gem_ctx_param (vm)
[1502.265854] Starting subtest: vm
[1502.319083] Subtest vm: SUCCESS (0.053s)
[1502.454124] [102/133] (307s left) kms_properties (plane-properties-legacy)
[1502.547292] Starting subtest: plane-properties-legacy
[1502.549811] Starting dynamic subtest: pipe-A-eDP-1
[1503.112395] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.564s)
[1503.124058] Starting dynamic subtest: pipe-B-eDP-1
[1504.366702] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.253s)
[1504.380986] Starting dynamic subtest: pipe-C-eDP-1
[1505.597905] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.230s)
[1505.611066] Starting dynamic subtest: pipe-D-eDP-1
[1506.834800] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.235s)
[1506.837327] Subtest plane-properties-legacy: SUCCESS (4.287s)
[1507.626562] [103/133] (302s left) gem_pxp (reject-modify-context-protection-off-3)
[1507.755933] Starting subtest: reject-modify-context-protection-off-3
[1507.758938] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s)
[1507.869002] [104/133] (302s left) prime_self_import (basic-with_one_bo_two_files)
[1507.908480] Starting subtest: basic-with_one_bo_two_files
[1507.924441] Subtest basic-with_one_bo_two_files: SUCCESS (0.018s)
[1508.023131] [105/133] (302s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[1508.109542] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[1508.112403] Starting dynamic subtest: pipe-A
[1508.170667] Dynamic subtest pipe-A: SUCCESS (0.065s)
[1508.184923] Starting dynamic subtest: pipe-B
[1509.346575] Dynamic subtest pipe-B: SUCCESS (1.173s)
[1509.360245] Starting dynamic subtest: pipe-C
[1510.445399] Dynamic subtest pipe-C: SUCCESS (1.097s)
[1510.457701] Starting dynamic subtest: pipe-D
[1511.576830] Dynamic subtest pipe-D: SUCCESS (1.130s)
[1511.579801] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (3.471s)
[1512.733453] [106/133] (297s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[1512.844557] Starting subtest: 4-tiled-16bpp-rotate-90
[1512.864794] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.019s)
[1512.971342] [107/133] (297s left) gen9_exec_parse (batch-invalid-length)
[1513.029944] Subtest batch-invalid-length: SKIP (0.000s)
[1513.088396] [108/133] (297s left) syncobj_timeline (invalid-signal-one-illegal-handle)
[1513.150952] Starting subtest: invalid-signal-one-illegal-handle
[1513.153893] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[1513.240298] [109/133] (297s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[1513.342183] Starting subtest: x-tiled-64bpp-rotate-180
[1514.908705] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.567s)
[1515.057553] [110/133] (295s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[1515.155699] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[1515.160414] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[1515.257632] [111/133] (295s left) gem_exec_params (invalid-ring2)
[1515.330291] Starting subtest: invalid-ring2
[1515.332575] Subtest invalid-ring2: SUCCESS (0.000s)
[1515.448451] [112/133] (295s left) gem_vm_create (invalid-create)
[1515.507543] Starting subtest: invalid-create
[1515.509801] Subtest invalid-create: SUCCESS (0.002s)
[1515.609257] [113/133] (295s left) kms_addfb_basic (bad-pitch-128)
[1515.664543] Starting subtest: bad-pitch-128
[1515.666556] Subtest bad-pitch-128: SUCCESS (0.000s)
[1515.800669] [114/133] (295s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[1515.858239] Starting subtest: single-wait-all-for-submit-available-submitted
[1515.860652] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[1515.956825] [115/133] (294s left) kms_cursor_legacy (cursorb-vs-flipa-toggle)
[1516.070662] Starting subtest: cursorB-vs-flipA-toggle
[1516.075610] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s)
[1516.215832] [116/133] (294s left) prime_vgem (fence-write-hang)
[1516.299598] Subtest fence-write-hang: SKIP (0.000s)
[1516.395384] [117/133] (294s left) fbdev (eof)
[1516.443402] Starting subtest: eof
[1516.445808] Subtest eof: SUCCESS (0.000s)
[1516.525304] [118/133] (294s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[1516.636707] Starting subtest: 2x-flip-vs-cursor-atomic
[1516.641382] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.001s)
[1516.785823] [119/133] (294s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[1516.877661] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt
[1516.882195] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[1516.972280] [120/133] (294s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[1517.078894] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[1523.942585] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.864s)
[1524.098173] [121/133] (287s left) prime_mmap_kms (buffer-sharing)
[1524.200534] Starting subtest: buffer-sharing
[1524.634961] Subtest buffer-sharing: SUCCESS (0.436s)
[1525.469853] [122/133] (285s left) gem_exec_fence (basic-await)
[1525.639956] Starting subtest: basic-await
[1525.643065] Starting dynamic subtest: rcs0
[1525.715911] Dynamic subtest rcs0: SUCCESS (0.075s)
[1525.730696] Starting dynamic subtest: bcs0
[1525.793463] Dynamic subtest bcs0: SUCCESS (0.076s)
[1525.807732] Starting dynamic subtest: vcs0
[1525.868892] Dynamic subtest vcs0: SUCCESS (0.074s)
[1525.883112] Starting dynamic subtest: vcs1
[1525.943215] Dynamic subtest vcs1: SUCCESS (0.073s)
[1525.957029] Starting dynamic subtest: vecs0
[1526.017797] Dynamic subtest vecs0: SUCCESS (0.073s)
[1526.032407] Starting dynamic subtest: ccs0
[1526.093122] Dynamic subtest ccs0: SUCCESS (0.074s)
[1526.095785] Subtest basic-await: SUCCESS (0.454s)
[1527.930640] [123/133] (283s left) prime_busy (before-wait)
[1528.003667] Starting subtest: before-wait
[1528.006579] Starting dynamic subtest: rcs0
[1528.042890] Dynamic subtest rcs0: SUCCESS (0.037s)
[1528.054812] Starting dynamic subtest: bcs0
[1528.095681] Dynamic subtest bcs0: SUCCESS (0.052s)
[1528.109185] Starting dynamic subtest: vcs0
[1528.138898] Dynamic subtest vcs0: SUCCESS (0.043s)
[1528.150512] Starting dynamic subtest: vcs1
[1528.182293] Dynamic subtest vcs1: SUCCESS (0.042s)
[1528.194602] Starting dynamic subtest: vecs0
[1528.225441] Dynamic subtest vecs0: SUCCESS (0.042s)
[1528.237685] Starting dynamic subtest: ccs0
[1528.267236] Dynamic subtest ccs0: SUCCESS (0.041s)
[1528.376181] Subtest before-wait: SUCCESS (0.374s)
[1528.459915] [124/133] (282s left) kms_cursor_legacy (short-busy-flip-before-cursor-toggle)
[1528.582691] Starting subtest: short-busy-flip-before-cursor-toggle
[1528.587692] Subtest short-busy-flip-before-cursor-toggle: SKIP (0.000s)
[1528.730867] [125/133] (282s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[1528.785517] Starting subtest: invalid-multi-wait-unsubmitted
[1528.787687] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[1528.887585] [126/133] (282s left) gem_mmap_wc (invalid-flags)
[1528.947753] Subtest invalid-flags: SKIP (0.000s)
[1529.011250] [127/133] (282s left) kms_big_fb (yf-tiled-64bpp-rotate-270)
[1529.106603] Starting subtest: yf-tiled-64bpp-rotate-270
[1529.111022] Subtest yf-tiled-64bpp-rotate-270: SKIP (0.000s)
[1529.216688] [128/133] (282s left) kms_tv_load_detect (load-detect)
[1529.274768] Subtest load-detect: SKIP (0.000s)
[1529.336365] [129/133] (282s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[1529.428642] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt
[1529.432687] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[1529.547640] [130/133] (282s left) syncobj_wait (wait-any-complex)
[1529.596427] Starting subtest: wait-any-complex
[1529.658098] Subtest wait-any-complex: SUCCESS (0.063s)
[1529.743870] [131/133] (281s left) sw_sync (sync_expired_merge)
[1529.793075] Starting subtest: sync_expired_merge
[1530.868656] Subtest sync_expired_merge: SUCCESS (1.074s)
[1530.935650] [132/133] (280s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt)
[1531.046714] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt
[1531.051818] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[1531.156205] [133/133] (280s left) kms_psr (psr-suspend)
[1531.250282] Starting subtest: psr-suspend
[1531.252595] Starting dynamic subtest: eDP-1
[1549.555334] Dynamic subtest eDP-1: SUCCESS (2.936s)
[1549.558061] Subtest psr-suspend: SUCCESS (2.937s)
[1550.412313] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_gttfill
results: parsing output: 1/ for test: perf
results: parsing output: 2/ for test: kms_joiner
results: parsing output: 3/ for test: prime_mmap
results: parsing output: 4/ for test: kms_plane
results: parsing output: 5/ for test: kms_async_flips
results: parsing output: 6/ for test: kms_cursor_crc
results: parsing output: 7/ for test: gem_exec_flush
results: parsing output: 8/ for test: gem_userptr_blits
results: parsing output: 9/ for test: syncobj_timeline
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: kms_cursor_legacy
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: kms_big_fb
results: parsing output: 15/ for test: kms_ccs
results: parsing output: 16/ for test: kms_plane
results: parsing output: 17/ for test: i915_drm_fdinfo
results: parsing output: 18/ for test: perf_pmu
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: gem_workarounds
results: parsing output: 23/ for test: kms_fence_pin_leak
results: parsing output: 24/ for test: gem_render_copy
results: parsing output: 25/ for test: kms_cdclk
results: parsing output: 26/ for test: gem_exec_params
results: parsing output: 27/ for test: syncobj_wait
results: parsing output: 28/ for test: gem_exec_store
results: parsing output: 29/ for test: gem_ctx_persistence
results: parsing output: 30/ for test: kms_psr
results: parsing output: 31/ for test: i915_hangman
results: parsing output: 32/ for test: kms_force_connector_basic
results: parsing output: 33/ for test: kms_universal_plane
results: parsing output: 34/ for test: dmabuf_sync_file
results: parsing output: 35/ for test: kms_pm_dc
results: parsing output: 36/ for test: gem_render_copy_redux
results: parsing output: 37/ for test: kms_cursor_crc
results: parsing output: 38/ for test: kms_psr2_sf
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_mmap_wc
results: parsing output: 41/ for test: gem_softpin
results: parsing output: 42/ for test: kms_content_protection
results: parsing output: 43/ for test: gem_ctx_shared
results: parsing output: 44/ for test: gem_softpin
results: parsing output: 45/ for test: kms_plane_alpha_blend
results: parsing output: 46/ for test: kms_busy
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: kms_plane_multiple
results: parsing output: 49/ for test: kms_chamelium_frames
results: parsing output: 50/ for test: i915_suspend
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_chamelium_hpd
results: parsing output: 53/ for test: kms_psr
results: parsing output: 54/ for test: kms_psr2_sf
results: parsing output: 55/ for test: api_intel_bb
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: gem_exec_schedule
results: parsing output: 58/ for test: gem_exec_schedule
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_cursor_crc
results: parsing output: 61/ for test: gem_shrink
results: parsing output: 62/ for test: syncobj_timeline
results: parsing output: 63/ for test: kms_dsc
results: parsing output: 64/ for test: kms_cursor_legacy
results: parsing output: 65/ for test: kms_vblank
results: parsing output: 66/ for test: kms_lease
results: parsing output: 67/ for test: kms_addfb_basic
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: gem_exec_params
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: kms_rmfb
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_ccs
results: parsing output: 75/ for test: i915_pm_rpm
results: parsing output: 76/ for test: kms_flip_scaled_crc
results: parsing output: 77/ for test: gem_unfence_active_buffers
results: parsing output: 78/ for test: gem_exec_suspend
results: parsing output: 79/ for test: gem_exec_whisper
results: parsing output: 80/ for test: gem_exec_params
results: parsing output: 81/ for test: kms_flip_scaled_crc
results: parsing output: 82/ for test: gem_fenced_exec_thrash
results: parsing output: 83/ for test: gem_exec_fence
results: parsing output: 84/ for test: i915_query
results: parsing output: 85/ for test: syncobj_eventfd
results: parsing output: 86/ for test: kms_psr2_sf
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: gem_create
results: parsing output: 89/ for test: kms_flip
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: gem_mmap_gtt
results: parsing output: 92/ for test: gem_mmap_gtt
results: parsing output: 93/ for test: kms_color_pipeline
results: parsing output: 94/ for test: kms_prime
results: parsing output: 95/ for test: gem_exec_reloc
results: parsing output: 96/ for test: gem_exec_balancer
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: kms_flip
results: parsing output: 99/ for test: kms_ccs
results: parsing output: 100/ for test: gem_ctx_param
results: parsing output: 101/ for test: kms_properties
results: parsing output: 102/ for test: gem_pxp
results: parsing output: 103/ for test: prime_self_import
results: parsing output: 104/ for test: kms_plane_scaling
results: parsing output: 105/ for test: kms_big_fb
results: parsing output: 106/ for test: gen9_exec_parse
results: parsing output: 107/ for test: syncobj_timeline
results: parsing output: 108/ for test: kms_big_fb
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: gem_exec_params
results: parsing output: 111/ for test: gem_vm_create
results: parsing output: 112/ for test: kms_addfb_basic
results: parsing output: 113/ for test: syncobj_timeline
results: parsing output: 114/ for test: kms_cursor_legacy
results: parsing output: 115/ for test: prime_vgem
results: parsing output: 116/ for test: fbdev
results: parsing output: 117/ for test: kms_cursor_legacy
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: prime_mmap_kms
results: parsing output: 121/ for test: gem_exec_fence
results: parsing output: 122/ for test: prime_busy
results: parsing output: 123/ for test: kms_cursor_legacy
results: parsing output: 124/ for test: syncobj_timeline
results: parsing output: 125/ for test: gem_mmap_wc
results: parsing output: 126/ for test: kms_big_fb
results: parsing output: 127/ for test: kms_tv_load_detect
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: syncobj_wait
results: parsing output: 130/ for test: sw_sync
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_psr
Done.