[59.972055] Initializing watchdogs
[59.972129]   /dev/watchdog0
[59.991845] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[60.003069] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[60.006908] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.009390] [001/134] (960s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[60.202768] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[60.204458] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[60.365474] [002/134] (960s left) gem_ctx_persistence (legacy-engines-persistence)
[60.446953] Starting subtest: legacy-engines-persistence
[60.448078] Starting dynamic subtest: render
[61.272178] Dynamic subtest render: SUCCESS (0.820s)
[61.283734] Starting dynamic subtest: bsd1
[62.088667] Dynamic subtest bsd1: SUCCESS (0.811s)
[62.098991] Starting dynamic subtest: bsd2
[62.858227] Dynamic subtest bsd2: SUCCESS (0.764s)
[62.868582] Starting dynamic subtest: blt
[63.611406] Dynamic subtest blt: SUCCESS (0.748s)
[63.621588] Starting dynamic subtest: vebox
[64.375114] Dynamic subtest vebox: SUCCESS (0.759s)
[64.376988] Subtest legacy-engines-persistence: SUCCESS (3.911s)
[64.536771] [003/134] (956s left) kms_cursor_legacy (single-move)
[64.719069] Starting subtest: single-move
[64.719988] Starting dynamic subtest: pipe-A
[70.114292] Dynamic subtest pipe-A: SUCCESS (5.382s)
[70.122669] Starting dynamic subtest: pipe-B
[75.503291] Dynamic subtest pipe-B: SUCCESS (5.383s)
[75.510741] Starting dynamic subtest: pipe-C
[80.887077] Dynamic subtest pipe-C: SUCCESS (5.379s)
[80.894579] Starting dynamic subtest: pipe-D
[86.270172] Dynamic subtest pipe-D: SUCCESS (5.379s)
[86.277972] Starting dynamic subtest: all-pipes
[91.655246] Dynamic subtest all-pipes: SUCCESS (5.382s)
[91.656174] Subtest single-move: SUCCESS (26.905s)
[91.772768] [004/134] (928s left) kms_chamelium_color (ctm-red-to-blue)
[91.955389] Subtest ctm-red-to-blue: SKIP (0.000s)
[92.015137] [005/134] (928s left) kms_content_protection (legacy)
[92.277149] Starting subtest: legacy
[92.562563] Starting dynamic subtest: pipe-A-DP-3
[213.803254] Dynamic subtest pipe-A-DP-3: FAIL (120.956s)
[213.804107] Subtest legacy: FAIL (121.355s)
[213.967931] [006/134] (806s left) gem_mmap_gtt (big-bo-tiledy)
[214.043915] Subtest big-bo-tiledY: SKIP (0.000s)
[214.153264] [007/134] (806s left) gem_exec_schedule (preempt-queue)
[214.239897] Subtest preempt-queue: SKIP (0.000s)
[214.596047] [008/134] (806s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[214.787895] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[214.789603] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[214.953235] [009/134] (806s left) gem_gtt_cpu_tlb
[215.089377] [010/134] (805s left) kms_flip (modeset-vs-vblank-race)
[215.267054] Starting subtest: modeset-vs-vblank-race
[215.271009] Starting dynamic subtest: A-DP3
[218.423663] Dynamic subtest A-DP3: SUCCESS (3.151s)
[218.457740] Starting dynamic subtest: B-DP3
[221.571321] Dynamic subtest B-DP3: SUCCESS (3.145s)
[221.606245] Starting dynamic subtest: C-DP3
[224.781129] Dynamic subtest C-DP3: SUCCESS (3.207s)
[224.816255] Starting dynamic subtest: D-DP3
[227.907284] Dynamic subtest D-DP3: SUCCESS (3.122s)
[227.914523] Subtest modeset-vs-vblank-race: SUCCESS (12.646s)
[228.286537] [011/134] (792s left) gem_exec_fence (nb-await)
[228.487356] Starting subtest: nb-await
[228.488298] Starting dynamic subtest: rcs0
[228.583920] Dynamic subtest rcs0: SUCCESS (0.099s)
[228.593955] Starting dynamic subtest: bcs0
[228.647530] Dynamic subtest bcs0: SUCCESS (0.063s)
[228.668557] Starting dynamic subtest: vcs0
[228.728051] Dynamic subtest vcs0: SUCCESS (0.078s)
[228.763745] Starting dynamic subtest: vcs1
[228.824171] Dynamic subtest vcs1: SUCCESS (0.093s)
[228.855519] Starting dynamic subtest: vecs0
[228.910179] Dynamic subtest vecs0: SUCCESS (0.084s)
[228.941906] Starting dynamic subtest: vecs1
[228.998844] Dynamic subtest vecs1: SUCCESS (0.086s)
[229.010215] Starting dynamic subtest: ccs0
[229.062323] Dynamic subtest ccs0: SUCCESS (0.062s)
[229.063469] Subtest nb-await: SUCCESS (0.579s)
[229.854786] [FACT gem_exec_fence (nb-await)] new: kernel.kmod_is_loaded.vgem: true
[229.856986] [012/134] (791s left) perf_pmu (init-busy)
[229.927570] Starting subtest: init-busy
[229.928487] Starting dynamic subtest: rcs0
[229.930368] Dynamic subtest rcs0: SUCCESS (0.002s)
[229.938563] Starting dynamic subtest: bcs0
[229.939436] Dynamic subtest bcs0: SUCCESS (0.000s)
[229.947513] Starting dynamic subtest: vcs0
[229.948424] Dynamic subtest vcs0: SUCCESS (0.000s)
[229.956505] Starting dynamic subtest: vcs1
[229.957436] Dynamic subtest vcs1: SUCCESS (0.001s)
[229.965638] Starting dynamic subtest: vecs0
[229.966482] Dynamic subtest vecs0: SUCCESS (0.000s)
[229.975255] Starting dynamic subtest: vecs1
[229.976167] Dynamic subtest vecs1: SUCCESS (0.000s)
[229.984295] Starting dynamic subtest: ccs0
[229.985176] Dynamic subtest ccs0: SUCCESS (0.000s)
[229.986208] Subtest init-busy: SUCCESS (0.009s)
[230.067676] [013/134] (791s left) syncobj_wait (wait-all-for-submit-complex)
[230.146533] Starting subtest: wait-all-for-submit-complex
[230.373489] Subtest wait-all-for-submit-complex: SUCCESS (0.218s)
[230.552809] [014/134] (790s left) kms_cursor_crc (cursor-offscreen-max-size)
[231.066161] Starting subtest: cursor-offscreen-max-size
[231.068801] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[231.323044] [015/134] (790s left) i915_pm_rpm (system-suspend-execbuf)
[233.031221] Starting subtest: system-suspend-execbuf
[293.271436] Subtest system-suspend-execbuf: SUCCESS (45.031s)
[293.699117] [016/134] (727s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff)
[293.891894] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff
[293.893614] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[294.083100] [017/134] (727s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[294.270787] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[294.285986] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.014s)
[294.423208] [018/134] (727s left) kms_feature_discovery (display-1x)
[294.608522] Starting subtest: display-1x
[294.609401] Subtest display-1x: SUCCESS (0.000s)
[294.738783] [019/134] (726s left) gem_exec_params (invalid-bsd-ring)
[294.820507] Starting subtest: invalid-bsd-ring
[294.821393] Subtest invalid-bsd-ring: SUCCESS (0.000s)
[295.003414] [020/134] (726s left) kms_chamelium_hpd (common-hpd-after-suspend)
[295.276928] Subtest common-hpd-after-suspend: SKIP (0.000s)
[295.469407] [021/134] (726s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[295.669558] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[295.671216] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[295.836490] [022/134] (726s left) kms_color (deep-color)
[296.024587] Starting subtest: deep-color
[299.337398] Starting dynamic subtest: pipe-A-DP-3-gamma
[305.561990] Dynamic subtest pipe-A-DP-3-gamma: SUCCESS (6.224s)
[305.579643] Starting dynamic subtest: pipe-A-DP-3-degamma
[311.749311] Dynamic subtest pipe-A-DP-3-degamma: SUCCESS (6.187s)
[311.760578] Starting dynamic subtest: pipe-A-DP-3-ctm
[317.928535] Dynamic subtest pipe-A-DP-3-ctm: SUCCESS (6.179s)
[321.138994] Starting dynamic subtest: pipe-B-DP-3-gamma
[327.270632] Dynamic subtest pipe-B-DP-3-gamma: SUCCESS (6.153s)
[327.281707] Starting dynamic subtest: pipe-B-DP-3-degamma
[333.455510] Dynamic subtest pipe-B-DP-3-degamma: SUCCESS (6.183s)
[333.475455] Starting dynamic subtest: pipe-B-DP-3-ctm
[339.653431] Dynamic subtest pipe-B-DP-3-ctm: SUCCESS (6.195s)
[342.950230] Starting dynamic subtest: pipe-C-DP-3-gamma
[349.124473] Dynamic subtest pipe-C-DP-3-gamma: SUCCESS (6.190s)
[349.145478] Starting dynamic subtest: pipe-C-DP-3-degamma
[355.291872] Dynamic subtest pipe-C-DP-3-degamma: SUCCESS (6.165s)
[355.309460] Starting dynamic subtest: pipe-C-DP-3-ctm
[361.523233] Dynamic subtest pipe-C-DP-3-ctm: SUCCESS (6.230s)
[364.787996] Starting dynamic subtest: pipe-D-DP-3-gamma
[370.973037] Dynamic subtest pipe-D-DP-3-gamma: SUCCESS (6.206s)
[370.992051] Starting dynamic subtest: pipe-D-DP-3-degamma
[377.161535] Dynamic subtest pipe-D-DP-3-degamma: SUCCESS (6.187s)
[377.180478] Starting dynamic subtest: pipe-D-DP-3-ctm
[383.350741] Dynamic subtest pipe-D-DP-3-ctm: SUCCESS (6.187s)
[383.351773] Subtest deep-color: SUCCESS (87.326s)
[383.656256] [023/134] (638s left) i915_drm_fdinfo (virtual-busy-idle-all)
[383.728362] Starting subtest: virtual-busy-idle-all
[383.730097] Subtest virtual-busy-idle-all: SKIP (0.000s)
[383.841338] [024/134] (638s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[384.031851] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[384.033634] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[384.235186] [025/134] (637s left) gem_mmap_gtt (coherency)
[384.315080] Subtest coherency: SKIP (0.000s)
[384.380893] [026/134] (637s left) gem_exec_balancer (bonded-pair)
[384.472127] Starting subtest: bonded-pair
[384.474128] Subtest bonded-pair: SKIP (0.000s)
[384.874759] [027/134] (637s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[385.057706] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[385.060206] Starting dynamic subtest: pipe-A-DP-3
[385.069332] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[385.080287] Starting dynamic subtest: pipe-B-DP-3
[385.089458] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[385.100271] Starting dynamic subtest: pipe-C-DP-3
[385.109282] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[385.120379] Starting dynamic subtest: pipe-D-DP-3
[385.134268] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[385.136268] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.007s)
[385.529554] [028/134] (636s left) prime_mmap (test_dup)
[385.605349] Starting subtest: test_dup
[385.606211] Starting dynamic subtest: test_dup-smem
[385.652415] Dynamic subtest test_dup-smem: SUCCESS (0.048s)
[385.665090] Starting dynamic subtest: test_dup-lmem0
[385.840722] Dynamic subtest test_dup-lmem0: SUCCESS (0.187s)
[385.841975] Subtest test_dup: SUCCESS (0.237s)
[385.976150] [029/134] (636s left) prime_vgem (fence-write-hang)
[386.067002] Subtest fence-write-hang: SKIP (0.000s)
[386.263682] [030/134] (636s left) gen9_exec_parse (bb-start-param)
[386.346330] Subtest bb-start-param: SKIP (0.000s)
[386.425530] [031/134] (636s left) kms_busy (extended-pageflip-hang-newfb)
[386.623204] Starting subtest: extended-pageflip-hang-newfb
[386.624116] Starting dynamic subtest: pipe-A
[394.511390] Dynamic subtest pipe-A: SUCCESS (7.886s)
[394.538076] Starting dynamic subtest: pipe-D
[402.400461] Dynamic subtest pipe-D: SUCCESS (7.881s)
[402.401359] Subtest extended-pageflip-hang-newfb: SUCCESS (15.778s)
[402.745486] [032/134] (619s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[402.937140] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[402.938904] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[403.090535] [033/134] (619s left) kms_pipe_crc_basic (read-crc)
[403.278210] Starting subtest: read-crc
[403.279154] Starting dynamic subtest: pipe-A-DP-3
[403.938778] Dynamic subtest pipe-A-DP-3: SUCCESS (0.658s)
[403.960117] Starting dynamic subtest: pipe-B-DP-3
[404.549324] Dynamic subtest pipe-B-DP-3: SUCCESS (0.609s)
[404.563580] Starting dynamic subtest: pipe-C-DP-3
[405.124415] Dynamic subtest pipe-C-DP-3: SUCCESS (0.573s)
[405.139280] Starting dynamic subtest: pipe-D-DP-3
[405.656241] Dynamic subtest pipe-D-DP-3: SUCCESS (0.529s)
[405.657233] Subtest read-crc: SUCCESS (2.379s)
[405.929334] [034/134] (616s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75)
[406.123119] Starting subtest: planes-upscale-20x20-downscale-factor-0-75
[406.123830] Starting dynamic subtest: pipe-A
[406.220184] Dynamic subtest pipe-A: SUCCESS (0.098s)
[406.245267] Starting dynamic subtest: pipe-B
[406.449431] Dynamic subtest pipe-B: SUCCESS (0.227s)
[406.463552] Starting dynamic subtest: pipe-C
[406.646033] Dynamic subtest pipe-C: SUCCESS (0.195s)
[406.665904] Starting dynamic subtest: pipe-D
[406.875596] Dynamic subtest pipe-D: SUCCESS (0.228s)
[406.876515] Subtest planes-upscale-20x20-downscale-factor-0-75: SUCCESS (0.754s)
[407.205719] [035/134] (615s left) i915_power (sanity)
[407.291944] Starting subtest: sanity
[411.355095] Subtest sanity: SUCCESS (4.063s)
[411.528741] [036/134] (611s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled)
[411.612693] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled
[411.614646] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[411.908968] [037/134] (611s left) gem_ctx_isolation (nonpriv)
[411.997253] Starting subtest: nonpriv
[411.998187] Starting dynamic subtest: rcs0
[412.760889] Dynamic subtest rcs0: SUCCESS (0.763s)
[412.773361] Starting dynamic subtest: bcs0
[413.550187] Dynamic subtest bcs0: SUCCESS (0.788s)
[413.562402] Starting dynamic subtest: vcs0
[414.380286] Dynamic subtest vcs0: SUCCESS (0.829s)
[414.393193] Starting dynamic subtest: vcs1
[415.192228] Dynamic subtest vcs1: SUCCESS (0.811s)
[415.204884] Starting dynamic subtest: vecs0
[416.004108] Dynamic subtest vecs0: SUCCESS (0.811s)
[416.017209] Starting dynamic subtest: vecs1
[416.799582] Dynamic subtest vecs1: SUCCESS (0.794s)
[416.812601] Starting dynamic subtest: ccs0
[417.604413] Dynamic subtest ccs0: SUCCESS (0.804s)
[417.605344] Subtest nonpriv: SUCCESS (5.607s)
[417.932868] [038/134] (605s left) gem_lmem_swapping (parallel-random-verify-ccs)
[420.733422] Starting subtest: parallel-random-verify-ccs
[420.734276] Starting dynamic subtest: lmem0
[486.948513] Dynamic subtest lmem0: SUCCESS (66.212s)
[486.949434] Subtest parallel-random-verify-ccs: SUCCESS (66.213s)
[487.979843] [FACT gem_lmem_swapping (parallel-random-verify-ccs)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[487.980876] [FACT gem_lmem_swapping (parallel-random-verify-ccs)] deleted: kernel.kmod_is_loaded.i915: true
[487.982952] [039/134] (535s left) gem_mmap_wc (bad-size)
[489.562934] Subtest bad-size: SKIP (0.000s)
[489.621143] [FACT gem_mmap_wc (bad-size)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[489.623562] [FACT gem_mmap_wc (bad-size)] new: kernel.kmod_is_loaded.i915: true
[489.626492] [040/134] (533s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[489.817213] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[489.818974] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[489.982889] [041/134] (533s left) gem_exec_schedule (u-lateslice)
[490.076808] Starting subtest: u-lateslice
[490.077724] Starting dynamic subtest: rcs0
[490.134418] Dynamic subtest rcs0: SUCCESS (0.057s)
[490.148059] Starting dynamic subtest: bcs0
[490.157712] Dynamic subtest bcs0: SUCCESS (0.022s)
[490.170508] Starting dynamic subtest: vcs0
[490.183192] Dynamic subtest vcs0: SUCCESS (0.024s)
[490.195244] Starting dynamic subtest: vcs1
[490.204743] Dynamic subtest vcs1: SUCCESS (0.020s)
[490.216677] Starting dynamic subtest: vecs0
[490.225975] Dynamic subtest vecs0: SUCCESS (0.020s)
[490.238203] Starting dynamic subtest: vecs1
[490.249374] Dynamic subtest vecs1: SUCCESS (0.022s)
[490.261516] Starting dynamic subtest: ccs0
[490.271035] Dynamic subtest ccs0: SUCCESS (0.020s)
[490.271984] Subtest u-lateslice: SUCCESS (0.195s)
[490.779860] [042/134] (532s left) gem_mmap_wc (write-cpu-read-wc)
[490.869360] Subtest write-cpu-read-wc: SKIP (0.000s)
[490.941509] [043/134] (532s left) kms_flip (plain-flip-ts-check-interruptible)
[491.134440] Starting subtest: plain-flip-ts-check-interruptible
[491.139324] Starting dynamic subtest: A-DP3
[499.252855] Dynamic subtest A-DP3: SUCCESS (8.113s)
[499.294979] Starting dynamic subtest: B-DP3
[507.323566] Dynamic subtest B-DP3: SUCCESS (8.065s)
[507.339144] Starting dynamic subtest: C-DP3
[515.349589] Dynamic subtest C-DP3: SUCCESS (8.021s)
[515.365198] Starting dynamic subtest: D-DP3
[523.375710] Dynamic subtest D-DP3: SUCCESS (8.022s)
[523.378112] Subtest plain-flip-ts-check-interruptible: SUCCESS (32.243s)
[523.727374] [044/134] (499s left) kms_big_fb (linear-8bpp-rotate-270)
[523.927636] Starting subtest: linear-8bpp-rotate-270
[523.992249] Subtest linear-8bpp-rotate-270: SKIP (0.064s)
[524.207879] [045/134] (499s left) syncobj_timeline (signal-point-0)
[524.287403] Starting subtest: signal-point-0
[524.288344] Subtest signal-point-0: SUCCESS (0.000s)
[524.427983] [046/134] (499s left) gem_watchdog (default-physical)
[524.513849] Starting subtest: default-physical
[525.566838] Subtest default-physical: SUCCESS (1.053s)
[525.691687] [047/134] (498s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[525.886313] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[525.935669] [048/134] (497s left) perf (gen12-oa-tlb-invalidate)
[526.336366] Starting subtest: gen12-oa-tlb-invalidate
[526.337215] Starting dynamic subtest: 0-rcs0
[536.395056] Dynamic subtest 0-rcs0: SUCCESS (10.058s)
[536.396026] Subtest gen12-oa-tlb-invalidate: SUCCESS (10.059s)
[536.454267] [049/134] (487s left) kms_properties (crtc-properties-legacy)
[536.650948] Starting subtest: crtc-properties-legacy
[536.651901] Starting dynamic subtest: pipe-A-DP-3
[536.999792] Dynamic subtest pipe-A-DP-3: SUCCESS (0.348s)
[537.019192] Starting dynamic subtest: pipe-B-DP-3
[537.361399] Dynamic subtest pipe-B-DP-3: SUCCESS (0.359s)
[537.373847] Starting dynamic subtest: pipe-C-DP-3
[537.717123] Dynamic subtest pipe-C-DP-3: SUCCESS (0.353s)
[537.729448] Starting dynamic subtest: pipe-D-DP-3
[538.071100] Dynamic subtest pipe-D-DP-3: SUCCESS (0.352s)
[538.071980] Subtest crtc-properties-legacy: SUCCESS (1.421s)
[538.355847] [050/134] (485s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[538.552161] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[538.553844] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[538.737935] [051/134] (485s left) sysfs_defaults (readonly)
[538.820956] Starting subtest: readonly
[538.821865] Starting dynamic subtest: vecs0
[538.822853] Dynamic subtest vecs0: SUCCESS (0.000s)
[538.833791] Starting dynamic subtest: ccs0
[538.834789] Dynamic subtest ccs0: SUCCESS (0.000s)
[538.845758] Starting dynamic subtest: vcs0
[538.846972] Dynamic subtest vcs0: SUCCESS (0.000s)
[538.857628] Starting dynamic subtest: bcs0
[538.858683] Dynamic subtest bcs0: SUCCESS (0.000s)
[538.869342] Starting dynamic subtest: vecs1
[538.870383] Dynamic subtest vecs1: SUCCESS (0.000s)
[538.880845] Starting dynamic subtest: rcs0
[538.882059] Dynamic subtest rcs0: SUCCESS (0.001s)
[538.892497] Starting dynamic subtest: vcs1
[538.893593] Dynamic subtest vcs1: SUCCESS (0.000s)
[538.894625] Subtest readonly: SUCCESS (0.012s)
[538.952417] [052/134] (485s left) gem_exec_balancer (sequential)
[539.040816] Starting subtest: sequential
[544.988283] Subtest sequential: SUCCESS (5.947s)
[545.427530] [053/134] (478s left) gem_exercise_blt (fast-copy-emit)
[545.517741] Starting subtest: fast-copy-emit
[545.518561] Starting dynamic subtest: linear-smem-smem-emit
[545.562068] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.044s)
[545.574956] Starting dynamic subtest: linear-smem-lmem0-emit
[545.578376] Dynamic subtest linear-smem-lmem0-emit: SUCCESS (0.015s)
[545.590699] Starting dynamic subtest: linear-lmem0-smem-emit
[545.682933] Dynamic subtest linear-lmem0-smem-emit: SUCCESS (0.103s)
[545.695504] Starting dynamic subtest: linear-lmem0-lmem0-emit
[545.797200] Dynamic subtest linear-lmem0-lmem0-emit: SUCCESS (0.113s)
[545.809647] Starting dynamic subtest: xmajor-smem-smem-emit
[545.814933] Dynamic subtest xmajor-smem-smem-emit: SUCCESS (0.017s)
[545.827407] Starting dynamic subtest: xmajor-smem-lmem0-emit
[545.830235] Dynamic subtest xmajor-smem-lmem0-emit: SUCCESS (0.014s)
[545.842617] Starting dynamic subtest: xmajor-lmem0-smem-emit
[545.935556] Dynamic subtest xmajor-lmem0-smem-emit: SUCCESS (0.104s)
[545.948182] Starting dynamic subtest: xmajor-lmem0-lmem0-emit
[546.047309] Dynamic subtest xmajor-lmem0-lmem0-emit: SUCCESS (0.111s)
[546.059880] Starting dynamic subtest: tile4-smem-smem-emit
[546.063467] Dynamic subtest tile4-smem-smem-emit: SUCCESS (0.015s)
[546.075945] Starting dynamic subtest: tile4-smem-lmem0-emit
[546.078664] Dynamic subtest tile4-smem-lmem0-emit: SUCCESS (0.014s)
[546.091142] Starting dynamic subtest: tile4-lmem0-smem-emit
[546.186318] Dynamic subtest tile4-lmem0-smem-emit: SUCCESS (0.106s)
[546.198882] Starting dynamic subtest: tile4-lmem0-lmem0-emit
[546.289891] Dynamic subtest tile4-lmem0-lmem0-emit: SUCCESS (0.102s)
[546.302426] Starting dynamic subtest: tile64-smem-smem-emit
[546.306077] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.015s)
[546.318422] Starting dynamic subtest: tile64-smem-lmem0-emit
[546.321400] Dynamic subtest tile64-smem-lmem0-emit: SUCCESS (0.014s)
[546.333834] Starting dynamic subtest: tile64-lmem0-smem-emit
[546.434462] Dynamic subtest tile64-lmem0-smem-emit: SUCCESS (0.112s)
[546.447049] Starting dynamic subtest: tile64-lmem0-lmem0-emit
[546.538176] Dynamic subtest tile64-lmem0-lmem0-emit: SUCCESS (0.103s)
[546.539167] Subtest fast-copy-emit: SUCCESS (1.021s)
[546.754201] [054/134] (477s left) gem_exec_params (larger-than-life-batch)
[546.838167] Starting subtest: larger-than-life-batch
[556.925396] Subtest larger-than-life-batch: SUCCESS (10.086s)
[557.379382] [055/134] (466s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[557.607263] Starting subtest: pixel-format-y-tiled-ccs-modifier
[557.638133] Starting dynamic subtest: pipe-A-plane-0
[557.639957] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[557.651676] Starting dynamic subtest: pipe-A-plane-3
[557.653385] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[557.665122] Starting dynamic subtest: pipe-A-plane-5
[557.666924] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[557.841437] Starting dynamic subtest: pipe-B-plane-0
[557.843229] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[557.854885] Starting dynamic subtest: pipe-B-plane-3
[557.856677] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[557.868296] Starting dynamic subtest: pipe-B-plane-5
[557.870096] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[557.904881] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.297s)
[558.116765] [056/134] (466s left) syncobj_wait (wait-all-for-submit-delayed-submit)
[558.199393] Starting subtest: wait-all-for-submit-delayed-submit
[558.300512] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.101s)
[558.421144] [057/134] (465s left) syncobj_eventfd (timeline-wait)
[558.508392] Starting subtest: timeline-wait
[558.519175] Subtest timeline-wait: SUCCESS (0.011s)
[558.645385] [058/134] (465s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180)
[558.844421] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180
[558.846195] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[559.038317] [059/134] (465s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[559.118898] Starting subtest: invalid-smem-bo-on-discrete
[559.119856] Subtest invalid-smem-bo-on-discrete: SUCCESS (0.000s)
[559.383730] [060/134] (465s left) dumb_buffer (map-invalid-size)
[559.461323] Starting subtest: map-invalid-size
[559.462249] Subtest map-invalid-size: SUCCESS (0.000s)
[559.611842] [061/134] (464s left) kms_addfb_basic (unused-pitches)
[559.699876] Starting subtest: unused-pitches
[559.700855] Subtest unused-pitches: SUCCESS (0.000s)
[559.991336] [062/134] (464s left) gem_eio (wait-immediate)
[560.360455] Starting subtest: wait-immediate
[561.051397] Subtest wait-immediate: SUCCESS (0.691s)
[561.315143] [063/134] (463s left) prime_vgem (sync)
[561.407453] Starting subtest: sync
[561.408383] Starting dynamic subtest: rcs0
[561.510342] Dynamic subtest rcs0: SUCCESS (0.102s)
[561.525012] Starting dynamic subtest: bcs0
[561.598549] Dynamic subtest bcs0: SUCCESS (0.087s)
[561.620477] Starting dynamic subtest: vcs0
[561.646881] Dynamic subtest vcs0: SUCCESS (0.046s)
[561.671493] Starting dynamic subtest: vcs1
[561.691837] Dynamic subtest vcs1: SUCCESS (0.043s)
[561.715652] Starting dynamic subtest: vecs0
[561.733912] Dynamic subtest vecs0: SUCCESS (0.040s)
[561.752988] Starting dynamic subtest: vecs1
[561.774099] Dynamic subtest vecs1: SUCCESS (0.039s)
[561.792759] Starting dynamic subtest: ccs0
[561.814568] Dynamic subtest ccs0: SUCCESS (0.039s)
[561.815550] Subtest sync: SUCCESS (0.408s)
[562.032906] [064/134] (462s left) kms_lease (lease-revoke)
[562.221317] Starting subtest: lease-revoke
[562.222242] Starting dynamic subtest: pipe-A-DP-3
[562.331302] Dynamic subtest pipe-A-DP-3: SUCCESS (0.109s)
[562.345797] Starting dynamic subtest: pipe-B-DP-3
[562.405495] Dynamic subtest pipe-B-DP-3: SUCCESS (0.073s)
[562.419967] Starting dynamic subtest: pipe-C-DP-3
[562.484265] Dynamic subtest pipe-C-DP-3: SUCCESS (0.076s)
[562.497375] Starting dynamic subtest: pipe-D-DP-3
[562.558255] Dynamic subtest pipe-D-DP-3: SUCCESS (0.072s)
[562.559174] Subtest lease-revoke: SUCCESS (0.338s)
[562.779086] [065/134] (462s left) kms_prime (basic-crc-hybrid)
[562.970196] Subtest basic-crc-hybrid: SKIP (0.000s)
[563.165774] [066/134] (461s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0)
[563.361045] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0
[564.685168] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.323s)
[564.955415] [067/134] (460s left) gem_create (create-ext-placement-each)
[565.147217] Starting subtest: create-ext-placement-each
[565.148170] Subtest create-ext-placement-each: SUCCESS (0.000s)
[565.348339] [068/134] (459s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[565.429494] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[565.539634] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.109s)
[565.719734] [069/134] (459s left) gem_softpin (evict-prime-sanity-check)
[565.803137] Starting subtest: evict-prime-sanity-check
[565.804090] Starting dynamic subtest: rcs0
[566.968393] Dynamic subtest rcs0: SUCCESS (1.165s)
[566.984996] Starting dynamic subtest: bcs0
[568.078324] Dynamic subtest bcs0: SUCCESS (1.109s)
[568.092689] Starting dynamic subtest: vcs0
[569.202306] Dynamic subtest vcs0: SUCCESS (1.123s)
[569.217722] Starting dynamic subtest: vcs1
[570.341485] Dynamic subtest vcs1: SUCCESS (1.138s)
[570.358003] Starting dynamic subtest: vecs0
[571.471323] Dynamic subtest vecs0: SUCCESS (1.128s)
[571.486431] Starting dynamic subtest: vecs1
[572.603297] Dynamic subtest vecs1: SUCCESS (1.131s)
[572.619425] Starting dynamic subtest: ccs0
[573.720202] Dynamic subtest ccs0: SUCCESS (1.115s)
[573.735287] Starting dynamic subtest: all
[574.847438] Dynamic subtest all: SUCCESS (1.126s)
[574.848470] Subtest evict-prime-sanity-check: SUCCESS (9.045s)
[574.986838] [070/134] (450s left) kms_cursor_edge_walk (256x256-top-bottom)
[575.173405] Starting subtest: 256x256-top-bottom
[575.174338] Starting dynamic subtest: pipe-A-DP-3
[578.644395] Dynamic subtest pipe-A-DP-3: SUCCESS (3.469s)
[578.662440] Starting dynamic subtest: pipe-D-DP-3
[581.976448] Dynamic subtest pipe-D-DP-3: SUCCESS (3.329s)
[581.977495] Subtest 256x256-top-bottom: SUCCESS (6.803s)
[582.297061] [071/134] (443s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format)
[582.484252] Starting subtest: plane-scaler-unity-scaling-with-pixel-format
[582.484977] Starting dynamic subtest: pipe-A
[584.559493] Dynamic subtest pipe-A: SUCCESS (2.075s)
[584.583833] Starting dynamic subtest: pipe-B
[586.755427] Dynamic subtest pipe-B: SUCCESS (2.194s)
[586.781296] Starting dynamic subtest: pipe-C
[587.069081] Dynamic subtest pipe-C: SUCCESS (0.311s)
[587.099618] Starting dynamic subtest: pipe-D
[587.382191] Dynamic subtest pipe-D: SUCCESS (0.311s)
[587.386069] Subtest plane-scaler-unity-scaling-with-pixel-format: SUCCESS (4.900s)
[587.750803] [072/134] (437s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[588.123670] Starting subtest: cursor-rapid-movement-128x128
[588.128352] Starting dynamic subtest: pipe-A-DP-3
[588.574996] Dynamic subtest pipe-A-DP-3: SUCCESS (0.445s)
[588.626734] Starting dynamic subtest: pipe-D-DP-3
[588.986840] Dynamic subtest pipe-D-DP-3: SUCCESS (0.372s)
[588.987892] Subtest cursor-rapid-movement-128x128: SUCCESS (0.864s)
[589.469807] [073/134] (436s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[589.665067] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[589.666874] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[589.864619] [074/134] (435s left) kms_chamelium_color (ctm-blue-to-red)
[590.051099] Subtest ctm-blue-to-red: SKIP (0.000s)
[590.150868] [075/134] (435s left) kms_big_fb (4-tiled-addfb)
[590.349416] Starting subtest: 4-tiled-addfb
[590.350361] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[590.563461] [076/134] (435s left) kms_psr (fbc-psr2-cursor-render)
[590.752120] Subtest fbc-psr2-cursor-render: SKIP (0.000s)
[590.824720] [077/134] (435s left) kms_psr (fbc-psr-sprite-mmap-cpu)
[591.013237] Subtest fbc-psr-sprite-mmap-cpu: SKIP (0.000s)
[591.074739] [078/134] (434s left) gem_sync (basic-many-each)
[591.169337] Starting subtest: basic-many-each
[593.720497] Subtest basic-many-each: SUCCESS (2.552s)
[594.013398] [079/134] (432s left) prime_mmap_coherency (ioctl-errors)
[594.097352] Starting subtest: ioctl-errors
[599.912482] Subtest ioctl-errors: SUCCESS (5.815s)
[600.175873] [080/134] (426s left) gem_eio (unwedge-stress)
[600.516209] Starting subtest: unwedge-stress
[600.517162] Starting dynamic subtest: render
[618.121360] Dynamic subtest render: SUCCESS (17.604s)
[618.135134] Starting dynamic subtest: bsd1
[636.127260] Dynamic subtest bsd1: SUCCESS (18.004s)
[636.140569] Starting dynamic subtest: bsd2
[654.187942] Dynamic subtest bsd2: SUCCESS (18.058s)
[654.208586] Starting dynamic subtest: blt
[672.158459] Dynamic subtest blt: SUCCESS (17.967s)
[672.172567] Starting dynamic subtest: vebox
[690.130308] Dynamic subtest vebox: SUCCESS (17.969s)
[690.131385] Subtest unwedge-stress: SUCCESS (89.611s)
[690.490858] [081/134] (335s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[690.679202] Starting subtest: cursorA-vs-flipB-legacy
[690.680956] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[690.834915] [082/134] (335s left) gem_mmap_offset (open-flood)
[690.914649] Starting subtest: open-flood
[712.401384] Subtest open-flood: SUCCESS (21.485s)
[712.579697] [083/134] (313s left) gem_pxp (verify-pxp-stale-buf-optout-execution)
[715.186305] Starting subtest: verify-pxp-stale-buf-optout-execution
[715.188518] Subtest verify-pxp-stale-buf-optout-execution: SKIP (0.000s)
[715.363222] [084/134] (311s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[715.554932] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[715.556664] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[715.743011] [085/134] (310s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[715.936820] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[715.938481] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[716.122718] [086/134] (310s left) perf (whitelisted-registers-userspace-config)
[716.372959] Starting subtest: whitelisted-registers-userspace-config
[716.373908] Subtest whitelisted-registers-userspace-config: SUCCESS (0.001s)
[716.434793] [087/134] (310s left) kms_properties (colorop-properties-atomic)
[716.628737] Starting subtest: colorop-properties-atomic
[716.631095] Starting dynamic subtest: pipe-A-DP-3
[716.834153] Dynamic subtest pipe-A-DP-3: SUCCESS (0.203s)
[716.861150] Starting dynamic subtest: pipe-B-DP-3
[717.053372] Dynamic subtest pipe-B-DP-3: SUCCESS (0.217s)
[717.078670] Starting dynamic subtest: pipe-C-DP-3
[717.235442] Dynamic subtest pipe-C-DP-3: SUCCESS (0.178s)
[717.254175] Starting dynamic subtest: pipe-D-DP-3
[717.439055] Dynamic subtest pipe-D-DP-3: SUCCESS (0.201s)
[717.440252] Subtest colorop-properties-atomic: SUCCESS (0.810s)
[717.784546] [088/134] (309s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[717.976804] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[717.978463] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[718.188517] [089/134] (308s left) kms_psr (psr-sprite-blt)
[718.376094] Subtest psr-sprite-blt: SKIP (0.000s)
[718.442831] [090/134] (308s left) kms_addfb_basic (no-handle)
[718.523399] Starting subtest: no-handle
[718.524346] Subtest no-handle: SUCCESS (0.000s)
[718.800989] [091/134] (308s left) gem_userptr_blits (coherency-unsync)
[718.885948] Subtest coherency-unsync: SKIP (0.000s)
[719.111140] [092/134] (308s left) syncobj_wait (single-wait-all-for-submit-signaled)
[719.195704] Starting subtest: single-wait-all-for-submit-signaled
[719.196609] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[719.380080] [093/134] (307s left) gem_busy (close-race)
[719.469498] Starting subtest: close-race
[741.583415] Subtest close-race: SUCCESS (22.113s)
[742.156855] [094/134] (285s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-downscaling)
[742.392220] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-downscaling
[742.393959] Subtest flip-32bpp-ytile-to-64bpp-ytile-downscaling: SKIP (0.000s)
[742.551458] [095/134] (284s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[742.630957] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[742.712698] [096/134] (284s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[742.902557] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[745.780587] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (2.879s)
[746.015765] [097/134] (281s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[746.205860] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu
[746.207474] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[746.416884] [098/134] (281s left) gem_mmap_wc (coherency)
[746.493193] Subtest coherency: SKIP (0.000s)
[746.576834] [099/134] (281s left) kms_pm_rpm (basic-pci-d3-state)
[748.129346] Starting subtest: basic-pci-d3-state
[748.771451] Subtest basic-pci-d3-state: SUCCESS (0.641s)
[749.022886] [100/134] (278s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt)
[749.213120] Starting subtest: fbcpsr-rgb101010-draw-blt
[749.214856] Subtest fbcpsr-rgb101010-draw-blt: SKIP (0.000s)
[749.424454] [101/134] (278s left) gem_exec_async (forked-writes)
[749.520200] Starting subtest: forked-writes
[749.521087] Starting dynamic subtest: rcs0
[749.582641] Dynamic subtest rcs0: SUCCESS (0.063s)
[749.596990] Starting dynamic subtest: bcs0
[749.619176] Dynamic subtest bcs0: SUCCESS (0.035s)
[749.633048] Starting dynamic subtest: vcs0
[749.654418] Dynamic subtest vcs0: SUCCESS (0.033s)
[749.668107] Starting dynamic subtest: vcs1
[749.688874] Dynamic subtest vcs1: SUCCESS (0.034s)
[749.703120] Starting dynamic subtest: vecs0
[749.723512] Dynamic subtest vecs0: SUCCESS (0.034s)
[749.737233] Starting dynamic subtest: vecs1
[749.758293] Dynamic subtest vecs1: SUCCESS (0.034s)
[749.772032] Starting dynamic subtest: ccs0
[749.792412] Dynamic subtest ccs0: SUCCESS (0.033s)
[749.793330] Subtest forked-writes: SUCCESS (0.274s)
[750.155638] [102/134] (277s left) syncobj_wait (single-wait-all-for-submit-submitted)
[750.241494] Starting subtest: single-wait-all-for-submit-submitted
[750.347319] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.105s)
[750.539598] [103/134] (277s left) gem_exec_whisper (basic-fds-priority)
[750.631343] Starting subtest: basic-fds-priority
[773.268104] Subtest basic-fds-priority: SUCCESS (22.637s)
[773.548412] [104/134] (254s left) i915_drm_fdinfo (memory-info-resident)
[773.618552] Starting subtest: memory-info-resident
[773.619450] Starting dynamic subtest: lmem0
[777.238852] Dynamic subtest lmem0: SUCCESS (3.619s)
[777.255824] Starting dynamic subtest: smem0
[781.890135] Dynamic subtest smem0: SUCCESS (4.648s)
[781.891106] Subtest memory-info-resident: SUCCESS (8.272s)
[782.031298] [105/134] (246s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs)
[782.227797] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs
[782.229976] Starting dynamic subtest: pipe-A-DP-3
[782.238400] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[782.251934] Starting dynamic subtest: pipe-B-DP-3
[782.260410] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[782.273551] Starting dynamic subtest: pipe-C-DP-3
[782.281841] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[782.295119] Starting dynamic subtest: pipe-D-DP-3
[782.305000] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[782.307050] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.009s)
[782.702581] [106/134] (245s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc)
[782.889995] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc
[782.891729] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[783.126188] [107/134] (245s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[783.323819] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[783.325497] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[783.519505] [108/134] (245s left) kms_psr (psr2-dpms)
[783.724355] Subtest psr2-dpms: SKIP (0.000s)
[783.794152] [109/134] (244s left) syncobj_timeline (single-wait-for-submit-signaled)
[783.874966] Starting subtest: single-wait-for-submit-signaled
[783.876406] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[784.068740] [110/134] (244s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[784.253349] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[784.254217] Starting dynamic subtest: pipe-A-DP-3
[784.262489] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[784.276316] Starting dynamic subtest: pipe-B-DP-3
[784.284707] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[784.300444] Starting dynamic subtest: pipe-C-DP-3
[784.309404] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[784.323038] Starting dynamic subtest: pipe-D-DP-3
[784.333015] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[784.335096] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[784.744776] [111/134] (244s left) gem_exec_reloc (basic-gtt-cpu-noreloc)
[784.843497] Subtest basic-gtt-cpu-noreloc: SKIP (0.000s)
[784.953769] [112/134] (243s left) kms_atomic (plane-cursor-legacy)
[785.142152] Starting subtest: plane-cursor-legacy
[785.143042] Starting dynamic subtest: pipe-A-DP-3
[785.734830] Dynamic subtest pipe-A-DP-3: SUCCESS (0.592s)
[785.735727] Subtest plane-cursor-legacy: SUCCESS (0.594s)
[786.066838] [113/134] (242s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[786.267078] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s)
[786.425486] [114/134] (242s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[786.623904] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[786.625561] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[786.838973] [115/134] (242s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[787.034157] Starting subtest: 2x-absolute-wf_vblank-interruptible
[787.049694] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.015s)
[787.218286] [116/134] (241s left) kms_universal_plane (universal-plane-sanity)
[787.401520] Starting subtest: universal-plane-sanity
[787.403959] Starting dynamic subtest: pipe-A-DP-3
[788.035136] Dynamic subtest pipe-A-DP-3: SUCCESS (0.632s)
[788.052360] Starting dynamic subtest: pipe-B-DP-3
[788.528195] Dynamic subtest pipe-B-DP-3: SUCCESS (0.490s)
[788.547958] Starting dynamic subtest: pipe-C-DP-3
[789.011180] Dynamic subtest pipe-C-DP-3: SUCCESS (0.480s)
[789.031626] Starting dynamic subtest: pipe-D-DP-3
[789.502563] Dynamic subtest pipe-D-DP-3: SUCCESS (0.488s)
[789.503512] Subtest universal-plane-sanity: SUCCESS (2.100s)
[789.798937] [117/134] (239s left) gem_barrier_race (remote-request)
[789.897103] Starting subtest: remote-request
[789.898106] Starting dynamic subtest: rcs0
[795.039265] Dynamic subtest rcs0: SUCCESS (5.142s)
[795.040194] Subtest remote-request: SUCCESS (5.143s)
[795.261016] [118/134] (234s left) kms_psr (fbc-pr-cursor-blt)
[795.451148] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[795.523323] [119/134] (233s left) kms_frontbuffer_tracking (psr-abgr161616f-draw-mmap-gtt)
[795.713303] Starting subtest: psr-abgr161616f-draw-mmap-gtt
[795.715037] Subtest psr-abgr161616f-draw-mmap-gtt: SKIP (0.000s)
[795.886339] [120/134] (233s left) kms_plane_lowres (tiling-yf)
[796.072587] Starting subtest: tiling-yf
[796.074336] Subtest tiling-yf: SKIP (0.000s)
[796.248986] [121/134] (233s left) kms_getfb (getfb-handle-valid)
[796.435864] Starting subtest: getfb-handle-valid
[796.436818] Subtest getfb-handle-valid: SUCCESS (0.000s)
[796.661737] [122/134] (233s left) kms_psr (pr-primary-mmap-cpu)
[796.851382] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[796.929339] [123/134] (232s left) kms_joiner (basic-max-non-joiner)
[797.123412] Starting subtest: basic-max-non-joiner
[797.125171] Subtest basic-max-non-joiner: SKIP (0.000s)
[797.285875] [124/134] (232s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[797.362503] Starting subtest: multi-wait-all-for-submit-available-signaled
[797.363412] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.001s)
[797.542790] [125/134] (232s left) i915_query (query-topology-kernel-writes)
[797.623703] Starting subtest: query-topology-kernel-writes
[797.624613] Subtest query-topology-kernel-writes: SUCCESS (0.000s)
[797.809215] [126/134] (232s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[797.994355] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[797.995241] Starting dynamic subtest: pipe-A-DP-3
[798.003545] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[798.017067] Starting dynamic subtest: pipe-B-DP-3
[798.025548] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[798.038874] Starting dynamic subtest: pipe-C-DP-3
[798.047367] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[798.060701] Starting dynamic subtest: pipe-D-DP-3
[798.070538] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[798.072413] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SKIP (0.007s)
[798.477152] [127/134] (231s left) gem_exec_create (forked)
[798.563279] Starting subtest: forked
[798.564224] Starting dynamic subtest: smem
[818.701964] Dynamic subtest smem: SUCCESS (20.138s)
[818.724220] Starting dynamic subtest: lmem0
[838.861368] Dynamic subtest lmem0: SUCCESS (20.158s)
[838.862328] Subtest forked: SUCCESS (40.298s)
[839.133227] [128/134] (191s left) kms_big_fb (y-tiled-addfb-size-offset-overflow)
[839.330984] Starting subtest: y-tiled-addfb-size-offset-overflow
[839.332800] Subtest y-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[839.529786] [129/134] (190s left) kms_vblank (ts-continuation-modeset-hang)
[839.718807] Starting subtest: ts-continuation-modeset-hang
[839.721126] Starting dynamic subtest: pipe-A-DP-3
[865.791084] Dynamic subtest pipe-A-DP-3: SUCCESS (26.069s)
[865.806268] Starting dynamic subtest: pipe-D-DP-3
[890.785494] Dynamic subtest pipe-D-DP-3: SUCCESS (24.991s)
[890.786367] Subtest ts-continuation-modeset-hang: SUCCESS (51.066s)
[891.104939] [130/134] (139s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt)
[891.301073] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt
[894.073514] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (2.773s)
[894.325682] [131/134] (136s left) syncobj_wait (invalid-reset-bad-pad)
[894.410907] Starting subtest: invalid-reset-bad-pad
[894.411781] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[894.543250] [132/134] (136s left) drm_read (empty-block)
[894.807577] Starting subtest: empty-block
[895.808949] Subtest empty-block: SUCCESS (1.002s)
[896.048020] [133/134] (134s left) api_intel_bb (render-ccs)
[896.127534] Starting subtest: render-ccs
[896.219591] Subtest render-ccs: SUCCESS (0.093s)
[896.461242] [134/134] (134s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[896.652902] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[896.654742] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[896.863053] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: gem_ctx_persistence
results: parsing output: 2/ for test: kms_cursor_legacy
results: parsing output: 3/ for test: kms_chamelium_color
results: parsing output: 4/ for test: kms_content_protection
results: parsing output: 5/ for test: gem_mmap_gtt
results: parsing output: 6/ for test: gem_exec_schedule
results: parsing output: 7/ for test: kms_big_fb
results: parsing output: 8/ for test: gem_gtt_cpu_tlb
results: parsing output: 9/ for test: kms_flip
results: parsing output: 10/ for test: gem_exec_fence
results: parsing output: 11/ for test: perf_pmu
results: parsing output: 12/ for test: syncobj_wait
results: parsing output: 13/ for test: kms_cursor_crc
results: parsing output: 14/ for test: i915_pm_rpm
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: kms_flip
results: parsing output: 17/ for test: kms_feature_discovery
results: parsing output: 18/ for test: gem_exec_params
results: parsing output: 19/ for test: kms_chamelium_hpd
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_color
results: parsing output: 22/ for test: i915_drm_fdinfo
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: gem_mmap_gtt
results: parsing output: 25/ for test: gem_exec_balancer
results: parsing output: 26/ for test: kms_ccs
results: parsing output: 27/ for test: prime_mmap
results: parsing output: 28/ for test: prime_vgem
results: parsing output: 29/ for test: gen9_exec_parse
results: parsing output: 30/ for test: kms_busy
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_pipe_crc_basic
results: parsing output: 33/ for test: kms_plane_scaling
results: parsing output: 34/ for test: i915_power
results: parsing output: 35/ for test: gem_render_copy
results: parsing output: 36/ for test: gem_ctx_isolation
results: parsing output: 37/ for test: gem_lmem_swapping
results: parsing output: 38/ for test: gem_mmap_wc
results: parsing output: 39/ for test: kms_flip_scaled_crc
results: parsing output: 40/ for test: gem_exec_schedule
results: parsing output: 41/ for test: gem_mmap_wc
results: parsing output: 42/ for test: kms_flip
results: parsing output: 43/ for test: kms_big_fb
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: gem_watchdog
results: parsing output: 46/ for test: kms_psr2_sf
results: parsing output: 47/ for test: perf
results: parsing output: 48/ for test: kms_properties
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: sysfs_defaults
results: parsing output: 51/ for test: gem_exec_balancer
results: parsing output: 52/ for test: gem_exercise_blt
results: parsing output: 53/ for test: gem_exec_params
results: parsing output: 54/ for test: kms_plane
results: parsing output: 55/ for test: syncobj_wait
results: parsing output: 56/ for test: syncobj_eventfd
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: kms_addfb_basic
results: parsing output: 59/ for test: dumb_buffer
results: parsing output: 60/ for test: kms_addfb_basic
results: parsing output: 61/ for test: gem_eio
results: parsing output: 62/ for test: prime_vgem
results: parsing output: 63/ for test: kms_lease
results: parsing output: 64/ for test: kms_prime
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: gem_create
results: parsing output: 67/ for test: syncobj_timeline
results: parsing output: 68/ for test: gem_softpin
results: parsing output: 69/ for test: kms_cursor_edge_walk
results: parsing output: 70/ for test: kms_plane_scaling
results: parsing output: 71/ for test: kms_cursor_crc
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_chamelium_color
results: parsing output: 74/ for test: kms_big_fb
results: parsing output: 75/ for test: kms_psr
results: parsing output: 76/ for test: kms_psr
results: parsing output: 77/ for test: gem_sync
results: parsing output: 78/ for test: prime_mmap_coherency
results: parsing output: 79/ for test: gem_eio
results: parsing output: 80/ for test: kms_cursor_legacy
results: parsing output: 81/ for test: gem_mmap_offset
results: parsing output: 82/ for test: gem_pxp
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: perf
results: parsing output: 86/ for test: kms_properties
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_psr
results: parsing output: 89/ for test: kms_addfb_basic
results: parsing output: 90/ for test: gem_userptr_blits
results: parsing output: 91/ for test: syncobj_wait
results: parsing output: 92/ for test: gem_busy
results: parsing output: 93/ for test: kms_flip_scaled_crc
results: parsing output: 94/ for test: kms_pipe_b_c_ivb
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: gem_mmap_wc
results: parsing output: 98/ for test: kms_pm_rpm
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: gem_exec_async
results: parsing output: 101/ for test: syncobj_wait
results: parsing output: 102/ for test: gem_exec_whisper
results: parsing output: 103/ for test: i915_drm_fdinfo
results: parsing output: 104/ for test: kms_ccs
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_psr
results: parsing output: 108/ for test: syncobj_timeline
results: parsing output: 109/ for test: kms_ccs
results: parsing output: 110/ for test: gem_exec_reloc
results: parsing output: 111/ for test: kms_atomic
results: parsing output: 112/ for test: kms_addfb_basic
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_flip
results: parsing output: 115/ for test: kms_universal_plane
results: parsing output: 116/ for test: gem_barrier_race
results: parsing output: 117/ for test: kms_psr
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_plane_lowres
results: parsing output: 120/ for test: kms_getfb
results: parsing output: 121/ for test: kms_psr
results: parsing output: 122/ for test: kms_joiner
results: parsing output: 123/ for test: syncobj_timeline
results: parsing output: 124/ for test: i915_query
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: gem_exec_create
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: kms_vblank
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: syncobj_wait
results: parsing output: 131/ for test: drm_read
results: parsing output: 132/ for test: api_intel_bb
results: parsing output: 133/ for test: kms_frontbuffer_tracking
Done.