This thread has been locked.

If you have a related question, please click the "Ask a related question" button in the top right corner. The newly created question will be automatically linked to this question.

DRA72XEVM: Playing a video file in Qt crashes the whole program

Part Number: DRA72XEVM


Hi there,

I have a sample qt app that plays an h264/mp4 video. But when i tried to play video, the app crashes throwing the following error:

root@dra7xx-evm:~/mplayer# ./mplayer
No such plugin for spec  "Auto"
Using Wayland-EGL
wlpvr: PVR Services Initialised

(mplayer:2215): GStreamer-CRITICAL **: gst_buffer_peek_memory: assertion 'GST_IS_BUFFER (buffer)' failed

** (mplayer:2215): CRITICAL **: gst_fd_memory_get_fd: assertion 'mem != NULL' failed
Segmentation fault (core dumped)

Here is the code:

import QtQuick 2.3
import QtQuick.Window 2.2
import QtMultimedia 5.5

Window {
    visible: true
    height: 480
    width: 640

    MediaPlayer {
        id: mediaplayer
        source: "file:///Video/NonCritical/06082018/hi.mp4"
    }

    VideoOutput {
        source: mediaplayer
    }

    MouseArea {
        id: playArea
        anchors.fill: parent
        onPressed: mediaplayer.play();
    }

}

Any solution?

  • Hi Sam,
    Does the playback work fine with playbin? Do you have any idea of the underlying gstreamer pipeline executed when Qt app is run?
    Does it happen for all streams?
    waylandsink by default supports only desktop-shell . Is weston configured for ivi-shell?

    Ramprasad
  • The playback works fine with gst-launch.
    No i have no i idea of the underlying gstreamer pipeline.
    yes it happens for all streams.
    No, weston is not configured for ivi-shell and futhermore we are perfectly running qt apps with live-streaming on the device.
  • Sam,
    I tried with this QT application available in PSDKLA3.04 filesystem to playback a small stream, it is working .

    /usr/share/qt5/examples/multimedia/video/qmlvideo/qmlvideo

    Can you share the binary for your qT application to reproduce the issue?
  • hi Ram,

    The above mentioned app also throws the same error. Moreover we tried to run some sample videos in /usr/share/ti/video. Videos with .264 and .m2v types run smoothly but the files with other type crashes with same error.
  • Hi Sam,
    Can you confirm if gstvpe is enabled in this case? You can check this by adding this statement
    export GST_DEBUG=vpe:6
    before executing the playback. If you are seeing QBUF and DQBUF are happening, it confirms vpe is used and there are some issues with gst-vpe in PSDKLA3.04, you need to apply these changes on gst vpe


    Apply these changes from 3 commits and rebuild gst-vpe and copu the libgstvpe.so to /usr/lib/gstreamer-1.0 and check if the iss
    git.ti.com/.../a1fe1f3e3ae0582a4f84ae8fa7ca052fff2e9f76

    git.ti.com/.../a4e86912b52fc07622c36f647118a476e3800d22

    git.ti.com/.../b9dba5a8bc7d14d55125abdce04672e3dc30bbdf
  • Yes there are QBUF and DQBUF in the output. I have attached the copy of the output.

    No such plugin for spec  "Auto"
    Using Wayland-EGL
    wlpvr: PVR Services Initialised
    0:00:00.209826498  2624   0x247090 DEBUG                    vpe gstvpe.c:997:gst_vpe_change_state:<vpe> begin: changing state NULL -> READY
    0:00:00.209967367  2624   0x247090 DEBUG                    vpe gstvpe.c:1009:gst_vpe_change_state:<vpe> parent state change returned: 1
    0:00:00.210028530  2624   0x247090 DEBUG                    vpe gstvpe.c:1025:gst_vpe_change_state:<vpe> end
    0:00:00.260380533  2624   0x247090 DEBUG                    vpe gstvpe.c:997:gst_vpe_change_state:<vpe> begin: changing state READY -> PAUSED
    0:00:00.260445437  2624   0x247090 DEBUG                    vpe gstvpe.c:709:gst_vpe_activate_mode:<vpe> gst_vpe_activate_mode (active = 1)
    0:00:00.260665199  2624   0x247090 DEBUG                    vpe gstvpe.c:716:gst_vpe_activate_mode:<vpe> gst_pad_start_task returned 1
    0:00:00.260721807  2624   0x247090 DEBUG                    vpe gstvpe.c:1009:gst_vpe_change_state:<vpe> parent state change returned: 1
    0:00:00.260754015  2624   0x247090 DEBUG                    vpe gstvpe.c:1025:gst_vpe_change_state:<vpe> end
    0:00:00.260932298  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=stream-start
    0:00:00.261007125  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.261385325  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=caps
    0:00:00.261474791  2624   0x247090 DEBUG                    vpe gstvpe.c:115:gst_vpe_parse_input_caps:<vpe> Input caps: video/x-raw, format=(string)NV12, width=(int)512, height=(int)384, framerate=(fraction)10000/399, pixel-aspect-ratio=(fraction)1/1, drm_mem=(boolean)true
    0:00:00.261605413  2624   0x247090 DEBUG                    vpe gstvpe.c:186:gst_vpe_set_output_caps:<vpe> Downstream allowed caps: video/x-raw, format=(string)NV12, width=(int)[ 1, 2147483647 ], height=(int)[ 1, 2147483647 ], framerate=(fraction)[ 0/1, 2147483647/1 ]; video/x-raw, format=(string)YUYV, width=(int)[ 1, 2147483647 ], height=(int)[ 1, 2147483647 ], framerate=(fraction)[ 0/1, 2147483647/1 ]; video/x-raw, format=(string)YUY2, width=(int)[ 1, 2147483647 ], height=(int)[ 1, 2147483647 ], framerate=(fraction)[ 0/1, 2147483647/1 ]
    0:00:00.261668365  2624   0x247090 DEBUG                    vpe gstvpe.c:231:gst_vpe_set_output_caps:<vpe> Passthrough = TRUE
    0:00:00.261752626  2624   0x247090 DEBUG                    vpe gstvpe.c:280:gst_vpe_set_output_caps:<vpe> framerate conversion: from 10000/399 to 10000/399, repeat_factor: 1
    
    0:00:00.261886338  2624   0x247090 INFO                     vpe gstvpe.c:740:gst_vpe_sink_setcaps:<vpe> set caps done 1
    0:00:00.262083165  2624   0x247090 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.262205327  2624   0x247090 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.264578471  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=segment
    0:00:00.264868669  2624   0x247090 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.264988717  2624   0x247090 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.265670941  2624   0x247090 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.265791802  2624   0x247090 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.266246618  2624   0x247090 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.266363901  2624   0x247090 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.286550996  2624   0x247090 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.286739690  2624   0x247090 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.287925692  2624   0x247090 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.288060055  2624   0x247090 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.290093063  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.290249223  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.290372362  2624 0xaff2fc90 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.290498754  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.290594402  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.290625146  2624 0xaff2fc90 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.290826364  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.291078660  2624 0xaff2fc90 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=reconfigure
    0:00:00.291671092  2624 0xaff2fc90 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:00.297451778  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=caps
    0:00:00.297553444  2624   0x247090 DEBUG                    vpe gstvpe.c:115:gst_vpe_parse_input_caps:<vpe> Input caps: video/x-raw, format=(string)NV12, width=(int)512, height=(int)384, framerate=(fraction)10000/399, pixel-aspect-ratio=(fraction)1/1, drm_mem=(boolean)true, max-ref-frames=(int)18
    0:00:00.297615908  2624   0x247090 DEBUG                    vpe gstvpe.c:121:gst_vpe_parse_input_caps:<vpe> Already set caps comapred with the new caps, returned FALSE
    0:00:00.300098690  2624   0x247090 DEBUG                    vpe gstvpe.c:231:gst_vpe_set_output_caps:<vpe> Passthrough = TRUE
    0:00:00.300178884  2624   0x247090 DEBUG                    vpe gstvpe.c:280:gst_vpe_set_output_caps:<vpe> framerate conversion: from 10000/399 to 10000/399, repeat_factor: 1
    
    0:00:00.301185628  2624   0x247090 INFO                     vpe gstvpe.c:740:gst_vpe_sink_setcaps:<vpe> set caps done 1
    0:00:00.301665820  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.301882980  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.334351572  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.334682111  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.337399295  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.337634836  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.340464098  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.340726154  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.343476684  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.343862855  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.346335714  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.346558892  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.349336426  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.349570178  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.355149807  2624   0x247090 DEBUG                    vpe gstvpe.c:820:gst_vpe_chain:<vpe> chain: 0:00:00.097600000 ( ptr 0xaff30b38)
    0:00:00.355229676  2624   0x247090 DEBUG                    vpe gstvpe.c:535:gst_vpe_create:<vpe> dce_init() done
    0:00:00.355314426  2624   0x247090 DEBUG                    vpe gstvpe.c:115:gst_vpe_parse_input_caps:<vpe> Input caps: video/x-raw, format=(string)NV12, width=(int)512, height=(int)384, framerate=(fraction)10000/399, pixel-aspect-ratio=(fraction)1/1, drm_mem=(boolean)true, max-ref-frames=(int)18
    0:00:00.355380306  2624   0x247090 DEBUG                    vpe gstvpe.c:121:gst_vpe_parse_input_caps:<vpe> Already set caps comapred with the new caps, returned TRUE
    0:00:00.355468796  2624   0x247090 DEBUG                    vpe gstvpe.c:562:gst_vpe_init_input_bufs:<vpe> Using min input buffers: 18
    0:00:00.355512554  2624   0x247090 DEBUG                    vpe gstvpe.c:563:gst_vpe_init_input_bufs:<vpe> parse/set caps done
    0:00:00.355812999  2624   0x247090 DEBUG                    vpe gstvpe.c:569:gst_vpe_init_input_bufs:<vpe> gst_vpe_init_input_buffers done
    0:00:00.358326524  2624   0x247090 DEBUG                    vpe gstvpe.c:231:gst_vpe_set_output_caps:<vpe> Passthrough = FALSE
    0:00:00.358389151  2624   0x247090 DEBUG                    vpe gstvpe.c:280:gst_vpe_set_output_caps:<vpe> framerate conversion: from 10000/399 to 10000/399, repeat_factor: 1
    
    0:00:00.359483735  2624   0x247090 DEBUG                    vpe gstvpe.c:861:gst_vpe_chain:<vpe> Importing buffer not allocated by self 0xaff30b38
    0:00:00.359524402  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:443:gst_vpe_buffer_pool_import: Entered gst_vpe_buffer_pool_get
    0:00:00.359552706  2624   0x247090 WARN                     vpe gstvpebufferpool.c:462:gst_vpe_buffer_pool_import: Allocating a new input buffer index: 0/128, 0
    0:00:00.359587354  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:155:gst_vpe_buffer_import: Importing buffer
    0:00:00.359636154  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:472:gst_vpe_buffer_pool_import: New buffer allocated, index: 0
    0:00:00.359668850  2624   0x247090 DEBUG                    vpe gstvpe.c:584:gst_vpe_set_streaming:<vpe> Calling open(/dev/v4l/by-path/platform-489d0000.vpe-video-index0)
    0:00:00.359940178  2624   0x247090 DEBUG                    vpe gstvpe.c:590:gst_vpe_set_streaming:<vpe> Opened /dev/v4l/by-path/platform-489d0000.vpe-video-index0
    0:00:00.359990279  2624   0x247090 DEBUG                    vpe gstvpe.c:516:gst_vpe_print_driver_capabilities:<vpe> driver:      'vpe'
    0:00:00.360021999  2624   0x247090 DEBUG                    vpe gstvpe.c:517:gst_vpe_print_driver_capabilities:<vpe> card:        'vpe'
    0:00:00.360048676  2624   0x247090 DEBUG                    vpe gstvpe.c:518:gst_vpe_print_driver_capabilities:<vpe> bus_info:    'platform:vpe'
    0:00:00.360074540  2624   0x247090 DEBUG                    vpe gstvpe.c:519:gst_vpe_print_driver_capabilities:<vpe> version:     00040454
    0:00:00.360102519  2624   0x247090 DEBUG                    vpe gstvpe.c:520:gst_vpe_print_driver_capabilities:<vpe> capabilites: 84204000
    0:00:00.360127082  2624   0x247090 DEBUG                    vpe gstvpe.c:420:gst_vpe_input_set_fmt:<vpe> input S_FMT field: 0, image: 512x384, numbufs: 0
    0:00:00.360170188  2624   0x247090 DEBUG                    vpe gstvpe.c:428:gst_vpe_input_set_fmt:<vpe> sizeimage[0] = 196608, sizeimage[1] = 98304
    0:00:00.360200607  2624   0x247090 DEBUG                    vpe gstvpe.c:435:gst_vpe_input_set_fmt:<vpe> Crop values: top: 24, left: 32, width: 352, height: 288
    0:00:00.360243226  2624   0x247090 DEBUG                    vpe gstvpe.c:347:gst_vpe_output_set_fmt:<vpe> vpe: output S_FMT image: 352x288
    0:00:00.360278362  2624   0x247090 DEBUG                    vpe gstvpe.c:355:gst_vpe_output_set_fmt:<vpe> sizeimage[0] = 101376, sizeimage[1] = 50688
    0:00:00.360309919  2624   0x247090 DEBUG                    vpe gstvpe.c:562:gst_vpe_init_input_bufs:<vpe> Using min input buffers: 18
    0:00:00.360333831  2624   0x247090 DEBUG                    vpe gstvpe.c:563:gst_vpe_init_input_bufs:<vpe> parse/set caps done
    0:00:00.360386210  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360428015  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360466730  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360505770  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360540580  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360579946  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360613292  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360648103  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360685028  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360718375  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360752698  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360791738  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360828988  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360863474  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360896658  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360934559  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.360968394  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361001415  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361035087  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361072500  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361106335  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361139519  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361176932  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361210116  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361243951  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361278436  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361314874  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361348220  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361382380  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361416866  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361452815  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361487463  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf input, index = 0, fd = 33, plane[0], size = 196608, plane[1] size = 98304
    0:00:00.361519020  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:622:gst_vpe_buffer_pool_set_streaming: Start streaming for type: 10
    0:00:00.361732602  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 0, type: 9
    0:00:00.361773268  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b668
    0:00:00.361804012  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 0, q_cnt = 0
    0:00:00.361865663  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 1, type: 9
    0:00:00.361899498  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b348
    0:00:00.361924548  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 1, q_cnt = 0
    0:00:00.361987988  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 2, type: 9
    0:00:00.362018407  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0x285c08
    0:00:00.362047524  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 2, q_cnt = 0
    0:00:00.362107223  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 3, type: 9
    0:00:00.362142034  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b5c8
    0:00:00.362166759  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 3, q_cnt = 0
    0:00:00.362223204  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 4, type: 9
    0:00:00.362257039  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b488
    0:00:00.362286319  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 4, q_cnt = 0
    0:00:00.362345204  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 5, type: 9
    0:00:00.362377900  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b3e8
    0:00:00.362469970  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 5, q_cnt = 0
    0:00:00.362540567  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 6, type: 9
    0:00:00.362574564  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b528
    0:00:00.362603356  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 6, q_cnt = 0
    0:00:00.362667772  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:96:gst_vpe_buffer_new: Allocated a new VPE buffer, 352x288, index: 7, type: 9
    0:00:00.362701770  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0x2570b8
    0:00:00.362729423  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 7, q_cnt = 0
    0:00:00.362760980  2624   0x247090 DEBUG                    vpe gstvpe.c:609:gst_vpe_set_streaming:<vpe> gst_vpe_init_output_buffers done
    0:00:00.362805063  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.362844591  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.362882004  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.362919092  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.362955855  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.362994244  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.363029706  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.363065818  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:596:gst_vpe_buffer_pool_set_streaming: query buf output, index = 0, fd = 63, plane[0], size = 101376, plane[1] size = 50688
    0:00:00.363376674  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 0
    0:00:00.363675167  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 1
    0:00:00.363966340  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 2
    0:00:00.364254911  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 3
    0:00:00.364543156  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 4
    0:00:00.364827823  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 5
    0:00:00.365105820  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 6
    0:00:00.365379426  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:617:gst_vpe_buffer_pool_set_streaming: vpebufferpool: op QBUF succeeded: index = 7
    0:00:00.365412772  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:622:gst_vpe_buffer_pool_set_streaming: Start streaming for type: 9
    0:00:00.365455879  2624   0x247090 DEBUG                    vpe gstvpe.c:875:gst_vpe_chain:<vpe> Push the buffer into the V4L2 driver 0
    0:00:00.365481418  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:349:gst_vpe_buffer_pool_queue: Queueing buffer, fd: 33
    0:00:00.365509234  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:370:gst_vpe_buffer_pool_queue: Queueing V4L2_FIELD_ANY index=31
    0:00:00.365568770  2624   0x247090 LOG                      vpe gstvpebufferpool.c:386:gst_vpe_buffer_pool_queue: Q_CNT after QBUF index = 0, q_cnt: 1
    0:00:00.365646199  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.365754535  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:289:gst_vpe_buffer_pool_dequeue: No buffers to DQBUF from output Q, try again
    0:00:00.365787719  2624 0xaff30120 DEBUG                    vpe gstvpebufferpool.c:678:gst_vpe_buffer_pool_alloc_buffer: Failed (nil)
    0:00:00.365819114  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for input Q
    0:00:00.365849370  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:289:gst_vpe_buffer_pool_dequeue: No buffers to DQBUF from input Q, try again
    0:00:00.366013826  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.366225943  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.369123850  2624   0x247090 DEBUG                    vpe gstvpe.c:820:gst_vpe_chain:<vpe> chain: 0:00:00.137600000 ( ptr 0x2573d8)
    0:00:00.369172487  2624   0x247090 DEBUG                    vpe gstvpe.c:861:gst_vpe_chain:<vpe> Importing buffer not allocated by self 0x2573d8
    0:00:00.369202580  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:443:gst_vpe_buffer_pool_import: Entered gst_vpe_buffer_pool_get
    0:00:00.369226330  2624   0x247090 WARN                     vpe gstvpebufferpool.c:462:gst_vpe_buffer_pool_import: Allocating a new input buffer index: 1/128, 1
    0:00:00.369253495  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:155:gst_vpe_buffer_import: Importing buffer
    0:00:00.369286842  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:472:gst_vpe_buffer_pool_import: New buffer allocated, index: 1
    0:00:00.369313356  2624   0x247090 DEBUG                    vpe gstvpe.c:875:gst_vpe_chain:<vpe> Push the buffer into the V4L2 driver 1
    0:00:00.369336943  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:349:gst_vpe_buffer_pool_queue: Queueing buffer, fd: 38
    0:00:00.369364108  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:370:gst_vpe_buffer_pool_queue: Queueing V4L2_FIELD_ANY index=30
    0:00:00.369414047  2624   0x247090 LOG                      vpe gstvpebufferpool.c:386:gst_vpe_buffer_pool_queue: Q_CNT after QBUF index = 1, q_cnt: 1
    0:00:00.369748002  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.369943690  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.372156282  2624   0x247090 DEBUG                    vpe gstvpe.c:820:gst_vpe_chain:<vpe> chain: 0:00:00.177600000 ( ptr 0xaff309f8)
    0:00:00.372207684  2624   0x247090 DEBUG                    vpe gstvpe.c:861:gst_vpe_chain:<vpe> Importing buffer not allocated by self 0xaff309f8
    0:00:00.372238591  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:443:gst_vpe_buffer_pool_import: Entered gst_vpe_buffer_pool_get
    0:00:00.372264780  2624   0x247090 WARN                     vpe gstvpebufferpool.c:462:gst_vpe_buffer_pool_import: Allocating a new input buffer index: 2/128, 2
    0:00:00.372294548  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:155:gst_vpe_buffer_import: Importing buffer
    0:00:00.372329847  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:472:gst_vpe_buffer_pool_import: New buffer allocated, index: 2
    0:00:00.372357175  2624   0x247090 DEBUG                    vpe gstvpe.c:875:gst_vpe_chain:<vpe> Push the buffer into the V4L2 driver 2
    0:00:00.372382876  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:349:gst_vpe_buffer_pool_queue: Queueing buffer, fd: 39
    0:00:00.372409716  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:370:gst_vpe_buffer_pool_queue: Queueing V4L2_FIELD_ANY index=29
    0:00:00.372463559  2624   0x247090 LOG                      vpe gstvpebufferpool.c:386:gst_vpe_buffer_pool_queue: Q_CNT after QBUF index = 2, q_cnt: 1
    0:00:00.372848591  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.373051599  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.375963007  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.376100135  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for output succeeded, index: 0, type: 9, field: 1, q_cnt: 1
    0:00:00.376145844  2624 0xaff30120 DEBUG                    vpe gstvpe.c:484:gst_vpe_dequeue_loop:<vpe> push: 0:00:00.097600000 (ptr 0xaff5b668)
    0:00:00.376246210  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.376351943  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for output succeeded, index: 1, type: 9, field: 1, q_cnt: 1
    0:00:00.376391796  2624 0xaff30120 DEBUG                    vpe gstvpe.c:484:gst_vpe_dequeue_loop:<vpe> push: 0:00:00.137600000 (ptr 0xaff5b348)
    0:00:00.376474431  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.376581140  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for output succeeded, index: 2, type: 9, field: 1, q_cnt: 1
    0:00:00.376618716  2624 0xaff30120 DEBUG                    vpe gstvpe.c:484:gst_vpe_dequeue_loop:<vpe> push: 0:00:00.177600000 (ptr 0x285c08)
    0:00:00.376687362  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.376718594  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:289:gst_vpe_buffer_pool_dequeue: No buffers to DQBUF from output Q, try again
    0:00:00.376743482  2624 0xaff30120 DEBUG                    vpe gstvpebufferpool.c:678:gst_vpe_buffer_pool_alloc_buffer: Failed (nil)
    0:00:00.376766255  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for input Q
    0:00:00.376858812  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:298:gst_vpe_buffer_pool_dequeue: DQBUF input for v4l2_index: 31
    0:00:00.376884514  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for input succeeded, index: 0, type: 10, field: 1, q_cnt: 1
    0:00:00.377031890  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for input Q
    0:00:00.377212612  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:298:gst_vpe_buffer_pool_dequeue: DQBUF input for v4l2_index: 30
    0:00:00.377252791  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for input succeeded, index: 1, type: 10, field: 1, q_cnt: 1
    0:00:00.377311514  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for input Q
    0:00:00.377425706  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:298:gst_vpe_buffer_pool_dequeue: DQBUF input for v4l2_index: 29
    0:00:00.377500207  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for input succeeded, index: 2, type: 10, field: 1, q_cnt: 1
    0:00:00.377587884  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for input Q
    0:00:00.377618791  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:327:gst_vpe_buffer_pool_dequeue: No buffers to dequeue from input Q
    0:00:00.380126460  2624   0x247090 DEBUG                    vpe gstvpe.c:820:gst_vpe_chain:<vpe> chain: 0:00:00.217600000 ( ptr 0xaff30958)
    0:00:00.380181604  2624   0x247090 DEBUG                    vpe gstvpe.c:861:gst_vpe_chain:<vpe> Importing buffer not allocated by self 0xaff30958
    0:00:00.380207956  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:443:gst_vpe_buffer_pool_import: Entered gst_vpe_buffer_pool_get
    0:00:00.380230730  2624   0x247090 WARN                     vpe gstvpebufferpool.c:462:gst_vpe_buffer_pool_import: Allocating a new input buffer index: 3/128, 0
    0:00:00.380257407  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:155:gst_vpe_buffer_import: Importing buffer
    0:00:00.380286362  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:472:gst_vpe_buffer_pool_import: New buffer allocated, index: 3
    0:00:00.380313202  2624   0x247090 DEBUG                    vpe gstvpe.c:875:gst_vpe_chain:<vpe> Push the buffer into the V4L2 driver 0
    0:00:00.380337439  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:349:gst_vpe_buffer_pool_queue: Queueing buffer, fd: 40
    0:00:00.380360700  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:370:gst_vpe_buffer_pool_queue: Queueing V4L2_FIELD_ANY index=29
    0:00:00.380413730  2624   0x247090 LOG                      vpe gstvpebufferpool.c:386:gst_vpe_buffer_pool_queue: Q_CNT after QBUF index = 3, q_cnt: 1
    0:00:00.383106514  2624   0x247090 DEBUG                    vpe gstvpe.c:820:gst_vpe_chain:<vpe> chain: 0:00:00.257500000 ( ptr 0xaff30818)
    0:00:00.383279103  2624   0x247090 DEBUG                    vpe gstvpe.c:861:gst_vpe_chain:<vpe> Importing buffer not allocated by self 0xaff30818
    0:00:00.383434287  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:443:gst_vpe_buffer_pool_import: Entered gst_vpe_buffer_pool_get
    0:00:00.383468772  2624   0x247090 WARN                     vpe gstvpebufferpool.c:462:gst_vpe_buffer_pool_import: Allocating a new input buffer index: 4/128, 1
    0:00:00.383499354  2624   0x247090 DEBUG                    vpe gstvpebuffer.c:155:gst_vpe_buffer_import: Importing buffer
    0:00:00.383617450  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:472:gst_vpe_buffer_pool_import: New buffer allocated, index: 4
    0:00:00.383654050  2624   0x247090 DEBUG                    vpe gstvpe.c:875:gst_vpe_chain:<vpe> Push the buffer into the V4L2 driver 1
    0:00:00.383681378  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:349:gst_vpe_buffer_pool_queue: Queueing buffer, fd: 41
    0:00:00.383728876  2624   0x247090 DEBUG                    vpe gstvpebufferpool.c:370:gst_vpe_buffer_pool_queue: Queueing V4L2_FIELD_ANY index=30
    0:00:00.383970111  2624   0x247090 LOG                      vpe gstvpebufferpool.c:386:gst_vpe_buffer_pool_queue: Q_CNT after QBUF index = 4, q_cnt: 1
    0:00:00.384386375  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:00.384655263  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:00.387717626  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.387837186  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for output succeeded, index: 3, type: 9, field: 1, q_cnt: 1
    0:00:00.387878178  2624 0xaff30120 DEBUG                    vpe gstvpe.c:484:gst_vpe_dequeue_loop:<vpe> push: 0:00:00.217600000 (ptr 0xaff5b5c8)
    0:00:00.387957559  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:269:gst_vpe_buffer_pool_dequeue: Entered for output Q
    0:00:00.388056623  2624 0xaff30120 LOG                      vpe gstvpebufferpool.c:309:gst_vpe_buffer_pool_dequeue: DQBUF for output succeeded, index: 4, type: 9, field: 1, q_cnt: 1
    0:00:00.388095175  2624 0xaff30120 DEBUG                    vpe gstvpe.c:484:gst_vpe_dequeue_loop:<vpe> push: 0:00:00.257500000 (ptr 0xaff5b488)
    0:00:26.230554132  2624   0x22c940 DEBUG                    vpe gstvpe.c:973:gst_vpe_src_event:<vpe> begin: event=seek
    0:00:26.234487086  2624   0x22c940 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=flush-start
    0:00:26.234546297  2624   0x22c940 DEBUG                    vpe gstvpebufferpool.c:627:gst_vpe_buffer_pool_set_streaming: Stop streaming for type: 10
    0:00:26.235090417  2624   0x22c940 DEBUG                    vpe gstvpebufferpool.c:627:gst_vpe_buffer_pool_set_streaming: Stop streaming for type: 9
    0:00:26.242738190  2624 0xaff2fc90 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b348
    0:00:26.242850430  2624 0xaff2fc90 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 1, q_cnt = 0
    0:00:26.242898580  2624 0xaff2fc90 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0x285c08
    0:00:26.242935993  2624 0xaff2fc90 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 2, q_cnt = 0
    0:00:26.242982678  2624 0xaff2fc90 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b5c8
    0:00:26.243017977  2624 0xaff2fc90 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 3, q_cnt = 0
    0:00:26.243117041  2624 0xaff30120 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b488
    0:00:26.243174462  2624 0xaff30120 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 4, q_cnt = 0
    0:00:26.243542740  2624   0x22c940 DEBUG                    vpe gstvpebufferpool.c:192:gst_vpe_buffer_pool_put: Entered for output Q, buf=0xaff5b668
    0:00:26.243615940  2624   0x22c940 DEBUG                    vpe gstvpebufferpool.c:216:gst_vpe_buffer_pool_put: vpebufferpool: buf marked free: index = 0, q_cnt = 0
    0:00:26.243726553  2624   0x22c940 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:26.288506897  2624   0x22c940 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=flush-stop
    0:00:26.288891278  2624   0x22c940 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:26.289055083  2624   0x22c940 DEBUG                    vpe gstvpe.c:984:gst_vpe_src_event:<vpe> end
    0:00:26.291058974  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=segment
    0:00:26.291402201  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:26.294484897  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:26.294843251  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:26.299427035  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:26.299766033  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:26.302423843  2624   0x247090 DEBUG                    vpe gstvpe.c:901:gst_vpe_event:<vpe> begin: event=tag
    0:00:26.302741531  2624   0x247090 DEBUG                    vpe gstvpe.c:964:gst_vpe_event:<vpe> end ret=1
    0:00:26.330209262  2624   0x247090 DEBUG                    vpe gstvpe.c:820:gst_vpe_chain:<vpe> chain: 0:00:00.097600000 ( ptr 0xaff30818)
    0:00:26.330490025  2624   0x247090 DEBUG                    vpe gstvpe.c:115:gst_vpe_parse_input_caps:<vpe> Input caps: video/x-raw, format=(string)NV12, width=(int)512, height=(int)384, framerate=(fraction)10000/399, pixel-aspect-ratio=(fraction)1/1, drm_mem=(boolean)true, max-ref-frames=(int)18
    0:00:26.330549398  2624   0x247090 DEBUG                    vpe gstvpe.c:121:gst_vpe_parse_input_caps:<vpe> Already set caps comapred with the new caps, returned TRUE
    0:00:26.330589089  2624   0x247090 DEBUG                    vpe gstvpe.c:562:gst_vpe_init_input_bufs:<vpe> Using min input buffers: 18
    0:00:26.330620809  2624   0x247090 DEBUG                    vpe gstvpe.c:563:gst_vpe_init_input_bufs:<vpe> parse/set caps done
    0:00:26.337334875  2624   0x247090 DEBUG                    vpe gstvpe.c:584:gst_vpe_set_streaming:<vpe> Calling open(/dev/v4l/by-path/platform-489d0000.vpe-video-index0)
    0:00:26.337575785  2624   0x247090 DEBUG                    vpe gstvpe.c:590:gst_vpe_set_streaming:<vpe> Opened /dev/v4l/by-path/platform-489d0000.vpe-video-index0
    0:00:26.337720883  2624   0x247090 DEBUG                    vpe gstvpe.c:516:gst_vpe_print_driver_capabilities:<vpe> driver:      'vpe'
    0:00:26.337844347  2624   0x247090 DEBUG                    vpe gstvpe.c:517:gst_vpe_print_driver_capabilities:<vpe> card:        'vpe'
    0:00:26.337973342  2624   0x247090 DEBUG                    vpe gstvpe.c:518:gst_vpe_print_driver_capabilities:<vpe> bus_info:    'platform:vpe'
    0:00:26.338095017  2624   0x247090 DEBUG                    vpe gstvpe.c:519:gst_vpe_print_driver_capabilities:<vpe> version:     00040454
    0:00:26.338213926  2624   0x247090 DEBUG                    vpe gstvpe.c:520:gst_vpe_print_driver_capabilities:<vpe> capabilites: 84204000
    0:00:26.338335926  2624   0x247090 DEBUG                    vpe gstvpe.c:420:gst_vpe_input_set_fmt:<vpe> input S_FMT field: 0, image: 512x384, numbufs: 0
    0:00:26.338681430  2624   0x247090 DEBUG                    vpe gstvpe.c:428:gst_vpe_input_set_fmt:<vpe> sizeimage[0] = 196608, sizeimage[1] = 98304
    0:00:26.338834662  2624   0x247090 DEBUG                    vpe gstvpe.c:435:gst_vpe_input_set_fmt:<vpe> Crop values: top: 24, left: 32, width: 352, height: 288
    0:00:26.339014571  2624   0x247090 DEBUG                    vpe gstvpe.c:347:gst_vpe_output_set_fmt:<vpe> vpe: output S_FMT image: 352x288
    0:00:26.339151049  2624   0x247090 DEBUG                    vpe gstvpe.c:355:gst_vpe_output_set_fmt:<vpe> sizeimage[0] = 101376, sizeimage[1] = 50688
    0:00:26.339282158  2624   0x247090 DEBUG                    vpe gstvpe.c:562:gst_vpe_init_input_bufs:<vpe> Using min input buffers: 18
    0:00:26.339418961  2624   0x247090 DEBUG                    vpe gstvpe.c:563:gst_vpe_init_input_bufs:<vpe> parse/set caps done
    
    (mplayer:2624): GStreamer-CRITICAL **: gst_buffer_peek_memory: assertion 'GST_IS_BUFFER (buffer)' failed
    
    ** (mplayer:2624): CRITICAL **: gst_fd_memory_get_fd: assertion 'mem != NULL' failed
    Segmentation fault (core dumped)
    

  • OK,

    Apply these 3 commits. Your issue should get resolved.

    The second commit was for same error with trick-play.

  • Thanks Ram,

    It solved the playback issue. But at times the app crashes with the following error

    MmRpc_use: Error: unable to declare buffer use
    ../git/libdce_linux.c:115:    dce_buf_lock    ERROR: Failed eError == DCE_EOK error val -5../git/libdce.c:509:    Engine_open    ERROR: Failed eError == DCE_EOK error val -5MmRpc_release: Error: unable to release buffer
    ../git/libdce_linux.c:145:    dce_buf_unlock    ERROR: Failed eError == DCE_EOK error val -5MmRpc_use: Error: unable to declare buffer use
    ../git/libdce_linux.c:115:    dce_buf_lock    ERROR: Failed eError == DCE_EOK error val -5../git/libdce.c:509:    Engine_open    ERROR: Failed eError == DCE_EOK error val -5MmRpc_release: Error: unable to release buffer
    ../git/libdce_linux.c:145:    dce_buf_unlock    ERROR: Failed eError == DCE_EOK error val -5MmRpc_use: Error: unable to declare buffer use
    ../git/libdce_linux.c:115:    dce_buf_lock    ERROR: Failed eError == DCE_EOK error val -5../git/libdce.c:509:    Engine_open    ERROR: Failed eError == DCE_EOK error val -5MmRpc_release: Error: unable to release buffer
    ../git/libdce_linux.c:145:    dce_buf_unlock    ERROR: Failed eError == DCE_EOK error val -5MmRpc_use: Error: unable to declare buffer use
    ../git/libdce_linux.c:115:    dce_buf_lock    ERROR: Failed eError == DCE_EOK error val -5../git/libdce.c:509:    Engine_open    ERROR: Failed eError == DCE_EOK error val -5MmRpc_release: Error: unable to release buffer
    qml: micstatus, micClickCount:  false 0

    (qmlplayer2:1550): GStreamer-CRITICAL **: gst_mini_object_unref: assertion 'mini_object->refcount > 0' failed
    ../git/libdce_linux.c:145:    dce_buf_unlock    ERROR: Failed eError == DCE_EOK error val -5../git/libdce.c:485:    Engine_open    ERROR: Failed engine_open_msg != NULL error val -2

    It occurs once in every 20-30 time.

  • Hi Sam,
    When this issue happens , can you check the dmesg and look for
    "omapdrm omapdrm.0: could not remap"
    if this is observed, then the 128MB TILER is not sufficient.

    Is this happening for all type of streams?
  • HI Sam,
    Did you apply all three patches? First patch with commit-id a1fe1f3e3ae0582a4f84ae8fa7ca052fff2e9f76
    should resolve your issue of dce_errors.