Help!!! Pipe Stalling with No Error
Nicolas Dufresne
nicolas at ndufresne.ca
Fri May 29 22:10:34 UTC 2020
Le vendredi 29 mai 2020 à 14:01 +0000, Dass, Reena A Collins a
écrit :
> Thanks for the suggestion. Here is the log with GST_DEBUG="*SCHED*:5", turned
> on.
That seem all pretty "custom", basically no time information at all, just bytes.
I think it's simply too much non-gstreamer code involved for use to help here.
Again, add traces in your code, try and find exactly were it blocks.
>
> Here is the log
> 0:00:01.205403860 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomInput:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f61080050a0,
> pts 0:00:00.000000000, dts 0:00:00.000000000, dur 99:99:99.999999999, size 48,
> offset none, offset_end none, flags 0x40
> 0:00:01.878039009 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform1:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f61080054e0,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x40
> 0:00:01.878903280 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> calling
> chainfunction &0x7f611daa7c79 with buffer buffer: 0x7f61080054e0, pts
> 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size 48,
> offset none, offset_end none, flags 0x40
> 0:00:01.891255096 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> called
> chainfunction &0x7f611daa7c79 with buffer 0x7f61080054e0, returned ok
> 0:00:01.891304767 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform1:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f61080054e0, returned
> ok
> 0:00:01.891340703 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform1:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f61080053d0,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:01.891826856 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform1:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f61080053d0, returned
> ok
> 0:00:01.891872637 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform1:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f61080052c0,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:01.947088407 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> calling
> chainfunction &0x7f611daa7c79 with buffer buffer: 0x7f61080053d0, pts
> 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size 48,
> offset none, offset_end none, flags 0x40
> 0:00:01.947492764 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> called
> chainfunction &0x7f611daa7c79 with buffer 0x7f61080053d0, returned ok
> 0:00:01.947541521 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> calling
> chainfunction &0x7f611daa7c79 with buffer buffer: 0x7f61080055f0, pts
> 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size 48,
> offset none, offset_end none, flags 0x0
> 0:00:01.947945965 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> called
> chainfunction &0x7f611daa7c79 with buffer 0x7f61080055f0, returned ok
> 0:00:01.948001215 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform1:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f61080052c0, returned
> ok
> 0:00:01.948036756 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform1:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f61080051b0,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:01.948745073 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> calling
> chainfunction &0x7f611daa7c79 with buffer buffer: 0x7f61080052c0, pts
> 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size 48,
> offset none, offset_end none, flags 0x40
> 0:00:01.948809066 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<Queue:sink> calling chainfunction
> &gst_queue_chain with buffer buffer: 0x7f6108005700, pts 99:99:99.999999999,
> dts 99:99:99.999999999, dur 99:99:99.999999999, size 48, offset none,
> offset_end none, flags 0x0
> 0:00:01.948870751 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform2:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f6108005700,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:01.948992865 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<Queue:sink> called chainfunction
> &gst_queue_chain with buffer 0x7f6108005700, returned ok
> 0:00:01.949021497 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<Queue:sink> calling chainfunction
> &gst_queue_chain with buffer buffer: 0x7f6108005810, pts 99:99:99.999999999,
> dts 99:99:99.999999999, dur 99:99:99.999999999, size 48, offset none,
> offset_end none, flags 0x0
> 0:00:01.949091665 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<Queue:sink> called chainfunction
> &gst_queue_chain with buffer 0x7f6108005810, returned ok
> 0:00:01.949118786 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<Queue:sink> calling chainfunction
> &gst_queue_chain with buffer buffer: 0x7f6108005920, pts 99:99:99.999999999,
> dts 99:99:99.999999999, dur 99:99:99.999999999, size 48, offset none,
> offset_end none, flags 0x0
> 0:00:01.949650400 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<Queue:sink> called chainfunction
> &gst_queue_chain with buffer 0x7f6108005920, returned ok
> 0:00:01.949764867 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<Queue:sink> calling chainfunction
> &gst_queue_chain with buffer buffer: 0x7f6108005a30, pts 99:99:99.999999999,
> dts 99:99:99.999999999, dur 99:99:99.999999999, size 48, offset none,
> offset_end none, flags 0x0
> 0:00:01.949793326 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<Queue:sink> called chainfunction
> &gst_queue_chain with buffer 0x7f6108005a30, returned ok
> 0:00:01.954895989 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomDemuxer:sink> called
> chainfunction &0x7f611daa7c79 with buffer 0x7f61080052c0, returned ok
> 0:00:01.954977438 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform1:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f61080051b0, returned
> ok
> 0:00:01.955014439 19653 0x221e940 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomInput:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f61080050a0, returned
> ok
> 0:00:02.432996027 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform3:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f6108005d60,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:02.433428170 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform3:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f6108005d60, returned
> ok
> 0:00:02.433478761 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform2:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f6108005700, returned
> ok
> 0:00:02.433504774 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform2:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f6108005810,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:02.434031428 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform3:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f6108005e70,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x40
> 0:00:02.434354455 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform3:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f6108005e70, returned
> ok
> 0:00:02.434388307 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4090:gst_pad_chain_data_unchecked:<CustomTransform2:sink> called
> chainfunction &gst_base_transform_chain with buffer 0x7f6108005810, returned
> ok
> 0:00:02.434414865 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform2:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f6108005920,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x0
> 0:00:02.434929090 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomTransform3:sink> calling
> chainfunction &gst_base_transform_chain with buffer buffer: 0x7f6114003010,
> pts 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size
> 48, offset none, offset_end none, flags 0x40
> 0:00:32.518582069 19653 0x221e720 DEBUG GST_SCHEDULING
> gstpad.c:4084:gst_pad_chain_data_unchecked:<CustomSink:sink> calling
> chainfunction &gst_base_sink_chain with buffer buffer: 0x7f6114003120, pts
> 99:99:99.999999999, dts 99:99:99.999999999, dur 99:99:99.999999999, size 8,
> offset none, offset_end none, flags 0x40
>
> -----Original Message-----
> From: gstreamer-devel [mailto:gstreamer-devel-bounces at lists.freedesktop.org]
> On Behalf Of Nicolas Dufresne
> Sent: Thursday, May 28, 2020 9:23 PM
> To: Discussion of the development of and with GStreamer
> Subject: [External] Re: Help!!! Pipe Stalling with No Error
>
> Le jeudi 28 mai 2020 à 13:21 +0000, Dass, Reena A Collins a écrit
> :
> > I added a couple of queues but it did not help. And you are right it is a
> > demuxer.
> > I've added another picture with the additional queues which has the levels
> > etc. if that helps.
>
> As that graph is from a pipleine in NULL state, it does not bring much
> information to the issue. Maybe you could share a trace with
> GST_DEBUG="*SCHED*:5", this way we could see the buffer flowing through each
> elements, and see which sink does not receices any data.
>
> Another useful point of information is a backtrace of all threads at the
> moment
> of a stall. Studying were each threads are block can greatly improve the
> understanding of the problem. If you cannot share that I would understand, so
> let's hope this suggestion can help you.
>
> _______________________________________________
> gstreamer-devel mailing list
> gstreamer-devel at lists.freedesktop.org
> https://lists.freedesktop.org/mailman/listinfo/gstreamer-devel
More information about the gstreamer-devel
mailing list