alternate ntfs streams gone?

[mvallevand]

are ntfs metadata working in your latest recordings?

Just created a test recording and yes it is working now but it is added when the file stops recording.

Martin

[pBS]

what is in logs when it writes ntfs data?

it's done it on multiple drives, and only after a certain time.. so doesn't seem to be related to the ntfs formats of the drives, and all drives have some files w ntfs metadata..
so for some reason it's just decided to quit writing them..
certain there's no setting in config for the ntfs stuff?
i turned off the art n metadata without any luck...they just affect the .xml file..

i sure hope v5 has reliable recording backup n import facilities.. [for individual files, not daily backups]

[mvallevand]

Probably these lines are what do it

Code:

2019-02-12 10:21:32.212    [DEBUG][10]    Graph stopping...
2019-02-12 10:21:34.999    [DEBUG][10]    Removing filter  NPVR Writer2
2019-02-12 10:21:34.999    [DEBUG][10]    Removing filter  NPVR Writer
2019-02-12 10:21:35.000    [DEBUG][10]    Removing filter  Infinite Pin Tee Filter
2019-02-12 10:21:35.003    [DEBUG][10]    Removing filter  Hauppauge HD PVR Encoder
2019-02-12 10:21:35.005    [DEBUG][10]    Removing filter  Hauppauge HD PVR Capture Device
2019-02-12 10:21:35.006    [DEBUG][10]    Removing filter  Hauppauge HD PVR Crossbar
2019-02-12 10:21:35.007    [DEBUG][10]    Graph stopped
2019-02-12 10:21:35.007    [DEBUG][10]    StoreMetaData@1
2019-02-12 10:21:35.012    [DEBUG][10]    StoreMetaData@2
2019-02-12 10:21:35.013    [DEBUG][10]    StoreMetaData@3
2019-02-12 10:21:35.013    [DEBUG][10]    StoreMetaData@4
2019-02-12 10:21:35.013    [DEBUG][10]    StoreMetaData@5
2019-02-12 10:21:35.013    [DEBUG][10]    StoreMetaData@6
2019-02-12 10:21:35.013    [DEBUG][10]    StoreMetaData@7
2019-02-12 10:21:35.015    [DEBUG][10]    StoreMetaData@8
2019-02-12 10:21:35.015    [DEBUG][10]    StoreMetaData@exit

Martin

[pBS]

i see those in my logs...but i thiink that's storing it w recording entry in database..
i don't think there's any logging of the ntfs writes.

actually, mine look like

Code:

2019-02-12 08:46:52.648    [DEBUG][9]    StopStream@exit
2019-02-12 08:46:52.648    [DEBUG][9]    StoreMetaData@1
2019-02-12 08:46:52.649    [DEBUG][9]    Storing Ensemble XML
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@1
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@2
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@3
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@4
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@5
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@exit
2019-02-12 08:46:52.651    [DEBUG][9]    StoreMetaData@exit

[mvallevand]

The metadata is already in the database before the recording starts. What do you have for StoreEnsembleMetadataXml in config.xml

Martin

[sub]

I just double checked, and the logic is still there, and is working here.

It always tries to store the metadata in the "recording.ts:metadata.xml" ads. If <StoreSeparateMetadataXml> is set to true, then it'll also try to store the separate copy in "recording.xml". These files are written at the end of a recording.

also, i have autoremovemissingrecordings set to false, and with rec service OFF, just going into nextpvr.exe deleted my recordings!!! [recordings were temp unavailable]
and noremovewhentreemissing set to true...!! why did it remove my recordings?

Hmm, I wouldn't think so - and we've not seen any other reports of this. Have you got the logs from when this happened, so we can see what actually happened?

oh and it still creates the weird .xml when dl artwork/metadata is off!!!

What is the filename? (ie, StoreSeparateMetadataXml is about NextPVR's recording metadata, and unrelated to artwork metadata)

[sub]

i see those in my logs...but i thiink that's storing it w recording entry in database..
i don't think there's any logging of the ntfs writes.

actually, mine look like

Code:

2019-02-12 08:46:52.648    [DEBUG][9]    StopStream@exit
2019-02-12 08:46:52.648    [DEBUG][9]    StoreMetaData@1
2019-02-12 08:46:52.649    [DEBUG][9]    Storing Ensemble XML
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@1
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@2
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@3
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@4
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@5
2019-02-12 08:46:52.650    [DEBUG][9]    ensemble@exit
2019-02-12 08:46:52.651    [DEBUG][9]    StoreMetaData@exit

Do you have <StoreEnsembleMetadataXml> set to true in your config.xml?

[mvallevand]

Do you have <StoreEnsembleMetadataXml> set to true in your config.xml?

I beat sub for a change!

Martin

[sub]

lol yep, hadn't read that far yet

[pBS]

i've never even heard of that setting...dunno who set it but it wasn't me... [noone else has access]

the darn logs roll over so fast i rarely get any useful info by the time i know to look...lol i sooooooo wish we could have a longer log setting...lol

i'll setup a test later to confirm the deleted recordings...

aha, after setting the ensemble to false, i now get this: [very end]

Code:

2019-02-12 09:54:39.984    [DEBUG][9]    Requesting wake up for 'RecordingOID257401' at 3/1/2019 3:57 PM
2019-02-12 09:54:39.984    [DEBUG][9]    Requesting wake up for 'RecordingOID257384-backup' at 3/1/2019 8:57 PM
2019-02-12 09:54:39.984    [DEBUG][9]    Requesting wake up for 'RecordingOID257384' at 3/1/2019 8:57 PM
2019-02-12 09:54:41.159    [DEBUG][19]    Downloaded Chunk: http://mia2.vaders.tv/.../41-05005.ts?....  [XtV3DxI6u90VxbF4JYTGKzFM6cOS8D98WlHgSzBnxm2qUfzv+Ck4oSNaQpgR2i8nSlXP7jPEfVO6pZQInly3ET+/RAU93TU3yBIfUdXOYjzIrvwlTq/adm8XPn50nq4aAQPqt7ccjgv+x3x+Ye2kmcCyD9vJ5AEWQA0/NiYFTBpWUio7xC+O7gCrPE4oJK90RE/3EuHam8rU9vkbX+dNWSKGMAGp7NU47NFzvZEGBeGDTJqsUscTlBeXTXHyIT/eMg6/KvbSSAAi88R/Z1BCoHZWbJuMwrsTRP/98TC6WlEqZ1eWrvNzQPiFCeno3GBSY4SmOf7+6suJCZ+y8GApN+96kmGRSgGI6qzXGqVzy9lMQm7+/pzPvb0pcHe9nY0PQdaww5objVc/+jgw4Eyaxg3pk0Xq/dbZXSfQzUCcRb0ldpm/+/RSSGzG66JqNy4oe6K29lC5pv5iIbBOeYomqP8yV1lx4R1UENw8yLj/MsIpaEPjOhgfjVN3ZSAuHoNkkTH+v7l3l8HFl0Im+doGXcQbVlj/SXdcP4H4AtdDU+CPsIPJNyCJBQKjeCfZAexbHgr2aHlg2m8SLvSaafk8b+9OjSWNK/dWsVSy0nHUcVpJ9mN4ugNzhzerl4HzH0PRhItw3T+GMkxCCXa3HaJ6Nhsj2M/4g8RbDKrjjPjGtxRU/ttWxWB47WEGkn+bIIPQPUryoS6YkCqxEqYMSrmhl5uwi/4BrKbASPXvoIgibGm+Sxv24XvkuVvZ2Ti9FL18aMe2yJu+qXqpljK98HWWjCB6NXC8B8sYnrD4cu/FN9cKRFO/AXsNHeDDTuHdf2mY2BLhra+o6l+jU8ut9chKrA==] (size=2869632)
2019-02-12 09:54:41.638    [DEBUG][19]    Downloaded Chunk: http://mia2.vaders.tv/.../46-05005.ts?....  [SQNK/r4CKJ/q1X5M6XZ1GOiMDXZRw+DoHkBhp+7z5XUOei1WJRTfRy0eePo/g9mhfxH7N2I0rJCwp8Sw5S1xYwen97AcrGtMSZigv44z9SgA4Y5zybuzJosyQ6UyGc2uGrbD19rtX58lpHLC9Xzey3WTuxwpr+IoYPCoLOvY/HdhAyHohFPnJjigSrib5ubAvpGar3OEG3ohG6Gp1W/lPCsIsHGVmN23kf3jCUoD3lms0CNgnIx087hEsELIdbWIHEUR8EcGaIgtiEva7quh55af45LcHNNw5LAhxrOLOUU71qyNA5LWYG+kHsoriNeVN+XgV6vZ/kDguWXRMAD0IKZYQgEFN+iH/4FVWHRWE6zRGNHZ+cKXYlTdonHauE20jvvbx4KkTcwKm1SM/PiUyY8PpIJtsnplFapoeaj5KgHUQ16FkTpt2cWb7SDj9vJ2wXvJCf+9mC/zc42eG2ICLXmMMe39Om1QZm25QqI8WVETgvqZYuZf7NeF/UuX4+Urst8tzYhuEwcs5rktFVWBHY3y3csc7f4+Feu3/NpyN3D4zOwjdMFKv+xjfipvbB0A7PoH+2+7PqDvV2b9JaX5f5VbOe56/bzn8r7i8HLgSOCPwcEcraGO+3CudfCZWAwqoxSXGVf4lOdB6WqNvQhdQRbLDj+XHXgsrq0pgSL5QWEsLll+96RSPh1qkDPcM+EZBKt089cQNgnTZzkxpPrO8BmTYbB3y9dunxYaqB5mxdaWEPbGPNMQkPrM+7XXS11EiytZ+i7TjPoqQUXuRJIbPHpzkpRBISOLYExJQQD3YsTtMEXX7dvBGAO/iAJO/yj5TJTWiwCcbLXwz4E3Wtj60A==] (size=2568832)
2019-02-12 09:54:44.527    [DEBUG][19]    Downloaded Chunk: http://mia2.vaders.tv/.../51-05005.ts?....  [m4yR5vcnY4fPSelHJhrSe/czmlWsSGYxMe/KllFFiKfovHKBJiz129hiZfbAefJV6hQyVnfEP5EZUFQmd+lMygkXfR0gSTvVvJPTIFaR3H3CHUA7sP5bueic/oYtFdGCYXJU5MEAL3hXSLl5cpgwfHTYP6GmFJj2NSO+MJW9MhOmgJM6NQdo7f9NUeyY8dEUL7p4xvRoiJ+M6+zEYrXgfFvgDOOYWVhVxIdCfFa9RWkFgyHT5Td8+rHtKjBIdDDu5BswNWj/4YW+CtxbS0A5byleyXofq7DYjRx/rwn+jrHBfq4g8hBTJCpv3Q/fi0x70ZGKVjtO1wAgZUy0Sa2Wf6evvY0szKuTmXz1B4D3TjVxaRTI3/ulqpzaGw99yq8C+C2pEIFNV5jS4ma8AMd3l6pJc0ipf/xRJerTLFeUYs7HP04JrkTFg3H6whK0BPBHo8jqL/aos7+8K9NRmQxKWJvJLq01aRpauhZhVC/a7z47fYujjKyqEkuojNWis2dbHB45Oa91gM2ftF/9yXXxAvLIFq1me+9XB3uNlaNmLsWUOAvjkVgnDYb4qD3DFo4au6/TwUBePiQFuxpxOLdjQtlKi38+SbzYd/dvEAFt1NpXtJ1n4qxIPhmYxcLRztndo/2+jICK0T80FEQpYzNRNPkfAXl4NatMQqd8QjjMRf80CLx4miacIw/qE70u85qLvo8KcB/zdd64OBlQkad7uXFQuToEchuSpO1GaYnHRj4O5N9tMwRCQSMqat9TGJcycM1uhRcpkZFOxrtwmr1GqMKTbsxWOeBwRkgzQ99yv+CVSgZqxWTYuSyIPSnSaSFgwp21Zv5cdk9f/bor6uqYvw==] (size=3405056)
2019-02-12 09:54:49.424    [DEBUG][19]    Downloaded Chunk: http://mia2.vaders.tv/.../56-05005.ts?....  [hK3SAy0Mo2MS4MvAPCLg6RQ/DcvvWhqWiKC+AS/CkC4mjSaHNh4amnbx+HMBZUIjLx9M7m3C/6sUHdSRmbJhLF0Xl49cvgycmfN3ADQhjUJJIcMgns4FouyEKyK84baYOXcUqCgVCsnETsDX/1eiF347bPIOmyml12jWsExQiCaBtTEeDYQm41Vfe+/esXPB7BjEJQ6XvNsBADESfiCR8m1AKcUPW4v1fzSni2qE32fUvnei/cEtCqHEuYggrA5KpfSuKdMtnQudJjyush8G1rpOoG4NX71duPmV9c1RthcG8+3uIXVaxX/SDZB7jwDH9uD2ZceBwK0eSDCpT7iBpbFMNOL4zgyunhBDyk/IeHg8FYZuEG8je8KT/qb5o8Nna2uxjnvYLZ/pr4x0M5Dv65wwEcmBcE2FfwQVkejNyWZt05UyM/GoTulWL4LEAFlTI3uMwTrHtPBgb5Rh5dRAzg6edOAujPMLoJTLaWiuK9lBfBPJTCL5LEJK6wMCLyk84PD7AyAhKdsO6fQ0Wc7t3gfQEUQ+AAntxGWghT2l9L0GVmb4IAJFYs8jdWatllge29g+uoc8Cxo3nnrY+Ubl20O5OVyeT31gr562XSHHOMgskJT7w0c0bgCegTnTzBbZYtxCXOAGBjr7atyqIrNY5L/NmQOYoHQDuYymtr8AV/WqY3p1C7XIe/ixhHkPGyIVIOj9iVXeXioMCMIhHIQbep5tvQ26wEga9cjxFRi1V+vpVKQ9BZ4OgOIBvfZfJBDnflgg2RlXhe8RbPbePkzCrauy+lHVQyyNt3vo84ciisr9C+0szIf1i1FFj80boXxYy4nApzGSbjG11WujoOUt2w==] (size=2848576)
2019-02-12 09:54:54.254    [DEBUG][19]    Downloaded Chunk: http://mia2.vaders.tv/.../01-05005.ts?....  [gqOLKqDkeerkQNXeSSyYPMAPxbApdfMa34EblNbTka/OSePAapgdDBDiJmuzNG4c25Yh4pC6YYMADpK0hn+pI11eKoxvVA86H+LaVKi12aX1F5tSuhVs/BnKSirqrCaEU46CvTZGiq/pdcFB1a4Ci/t2bmETRToI0324K7xY6cTlUAiJO8CmSVmNmmYZhyHqE6k6RcWud+m1+8xOCe98gGXHin92nloUuAjpFfTvTOv1wfpLmdC+pET+wBYHAGVgTEiKPIDHQx8E4T38asKaBWYA2i3BYW2nIqwaBBKckk7WT2PxkDL+whjbTeIBK52dD2TKWquw5HkotcATrGDv8jWlFHE3RBfbwfsabJuh3303zEs4G3ZRMdN9XsrNiE55hRqBzyDBt8MY+aVfMsWQ7G1ICcRLmZKCoKcOSh0k4mQt4gwxTeNVgEKDsNWzFeNrpicia0h1NYf2iDGpM9T1ZgqPVv/lH9cwPordWzrLaNsgW95E3M6LACZHEWnUsHLkmp2jGkd1lTkkTgCMGYaupg1fzp4FXKpNtp9m0MyLSSiA3OcvSEEXmolBsX9UsO+Cb0HY1Q862g6+GTjgjXxT9itlhfH7GIVxreoZxN6wMrutB3+Y29FxsPcduIG6Bhf30nh0dxOybzRETY5Z7DplHgrUcvqT9q/Uz5G45/LGbFQRdEXJGhHw+q4KP3HJrEzJJH0goEaWKS6lfT5RY1/yaQKlQovk2bZuRTe4/yV4w92bAhniTXlBTl5NumOwpFus5OHWHPu72FpYIku+RcTe0cm1/f3hxBM4wWuJyXEeF+vBnOIT+EaFFAZUwyZaY8KGPmeiS0TPItC8XscemB0ATw==] (size=2460544)
2019-02-12 09:54:59.190    [DEBUG][19]    Downloaded Chunk: http://mia2.vaders.tv/.../06-05005.ts?....  [epak5Aneb2NjRuhuKbxjWpkIOmIn0wQlxdi6LOImkRaGcaVPahI0E3fvuKaMYYFrqgIZIB2a864rP/ZvTphNOjezduA9QSm0m6qC3QIFVHxxkN/g+4+G9fXlrgwbdwb5b9mWcjhjlHAWWC0RqSy7Azl7VuWZ5HdM3mm1glII7s16wH62S0HSREdbK2ux2oqCuxX09VTmKd42ycfIaJFJVrEVOWXr+PlmRgv4LLgjtNDHwKxCZxQ2KCL6sRzsJbNsuzYPYCzc1aS2Ddl/tjrbRyu0i/1O6iVViayo+zJMo02RCvwlXBoMQFAth7Bq2Y1wXxHdRDvTHNi1X5tLsRh1NwSMjnW+IsCt6Dso6JoakEHkcY+OQVmW89SgUDoX/z651jyA6lz0yrCIPt2N/kn0ZBxF1l0GM1UWpPQlROp4N96UdxpwKeNzi3vG0UcGhxDGBnguAQ8DuQTbNWLARTAOqgcjaHO9laDXHbbPvzV4T4IVk0M/W0+OdpoeggEatSgZnbbkpIyZUk191aqpVbF3XS0/5N9fiMwnHXM1u8L32+ObY0vdUDgQIn/lGXuZuYz1qtEwOWOPjdALxV3qV0TJlgnUkQ3ItuBidrDd0qN+ZAbtjzmoCygzLfeURvg+26Vw7orrf2OQBFzVJsM6ahSCHMRYZ9aLCV3DAlhRk4bS5ZhjGD14HoUmvTlkzMeMtAvz4hpx9/Csht49tb2ggIj108G3622Ca0qXzgSTMFwsvnmMopLrEPhEQ8hD0uHg9JC3pLzmOkCO4RkhIA768WbmtSvFK5hRFlqPI8dpfCQitbZlIY/2Bz68ZWVW2UJEW2aAnvcbsGPF4TwjK+qOzYydVQ==] (size=3110272)
2019-02-12 09:55:00.085    [DEBUG][9]    Stopping recording (257467 on 69). Past end time of recording. 1
2019-02-12 09:55:00.167    [DEBUG][9]    StopStream@1
2019-02-12 09:55:00.168    [DEBUG][9]    Stopping m3u8 stream (http://mia2.vaders.tv:80/.../index.m3u8?....  [Bhecq3UU0ZjhKEQj53SZOacrPcnn7Z208tmahNiNq8Nr83g8905xrdKMSKeiWBP4NVEL3O3sOE17wdgZ0sBoAox8QYiUqO6/rLt5x1COvoqcPP3O+sMHsuwoErUenxloXMu+gmAMUImcuGkh3ZIKDMELi5B0cwyG7f6FESzMHblTtnNaII/bnpWwmqbPo6NEQzzS2PIClhv5x1rm5D7Rq2QNW+041DWyZb+/MqSj76LqzasPEatF+Qxe3t3cUAgDFGTaUmveqEF2jgdlBfKO/ZEYBP5CGcZU7/UL8L6ljdKKRx1HAxcta2pkFpjemQool0ltreMO/QolZz9+UkZmnXhfnVRtYNUy+LQ1K1CZ9PDSC+x3kFOT5UJUI1hnOwcSNTA2rpQ8Dllx5mkK6XYI/d9DFvxv7sOTdlBGX3Pppdd3F9uh12C7fHiQTV/8pQlbgT266HF62fhW1/fNC1OQ3nAaZVH37gjFVEtE3x2Rgzh6+ifo5ypS8F9PvmiBvkTckuxE8aSl+yPalqVvg9sXp7IF3t1+UqncuUcOEhhYsLu8YWsQ4xcqLTinP19QEvmKlJSl5DMWupiRKmE+w/2JXOXuIFsifEcmFPG8vl1cSKHypYviBHe4Vo6jQjzg5cR9egBhc+cyZ+ei9w4SpZBuORI9fTi+Qz6JlBml4OzCPj49y3N4dC7RxmfcIsTCd6lEHupXMF6AVajZwqjMgV7JEQrNaJ7vbhSM2d3hTmiXsTziKHye1p/1uSZ/210cVlSj8uRaTAH9u6HYKCPOjQ0IL0l8F18BPZGWWvZuoI/sZzyerYaU36SlhW9c0rwtwBsY])
2019-02-12 09:55:00.259    [DEBUG][9]    StopStream@2
2019-02-12 09:55:00.259    [DEBUG][9]    StopStream@3
2019-02-12 09:55:00.260    [DEBUG][9]    Graph stopping...
2019-02-12 09:55:00.366    [DEBUG][9]    Graph stopped
2019-02-12 09:55:00.369    [DEBUG][9]    Removing filter  NPVR Writer
2019-02-12 09:55:00.369    [DEBUG][9]    Removing filter  NPVR Net Push Source
2019-02-12 09:55:00.478    [DEBUG][9]    StopStream@exit
2019-02-12 09:55:00.483    [DEBUG][9]    StoreMetaData@1
2019-02-12 09:55:00.484    [DEBUG][9]    Filename is zero bytes long
2019-02-12 09:55:00.484    [DEBUG][9]    StoreMetaData@2
2019-02-12 09:55:00.484    [DEBUG][9]    StoreMetaData@3
2019-02-12 09:55:00.484    [DEBUG][9]    StoreMetaData@4
2019-02-12 09:55:00.484    [DEBUG][9]    StoreMetaData@5
2019-02-12 09:55:00.486    [DEBUG][9]    StoreMetaData@6
2019-02-12 09:55:00.486    [DEBUG][9]    StoreMetaData@7
2019-02-12 09:55:00.486    [DEBUG][9]    StoreMetaData@8
2019-02-12 09:55:00.486    [ERROR][9]    Unexpected error saving metadata: String cannot be of zero length.
Parameter name: oldValue
2019-02-12 09:55:00.487    [DEBUG][9]    Invalid file passed to StartPostProcessing(): ''