[79.433826] Initializing watchdogs
[79.434069]   /dev/watchdog0
[79.455300] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300)
[79.463241] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[79.466973] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[79.469954] [001/133] (960s left) gem_eio (in-flight-10ms)
[79.571278] Starting subtest: in-flight-10ms
[81.051714] Subtest in-flight-10ms: SUCCESS (1.481s)
[81.573291] [FACT gem_eio (in-flight-10ms)] new: kernel.kmod_is_loaded.vgem: true
[81.576018] [002/133] (958s left) gem_ctx_shared (q-smoketest-all)
[81.637029] Subtest Q-smoketest-all: SKIP (0.000s)
[81.743905] [003/133] (958s left) kms_joiner (basic-max-non-joiner)
[82.230096] Starting subtest: basic-max-non-joiner
[82.231537] Subtest basic-max-non-joiner: SKIP (0.000s)
[82.332425] [004/133] (957s left) gem_exec_balancer (parallel-out-fence)
[82.397877] Subtest parallel-out-fence: SKIP (0.000s)
[82.524440] [005/133] (957s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[83.011590] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[83.087424] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.074s)
[83.308140] [006/133] (956s left) gem_exec_schedule (preempt-other-chain)
[83.380779] Subtest preempt-other-chain: SKIP (0.000s)
[83.583198] [007/133] (956s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[83.643100] Starting subtest: invalid-smem-bo-on-discrete
[83.644333] Subtest invalid-smem-bo-on-discrete: SKIP (0.000s)
[84.172172] [008/133] (956s left) gem_eio (in-flight-internal-10ms)
[84.239913] Starting subtest: in-flight-internal-10ms
[84.280825] Subtest in-flight-internal-10ms: SUCCESS (0.041s)
[84.806753] [009/133] (955s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[85.284740] Starting subtest: basic-busy-flip-before-cursor-atomic
[86.351952] Subtest basic-busy-flip-before-cursor-atomic: SUCCESS (1.066s)
[86.615171] [010/133] (953s left) gem_busy (parallel)
[86.814747] Starting subtest: parallel
[86.815960] Starting dynamic subtest: rcs0
[86.842461] Dynamic subtest rcs0: SUCCESS (0.029s)
[86.853548] Starting dynamic subtest: bcs0
[86.858538] Dynamic subtest bcs0: SUCCESS (0.015s)
[86.859522] Subtest parallel: SUCCESS (0.046s)
[87.080615] [011/133] (953s left) kms_big_fb (x-tiled-32bpp-rotate-270)
[87.574848] Starting subtest: x-tiled-32bpp-rotate-270
[87.652378] Subtest x-tiled-32bpp-rotate-270: SKIP (0.077s)
[87.870984] [012/133] (952s left) syncobj_timeline (etime-multi-wait-submitted)
[87.929257] Starting subtest: etime-multi-wait-submitted
[88.035407] Subtest etime-multi-wait-submitted: SUCCESS (0.105s)
[88.132797] [013/133] (952s left) gem_exec_schedule (submit-late-slice)
[88.201881] Subtest submit-late-slice: SKIP (0.000s)
[88.402866] [014/133] (952s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-mc-ccs)
[88.458580] Subtest ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.000s)
[88.514314] [015/133] (952s left) kms_frontbuffer_tracking (fbc-farfromfence-mmap-gtt)
[89.006180] Starting subtest: fbc-farfromfence-mmap-gtt
[91.046238] Subtest fbc-farfromfence-mmap-gtt: SUCCESS (2.039s)
[91.269185] [016/133] (949s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[91.749423] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[91.750446] Starting dynamic subtest: pipe-A
[91.753342] Dynamic subtest pipe-A: SKIP (0.003s)
[91.767283] Starting dynamic subtest: pipe-B
[91.771219] Dynamic subtest pipe-B: SKIP (0.002s)
[91.772992] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.005s)
[91.847533] [017/133] (948s left) kms_psr (pr-basic)
[92.334045] Subtest pr-basic: SKIP (0.000s)
[92.391211] [018/133] (948s left) gen7_exec_parse (basic-allowed)
[92.455772] Subtest basic-allowed: SKIP (0.000s)
[92.509315] [019/133] (948s left) gen7_exec_parse (oacontrol-tracking)
[92.568269] Subtest oacontrol-tracking: SKIP (0.000s)
[92.626149] [020/133] (948s left) gem_workarounds (suspend-resume-context)
[92.696341] Starting subtest: suspend-resume-context
[109.008653] Subtest suspend-resume-context: SUCCESS (0.602s)
[117.156196] [021/133] (931s left) gem_mmap_wc (set-cache-level)
[117.243754] Starting subtest: set-cache-level
[117.244708] Subtest set-cache-level: SUCCESS (0.001s)
[117.362535] [022/133] (931s left) kms_big_fb (yf-tiled-8bpp-rotate-90)
[117.845624] Starting subtest: yf-tiled-8bpp-rotate-90
[117.847117] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s)
[117.956368] [023/133] (931s left) perf_pmu (busy-accuracy-50)
[118.013871] Starting subtest: busy-accuracy-50
[118.014723] Starting dynamic subtest: rcs0
[118.015915] Dynamic subtest rcs0: SKIP (0.000s)
[118.029123] Starting dynamic subtest: bcs0
[118.030876] Dynamic subtest bcs0: SKIP (0.000s)
[118.043955] Starting dynamic subtest: vcs0
[118.045793] Dynamic subtest vcs0: SKIP (0.000s)
[118.047311] Subtest busy-accuracy-50: SKIP (0.001s)
[118.111791] [024/133] (931s left) kms_flip (dpms-off-confusion-interruptible)
[118.599119] Starting subtest: dpms-off-confusion-interruptible
[118.600845] Starting dynamic subtest: A-VGA1
[126.361401] Dynamic subtest A-VGA1: SUCCESS (7.760s)
[126.378492] Starting dynamic subtest: B-VGA1
[134.052015] Dynamic subtest B-VGA1: SUCCESS (7.688s)
[134.067895] Starting dynamic subtest: A-HDMI-A1
[141.777796] Dynamic subtest A-HDMI-A1: SUCCESS (7.722s)
[141.791458] Starting dynamic subtest: B-HDMI-A1
[149.528603] Dynamic subtest B-HDMI-A1: SUCCESS (7.751s)
[149.529863] Subtest dpms-off-confusion-interruptible: SUCCESS (30.929s)
[149.710857] [025/133] (899s left) kms_cursor_legacy (2x-long-nonblocking-modeset-vs-cursor-atomic)
[150.199083] Starting subtest: 2x-long-nonblocking-modeset-vs-cursor-atomic
[151.818793] Subtest 2x-long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (1.620s)
[152.101811] [026/133] (897s left) kms_chamelium_frames (vga-frame-dump)
[152.722528] Subtest vga-frame-dump: SKIP (0.000s)
[152.934122] [027/133] (896s left) kms_draw_crc (draw-method-mmap-wc)
[153.415293] Starting subtest: draw-method-mmap-wc
[153.416176] Starting dynamic subtest: xrgb8888-untiled
[153.737709] Dynamic subtest xrgb8888-untiled: SUCCESS (0.322s)
[153.750711] Starting dynamic subtest: rgb565-untiled
[154.005093] Dynamic subtest rgb565-untiled: SUCCESS (0.266s)
[154.018148] Starting dynamic subtest: xrgb2101010-untiled
[154.272697] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.266s)
[154.287380] Starting dynamic subtest: xbgr16161616f-untiled
[154.556666] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.283s)
[154.570581] Starting dynamic subtest: xrgb8888-xtiled
[154.707212] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.149s)
[154.720798] Starting dynamic subtest: rgb565-xtiled
[154.857712] Dynamic subtest rgb565-xtiled: SUCCESS (0.149s)
[154.871024] Starting dynamic subtest: xrgb2101010-xtiled
[155.008111] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.149s)
[155.021612] Starting dynamic subtest: xbgr16161616f-xtiled
[155.158494] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.149s)
[155.159593] Subtest draw-method-mmap-wc: SUCCESS (1.744s)
[155.379843] [028/133] (893s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[155.871115] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[155.872937] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[155.980653] [029/133] (893s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[156.470665] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[156.472454] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[156.577752] [030/133] (892s left) kms_chamelium_frames (hdmi-crc-multiple)
[157.163556] Subtest hdmi-crc-multiple: SKIP (0.000s)
[157.377070] [031/133] (892s left) gem_exec_fence (submit-chain)
[157.556620] Subtest submit-chain: SKIP (0.000s)
[157.929867] [032/133] (891s left) kms_pm_rpm (i2c)
[169.701969] Subtest i2c: SKIP (0.000s)
[169.772124] [033/133] (879s left) gem_mmap_offset (partial-remap)
[169.832488] Starting subtest: partial-remap
[169.833136] Starting dynamic subtest: smem0
[169.839372] Dynamic subtest smem0: SUCCESS (0.005s)
[169.840175] Subtest partial-remap: SUCCESS (0.005s)
[169.954567] [034/133] (879s left) kms_atomic_interruptible (atomic-setmode)
[170.437984] Starting subtest: atomic-setmode
[170.439638] Starting dynamic subtest: pipe-A-VGA-1
[176.698837] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.259s)
[176.699597] Subtest atomic-setmode: SUCCESS (6.261s)
[176.975001] [035/133] (872s left) gem_ctx_create (basic-files)
[177.043101] Starting subtest: basic-files
[179.057627] Subtest basic-files: SUCCESS (2.015s)
[179.383644] [036/133] (870s left) gen3_render_tiledx_blits
[179.504503] [037/133] (870s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt)
[179.995145] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt
[181.601799] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SUCCESS (1.606s)
[181.749324] [038/133] (868s left) drm_read (short-buffer-wakeup)
[182.335934] Starting subtest: short-buffer-wakeup
[214.553012] Subtest short-buffer-wakeup: SUCCESS (32.215s)
[214.778121] [039/133] (835s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted-signaled)
[214.838679] Starting subtest: multi-wait-all-for-submit-available-submitted-signaled
[214.840530] Subtest multi-wait-all-for-submit-available-submitted-signaled: SUCCESS (0.001s)
[214.937237] [040/133] (835s left) syncobj_basic (illegal-fd-to-handle)
[214.994586] Starting subtest: illegal-fd-to-handle
[214.995578] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[215.085594] [041/133] (834s left) kms_scaling_modes (scaling-mode-full-aspect)
[215.566371] Starting subtest: scaling-mode-full-aspect
[215.571130] Subtest scaling-mode-full-aspect: SKIP (0.000s)
[215.673909] [042/133] (834s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[216.160673] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[216.162046] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[216.270451] [043/133] (833s left) kms_dirtyfb (default-dirtyfb-ioctl)
[216.750343] Starting subtest: default-dirtyfb-ioctl
[216.751177] Starting dynamic subtest: A-VGA-1
[218.096814] Dynamic subtest A-VGA-1: SUCCESS (1.346s)
[218.111635] Starting dynamic subtest: A-HDMI-A-1
[219.521652] Dynamic subtest A-HDMI-A-1: SUCCESS (1.423s)
[219.522456] Subtest default-dirtyfb-ioctl: SUCCESS (2.773s)
[219.766097] [044/133] (830s left) kms_rotation_crc (sprite-rotation-270)
[220.250049] Starting subtest: sprite-rotation-270
[220.251618] Subtest sprite-rotation-270: SKIP (0.001s)
[220.350044] [045/133] (829s left) kms_addfb_basic (bad-pitch-0)
[220.415806] Starting subtest: bad-pitch-0
[220.416552] Subtest bad-pitch-0: SUCCESS (0.000s)
[220.946131] [046/133] (829s left) syncobj_wait (multi-wait-for-submit-submitted)
[221.002419] Starting subtest: multi-wait-for-submit-submitted
[221.106215] Subtest multi-wait-for-submit-submitted: SUCCESS (0.103s)
[221.195585] [047/133] (829s left) kms_flip (blocking-absolute-wf_vblank)
[221.677190] Starting subtest: blocking-absolute-wf_vblank
[221.678046] Starting dynamic subtest: A-VGA1
[229.493643] Dynamic subtest A-VGA1: SUCCESS (7.816s)
[229.509874] Starting dynamic subtest: B-VGA1
[237.217078] Dynamic subtest B-VGA1: SUCCESS (7.722s)
[237.233098] Starting dynamic subtest: A-HDMI-A1
[245.109444] Dynamic subtest A-HDMI-A1: SUCCESS (7.888s)
[245.122095] Starting dynamic subtest: B-HDMI-A1
[253.024705] Dynamic subtest B-HDMI-A1: SUCCESS (7.915s)
[253.026108] Subtest blocking-absolute-wf_vblank: SUCCESS (31.350s)
[253.203958] [048/133] (797s left) gem_exec_reloc (basic-gtt-wc-active)
[253.267633] Starting subtest: basic-gtt-wc-active
[253.378512] Subtest basic-gtt-wc-active: SUCCESS (0.110s)
[253.893989] [049/133] (796s left) kms_ccs (random-ccs-data-4-tiled-mtl-mc-ccs)
[253.950171] Subtest random-ccs-data-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[254.018231] [050/133] (796s left) i915_drm_fdinfo (virtual-busy-hang)
[254.080015] Subtest virtual-busy-hang: SKIP (0.000s)
[254.133051] [051/133] (796s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[254.615970] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[254.617539] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[254.761251] [052/133] (795s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-y-tiled)
[254.829119] Starting subtest: yf-tiled-mc-ccs-to-vebox-y-tiled
[254.831574] Subtest yf-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[255.040339] [053/133] (795s left) gem_eio (in-flight-1us)
[255.103927] Starting subtest: in-flight-1us
[256.498902] Subtest in-flight-1us: SUCCESS (1.394s)
[257.024329] [054/133] (793s left) gem_exec_reloc (basic-write-wc)
[257.086471] Starting subtest: basic-write-wc
[257.088687] Subtest basic-write-wc: SUCCESS (0.003s)
[257.604234] [055/133] (793s left) syncobj_wait (wait-zero-handles)
[257.663502] Starting subtest: wait-zero-handles
[257.664397] Subtest wait-zero-handles: SUCCESS (0.000s)
[257.769171] [056/133] (793s left) perf_pmu (enable-race)
[257.834050] Starting subtest: enable-race
[257.834785] Starting dynamic subtest: rcs0
[257.836499] Dynamic subtest rcs0: SKIP (0.000s)
[257.851517] Starting dynamic subtest: bcs0
[257.853307] Dynamic subtest bcs0: SKIP (0.000s)
[257.867306] Starting dynamic subtest: vcs0
[257.869568] Dynamic subtest vcs0: SKIP (0.000s)
[257.871591] Subtest enable-race: SKIP (0.003s)
[257.938640] [057/133] (792s left) gem_softpin (zero)
[258.000059] Subtest zero: SKIP (0.000s)
[258.102915] [058/133] (792s left) gem_pxp (verify-pxp-stale-ctx-execution)
[260.673372] Starting subtest: verify-pxp-stale-ctx-execution
[260.674872] Subtest verify-pxp-stale-ctx-execution: SKIP (0.000s)
[260.777028] [059/133] (790s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[261.266154] Starting subtest: y-tiled-64bpp-rotate-0
[261.267741] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[261.380418] [060/133] (789s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[261.436929] Starting subtest: etime-multi-wait-all-for-submit-submitted
[261.546087] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.108s)
[261.648078] [061/133] (789s left) syncobj_timeline (invalid-signal-zero-handles)
[261.708127] Starting subtest: invalid-signal-zero-handles
[261.708772] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[261.805623] [062/133] (789s left) gem_exec_suspend (basic-s3)
[261.873577] Starting subtest: basic-S3
[261.874356] Starting dynamic subtest: smem
[279.669372] Dynamic subtest smem: SUCCESS (1.490s)
[279.670642] Subtest basic-S3: SUCCESS (1.492s)
[292.368622] [063/133] (770s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-mc-ccs)
[292.442744] Subtest crc-primary-suspend-4-tiled-dg2-mc-ccs: SKIP (0.000s)
[292.501653] [064/133] (770s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier)
[292.985808] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier
[292.987285] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier: SKIP (0.000s)
[293.074532] [065/133] (770s left) kms_lease (possible-crtcs-filtering)
[293.549154] Starting subtest: possible-crtcs-filtering
[293.551198] Subtest possible-crtcs-filtering: SUCCESS (0.003s)
[293.640139] [066/133] (769s left) i915_hangman (engine-engine-error)
[293.707944] Subtest engine-engine-error: SKIP (0.000s)
[293.788842] [067/133] (769s left) gem_softpin (evict-active)
[293.848093] Starting subtest: evict-active
[293.851515] Subtest evict-active: SUCCESS (0.004s)
[293.976961] [068/133] (769s left) vgem_basic (unload)
[294.031009] Starting subtest: unload
[322.981866] Subtest unload: SUCCESS (28.948s)
[323.118363] [069/133] (740s left) kms_frontbuffer_tracking (fbcpsr-2p-indfb-fliptrack-mmap-gtt)
[323.600060] Starting subtest: fbcpsr-2p-indfb-fliptrack-mmap-gtt
[323.601448] Subtest fbcpsr-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[323.717296] [070/133] (739s left) api_intel_allocator (fork-simple-once)
[323.776808] Starting subtest: fork-simple-once
[323.801791] Subtest fork-simple-once: SUCCESS (0.025s)
[323.938300] [071/133] (739s left) kms_vblank (wait-forked-hang)
[324.410549] Starting subtest: wait-forked-hang
[324.411653] Starting dynamic subtest: pipe-A-VGA-1
[330.756941] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.346s)
[330.771587] Starting dynamic subtest: pipe-A-HDMI-A-1
[336.804635] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.046s)
[336.822133] Starting dynamic subtest: pipe-B-VGA-1
[342.791302] Dynamic subtest pipe-B-VGA-1: SUCCESS (5.984s)
[342.808448] Starting dynamic subtest: pipe-B-HDMI-A-1
[348.775065] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (5.981s)
[348.777946] Subtest wait-forked-hang: SUCCESS (24.368s)
[349.071236] [072/133] (714s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[349.571642] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[349.573013] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[349.686991] [073/133] (714s left) gem_ctx_persistence (hostile)
[349.751557] Subtest hostile: SKIP (0.000s)
[349.813264] [074/133] (714s left) gem_mmap_wc (write-prefaulted)
[349.869431] Starting subtest: write-prefaulted
[350.018773] Subtest write-prefaulted: SUCCESS (0.147s)
[350.126435] [075/133] (713s left) gem_exec_reloc (basic-cpu-noreloc)
[350.192005] Starting subtest: basic-cpu-noreloc
[350.194146] Subtest basic-cpu-noreloc: SUCCESS (0.002s)
[350.704370] [076/133] (713s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[351.188634] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[351.190119] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[351.301608] [077/133] (712s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[351.774805] Starting subtest: coverage-vs-premult-vs-constant
[351.997414] Subtest coverage-vs-premult-vs-constant: SKIP (0.225s)
[352.341553] [078/133] (711s left) kms_cursor_crc (cursor-rapid-movement-64x64)
[352.821243] Starting subtest: cursor-rapid-movement-64x64
[352.837750] Starting dynamic subtest: pipe-A-VGA-1
[353.261070] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.424s)
[353.303252] Starting dynamic subtest: pipe-B-HDMI-A-1
[353.649949] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.359s)
[353.650659] Subtest cursor-rapid-movement-64x64: SUCCESS (0.830s)
[353.927466] [079/133] (710s left) kms_plane_scaling (planes-downscale-factor-0-75)
[354.414249] Starting subtest: planes-downscale-factor-0-75
[354.415154] Starting dynamic subtest: pipe-A
[354.418149] Dynamic subtest pipe-A: SKIP (0.002s)
[354.431865] Starting dynamic subtest: pipe-B
[354.436087] Dynamic subtest pipe-B: SKIP (0.001s)
[354.438160] Subtest planes-downscale-factor-0-75: SKIP (0.007s)
[354.524061] [080/133] (709s left) gem_userptr_blits (coherency-sync)
[354.599065] Starting subtest: coherency-sync
[380.611586] Subtest coherency-sync: SUCCESS (26.012s)
[380.768977] [081/133] (683s left) kms_ccs (missing-ccs-buffer-y-tiled-ccs)
[380.931911] Subtest missing-ccs-buffer-y-tiled-ccs: SKIP (0.000s)
[380.998922] [082/133] (683s left) kms_cursor_crc (cursor-onscreen-256x85)
[381.514384] Starting subtest: cursor-onscreen-256x85
[381.574218] Subtest cursor-onscreen-256x85: SKIP (0.059s)
[381.686663] [083/133] (682s left) kms_psr (psr2-primary-mmap-cpu)
[382.162625] Subtest psr2-primary-mmap-cpu: SKIP (0.000s)
[382.230456] [084/133] (682s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions)
[382.708252] Starting subtest: short-flip-after-cursor-atomic-transitions
[383.780758] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (1.072s)
[384.074487] [085/133] (680s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[384.563020] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[386.208700] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SUCCESS (1.645s)
[386.375396] [086/133] (678s left) kms_pm_rpm (drm-resources-equal)
[398.150279] Subtest drm-resources-equal: SKIP (0.000s)
[398.212415] [087/133] (666s left) gem_userptr_blits (map-fixed-invalidate-busy)
[398.291739] Starting subtest: map-fixed-invalidate-busy
[398.292694] Starting dynamic subtest: gtt
[399.291611] Dynamic subtest gtt: SUCCESS (0.999s)
[399.308109] Starting dynamic subtest: wb
[400.265200] Dynamic subtest wb: SUCCESS (0.972s)
[400.280644] Starting dynamic subtest: wc
[401.239373] Dynamic subtest wc: SUCCESS (0.972s)
[401.253674] Starting dynamic subtest: uc
[402.212556] Dynamic subtest uc: SUCCESS (0.972s)
[402.213196] Subtest map-fixed-invalidate-busy: SUCCESS (3.922s)
[402.345052] [088/133] (662s left) sw_sync (alloc_merge_fence)
[402.415935] Starting subtest: alloc_merge_fence
[402.416644] Subtest alloc_merge_fence: SUCCESS (0.000s)
[402.492787] [089/133] (662s left) kms_flip (2x-flip-vs-suspend-interruptible)
[402.970651] Starting subtest: 2x-flip-vs-suspend-interruptible
[402.972843] Starting dynamic subtest: AB-VGA1-HDMI-A1
[606.679083] Per-test timeout exceeded. Killing the current test with SIGQUIT.
[614.202131] Closing watchdogs
[614.210177] Initializing watchdogs
[614.210249]   /dev/watchdog0
[614.233075] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300)
[614.245172] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[614.246768] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[614.247758] [FACT before any test] new: kernel.kmod_is_loaded.vgem: true
[614.251095] [090/133] (457s left) gem_exec_fence (syncobj-timeline-unused-fence)
[614.621375] Starting subtest: syncobj-timeline-unused-fence
[614.623461] Subtest syncobj-timeline-unused-fence: SUCCESS (0.002s)
[614.851235] [091/133] (456s left) gem_exec_whisper (basic-fds-forked)
[614.920081] Starting subtest: basic-fds-forked
[617.466666] Subtest basic-fds-forked: SUCCESS (2.546s)
[617.676820] [092/133] (454s left) gem_exec_capture (userptr)
[617.740378] Subtest userptr: SKIP (0.000s)
[617.819725] [093/133] (454s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[617.879984] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.000s)
[617.938894] [094/133] (454s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[618.426176] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[618.427611] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[618.542184] [095/133] (453s left) kms_frontbuffer_tracking (psr-modesetfrombusy)
[619.027491] Starting subtest: psr-modesetfrombusy
[619.028825] Subtest psr-modesetfrombusy: SKIP (0.000s)
[619.143804] [096/133] (452s left) kms_content_protection (lic-type-0)
[619.645586] Starting subtest: lic-type-0
[619.647209] Subtest lic-type-0: SKIP (0.000s)
[619.765082] [097/133] (452s left) gem_mmap_gtt (basic-read)
[619.824997] Starting subtest: basic-read
[619.865353] Subtest basic-read: SUCCESS (0.041s)
[619.999330] [098/133] (452s left) api_intel_bb (purge-bb)
[620.058111] Starting subtest: purge-bb
[620.059921] Subtest purge-bb: SUCCESS (0.001s)
[620.197146] [099/133] (452s left) kms_color (legacy-gamma-reset)
[620.670116] Starting subtest: legacy-gamma-reset
[620.671047] Starting dynamic subtest: pipe-A-VGA-1
[620.934948] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.265s)
[620.951864] Starting dynamic subtest: pipe-A-HDMI-A-1
[620.952742] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.004s)
[620.968578] Starting dynamic subtest: pipe-B-VGA-1
[620.969360] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.004s)
[620.984502] Starting dynamic subtest: pipe-B-HDMI-A-1
[620.985276] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.004s)
[620.985974] Subtest legacy-gamma-reset: SUCCESS (0.282s)
[621.197236] [100/133] (451s left) kms_hdr (invalid-metadata-sizes)
[621.674220] Starting subtest: invalid-metadata-sizes
[621.677707] Subtest invalid-metadata-sizes: SKIP (0.000s)
[621.778966] [101/133] (450s left) kms_async_flips (test-cursor-atomic)
[622.256394] Starting subtest: test-cursor-atomic
[622.492395] Starting dynamic subtest: pipe-A-VGA-1
[622.590278] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.098s)
[622.711983] Starting dynamic subtest: pipe-A-HDMI-A-1
[622.843566] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.147s)
[623.006166] Starting dynamic subtest: pipe-B-VGA-1
[623.103365] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.112s)
[623.221215] Starting dynamic subtest: pipe-B-HDMI-A-1
[623.372100] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.165s)
[623.372857] Subtest test-cursor-atomic: SUCCESS (1.117s)
[623.794311] [102/133] (448s left) kms_psr (fbc-psr-no-drrs)
[624.272476] Subtest fbc-psr-no-drrs: SKIP (0.000s)
[624.341012] [103/133] (448s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[624.812251] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s)
[624.873105] [104/133] (447s left) syncobj_timeline (wait-all-interrupted)
[624.932019] Starting subtest: wait-all-interrupted
[625.034706] Subtest wait-all-interrupted: SUCCESS (0.102s)
[625.129473] [105/133] (447s left) gem_linear_blits (basic)
[625.336411] Starting subtest: basic
[625.346279] Subtest basic: SUCCESS (0.010s)
[625.494064] [106/133] (447s left) kms_tv_load_detect (load-detect)
[625.670413] Subtest load-detect: SKIP (0.000s)
[625.738773] [107/133] (446s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[626.234032] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[626.302030] [108/133] (446s left) prime_vgem (basic-fence-mmap)
[626.389017] Starting subtest: basic-fence-mmap
[626.429657] Subtest basic-fence-mmap: SUCCESS (0.040s)
[626.559796] [109/133] (446s left) gem_lmem_swapping (verify-random)
[626.641613] Subtest verify-random: SKIP (0.000s)
[626.713934] [110/133] (446s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-fullscreen)
[627.199428] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-fullscreen
[627.200867] Subtest fbcpsr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[627.318207] [111/133] (445s left) kms_plane_lowres (tiling-4)
[627.791624] Starting subtest: tiling-4
[627.793395] Subtest tiling-4: SKIP (0.000s)
[627.887115] [112/133] (445s left) kms_psr2_su (page_flip-p010)
[627.949953] Subtest page_flip-P010: SKIP (0.000s)
[628.016977] [113/133] (445s left) kms_properties (colorop-properties-legacy)
[628.489372] Starting subtest: colorop-properties-legacy
[628.490223] Starting dynamic subtest: pipe-A-VGA-1
[628.689924] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.200s)
[628.705420] Starting dynamic subtest: pipe-A-HDMI-A-1
[628.894391] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.202s)
[628.910959] Starting dynamic subtest: pipe-B-VGA-1
[629.022743] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.126s)
[629.038477] Starting dynamic subtest: pipe-B-HDMI-A-1
[629.243127] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.220s)
[629.243943] Subtest colorop-properties-legacy: SUCCESS (0.756s)
[629.520629] [114/133] (443s left) gem_ctx_isolation (preservation-reset)
[629.702997] Starting subtest: preservation-reset
[629.703629] Starting dynamic subtest: rcs0
[630.237909] Dynamic subtest rcs0: SUCCESS (0.535s)
[630.240861] Subtest preservation-reset: SUCCESS (0.538s)
[630.368103] [115/133] (442s left) i915_pm_rpm (gem-evict-pwrite)
[642.133496] Subtest gem-evict-pwrite: SKIP (0.000s)
[642.205042] [116/133] (431s left) gem_gpgpu_fill (basic)
[642.272434] Subtest basic: SKIP (0.000s)
[642.412620] [117/133] (430s left) gem_exec_balancer (full-pulse)
[642.472850] Subtest full-pulse: SKIP (0.000s)
[642.577646] [118/133] (430s left) sw_sync (sync_merge)
[642.638949] Starting subtest: sync_merge
[642.639863] Subtest sync_merge: SUCCESS (0.001s)
[642.725364] [119/133] (430s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[643.210499] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[645.273071] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SUCCESS (2.063s)
[645.432016] [120/133] (428s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[645.617499] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (0.000s)
[645.674856] [121/133] (427s left) kms_big_fb (linear-32bpp-rotate-270)
[646.173917] Starting subtest: linear-32bpp-rotate-270
[646.247510] Subtest linear-32bpp-rotate-270: SKIP (0.079s)
[646.487360] [122/133] (427s left) kms_big_fb (4-tiled-64bpp-rotate-180)
[647.014026] Starting subtest: 4-tiled-64bpp-rotate-180
[647.016611] Subtest 4-tiled-64bpp-rotate-180: SKIP (0.000s)
[647.131524] [123/133] (426s left) perf (polling-small-buf)
[647.377238] Subtest polling-small-buf: SKIP (0.000s)
[647.448517] [124/133] (426s left) i915_query (query-regions-garbage-items)
[647.522749] Starting subtest: query-regions-garbage-items
[647.524502] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[647.620261] [125/133] (426s left) kms_selftest (drm_plane_helper)
[647.702702] Starting subtest: drm_plane_helper
[647.717109] Starting dynamic subtest: drm_test_check_plane_state
[647.823621] Dynamic subtest drm_test_check_plane_state: SUCCESS (0.103s)
[647.839794] Starting dynamic subtest: drm_test_check_invalid_plane_state
[647.921313] Dynamic subtest drm_test_check_invalid_plane_state: SUCCESS (0.095s)
[647.924190] Subtest drm_plane_helper: SUCCESS (0.214s)
[648.083285] [126/133] (425s left) gem_mmap_gtt (medium-copy-xy)
[648.181380] Starting subtest: medium-copy-XY
[649.112651] Subtest medium-copy-XY: SUCCESS (0.931s)
[649.246188] [127/133] (424s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions)
[649.951132] Starting subtest: cursorB-vs-flipB-atomic-transitions
[661.011608] Subtest cursorB-vs-flipB-atomic-transitions: SUCCESS (11.057s)
[661.278152] [128/133] (412s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[661.791552] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu
[661.792993] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[661.907809] [129/133] (412s left) gem_exec_nop (basic-parallel)
[661.986325] Starting subtest: basic-parallel
[664.787287] Subtest basic-parallel: SUCCESS (2.799s)
[665.019827] [130/133] (409s left) vgem_basic (debugfs)
[665.086901] Starting subtest: debugfs
[665.087828] Subtest debugfs: SUCCESS (0.001s)
[665.168160] [131/133] (408s left) gem_create (create-massive)
[665.227929] Starting subtest: create-massive
[665.228680] Subtest create-massive: SUCCESS (0.000s)
[665.439275] [132/133] (408s left) kms_cursor_edge_walk (256x256-top-bottom)
[665.910236] Starting subtest: 256x256-top-bottom
[665.911264] Starting dynamic subtest: pipe-A-VGA-1
[669.299541] Dynamic subtest pipe-A-VGA-1: SUCCESS (3.388s)
[669.316573] Starting dynamic subtest: pipe-B-HDMI-A-1
[672.630276] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.329s)
[672.630994] Subtest 256x256-top-bottom: SUCCESS (6.721s)
[672.883862] [133/133] (401s left) kms_busy (extended-modeset-hang-newfb)
[673.366490] Starting subtest: extended-modeset-hang-newfb
[673.368726] Starting dynamic subtest: pipe-A
[685.623107] Dynamic subtest pipe-A: SUCCESS (12.253s)
[685.639370] Starting dynamic subtest: pipe-B
[697.718284] Dynamic subtest pipe-B: SUCCESS (12.092s)
[697.719111] Subtest extended-modeset-hang-newfb: SUCCESS (24.351s)
[697.968352] Closing watchdogs
results: parsing output: 0/ for test: gem_eio
results: parsing output: 1/ for test: gem_ctx_shared
results: parsing output: 2/ for test: kms_joiner
results: parsing output: 3/ for test: gem_exec_balancer
results: parsing output: 4/ for test: kms_big_fb
results: parsing output: 5/ for test: gem_exec_schedule
results: parsing output: 6/ for test: kms_addfb_basic
results: parsing output: 7/ for test: gem_eio
results: parsing output: 8/ for test: kms_cursor_legacy
results: parsing output: 9/ for test: gem_busy
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: gem_exec_schedule
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_plane_scaling
results: parsing output: 16/ for test: kms_psr
results: parsing output: 17/ for test: gen7_exec_parse
results: parsing output: 18/ for test: gen7_exec_parse
results: parsing output: 19/ for test: gem_workarounds
results: parsing output: 20/ for test: gem_mmap_wc
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: perf_pmu
results: parsing output: 23/ for test: kms_flip
results: parsing output: 24/ for test: kms_cursor_legacy
results: parsing output: 25/ for test: kms_chamelium_frames
results: parsing output: 26/ for test: kms_draw_crc
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: kms_chamelium_frames
results: parsing output: 30/ for test: gem_exec_fence
results: parsing output: 31/ for test: kms_pm_rpm
results: parsing output: 32/ for test: gem_mmap_offset
results: parsing output: 33/ for test: kms_atomic_interruptible
results: parsing output: 34/ for test: gem_ctx_create
results: parsing output: 35/ for test: gen3_render_tiledx_blits
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: drm_read
results: parsing output: 38/ for test: syncobj_timeline
results: parsing output: 39/ for test: syncobj_basic
results: parsing output: 40/ for test: kms_scaling_modes
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_dirtyfb
results: parsing output: 43/ for test: kms_rotation_crc
results: parsing output: 44/ for test: kms_addfb_basic
results: parsing output: 45/ for test: syncobj_wait
results: parsing output: 46/ for test: kms_flip
results: parsing output: 47/ for test: gem_exec_reloc
results: parsing output: 48/ for test: kms_ccs
results: parsing output: 49/ for test: i915_drm_fdinfo
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: gem_render_copy
results: parsing output: 52/ for test: gem_eio
results: parsing output: 53/ for test: gem_exec_reloc
results: parsing output: 54/ for test: syncobj_wait
results: parsing output: 55/ for test: perf_pmu
results: parsing output: 56/ for test: gem_softpin
results: parsing output: 57/ for test: gem_pxp
results: parsing output: 58/ for test: kms_big_fb
results: parsing output: 59/ for test: syncobj_timeline
results: parsing output: 60/ for test: syncobj_timeline
results: parsing output: 61/ for test: gem_exec_suspend
results: parsing output: 62/ for test: kms_ccs
results: parsing output: 63/ for test: kms_plane
results: parsing output: 64/ for test: kms_lease
results: parsing output: 65/ for test: i915_hangman
results: parsing output: 66/ for test: gem_softpin
results: parsing output: 67/ for test: vgem_basic
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: api_intel_allocator
results: parsing output: 70/ for test: kms_vblank
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_ctx_persistence
results: parsing output: 73/ for test: gem_mmap_wc
results: parsing output: 74/ for test: gem_exec_reloc
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_plane_alpha_blend
results: parsing output: 77/ for test: kms_cursor_crc
results: parsing output: 78/ for test: kms_plane_scaling
results: parsing output: 79/ for test: gem_userptr_blits
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: kms_cursor_crc
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: kms_cursor_legacy
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_pm_rpm
results: parsing output: 86/ for test: gem_userptr_blits
results: parsing output: 87/ for test: sw_sync
results: parsing output: 88/ for test: kms_flip
results: parsing output: 89/ for test: gem_exec_fence
results: parsing output: 90/ for test: gem_exec_whisper
results: parsing output: 91/ for test: gem_exec_capture
results: parsing output: 92/ for test: kms_ccs
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_content_protection
results: parsing output: 96/ for test: gem_mmap_gtt
results: parsing output: 97/ for test: api_intel_bb
results: parsing output: 98/ for test: kms_color
results: parsing output: 99/ for test: kms_hdr
results: parsing output: 100/ for test: kms_async_flips
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: syncobj_timeline
results: parsing output: 104/ for test: gem_linear_blits
results: parsing output: 105/ for test: kms_tv_load_detect
results: parsing output: 106/ for test: kms_psr2_sf
results: parsing output: 107/ for test: prime_vgem
results: parsing output: 108/ for test: gem_lmem_swapping
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_plane_lowres
results: parsing output: 111/ for test: kms_psr2_su
results: parsing output: 112/ for test: kms_properties
results: parsing output: 113/ for test: gem_ctx_isolation
results: parsing output: 114/ for test: i915_pm_rpm
results: parsing output: 115/ for test: gem_gpgpu_fill
results: parsing output: 116/ for test: gem_exec_balancer
results: parsing output: 117/ for test: sw_sync
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_flip_scaled_crc
results: parsing output: 120/ for test: kms_big_fb
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: perf
results: parsing output: 123/ for test: i915_query
results: parsing output: 124/ for test: kms_selftest
results: parsing output: 125/ for test: gem_mmap_gtt
results: parsing output: 126/ for test: kms_cursor_legacy
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: gem_exec_nop
results: parsing output: 129/ for test: vgem_basic
results: parsing output: 130/ for test: gem_create
results: parsing output: 131/ for test: kms_cursor_edge_walk
results: parsing output: 132/ for test: kms_busy
Done.