Shibboleth Developers

["Mahabalagiri, Datta" <>]

Sorry. Here is the logs.
It does pick up changes if I set maxRefreshDelay (after the set interval).

relying-party.xml configuration:
    <MetadataProvider id="ShibbolethMetadata" 
xsi:type="ChainingMetadataProvider" xmlns="urn:mace:shibboleth:2.0:metadata">
        <MetadataProvider id="IdPMD" 
xsi:type="ResourceBackedMetadataProvider" 
xmlns="urn:mace:shibboleth:2.0:metadata" >
            <MetadataResource xsi:type="resource:ClasspathResource" 
file="/conf/idp-metadata.xml"/>
        </MetadataProvider>
        <MetadataProvider xsi:type="FilesystemMetadataProvider" 
xmlns="urn:mace:shibboleth:2.0:metadata"
                  id="custom2"
                  
metadataFile="/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml"
 />
    </MetadataProvider>


2010-06-21-14:00:57.694 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:57.702 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:57.708 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:57.719 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:57.752 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:57.812 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:57.818 - [] - INFO [org.opensaml.xml.XMLConfigurator:189] - 
Preparing to load ValidatorSuites
2010-06-21-14:00:57.835 - [] - INFO [org.opensaml.xml.XMLConfigurator:191] - 
ValidatorSuites load complete
2010-06-21-14:00:57.852 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:57.890 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:57.894 - [] - INFO [org.opensaml.xml.XMLConfigurator:189] - 
Preparing to load ValidatorSuites
2010-06-21-14:00:57.901 - [] - INFO [org.opensaml.xml.XMLConfigurator:191] - 
ValidatorSuites load complete
2010-06-21-14:00:57.904 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:57.916 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:57.919 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:57.927 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:57.938 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.034 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.042 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.061 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.073 - [] - INFO [org.opensaml.xml.XMLConfigurator:189] - 
Preparing to load ValidatorSuites
2010-06-21-14:00:58.084 - [] - INFO [org.opensaml.xml.XMLConfigurator:191] - 
ValidatorSuites load complete
2010-06-21-14:00:58.121 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.167 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.176 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.234 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.237 - [] - INFO [org.opensaml.xml.XMLConfigurator:189] - 
Preparing to load ValidatorSuites
2010-06-21-14:00:58.260 - [] - INFO [org.opensaml.xml.XMLConfigurator:191] - 
ValidatorSuites load complete
2010-06-21-14:00:58.262 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.263 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.275 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.343 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.352 - [] - INFO [org.opensaml.xml.XMLConfigurator:189] - 
Preparing to load ValidatorSuites
2010-06-21-14:00:58.373 - [] - INFO [org.opensaml.xml.XMLConfigurator:191] - 
ValidatorSuites load complete
2010-06-21-14:00:58.374 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.376 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.377 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.378 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.381 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.387 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.391 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.394 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.396 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.401 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.402 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.411 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.412 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.413 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.416 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.440 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.453 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.507 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.509 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.510 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.512 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.512 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.514 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.540 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.542 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.591 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.592 - [] - INFO [org.opensaml.xml.XMLConfigurator:198] - 
Preparing to load IDAttributes
2010-06-21-14:00:58.592 - [] - INFO [org.opensaml.xml.XMLConfigurator:200] - 
IDAttributes load complete
2010-06-21-14:00:58.616 - [] - INFO [org.opensaml.xml.XMLConfigurator:180] - 
Preparing to load ObjectProviders
2010-06-21-14:00:58.621 - [] - INFO [org.opensaml.xml.XMLConfigurator:182] - 
ObjectProviders load complete
2010-06-21-14:00:58.630 - [] - INFO 
[org.apache.velocity.app.VelocityEngine:49] - LogSystem has been deprecated. 
Please use a LogChute implementation.
2010-06-21-14:00:58.915 - [] - WARN 
[edu.internet2.middleware.shibboleth.common.attribute.resolver.provider.dataConnector.ComputedIDDataConnector:64]
 - This data connector is deprecated.  The StoredID data connector should be 
used in its place.
2010-06-21-14:01:02.233 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:231] 
- Beginning refresh of metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.234 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:241] 
- Processing new metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.234 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:323] 
- Unmarshalling metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.289 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:327] 
- Filtering metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.289 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:336] 
- Releasing cached DOM for metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.290 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:339] 
- Post-processing metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.290 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:342] 
- Computing expiration time for metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.291 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:345] 
- Expiration of metadata from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
 will occur at 2010-06-22T01:01:02.233Z
2010-06-21-14:01:02.292 - [] - INFO 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:243] 
- New metadata loaded from 
'file:/usr/local/apache-tomcat-6.0.18/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml',
 next refresh will occur at approximately 2010-06-22T00:01:02.248Z
2010-06-21-14:01:02.297 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:231] 
- Beginning refresh of metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.297 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:241] 
- Processing new metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.297 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:323] 
- Unmarshalling metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.301 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:327] 
- Filtering metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.302 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:336] 
- Releasing cached DOM for metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.302 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:339] 
- Post-processing metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.302 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:342] 
- Computing expiration time for metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
2010-06-21-14:01:02.302 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:345] 
- Expiration of metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml'
 will occur at 2010-06-22T01:01:02.297Z
2010-06-21-14:01:02.303 - [] - INFO 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:243] 
- New metadata loaded from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/custom/custom-metadata.xml',
 next refresh will occur at approximately 2010-06-22T00:01:02.299Z
2010-06-21-14:01:02.519 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:231] 
- Beginning refresh of metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.531 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:241] 
- Processing new metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.532 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:323] 
- Unmarshalling metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.533 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:327] 
- Filtering metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.533 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:336] 
- Releasing cached DOM for metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.534 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:339] 
- Post-processing metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.534 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:342] 
- Computing expiration time for metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml'
2010-06-21-14:01:02.535 - [] - DEBUG 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:345] 
- Expiration of metadata from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml' will 
occur at 2010-06-22T01:01:02.519Z
2010-06-21-14:01:02.535 - [] - INFO 
[org.opensaml.saml2.metadata.provider.AbstractReloadingMetadataProvider:243] 
- New metadata loaded from 
'/usr/local/tomcat6/webapps/idp/WEB-INF/classes/conf/idp-metadata.xml', next 
refresh will occur at approximately 2010-06-22T00:01:02.523Z


Datta


> -----Original Message-----
> From: 
> 
>  [
> ]
>  On Behalf Of Chad La Joie
> Sent: Monday, June 21, 2010 1:43 PM
> To: 
> 
> Subject: Re: [Shib-Dev] New IdP v2.2 Snapshot Available
>
> I appreciate you testing but that's not a very helpful description for
> diagnosing the problem.  Try doing this:
>
> 1. Turn on debug logging for the metadata providers
> (org.opensaml.saml2.metadata)
>
> 2. Clear our your idp-process log
>
> 3. Start the IdP
>
> 4. Send me the log
>
> That should give me the information I need to begin to research the issue.
>
> On 6/21/10 4:37 PM, Mahabalagiri, Datta wrote:
> > I can't get the metadata to reload upon file changes. I don't think it
> worked me in the previous version either.
> >
> >          <MetadataProvider xsi:type="FilesystemMetadataProvider"
> xmlns="urn:mace:shibboleth:2.0:metadata"
> >                    id="custom"
> >                    metadataFile="/path-to-my-metadata/test-metadata.xml"
> />
>
> --
> Chad La Joie
> http://itumi.biz
> trusted identities, delivered