builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-043 starttime: 1487901028.28 results: success (0) buildid: 20170223160437 builduid: 73592bf9584a4129adf4223bea408182 revision: c8288de78a8d7fd44ea7487521d69a51444700eb ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.278214) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.278832) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.279091) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.297387) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.297818) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-23 17:50:28-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 111M=0s 2017-02-23 17:50:28 (111 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.120563 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.431909) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.432188) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018717 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.481528) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:28.481817) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev c8288de78a8d7fd44ea7487521d69a51444700eb --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev c8288de78a8d7fd44ea7487521d69a51444700eb --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-23 17:50:28,721 truncating revision to first 12 chars 2017-02-23 17:50:28,721 Setting DEBUG logging. 2017-02-23 17:50:28,721 attempt 1/10 2017-02-23 17:50:28,721 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/c8288de78a8d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-23 17:50:29,034 unpacking tar archive at: mozilla-beta-c8288de78a8d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.582971 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:29.077085) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:29.077376) ========= script_repo_revision: c8288de78a8d7fd44ea7487521d69a51444700eb ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:29.077717) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:29.077969) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-23 17:50:29.085089) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 32 secs) (at 2017-02-23 17:50:29.085933) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:50:29 INFO - MultiFileLogger online at 20170223 17:50:29 in /builds/slave/test 17:50:29 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 17:50:29 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:50:29 INFO - {'append_to_log': False, 17:50:29 INFO - 'base_work_dir': '/builds/slave/test', 17:50:29 INFO - 'blob_upload_branch': 'Mozilla-Beta', 17:50:29 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:50:29 INFO - 'branch': 'Mozilla-Beta', 17:50:29 INFO - 'buildbot_json_path': 'buildprops.json', 17:50:29 INFO - 'config_files': ('talos/linux_config.py',), 17:50:29 INFO - 'default_actions': ('clobber', 17:50:29 INFO - 'read-buildbot-config', 17:50:29 INFO - 'download-and-extract', 17:50:29 INFO - 'populate-webroot', 17:50:29 INFO - 'create-virtualenv', 17:50:29 INFO - 'install', 17:50:29 INFO - 'run-tests'), 17:50:29 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:50:29 INFO - 'download_minidump_stackwalk': True, 17:50:29 INFO - 'download_symbols': 'ondemand', 17:50:29 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:50:29 INFO - 'tooltool.py': '/tools/tooltool.py', 17:50:29 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:50:29 INFO - '/tools/misc-python/virtualenv.py')}, 17:50:29 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:50:29 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:50:29 INFO - 'installer_path': 'installer.exe', 17:50:29 INFO - 'log_level': 'info', 17:50:29 INFO - 'log_name': 'talos', 17:50:29 INFO - 'log_to_console': True, 17:50:29 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:50:29 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:50:29 INFO - 'opt_config_files': (), 17:50:29 INFO - 'pip_index': False, 17:50:29 INFO - 'sps_profile': False, 17:50:29 INFO - 'sps_profile_interval': 0, 17:50:29 INFO - 'suite': 'dromaeojs-e10s', 17:50:29 INFO - 'system_bits': '32', 17:50:29 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:50:29 INFO - 'title': 'talos-linux64-ix-043', 17:50:29 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:50:29 INFO - 'use_talos_json': True, 17:50:29 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:50:29 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:50:29 INFO - 'work_dir': 'build'} 17:50:29 INFO - [mozharness: 2017-02-24 01:50:29.422518Z] Running clobber step. 17:50:29 INFO - Running pre-action listener: _resource_record_pre_action 17:50:29 INFO - Running main action method: clobber 17:50:29 INFO - rmtree: /builds/slave/test/build 17:50:29 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:50:29 INFO - Running post-action listener: _resource_record_post_action 17:50:29 INFO - [mozharness: 2017-02-24 01:50:29.873161Z] Finished clobber step (success) 17:50:29 INFO - [mozharness: 2017-02-24 01:50:29.873260Z] Running read-buildbot-config step. 17:50:29 INFO - Running pre-action listener: _resource_record_pre_action 17:50:29 INFO - Running main action method: read_buildbot_config 17:50:29 INFO - Using buildbot properties: 17:50:29 INFO - { 17:50:29 INFO - "project": "", 17:50:29 INFO - "product": "firefox", 17:50:29 INFO - "script_repo_revision": "production", 17:50:29 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 17:50:29 INFO - "repository": "", 17:50:29 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 17:50:29 INFO - "buildid": "20170223160437", 17:50:29 INFO - "pgo_build": "True", 17:50:29 INFO - "basedir": "/builds/slave/test", 17:50:29 INFO - "buildnumber": 350, 17:50:29 INFO - "slavename": "talos-linux64-ix-043", 17:50:29 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 17:50:29 INFO - "platform": "ubuntu64_hw", 17:50:29 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 17:50:29 INFO - "branch": "mozilla-beta", 17:50:29 INFO - "repo_path": "releases/mozilla-beta", 17:50:29 INFO - "revision": "c8288de78a8d7fd44ea7487521d69a51444700eb", 17:50:29 INFO - "stage_platform": "linux64-pgo", 17:50:29 INFO - "builduid": "73592bf9584a4129adf4223bea408182", 17:50:29 INFO - "slavebuilddir": "test" 17:50:29 INFO - } 17:50:29 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2. 17:50:29 INFO - Running post-action listener: _resource_record_post_action 17:50:29 INFO - [mozharness: 2017-02-24 01:50:29.875689Z] Finished read-buildbot-config step (success) 17:50:29 INFO - [mozharness: 2017-02-24 01:50:29.875778Z] Running download-and-extract step. 17:50:29 INFO - Running pre-action listener: _resource_record_pre_action 17:50:29 INFO - Running main action method: download_and_extract 17:50:29 INFO - mkdir: /builds/slave/test/build/tests 17:50:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:29 INFO - trying https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 17:50:29 INFO - Downloading https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 17:50:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 17:50:30 INFO - Downloaded 1327 bytes. 17:50:30 INFO - Reading from file /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 17:50:30 INFO - Using the following test package requirements: 17:50:30 INFO - {u'common': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'], 17:50:30 INFO - u'cppunittest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.cppunittest.tests.zip'], 17:50:30 INFO - u'gtest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.gtest.tests.zip'], 17:50:30 INFO - u'jittest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'jsshell-linux-x86_64.zip'], 17:50:30 INFO - u'mochitest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.mochitest.tests.zip'], 17:50:30 INFO - u'mozbase': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'], 17:50:30 INFO - u'reftest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.reftest.tests.zip'], 17:50:30 INFO - u'talos': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.talos.tests.zip'], 17:50:30 INFO - u'web-platform': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.web-platform.tests.zip'], 17:50:30 INFO - u'xpcshell': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 17:50:30 INFO - u'firefox-52.0.en-US.linux-x86_64.xpcshell.tests.zip']} 17:50:30 INFO - Downloading packages: [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 17:50:30 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip 17:50:30 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:50:30 INFO - Fetch https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip into memory 17:50:31 INFO - Http code: 200 17:50:31 INFO - via: 1.1 bfd7406fdd888e34dfca79886cb7c964.cloudfront.net (CloudFront) 17:50:31 INFO - x-amz-cf-id: 4DzmhyoxP49wTQUvYfwDIMqnUWDt_6j3-MQcAYdR86ESglYI4DJcAA== 17:50:31 INFO - x-amz-version-id: MSWs8LlgLMEY6Ee66JKKfKgHYVDCRcjz 17:50:31 INFO - Expected file size: 21963596 17:50:31 INFO - Obtained file size: 21963596 17:50:35 INFO - Downloading packages: [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 17:50:35 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip 17:50:35 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:50:35 INFO - Fetch https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip into memory 17:50:35 INFO - Http code: 200 17:50:35 INFO - via: 1.1 032d42677fbf05c24a4bb71369581429.cloudfront.net (CloudFront) 17:50:35 INFO - x-amz-cf-id: 9X9Lz4nD_YXNGuvyqVBfD1d9MI5-xIXULnLCBtiH8wgL2VuMs-mS8g== 17:50:35 INFO - x-amz-version-id: MSWs8LlgLMEY6Ee66JKKfKgHYVDCRcjz 17:50:36 INFO - Expected file size: 21963596 17:50:36 INFO - Obtained file size: 21963596 17:50:40 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip 17:50:40 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 17:50:40 INFO - Fetch https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip into memory 17:50:41 INFO - Http code: 200 17:50:41 INFO - via: 1.1 e30ae5b3d9f6779a9b8bc992faad0b09.cloudfront.net (CloudFront) 17:50:41 INFO - x-amz-cf-id: Z7zk6bZe0ZU2uL2TfrYqiQ8W6r4rsTfwEl-yKXrNRrJNp9VBTGI9YA== 17:50:41 INFO - x-amz-version-id: 6Yqfoa8ngqTbhRb22jnLRScgeM6k9VR4 17:50:41 INFO - Expected file size: 14402992 17:50:41 INFO - Obtained file size: 14402992 17:50:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:41 INFO - trying https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 17:50:41 INFO - Downloading https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 17:50:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 17:50:42 INFO - Downloaded 57751538 bytes. 17:50:42 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 17:50:42 INFO - mkdir: /builds/slave/test/properties 17:50:42 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:50:42 INFO - Writing to file /builds/slave/test/properties/build_url 17:50:42 INFO - Contents: 17:50:42 INFO - build_url:https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 17:50:43 INFO - Running post-action listener: _resource_record_post_action 17:50:43 INFO - Running post-action listener: set_extra_try_arguments 17:50:43 INFO - [mozharness: 2017-02-24 01:50:43.354814Z] Finished download-and-extract step (success) 17:50:43 INFO - [mozharness: 2017-02-24 01:50:43.355039Z] Running populate-webroot step. 17:50:43 INFO - Running pre-action listener: _resource_record_pre_action 17:50:43 INFO - Running main action method: populate_webroot 17:50:43 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:50:43 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:50:43 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:50:43 INFO - '--tppagecycles', 17:50:43 INFO - '7'], 17:50:43 INFO - 'tests': ['tsvgm']}}, 17:50:43 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:50:43 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:50:43 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:50:43 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:50:43 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:50:43 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:50:43 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['damp', 'tps']}, 17:50:43 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'tests': ['damp', 'tps']}, 17:50:43 INFO - 'g3': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['dromaeo_dom']}, 17:50:43 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:50:43 INFO - 'g4': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['basic_compositor_video']}, 17:50:43 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 17:50:43 INFO - 'other': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['a11yr', 17:50:43 INFO - 'ts_paint', 17:50:43 INFO - 'tpaint', 17:50:43 INFO - 'sessionrestore', 17:50:43 INFO - 'sessionrestore_no_auto_restore', 17:50:43 INFO - 'tabpaint']}, 17:50:43 INFO - 'other-e10s': {'tests': ['a11yr', 17:50:43 INFO - 'ts_paint', 17:50:43 INFO - 'tpaint', 17:50:43 INFO - 'sessionrestore', 17:50:43 INFO - 'sessionrestore_no_auto_restore', 17:50:43 INFO - 'tabpaint']}, 17:50:43 INFO - 'other-e10s_l64': {'tests': ['a11yr', 17:50:43 INFO - 'ts_paint', 17:50:43 INFO - 'tpaint', 17:50:43 INFO - 'sessionrestore', 17:50:43 INFO - 'sessionrestore_no_auto_restore', 17:50:43 INFO - 'tabpaint']}, 17:50:43 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 17:50:43 INFO - 'ts_paint', 17:50:43 INFO - 'tpaint', 17:50:43 INFO - 'sessionrestore', 17:50:43 INFO - 'sessionrestore_no_auto_restore', 17:50:43 INFO - 'tabpaint']}, 17:50:43 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['a11yr', 17:50:43 INFO - 'ts_paint', 17:50:43 INFO - 'tpaint', 17:50:43 INFO - 'sessionrestore', 17:50:43 INFO - 'sessionrestore_no_auto_restore', 17:50:43 INFO - 'tabpaint']}, 17:50:43 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['a11yr', 17:50:43 INFO - 'ts_paint', 17:50:43 INFO - 'tpaint', 17:50:43 INFO - 'sessionrestore', 17:50:43 INFO - 'sessionrestore_no_auto_restore', 17:50:43 INFO - 'tabpaint']}, 17:50:43 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['tsvgx', 17:50:43 INFO - 'tsvgr_opacity', 17:50:43 INFO - 'tart', 17:50:43 INFO - 'tscrollx', 17:50:43 INFO - 'cart']}, 17:50:43 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:50:43 INFO - 'tsvgr_opacity', 17:50:43 INFO - 'tart', 17:50:43 INFO - 'tscrollx', 17:50:43 INFO - 'cart']}, 17:50:43 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'talos_options': ['--disable-e10s'], 17:50:43 INFO - 'tests': ['tp5o']}, 17:50:43 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'tests': ['tp5o']}, 17:50:43 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'talos_options': ['--disable-e10s', 17:50:43 INFO - '--xperf_path', 17:50:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:50:43 INFO - 'tests': ['tp5n']}, 17:50:43 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:50:43 INFO - 'talos_options': ['--xperf_path', 17:50:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:50:43 INFO - 'tests': ['tp5n']}}, 17:50:43 INFO - 'talos.zip': {'path': '', 17:50:43 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:50:43 INFO - Running post-action listener: _resource_record_post_action 17:50:43 INFO - [mozharness: 2017-02-24 01:50:43.372691Z] Finished populate-webroot step (success) 17:50:43 INFO - [mozharness: 2017-02-24 01:50:43.372779Z] Running create-virtualenv step. 17:50:43 INFO - Running pre-action listener: _resource_record_pre_action 17:50:43 INFO - Running main action method: create_virtualenv 17:50:43 INFO - Creating virtualenv /builds/slave/test/build/venv 17:50:43 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 17:50:43 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:50:43 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:50:43 INFO - Using real prefix '/usr' 17:50:43 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:50:43 INFO - Installing distribute.............................................................................................................................................................................................done. 17:50:45 INFO - Installing pip.................done. 17:50:45 INFO - Return code: 0 17:50:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 17:50:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 17:50:46 INFO - Reading from file tmpfile_stdout 17:50:46 INFO - Output received: 17:50:46 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 17:50:46 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:50:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 17:50:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 17:50:46 INFO - Using env: {'DISPLAY': ':0', 17:50:46 INFO - 'HOME': '/home/cltbld', 17:50:46 INFO - 'LANG': 'en_US.UTF-8', 17:50:46 INFO - 'LANGUAGE': 'en_US:en', 17:50:46 INFO - 'LOGNAME': 'cltbld', 17:50:46 INFO - 'MAIL': '/var/mail/cltbld', 17:50:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:46 INFO - 'MOZ_NO_REMOTE': '1', 17:50:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:46 INFO - 'NO_EM_RESTART': '1', 17:50:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:46 INFO - 'PWD': '/builds/slave/test', 17:50:46 INFO - 'SHELL': '/bin/bash', 17:50:46 INFO - 'SHLVL': '1', 17:50:46 INFO - 'TERM': 'linux', 17:50:46 INFO - 'TMOUT': '86400', 17:50:46 INFO - 'USER': 'cltbld', 17:50:46 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:46 INFO - '_': '/tools/buildbot/bin/python'} 17:50:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:46 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:50:46 INFO - Cleaning up... 17:50:46 INFO - Return code: 0 17:50:46 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 17:50:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 17:50:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 17:50:46 INFO - Using env: {'DISPLAY': ':0', 17:50:46 INFO - 'HOME': '/home/cltbld', 17:50:46 INFO - 'LANG': 'en_US.UTF-8', 17:50:46 INFO - 'LANGUAGE': 'en_US:en', 17:50:46 INFO - 'LOGNAME': 'cltbld', 17:50:46 INFO - 'MAIL': '/var/mail/cltbld', 17:50:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:46 INFO - 'MOZ_NO_REMOTE': '1', 17:50:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:46 INFO - 'NO_EM_RESTART': '1', 17:50:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:46 INFO - 'PWD': '/builds/slave/test', 17:50:46 INFO - 'SHELL': '/bin/bash', 17:50:46 INFO - 'SHLVL': '1', 17:50:46 INFO - 'TERM': 'linux', 17:50:46 INFO - 'TMOUT': '86400', 17:50:46 INFO - 'USER': 'cltbld', 17:50:46 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:46 INFO - '_': '/tools/buildbot/bin/python'} 17:50:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:46 INFO - Downloading/unpacking psutil>=3.1.1 17:50:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:50:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:50:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:50:48 INFO - Installing collected packages: psutil 17:50:48 INFO - Running setup.py install for psutil 17:50:48 INFO - building 'psutil._psutil_linux' extension 17:50:48 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 17:50:48 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 17:50:48 INFO - building 'psutil._psutil_posix' extension 17:50:48 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 17:50:49 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 17:50:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:50:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:50:49 INFO - Successfully installed psutil 17:50:49 INFO - Cleaning up... 17:50:49 INFO - Return code: 0 17:50:49 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 17:50:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 17:50:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 17:50:49 INFO - Using env: {'DISPLAY': ':0', 17:50:49 INFO - 'HOME': '/home/cltbld', 17:50:49 INFO - 'LANG': 'en_US.UTF-8', 17:50:49 INFO - 'LANGUAGE': 'en_US:en', 17:50:49 INFO - 'LOGNAME': 'cltbld', 17:50:49 INFO - 'MAIL': '/var/mail/cltbld', 17:50:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:49 INFO - 'MOZ_NO_REMOTE': '1', 17:50:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:49 INFO - 'NO_EM_RESTART': '1', 17:50:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:49 INFO - 'PWD': '/builds/slave/test', 17:50:49 INFO - 'SHELL': '/bin/bash', 17:50:49 INFO - 'SHLVL': '1', 17:50:49 INFO - 'TERM': 'linux', 17:50:49 INFO - 'TMOUT': '86400', 17:50:49 INFO - 'USER': 'cltbld', 17:50:49 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:49 INFO - '_': '/tools/buildbot/bin/python'} 17:50:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:49 INFO - Downloading/unpacking mozsystemmonitor==0.3 17:50:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:51 INFO - Downloading mozsystemmonitor-0.3.tar.gz 17:50:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:50:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 17:50:51 INFO - Installing collected packages: mozsystemmonitor 17:50:51 INFO - Running setup.py install for mozsystemmonitor 17:50:51 INFO - Successfully installed mozsystemmonitor 17:50:51 INFO - Cleaning up... 17:50:51 INFO - Return code: 0 17:50:51 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 17:50:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 17:50:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 17:50:51 INFO - Using env: {'DISPLAY': ':0', 17:50:51 INFO - 'HOME': '/home/cltbld', 17:50:51 INFO - 'LANG': 'en_US.UTF-8', 17:50:51 INFO - 'LANGUAGE': 'en_US:en', 17:50:51 INFO - 'LOGNAME': 'cltbld', 17:50:51 INFO - 'MAIL': '/var/mail/cltbld', 17:50:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:51 INFO - 'MOZ_NO_REMOTE': '1', 17:50:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:51 INFO - 'NO_EM_RESTART': '1', 17:50:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:51 INFO - 'PWD': '/builds/slave/test', 17:50:51 INFO - 'SHELL': '/bin/bash', 17:50:51 INFO - 'SHLVL': '1', 17:50:51 INFO - 'TERM': 'linux', 17:50:51 INFO - 'TMOUT': '86400', 17:50:51 INFO - 'USER': 'cltbld', 17:50:51 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:51 INFO - '_': '/tools/buildbot/bin/python'} 17:50:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:51 INFO - Downloading/unpacking jsonschema==2.5.1 17:50:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:50:53 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 17:50:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:54 INFO - Downloading functools32-3.2.3-2.tar.gz 17:50:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:50:54 INFO - warning: no files found matching '*.txt' 17:50:54 INFO - no previously-included directories found matching 'build' 17:50:54 INFO - no previously-included directories found matching 'dist' 17:50:54 INFO - no previously-included directories found matching '.git*' 17:50:54 INFO - Installing collected packages: jsonschema, functools32 17:50:54 INFO - Running setup.py install for functools32 17:50:54 INFO - warning: no files found matching '*.txt' 17:50:54 INFO - no previously-included directories found matching 'build' 17:50:54 INFO - no previously-included directories found matching 'dist' 17:50:54 INFO - no previously-included directories found matching '.git*' 17:50:54 INFO - Successfully installed jsonschema functools32 17:50:54 INFO - Cleaning up... 17:50:54 INFO - Return code: 0 17:50:54 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 17:50:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 17:50:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 17:50:54 INFO - Using env: {'DISPLAY': ':0', 17:50:54 INFO - 'HOME': '/home/cltbld', 17:50:54 INFO - 'LANG': 'en_US.UTF-8', 17:50:54 INFO - 'LANGUAGE': 'en_US:en', 17:50:54 INFO - 'LOGNAME': 'cltbld', 17:50:54 INFO - 'MAIL': '/var/mail/cltbld', 17:50:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:54 INFO - 'MOZ_NO_REMOTE': '1', 17:50:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:54 INFO - 'NO_EM_RESTART': '1', 17:50:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:54 INFO - 'PWD': '/builds/slave/test', 17:50:54 INFO - 'SHELL': '/bin/bash', 17:50:54 INFO - 'SHLVL': '1', 17:50:54 INFO - 'TERM': 'linux', 17:50:54 INFO - 'TMOUT': '86400', 17:50:54 INFO - 'USER': 'cltbld', 17:50:54 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:54 INFO - '_': '/tools/buildbot/bin/python'} 17:50:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:54 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 17:50:54 INFO - Cleaning up... 17:50:54 INFO - Return code: 0 17:50:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:50:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 17:50:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 17:50:54 INFO - Using env: {'DISPLAY': ':0', 17:50:54 INFO - 'HOME': '/home/cltbld', 17:50:54 INFO - 'LANG': 'en_US.UTF-8', 17:50:54 INFO - 'LANGUAGE': 'en_US:en', 17:50:54 INFO - 'LOGNAME': 'cltbld', 17:50:54 INFO - 'MAIL': '/var/mail/cltbld', 17:50:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:54 INFO - 'MOZ_NO_REMOTE': '1', 17:50:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:54 INFO - 'NO_EM_RESTART': '1', 17:50:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:54 INFO - 'PWD': '/builds/slave/test', 17:50:54 INFO - 'SHELL': '/bin/bash', 17:50:54 INFO - 'SHLVL': '1', 17:50:54 INFO - 'TERM': 'linux', 17:50:54 INFO - 'TMOUT': '86400', 17:50:54 INFO - 'USER': 'cltbld', 17:50:54 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:54 INFO - '_': '/tools/buildbot/bin/python'} 17:50:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:54 INFO - Downloading/unpacking blobuploader==1.2.4 17:50:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:56 INFO - Downloading blobuploader-1.2.4.tar.gz 17:50:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:50:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:50:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:50:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:50:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:50:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:50:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:50:57 INFO - Downloading docopt-0.6.1.tar.gz 17:50:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:50:57 INFO - Installing collected packages: blobuploader, requests, docopt 17:50:57 INFO - Running setup.py install for blobuploader 17:50:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:50:57 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:50:57 INFO - Running setup.py install for requests 17:50:58 INFO - Running setup.py install for docopt 17:50:58 INFO - Successfully installed blobuploader requests docopt 17:50:58 INFO - Cleaning up... 17:50:58 INFO - Return code: 0 17:50:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:50:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:50:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:50:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:50:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:50:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:50:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:50:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:50:58 INFO - Using env: {'DISPLAY': ':0', 17:50:58 INFO - 'HOME': '/home/cltbld', 17:50:58 INFO - 'LANG': 'en_US.UTF-8', 17:50:58 INFO - 'LANGUAGE': 'en_US:en', 17:50:58 INFO - 'LOGNAME': 'cltbld', 17:50:58 INFO - 'MAIL': '/var/mail/cltbld', 17:50:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:50:58 INFO - 'MOZ_NO_REMOTE': '1', 17:50:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:50:58 INFO - 'NO_EM_RESTART': '1', 17:50:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:50:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:50:58 INFO - 'PWD': '/builds/slave/test', 17:50:58 INFO - 'SHELL': '/bin/bash', 17:50:58 INFO - 'SHLVL': '1', 17:50:58 INFO - 'TERM': 'linux', 17:50:58 INFO - 'TMOUT': '86400', 17:50:58 INFO - 'USER': 'cltbld', 17:50:58 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:50:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:50:58 INFO - '_': '/tools/buildbot/bin/python'} 17:50:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:50:58 INFO - Running setup.py (path:/tmp/pip-oqMolv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:50:58 INFO - Running setup.py (path:/tmp/pip-sj6gTZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:50:58 INFO - Running setup.py (path:/tmp/pip-IiflO6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:50:58 INFO - Running setup.py (path:/tmp/pip-rzJ2eI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:50:58 INFO - Running setup.py (path:/tmp/pip-4Jg_1h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:50:58 INFO - Running setup.py (path:/tmp/pip-lUr2tM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:50:59 INFO - Running setup.py (path:/tmp/pip-wENmd2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:50:59 INFO - Running setup.py (path:/tmp/pip-tTIHGd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:50:59 INFO - Running setup.py (path:/tmp/pip-rz26PS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:50:59 INFO - Running setup.py (path:/tmp/pip-ulMvF6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:50:59 INFO - Running setup.py (path:/tmp/pip-hPWs0Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:50:59 INFO - Running setup.py (path:/tmp/pip-9M6uCF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:50:59 INFO - Running setup.py (path:/tmp/pip-DmDsuO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:50:59 INFO - Running setup.py (path:/tmp/pip-pX6p0F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:50:59 INFO - Running setup.py (path:/tmp/pip-eU2AXL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:50:59 INFO - Running setup.py (path:/tmp/pip-7Grqbz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:50:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:50:59 INFO - Running setup.py (path:/tmp/pip-0we39B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:50:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:50:59 INFO - Running setup.py install for manifestparser 17:50:59 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:50:59 INFO - Running setup.py install for mozcrash 17:50:59 INFO - Running setup.py install for mozdebug 17:51:00 INFO - Running setup.py install for mozdevice 17:51:00 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Running setup.py install for mozfile 17:51:00 INFO - Running setup.py install for mozhttpd 17:51:00 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Running setup.py install for mozinfo 17:51:00 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Running setup.py install for mozInstall 17:51:00 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Running setup.py install for mozleak 17:51:00 INFO - Running setup.py install for mozlog 17:51:00 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Running setup.py install for moznetwork 17:51:00 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:51:00 INFO - Running setup.py install for mozprocess 17:51:01 INFO - Running setup.py install for mozprofile 17:51:01 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:51:01 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:51:01 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:51:01 INFO - Running setup.py install for mozrunner 17:51:01 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:51:01 INFO - Running setup.py install for mozscreenshot 17:51:01 INFO - Running setup.py install for moztest 17:51:01 INFO - Running setup.py install for mozversion 17:51:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:51:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:51:01 INFO - Cleaning up... 17:51:01 INFO - Return code: 0 17:51:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:51:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:51:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:51:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:51:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:51:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:51:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:51:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:51:01 INFO - Using env: {'DISPLAY': ':0', 17:51:01 INFO - 'HOME': '/home/cltbld', 17:51:01 INFO - 'LANG': 'en_US.UTF-8', 17:51:01 INFO - 'LANGUAGE': 'en_US:en', 17:51:01 INFO - 'LOGNAME': 'cltbld', 17:51:01 INFO - 'MAIL': '/var/mail/cltbld', 17:51:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:51:01 INFO - 'MOZ_NO_REMOTE': '1', 17:51:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:51:01 INFO - 'NO_EM_RESTART': '1', 17:51:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:51:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:51:01 INFO - 'PWD': '/builds/slave/test', 17:51:01 INFO - 'SHELL': '/bin/bash', 17:51:01 INFO - 'SHLVL': '1', 17:51:01 INFO - 'TERM': 'linux', 17:51:01 INFO - 'TMOUT': '86400', 17:51:01 INFO - 'USER': 'cltbld', 17:51:01 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:51:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:51:01 INFO - '_': '/tools/buildbot/bin/python'} 17:51:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:51:01 INFO - Running setup.py (path:/tmp/pip-fuBVWJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:51:01 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 17:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:51:01 INFO - Running setup.py (path:/tmp/pip-RMDR0N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:51:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:51:01 INFO - Running setup.py (path:/tmp/pip-_RLcLf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:51:02 INFO - Running setup.py (path:/tmp/pip-OgeSD1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:51:02 INFO - Running setup.py (path:/tmp/pip-g9MmnG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:51:02 INFO - Running setup.py (path:/tmp/pip-cJdXNC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:51:02 INFO - Running setup.py (path:/tmp/pip-mOBskN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:51:02 INFO - Running setup.py (path:/tmp/pip-3YpZVK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:51:02 INFO - Running setup.py (path:/tmp/pip-km856w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:51:02 INFO - Running setup.py (path:/tmp/pip-YriJMW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:51:02 INFO - Running setup.py (path:/tmp/pip-QlV2VB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:51:02 INFO - Running setup.py (path:/tmp/pip-2sHftI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:51:02 INFO - Running setup.py (path:/tmp/pip-rAIIKf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:51:02 INFO - Running setup.py (path:/tmp/pip-vthpfp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:51:02 INFO - Running setup.py (path:/tmp/pip-fK09vi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:51:02 INFO - Running setup.py (path:/tmp/pip-GbmYtv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 17:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:51:02 INFO - Running setup.py (path:/tmp/pip-nVH22c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:51:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 17:51:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:51:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:51:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:51:03 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:51:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:51:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:51:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:51:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:51:05 INFO - Downloading blessings-1.6.tar.gz 17:51:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:51:05 INFO - Installing collected packages: blessings 17:51:05 INFO - Running setup.py install for blessings 17:51:05 INFO - Successfully installed blessings 17:51:05 INFO - Cleaning up... 17:51:05 INFO - Return code: 0 17:51:05 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:51:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:51:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:51:05 INFO - Reading from file tmpfile_stdout 17:51:05 INFO - Current package versions: 17:51:05 INFO - argparse == 1.2.1 17:51:05 INFO - blessings == 1.6 17:51:05 INFO - blobuploader == 1.2.4 17:51:05 INFO - docopt == 0.6.1 17:51:05 INFO - functools32 == 3.2.3-2 17:51:05 INFO - jsonschema == 2.5.1 17:51:05 INFO - manifestparser == 1.1 17:51:05 INFO - mozInstall == 1.12 17:51:05 INFO - mozcrash == 1.0 17:51:05 INFO - mozdebug == 0.1 17:51:05 INFO - mozdevice == 0.48 17:51:05 INFO - mozfile == 1.2 17:51:05 INFO - mozhttpd == 0.7 17:51:05 INFO - mozinfo == 0.9 17:51:05 INFO - mozleak == 0.1 17:51:05 INFO - mozlog == 3.4 17:51:05 INFO - moznetwork == 0.27 17:51:05 INFO - mozprocess == 0.23 17:51:05 INFO - mozprofile == 0.28 17:51:05 INFO - mozrunner == 6.13 17:51:05 INFO - mozscreenshot == 0.1 17:51:05 INFO - mozsystemmonitor == 0.3 17:51:05 INFO - moztest == 0.8 17:51:05 INFO - mozversion == 1.4 17:51:05 INFO - psutil == 3.1.1 17:51:05 INFO - requests == 1.2.3 17:51:05 INFO - wsgiref == 0.1.2 17:51:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:51:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:51:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:51:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:51:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:51:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:51:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 17:51:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:51:05 INFO - Using env: {'DISPLAY': ':0', 17:51:05 INFO - 'HOME': '/home/cltbld', 17:51:05 INFO - 'LANG': 'en_US.UTF-8', 17:51:05 INFO - 'LANGUAGE': 'en_US:en', 17:51:05 INFO - 'LOGNAME': 'cltbld', 17:51:05 INFO - 'MAIL': '/var/mail/cltbld', 17:51:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:51:05 INFO - 'MOZ_NO_REMOTE': '1', 17:51:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:51:05 INFO - 'NO_EM_RESTART': '1', 17:51:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:51:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:51:05 INFO - 'PWD': '/builds/slave/test', 17:51:05 INFO - 'SHELL': '/bin/bash', 17:51:05 INFO - 'SHLVL': '1', 17:51:05 INFO - 'TERM': 'linux', 17:51:05 INFO - 'TMOUT': '86400', 17:51:05 INFO - 'USER': 'cltbld', 17:51:05 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:51:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:51:05 INFO - '_': '/tools/buildbot/bin/python'} 17:51:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:51:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:51:05 INFO - Cleaning up... 17:51:05 INFO - Return code: 0 17:51:05 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:51:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:51:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:51:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:51:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:51:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f08d9469f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x133c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1409ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:51:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 17:51:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:51:05 INFO - Using env: {'DISPLAY': ':0', 17:51:05 INFO - 'HOME': '/home/cltbld', 17:51:05 INFO - 'LANG': 'en_US.UTF-8', 17:51:05 INFO - 'LANGUAGE': 'en_US:en', 17:51:05 INFO - 'LOGNAME': 'cltbld', 17:51:05 INFO - 'MAIL': '/var/mail/cltbld', 17:51:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:51:05 INFO - 'MOZ_NO_REMOTE': '1', 17:51:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:51:05 INFO - 'NO_EM_RESTART': '1', 17:51:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:51:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:51:05 INFO - 'PWD': '/builds/slave/test', 17:51:05 INFO - 'SHELL': '/bin/bash', 17:51:05 INFO - 'SHLVL': '1', 17:51:05 INFO - 'TERM': 'linux', 17:51:05 INFO - 'TMOUT': '86400', 17:51:05 INFO - 'USER': 'cltbld', 17:51:05 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:51:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:51:05 INFO - '_': '/tools/buildbot/bin/python'} 17:51:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:51:06 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 17:51:06 INFO - Cleaning up... 17:51:06 INFO - Return code: 0 17:51:06 INFO - Running post-action listener: _resource_record_post_action 17:51:06 INFO - Running post-action listener: _start_resource_monitoring 17:51:06 INFO - Starting resource monitoring. 17:51:06 INFO - [mozharness: 2017-02-24 01:51:06.055928Z] Finished create-virtualenv step (success) 17:51:06 INFO - [mozharness: 2017-02-24 01:51:06.056435Z] Running install step. 17:51:06 INFO - Running pre-action listener: _resource_record_pre_action 17:51:06 INFO - Running main action method: install 17:51:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:51:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:51:06 INFO - Reading from file tmpfile_stdout 17:51:06 INFO - Detecting whether we're running mozinstall >=1.0... 17:51:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:51:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:51:06 INFO - Reading from file tmpfile_stdout 17:51:06 INFO - Output received: 17:51:06 INFO - Usage: mozinstall [options] installer 17:51:06 INFO - Options: 17:51:06 INFO - -h, --help show this help message and exit 17:51:06 INFO - -d DEST, --destination=DEST 17:51:06 INFO - Directory to install application into. [default: 17:51:06 INFO - "/builds/slave/test"] 17:51:06 INFO - --app=APP Application being installed. [default: firefox] 17:51:06 INFO - mkdir: /builds/slave/test/build/application 17:51:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 17:51:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 17:51:19 INFO - Reading from file tmpfile_stdout 17:51:19 INFO - Output received: 17:51:19 INFO - /builds/slave/test/build/application/firefox/firefox 17:51:19 INFO - Running post-action listener: _resource_record_post_action 17:51:19 INFO - [mozharness: 2017-02-24 01:51:19.998759Z] Finished install step (success) 17:51:19 INFO - [mozharness: 2017-02-24 01:51:19.999004Z] Running run-tests step. 17:51:19 INFO - Running pre-action listener: _resource_record_pre_action 17:51:19 INFO - Running main action method: run_tests 17:51:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:51:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:51:20 INFO - Python 2.7.3 17:51:20 INFO - Return code: 0 17:51:20 INFO - grabbing minidump binary from tooltool 17:51:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:51:20 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1406f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1407d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14081d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:51:20 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 17:51:20 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 17:51:20 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 17:51:20 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:51:20 INFO - Return code: 0 17:51:20 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 17:51:20 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:51:20 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:51:20 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 17:51:20 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:51:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 17:51:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-043 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 17:51:20 INFO - Using env: {'DISPLAY': ':0', 17:51:20 INFO - 'HOME': '/home/cltbld', 17:51:20 INFO - 'LANG': 'en_US.UTF-8', 17:51:20 INFO - 'LANGUAGE': 'en_US:en', 17:51:20 INFO - 'LOGNAME': 'cltbld', 17:51:20 INFO - 'MAIL': '/var/mail/cltbld', 17:51:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:51:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 17:51:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:51:20 INFO - 'MOZ_NO_REMOTE': '1', 17:51:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:51:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:51:20 INFO - 'NO_EM_RESTART': '1', 17:51:20 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:51:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:51:20 INFO - 'PWD': '/builds/slave/test', 17:51:20 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:51:20 INFO - 'SHELL': '/bin/bash', 17:51:20 INFO - 'SHLVL': '1', 17:51:20 INFO - 'TERM': 'linux', 17:51:20 INFO - 'TMOUT': '86400', 17:51:20 INFO - 'USER': 'cltbld', 17:51:20 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561', 17:51:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:51:20 INFO - '_': '/tools/buildbot/bin/python'} 17:51:20 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 17:51:20 INFO - mozversion application_buildid: 20170223160437 17:51:20 INFO - mozversion application_changeset: c8288de78a8d7fd44ea7487521d69a51444700eb 17:51:20 INFO - mozversion application_display_name: Firefox 17:51:20 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:51:20 INFO - mozversion application_name: Firefox 17:51:20 INFO - mozversion application_remotingname: firefox 17:51:20 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 17:51:20 INFO - mozversion application_vendor: Mozilla 17:51:20 INFO - mozversion application_version: 52.0 17:51:20 INFO - mozversion platform_buildid: 20170223160437 17:51:20 INFO - mozversion platform_changeset: c8288de78a8d7fd44ea7487521d69a51444700eb 17:51:20 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 17:51:20 INFO - mozversion platform_version: 52.0 17:51:20 INFO - using testdate: 1487901080 17:51:20 INFO - actual date: 1487901080 17:51:20 INFO - starting webserver on 'localhost:44724' 17:51:20 INFO - SUITE-START | Running 2 tests 17:51:20 INFO - TEST-START | dromaeo_css 17:51:20 INFO - operating with platform_type : linux_ 17:51:20 INFO - Initialising browser for dromaeo_css test... 17:51:20 INFO - TEST-INFO | started process 897 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZXKDwu/profile http://localhost:44724/getInfo.html) 17:51:25 INFO - PROCESS | 897 | __metrics Screen width/height:1600/1200 17:51:25 INFO - PROCESS | 897 | colorDepth:24 17:51:25 INFO - PROCESS | 897 | Browser inner width/height: 1024/697 17:51:25 INFO - PROCESS | 897 | __metrics 17:51:25 ERROR - PROCESS | 897 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3197: TypeError: this.tabs is undefined 17:51:26 INFO - TEST-INFO | 897: exit 0 17:51:26 INFO - Browser initialized. 17:51:26 INFO - Running cycle 1/1 for dromaeo_css test... 17:51:26 INFO - TEST-INFO | started process 1031 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZXKDwu/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:51:38 INFO - PROCESS | 1031 | RSS: Main: 146690048 17:51:38 INFO - PROCESS | 1031 | 17:54:38 INFO - PROCESS | 1031 | Cycle 1(1): loaded http://localhost:44724/tests/dromaeo/cssquery-dojo.html (next: http://localhost:44724/tests/dromaeo/cssquery-ext.html) 17:54:39 INFO - PROCESS | 1031 | RSS: Main: 154230784 17:54:39 INFO - PROCESS | 1031 | 17:57:41 INFO - PROCESS | 1031 | Cycle 1(1): loaded http://localhost:44724/tests/dromaeo/cssquery-ext.html (next: http://localhost:44724/tests/dromaeo/cssquery-jquery.html) 17:57:42 INFO - PROCESS | 1031 | RSS: Main: 152227840 17:57:42 INFO - PROCESS | 1031 | 18:00:44 INFO - PROCESS | 1031 | Cycle 1(1): loaded http://localhost:44724/tests/dromaeo/cssquery-jquery.html (next: http://localhost:44724/tests/dromaeo/cssquery-mootools.html) 18:00:44 INFO - PROCESS | 1031 | RSS: Main: 151269376 18:00:44 INFO - PROCESS | 1031 | 18:03:46 INFO - PROCESS | 1031 | Cycle 1(1): loaded http://localhost:44724/tests/dromaeo/cssquery-mootools.html (next: http://localhost:44724/tests/dromaeo/cssquery-prototype.html) 18:03:47 INFO - PROCESS | 1031 | RSS: Main: 153710592 18:03:47 INFO - PROCESS | 1031 | 18:06:49 INFO - PROCESS | 1031 | Cycle 1(1): loaded http://localhost:44724/tests/dromaeo/cssquery-prototype.html (next: http://localhost:44724/tests/dromaeo/cssquery-yui.html) 18:06:50 INFO - PROCESS | 1031 | RSS: Main: 153944064 18:06:50 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | Cycle 1(1): loaded http://localhost:44724/tests/dromaeo/cssquery-yui.html (next: http://localhost:44724/tests/dromaeo/cssquery-dojo.html) 18:09:53 INFO - PROCESS | 1031 | RSS: Main: 155090944 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | __start_tp_report 18:09:53 INFO - PROCESS | 1031 | _x_x_mozilla_page_load 18:09:53 INFO - PROCESS | 1031 | _x_x_mozilla_page_load_details 18:09:53 INFO - PROCESS | 1031 | |i|pagename|runs| 18:09:53 INFO - PROCESS | 1031 | |0;dojo.html;3239.1416274687203;3263.216827961287;3263.592050993626;3268.0359294008267;3276.7706260561754;5732.398098199692;5834.620749651275;5853.975554278;5854.5023672987845;5862.970685146568;5812.4768770810615;5872.119182122684;5873.853153671161;5875.294964604253;5882.264716910387;5313.73431328433;5333.599980001496;5341.973290133544;5381.19282107685;5391.433899440561;5368.570514358842;5386.78452861885;5388.946110538884;5392.1911713243135;5406.324209473816;5101.6683915545555;5116.1302578561545;5367.436419175989;5380.408155102936;5391.541718953894;5206.45332240115;5224.973875130619;5289.735513224324;5336.4129945705945;5401.297831281948;5248.685078895279;5335.439778823245;5354.009508240949;5355.946440535623;5358.892822143574;5799.652020878761;5821.79623713168;5856.209411729405;5886.499647529965;5914.053751399799;5919.112133180014;5960.344362120163;6042.788502402439;6135.141080248769;6199.783007594758;6052.757889684407;6077.665728384937;6083.756649734005;6171.166892469549;6172.259328880518;5703.08750599902;5727.1695604137585;5735.455131762517;5735.8852822944145;5739.7991070312755;6143.634700640286;6191.628502289877;6237.656928868956;6276.592021518587;6283.842903927439;6040.335563088057;6053.182820319289;6062.878742425127;6072.453479186895;6097.512199024068;5843.707814609253;6155.076738489262;6157.8460538486;6160.9383906160365;6175.59858609189;5820.912686309709;6021.729022194012;6068.878622427526;6098.512119030555;6139.124180917401;6113.57204995646;6156.045812899008;6159.353267906895;6175.042868355412;6178.104174894615;4739.834105806281;4743.810247590127;4748.738819364899;4764.666473346832;4774.474807771212;4062.5937406259136;4111.814968326433;4135.400366946776;4142.420061191436;4175.394567787654;5806.709664516758;5853.795117170878;5859.882802343929;5885.676287804126;5900.291964964232;6188.845278868064;6214.036824292242;6217.0052791553135;6218.81343559694;6239.594426362272;5724.77100915967;5773.740181691834;5813.3895940925595;5861.150133230658;5926.259217597801;5348.705821179872;5365.436629153961;5387.865303367447;5395.7841686332895;5398.217258497496;6406.1031455597185;6449.774257900951;6458.838529036811;6459.741610335628;6464;5829.09649004405;5931.851703707442;6239.594426362272;6245.469135123565;6261.937380626136;6299.433051025429;6355.205599300088;6357.96821015892;6398.0402939559435;6459.128017717548;6107.053406721788;6113.2969708482315;6116.296625887901;6116.29662588808;6131.84670383244;5987.34139244674;6203.658798766111;6248.562600617913;6254.061890716429;6256.687165641609;5896.7936122235515;5908.350081490947;5985.640861548147;5995.310539288038;5995.490383317292;6019.367966363644;6019.608725432833;6035;6065.6663883486835;6075.544334175043;5921.3782552831335;5971.044632858721;5979.701014949323;5991.970040149771;5993.61041532299;5934.3175534814045;5970.671613061323;5981.252343457068;6017.127516509994;6091.573589848668;5914.4381283777975;5921.4966727826895;5932.347441781487;5955.225820643289;5967.104934259895 18:09:53 INFO - PROCESS | 1031 | |1;ext.html;554.5314209492977;602.0818252165448;612.996935015325;665.8035879415572;689.8137502874221;41341.17317653649;42261.57738422615;44549;44627.330590041136;44628;44887.551124488746;45934.540654593446;45981.54018459815;46014.76992615041;46273;8496.660133594649;8679.132086791302;8839.07189745077;10847.240693151483;11098.112151027899;10937.289076210021;11015.83476247857;11039.779204415907;11065.50205240766;11075.280106793072;11052.557897684082;11109.777804443906;11111.999920007198;11115.944420277927;11133.276337038067;11018.283811552263;11039.337639741601;11075.224734268604;11079.50142243597;11080.113590912708;10886.510107045202;10954.342739435659;10961.397123158224;10969.670909872717;10977.780444391148;45088.549114508765;45203.54796452059;45265.77367113176;45401.09197816025;45676.54323456789;3685.5208822852856;3805.9619403805887;3880.670143037817;4016.959830401717;4238.639715624176;33860.153496162544;33868.83065584681;33906;34123.6587634123;34263.31473370543;4511.323301504768;4574.748388838612;4606.193916064709;4615.3617103637325;4636.235021221494;334185;336110;336272;336462;336810;63413;63807;64101.038484422774;64101.67949160224;64101.67949160318;67072.6646366765;67244.32755672479;67273.66363168153;67278.66360668263;67679.66160169168;16832;16968.06675632852;17428.738568921475;17612.20745066475;17626.5593360167;12813.167144135601;13426.597202083953;13573.660658483617;13581.932090339486;13602.93198534001;20976.26583069585;21248.575028499345;21481.78518214829;21575.78424215769;21611.67582486264;7451.180370159278;7525.849483010418;7587.734429294948;7591.8861217081785;7723.691052357843;995.6216637677636;1010.545254635417;1102.5479553383075;1130.7173206698326;1132.705496570881;31957.969246765675;32415.51376729351;32468.512972305434;32966.67033329636;33172.3365532688;1132.898039176478;1145.873953865074;1155.7110722319421;1181.8936295733424;1210.082019998295;17284.91357543204;17507.124643767762;17565.38521151779;17670.823291767174;17732.468025959242;489284;495570;496520;497455;498554;63539.68230158912;64373;64698;64866;64902.35097648963;1374.113696665665;1419.6805718713206;1425.2731107135435;1450.4125829039467;1451.122071146962;31095;31106.377872442878;31598.684013159575;32000.839995799874;32513.349733004736;48062.356570387565;48261.5173848257;48334.516654833;48402.273965889835;48520.272195917794;412629;414777;416631;417546;421774;30299.848500757354;30739.692603074578;31124;31268.843655781577;32965.83517082399;49252.507474924794;49469.752651236515;49953.75023124861;50676;51323.74338128435;42316.36525452182;43107;43534.56465435305;43688.344674830536;44030.779846100566;41616.375754364315;42179.789101054295;42598.148037039704;43525.78237108794;44506;41571;41722;42356.36465453082;42716.718498445094;42858.14283714371;36045.81977090098;38209;38446.23107537778;38689.2262154761;39268.410973835984;28489.572656409757;28639.14082577526;28663.570046448902;28765.712342876304;28854.278643033253 18:09:53 INFO - PROCESS | 1031 | |2;jquery.html;413.6752649170401;416.84576706618554;425.36408069935453;427.08603588321;441.8276872019913;18554.536136596576;19433.222671093175;20158.697619535684;20289.49276268094;20397.898010509925;19421.22315107394;19614.313499027536;19818.90090549545;19920;20145.496362590944;5669.404712505189;5922.88154236915;5924.437178468039;5931.555133364994;5931.940680593204;4235.6187943085115;5334.146536554152;5804.187413762077;5903.88192236155;6550.443212326958;6536.673166341688;6580.045893345486;6585.308542603029;6590.703418346162;6612.338766123397;6430.903536446934;6603.9669801650925;6625.238097618787;6656.70044847983;6663.900041499382;5809.941900581025;5989;5994.910076348859;5996.130561068664;6006.609570377956;13807.309634518233;16707.331706731715;18824.152913118807;19219.32732354375;19238.903805481023;2192.7039849620255;2358.327876555191;2382.4401265702545;2406.7833894949363;2862.1127450490417;9807.215422766161;10388.688339349832;10575.682729518127;12580.685482863002;14256.35846386915;1976.1305025788752;2009.6836572045333;2030.9893205726373;2047.6314263432575;2107.8419118566167;74924;79177.99999999942;81920.59039704823;88374.5581272096;90775.54612226896;11226.550937962553;11234.157438192005;11436.542538298374;11518.769624607628;11860.110491713156;16607.169641517874;16617.916910415614;16640.667186656443;16649.83350166507;16670.833291666928;8429.957850210709;8484.448510846774;8594.742157735278;8672.653093876173;8809.471431714117;8223.753287401387;8306.750797476085;8457.154284571494;8473.95763021181;8474.364422668325;4971.1549036663855;4975.701457912537;5033.421156566968;5111.182210846247;5194.3766747990485;1915.3775023117541;2048.539078707309;2084.2288353309373;2125.2455378340464;2171.4137182960512;913.620847348343;990.5294984882267;1046.0459463229006;1095.6439157273917;1147.449224372306;19938.102785374693;20032.298869539496;20303.390898273075;20324.288649897182;20385.796142038686;1009.4246279620546;1018.0837246478229;1025.3642741500319;1046.2048842879467;1070.571771291474;9975.102240798218;11181.706476458836;11386.202965792316;11405.14461415397;11583.710407239887;424562;430662;448602;458991;459868;55088.898222036136;89986;91200.54399728091;92085.53957230171;93022;1032.9535170917327;1039.2828948025838;1043.8799538053222;1052.55792567122;1072.5816931396762;17388.217530210917;17706.73439898377;17713.468595942144;17784.644307114046;18077.457676269732;41946.37080443735;42191.1561768769;42736;43092.35361469518;43993.34009989789;53674.73162634318;57303.71348143233;57777.422225778886;57916;58426.4157358421;7905.762827115196;8020;8218;8275.089740128702;8416.284615807725;11770.646880593597;11994.340311282964;12553.246805191719;12621.684457888627;12923.418446169757;10320.741981450525;10334.431606261427;11129.55481780752;11189.384583847966;11298.548058077913;10179.592816287266;10747.677569672922;10757.623483178051;10793.19051071157;10893;10885.619003334845;10969.945150274198;11059.612913547988;11169.888301116885;11324.60363887293;8022.197780221931;8285.171482851667;8334.6666133354;8686.826263474568;8848.734537963872;8092.109867914407;10406.47967601632;11169.106471482099;11184.608538701432;11402.372869492257 18:09:53 INFO - PROCESS | 1031 | |3;mootools.html;1502.992485037575;1530.8316085230626;1690.2224976510804;1814.2198854492578;1840.1167439628978;7839.333656639178;8055.879161812578;8444.704435344764;8720.694775682845;8832.425892316995;8424;8746.431481953668;8752.518611476366;8964.551772411369;8991.550422478866;2483.230198638423;2495.463475352799;2513.070164039308;2517.5720127578265;2518.9496210075786;2443.389152711822;2507.6865391826022;2512.321673148249;2514.0823599386276;2543.2878793937725;2419.5040016796515;2458.791002764767;2463.470353873917;2470.72821989581;2472.863992480422;2348.3072493614427;2355.9175428859908;2370.608849539824;2371.9288421347387;2375.239923224569;2446.926592202237;2447.608382658766;2457.4839283750434;2477.046337160188;2477.4797292568583;8549.444286121383;8599.656013759442;8610.095939926281;8624.784380390478;8867.822643547157;5346.545543628797;5476.890462190734;5482.506574408322;5482.780688772445;5487.862803429906;3283.277678910636;3325.48454989477;3371.5616969794014;3395.5076513905346;3482.512448257246;1003.7942221844577;1009.2329829329689;1038.2524582300732;1050.7005503431562;1067.3755852826107;12346.753064938652;12443.440045197987;12468.937655311665;12489.063320250927;12495.062870284764;4853.708777473363;4912.95087049125;5051.898962020812;5064.164412871834;5122.257272695439;10335.379877207391;10370.481475926174;10377.688669339932;10382.169426445866;10390.584376625002;5563.554915606742;5576.079946808731;5578.8047418340975;5601.187827764951;5603.747831347518;4947.282644016669;5108.540231379194;5154.690718556899;5168.560672342818;5263;3886.805659717003;3908.413737939332;4007.779572123561;4012.498437695288;4080.4083407906282;1153.2676750263474;1163.2322667039882;1169.6607983684637;1171.701216189866;1187.7268228307364;858.8754630578657;918.4535201555065;927.174814415171;938.1462868789368;947.2800671489717;5712.485876271156;5847.8245652630485;5869.2956845178;5880.235569375954;6201.131841542187;950.805084957582;977.5503268496429;991.2912267728465;1004.2217281606668;1032.6024480575034;3704.722145839019;3767.773933563995;3793.2223894101644;3801.239752049601;3853.113783829735;10756.515956781963;11023.06303964156;11126.276792008493;11142.777144457228;11178.832317515244;10830.620928267474;10972.725681857857;11027.779444411068;11031.338119712844;11053.557857685602;7896.802579935547;8379.83240335202;8542.231199191978;8564.657413703506;8602.612882420306;5469.835904922858;5750.913736294043;5885.793997210077;5957.076653118774;5988.520918326611;9626.518674066128;10265.076143147153;10266.486675666038;10297.691069267934;10336.638217662347;10073.395596264247;10169.135623472088;10183;10336.586536538454;10371.429571373646;7489.513181643176;7628.8855667163925;7673.961630191813;7681.961590192013;7718.266764657348;8529.360297977553;8571.528565928933;8602.655893764178;8631.309495240492;8636.395452318277;7465.328120469184;7624.504407213513;7794.961025194838;7852.1755215703815;8100.83798324042;7437.8140546486775;7445.516041457288;7525.285097915689;7538;7630.961845190738;6860.279670634512;6870.141232345957;6911.89632155508;6954.79135625932;6992.860142797217;4864.756762161948;4907.460179380194;4924.729139897197;4979.128652485728;5085.796568137381;4778.402699662543;4826.276058591099;4865.756712164449;4881.658283920234;4953.281774142802 18:09:53 INFO - PROCESS | 1031 | |4;prototype.html;340.97954122752634;343.54823407219504;356.48487934934025;357.59234472701144;366.7597723491111;5427.728613569326;5570.749316280767;5675.574331925107;5683.261176047114;5702.401247868971;5400.891982160354;5497.285352904127;5585.609007369476;5605.691686957216;5648.915266271009;4410.338449232617;4429.737524805415;4433.423654924855;4437.733735975836;4441.844535441261;4190.2248084104385;4352.347147927804;4405.140997505488;4427.911441771163;4484.349769283452;4330.307150855863;4334.869953901388;4346.15250026245;4351.978240108795;4369.300911854104;4354.368616550598;4357.694961352722;4358.193734159191;4366.6026871400845;4371.300591905312;3799.3920972644246;3839.884803455901;3857.1514266861245;3857.5756666766633;3898.9256227242317;5430.864228394283;5448.346198456171;5476.397596264408;5479.643823151482;5483.479069488392;4979.30289759434;4981.72600506972;4988.7505624718615;5005.299258103868;5014.122528557525;5729.169270455803;5827.679477628729;5860;5862.296524417055;5880.4119588041285;4192.434021407102;4193.20329137466;4198.412222288882;4230.555791641864;4246.7027308088445;6155.692215389257;6186.474149697281;6196.81409557714;6209.192804935375;6221.96889015552;4204.969782403331;4278.251306021434;4301.505326887385;4304.956950430455;4316.43886294786;4338.327559228262;4352;4369.737815731003;4371.453568303962;4386.495553011445;4984.601231901439;4992.975035124874;5008.749562521859;5022.84931452057;5037.974810125999;5667.659940403589;5769.307683078057;5911.881762364815;5992.730327135202;6003.309619393738;1432.3912337256625;1453.3024148408822;1462.6855226126434;1466.2961778346453;1470.7499725046769;955.1737746849064;980.2452111873818;995.3530205366569;1009.485162567096;1011.1607365886297;5515.310586176728;5523.7790488380815;5526.723663816793;5529.751161197756;5548.472895074961;5785.326317788151;5797.275340582427;5827.708614569255;5828.6794226317115;5867.677277749679;5454.7818087276855;5553.4724201200825;5558.833235002957;5707.914381284284;5764.625299355528;3090.242890491799;3122.6877312269044;3152.716255537013;3165.3036332006923;3175.142711467891;6005.399460054047;6072.696365181723;6104.8779024420155;6105.694715264219;6124.571280010446;6172.012478003498;6180.721867515973;6188.4739797117745;6230.345813689588;6255.437010669061;6221.3778622138325;6227.532935029891;6230.937690623126;6288.685565721696;6356.809295721136;5966.522678185822;6006.909896351645;6032.4570788629235;6047.140938525082;6095.695215239131;6025.126356678345;6036.939630603813;6059.969700151471;6081.331053584014;6096.451319381277;6137.588354678538;6244.906326405016;6298.779542715983;6315.5894866833505;6381.3937675920715;4367.192069467159;4389;4410.977945110254;4414.624756895571;4450.376947227326;5860.912086318794;6023.3073196582955;6117.296510901303;6145.6927153641245;6156.661383623944;5824.767009319749;5915.467607915309;5950.553708471795;5955.106733989936;5986.311574169026;5924;5927.31835838884;5937.614055086406;5940.940590594038;5946.405359464019;5614.466625670555;5862.296524417097;5865.706714664335;5879.353271140086;5892.882142357043;5964.31410387811;5965.224520812267;5976.133460648269;5987.670678112746;6000.939990600213;5640.71796410186;5801.477866991991;5825.650460972355;5834.562407819346;5836.241288632451 18:09:53 INFO - PROCESS | 1031 | |5;yui.html;766.3792328214143;768.3469051306387;803.5259197073725;821.6343727041466;824.6536454689032;14255.714885702293;14819.18494482803;15224.923875380622;15229.238538073094;15380.077195368258;14621.853781462181;14943.85056149441;14967.775483367759;14985.475508357209;15005.474808381708;720.8342081321299;745.8732015557341;826.3636999510373;854.811941372897;863.5380071661663;857.4169564696004;865.1867244789909;865.709987154301;869.9130086991313;871.5119533061505;912.6075787411411;912.9360944733871;913.6071489259616;914.4696076275744;914.6798620482845;916.7524768312585;917.564157025411;917.5733284022962;921.6635927886273;922.3082687984012;669.8894682377402;672.993270067298;674.7402250133684;676.9187697476334;676.9661516924183;14248.358823852952;14553;14578.343974521173;14607.196604186765;14648.267586620734;14478.203698796668;15099.698006039927;15152.696946061127;15154.166520841349;15168.393264269416;11557.364344961024;11801.114916381306;11838.46726897283;11848.466818993165;11849.40752962357;3839.8464061437508;3840.1551658635058;3850.3646898261754;3852.8844134676006;3941.743786653887;53634;53851.730741346044;56789.148162777594;59177;65524;11013.449327533592;11425.60010399632;11473.139514536277;11583;11731.530738770523;18804.247830086642;19130;20982.895085524473;21193.152273908872;21202.15191392358;8314.875276870851;8318.542480163649;8385.580720963928;8439.70461033861;8550.657973681107;4723.244280915037;4751.714897106184;4792.520747925179;4876.146674331978;5000.89998200034;3466.930661386758;3579.731520136;3584.6415358463946;3596.7122630189524;3611.1694310308776;637.6269882119012;644.5455953552735;645.4997377032837;651.2445563146726;660.2736989311815;697.4524997876744;738.564247094217;758.5714071549556;768.4313607930203;782.1318336646318;7474.364679002346;7647.579383133981;7857.882131768028;7984.041914970125;8067.556284404297;685.239384283445;731.7841236835146;745.6756311004731;778.283978739561;798.0622768247403;3767.208886133888;3852.8073596320073;3941.763494190358;4057.9797101014306;4082.2039702258367;48953.755231223615;62574.68712656499;71828;92975;98784;27488.58767118495;27805.443891122064;52894;72152.63923680453;72556.27443725601;45827.77086114548;50128.49871501311;65666.34333656602;66922;67348;8080.515169089874;8421.789455263668;8501.829963400574;8538.78653033679;8554.358423118167;39010;41038.17923641451;41552.37671434991;41909.58090419057;44845.32732009088;41095.589044109176;41456;43718.78140609276;60835;62034.37965620466;11871.703207419883;11927.701807454883;11935.641930742091;11937.16439849237;12525.248485090924;13497.730045398841;13641.522546711214;13655.385507651981;13794.93102534481;13815.240161791198;12205.755884882075;12411.565595204125;12681.8097728536;12793.42429590652;12928.03039772002;11937.761244775229;12088.15382923222;12189.329586872807;12743.171693839871;13004.414801334153;12185;12408.62774116778;12975.221486710827;13002.739945200854;13096.672583185496;9711.465869377253;10048;10091.444970526398;10328.741781455523;10789.838152427563;9834.0331933615;10048.949755251177;10138.89861101409;10220.28458007962;10237.48812559384 18:09:53 INFO - PROCESS | 1031 | __end_tp_report 18:09:53 INFO - PROCESS | 1031 | __start_cc_report 18:09:53 INFO - PROCESS | 1031 | _x_x_mozilla_cycle_collect,325 18:09:53 INFO - PROCESS | 1031 | __end_cc_report 18:09:53 INFO - PROCESS | 1031 | __startTimestamp1487902193326__endTimestamp 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | ------- Summary: start ------- 18:09:53 INFO - PROCESS | 1031 | Number of tests: 6 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | [#0] dojo.html Cycles:165 Average:5733.50 Median:5921.50 stddev:647.96 (10.9%) stddev-sans-first:619.70 18:09:53 INFO - PROCESS | 1031 | Values: 3239.1 3263.2 3263.6 3268.0 3276.8 5732.4 5834.6 5854.0 5854.5 5863.0 5812.5 5872.1 5873.9 5875.3 5882.3 5313.7 5333.6 5342.0 5381.2 5391.4 5368.6 5386.8 5388.9 5392.2 5406.3 5101.7 5116.1 5367.4 5380.4 5391.5 5206.5 5225.0 5289.7 5336.4 5401.3 5248.7 5335.4 5354.0 5355.9 5358.9 5799.7 5821.8 5856.2 5886.5 5914.1 5919.1 5960.3 6042.8 6135.1 6199.8 6052.8 6077.7 6083.8 6171.2 6172.3 5703.1 5727.2 5735.5 5735.9 5739.8 6143.6 6191.6 6237.7 6276.6 6283.8 6040.3 6053.2 6062.9 6072.5 6097.5 5843.7 6155.1 6157.8 6160.9 6175.6 5820.9 6021.7 6068.9 6098.5 6139.1 6113.6 6156.0 6159.4 6175.0 6178.1 4739.8 4743.8 4748.7 4764.7 4774.5 4062.6 4111.8 4135.4 4142.4 4175.4 5806.7 5853.8 5859.9 5885.7 5900.3 6188.8 6214.0 6217.0 6218.8 6239.6 5724.8 5773.7 5813.4 5861.2 5926.3 5348.7 5365.4 5387.9 5395.8 5398.2 6406.1 6449.8 6458.8 6459.7 6464.0 5829.1 5931.9 6239.6 6245.5 6261.9 6299.4 6355.2 6358.0 6398.0 6459.1 6107.1 6113.3 6116.3 6116.3 6131.8 5987.3 6203.7 6248.6 6254.1 6256.7 5896.8 5908.4 5985.6 5995.3 5995.5 6019.4 6019.6 6035.0 6065.7 6075.5 5921.4 5971.0 5979.7 5992.0 5993.6 5934.3 5970.7 5981.3 6017.1 6091.6 5914.4 5921.5 5932.3 5955.2 5967.1 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | [#1] ext.html Cycles:180 Average:59595.63 Median:38567.73 stddev:111079.17 (288.0%) stddev-sans-first:111302.32 18:09:53 INFO - PROCESS | 1031 | Values: 554.5 602.1 613.0 665.8 689.8 41341.2 42261.6 44549.0 44627.3 44628.0 44887.6 45934.5 45981.5 46014.8 46273.0 8496.7 8679.1 8839.1 10847.2 11098.1 10937.3 11015.8 11039.8 11065.5 11075.3 11052.6 11109.8 11112.0 11115.9 11133.3 11018.3 11039.3 11075.2 11079.5 11080.1 10886.5 10954.3 10961.4 10969.7 10977.8 45088.5 45203.5 45265.8 45401.1 45676.5 3685.5 3806.0 3880.7 4017.0 4238.6 33860.2 33868.8 33906.0 34123.7 34263.3 4511.3 4574.7 4606.2 4615.4 4636.2 334185.0 336110.0 336272.0 336462.0 336810.0 63413.0 63807.0 64101.0 64101.7 64101.7 67072.7 67244.3 67273.7 67278.7 67679.7 16832.0 16968.1 17428.7 17612.2 17626.6 12813.2 13426.6 13573.7 13581.9 13602.9 20976.3 21248.6 21481.8 21575.8 21611.7 7451.2 7525.8 7587.7 7591.9 7723.7 995.6 1010.5 1102.5 1130.7 1132.7 31958.0 32415.5 32468.5 32966.7 33172.3 1132.9 1145.9 1155.7 1181.9 1210.1 17284.9 17507.1 17565.4 17670.8 17732.5 489284.0 495570.0 496520.0 497455.0 498554.0 63539.7 64373.0 64698.0 64866.0 64902.4 1374.1 1419.7 1425.3 1450.4 1451.1 31095.0 31106.4 31598.7 32000.8 32513.3 48062.4 48261.5 48334.5 48402.3 48520.3 412629.0 414777.0 416631.0 417546.0 421774.0 30299.8 30739.7 31124.0 31268.8 32965.8 49252.5 49469.8 49953.8 50676.0 51323.7 42316.4 43107.0 43534.6 43688.3 44030.8 41616.4 42179.8 42598.1 43525.8 44506.0 41571.0 41722.0 42356.4 42716.7 42858.1 36045.8 38209.0 38446.2 38689.2 39268.4 28489.6 28639.1 28663.6 28765.7 28854.3 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | [#2] jquery.html Cycles:180 Average:27560.24 Median:2275.52 stddev:73505.31 (3230.3%) stddev-sans-first:73683.25 18:09:53 INFO - PROCESS | 1031 | Values: 413.7 416.8 425.4 427.1 441.8 18554.5 19433.2 20158.7 20289.5 20397.9 19421.2 19614.3 19818.9 19920.0 20145.5 5669.4 5922.9 5924.4 5931.6 5931.9 4235.6 5334.1 5804.2 5903.9 6550.4 6536.7 6580.0 6585.3 6590.7 6612.3 6430.9 6604.0 6625.2 6656.7 6663.9 5809.9 5989.0 5994.9 5996.1 6006.6 13807.3 16707.3 18824.2 19219.3 19238.9 2192.7 2358.3 2382.4 2406.8 2862.1 9807.2 10388.7 10575.7 12580.7 14256.4 1976.1 2009.7 2031.0 2047.6 2107.8 74924.0 79178.0 81920.6 88374.6 90775.5 11226.6 11234.2 11436.5 11518.8 11860.1 16607.2 16617.9 16640.7 16649.8 16670.8 8430.0 8484.4 8594.7 8672.7 8809.5 8223.8 8306.8 8457.2 8474.0 8474.4 4971.2 4975.7 5033.4 5111.2 5194.4 1915.4 2048.5 2084.2 2125.2 2171.4 913.6 990.5 1046.0 1095.6 1147.4 19938.1 20032.3 20303.4 20324.3 20385.8 1009.4 1018.1 1025.4 1046.2 1070.6 9975.1 11181.7 11386.2 11405.1 11583.7 424562.0 430662.0 448602.0 458991.0 459868.0 55088.9 89986.0 91200.5 92085.5 93022.0 1033.0 1039.3 1043.9 1052.6 1072.6 17388.2 17706.7 17713.5 17784.6 18077.5 41946.4 42191.2 42736.0 43092.4 43993.3 53674.7 57303.7 57777.4 57916.0 58426.4 7905.8 8020.0 8218.0 8275.1 8416.3 11770.6 11994.3 12553.2 12621.7 12923.4 10320.7 10334.4 11129.6 11189.4 11298.5 10179.6 10747.7 10757.6 10793.2 10893.0 10885.6 10969.9 11059.6 11169.9 11324.6 8022.2 8285.2 8334.7 8686.8 8848.7 8092.1 10406.5 11169.1 11184.6 11402.4 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | [#3] mootools.html Cycles:180 Average:5827.24 Median:4873.71 stddev:3293.64 (67.6%) stddev-sans-first:3286.85 18:09:53 INFO - PROCESS | 1031 | Values: 1503.0 1530.8 1690.2 1814.2 1840.1 7839.3 8055.9 8444.7 8720.7 8832.4 8424.0 8746.4 8752.5 8964.6 8991.6 2483.2 2495.5 2513.1 2517.6 2518.9 2443.4 2507.7 2512.3 2514.1 2543.3 2419.5 2458.8 2463.5 2470.7 2472.9 2348.3 2355.9 2370.6 2371.9 2375.2 2446.9 2447.6 2457.5 2477.0 2477.5 8549.4 8599.7 8610.1 8624.8 8867.8 5346.5 5476.9 5482.5 5482.8 5487.9 3283.3 3325.5 3371.6 3395.5 3482.5 1003.8 1009.2 1038.3 1050.7 1067.4 12346.8 12443.4 12468.9 12489.1 12495.1 4853.7 4913.0 5051.9 5064.2 5122.3 10335.4 10370.5 10377.7 10382.2 10390.6 5563.6 5576.1 5578.8 5601.2 5603.7 4947.3 5108.5 5154.7 5168.6 5263.0 3886.8 3908.4 4007.8 4012.5 4080.4 1153.3 1163.2 1169.7 1171.7 1187.7 858.9 918.5 927.2 938.1 947.3 5712.5 5847.8 5869.3 5880.2 6201.1 950.8 977.6 991.3 1004.2 1032.6 3704.7 3767.8 3793.2 3801.2 3853.1 10756.5 11023.1 11126.3 11142.8 11178.8 10830.6 10972.7 11027.8 11031.3 11053.6 7896.8 8379.8 8542.2 8564.7 8602.6 5469.8 5750.9 5885.8 5957.1 5988.5 9626.5 10265.1 10266.5 10297.7 10336.6 10073.4 10169.1 10183.0 10336.6 10371.4 7489.5 7628.9 7674.0 7682.0 7718.3 8529.4 8571.5 8602.7 8631.3 8636.4 7465.3 7624.5 7795.0 7852.2 8100.8 7437.8 7445.5 7525.3 7538.0 7631.0 6860.3 6870.1 6911.9 6954.8 6992.9 4864.8 4907.5 4924.7 4979.1 5085.8 4778.4 4826.3 4865.8 4881.7 4953.3 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | [#4] prototype.html Cycles:180 Average:4957.68 Median:5610.08 stddev:1464.07 (26.1%) stddev-sans-first:1426.58 18:09:53 INFO - PROCESS | 1031 | Values: 341.0 343.5 356.5 357.6 366.8 5427.7 5570.7 5675.6 5683.3 5702.4 5400.9 5497.3 5585.6 5605.7 5648.9 4410.3 4429.7 4433.4 4437.7 4441.8 4190.2 4352.3 4405.1 4427.9 4484.3 4330.3 4334.9 4346.2 4352.0 4369.3 4354.4 4357.7 4358.2 4366.6 4371.3 3799.4 3839.9 3857.2 3857.6 3898.9 5430.9 5448.3 5476.4 5479.6 5483.5 4979.3 4981.7 4988.8 5005.3 5014.1 5729.2 5827.7 5860.0 5862.3 5880.4 4192.4 4193.2 4198.4 4230.6 4246.7 6155.7 6186.5 6196.8 6209.2 6222.0 4205.0 4278.3 4301.5 4305.0 4316.4 4338.3 4352.0 4369.7 4371.5 4386.5 4984.6 4993.0 5008.7 5022.8 5038.0 5667.7 5769.3 5911.9 5992.7 6003.3 1432.4 1453.3 1462.7 1466.3 1470.7 955.2 980.2 995.4 1009.5 1011.2 5515.3 5523.8 5526.7 5529.8 5548.5 5785.3 5797.3 5827.7 5828.7 5867.7 5454.8 5553.5 5558.8 5707.9 5764.6 3090.2 3122.7 3152.7 3165.3 3175.1 6005.4 6072.7 6104.9 6105.7 6124.6 6172.0 6180.7 6188.5 6230.3 6255.4 6221.4 6227.5 6230.9 6288.7 6356.8 5966.5 6006.9 6032.5 6047.1 6095.7 6025.1 6036.9 6060.0 6081.3 6096.5 6137.6 6244.9 6298.8 6315.6 6381.4 4367.2 4389.0 4411.0 4414.6 4450.4 5860.9 6023.3 6117.3 6145.7 6156.7 5824.8 5915.5 5950.6 5955.1 5986.3 5924.0 5927.3 5937.6 5940.9 5946.4 5614.5 5862.3 5865.7 5879.4 5892.9 5964.3 5965.2 5976.1 5987.7 6000.9 5640.7 5801.5 5825.7 5834.6 5836.2 18:09:53 INFO - PROCESS | 1031 | 18:09:53 INFO - PROCESS | 1031 | [#5] yui.html Cycles:180 Average:15796.49 Median:42814.18 stddev:19820.88 (46.3%) stddev-sans-first:19844.35 18:09:53 INFO - PROCESS | 1031 | Values: 766.4 768.3 803.5 821.6 824.7 14255.7 14819.2 15224.9 15229.2 15380.1 14621.9 14943.9 14967.8 14985.5 15005.5 720.8 745.9 826.4 854.8 863.5 857.4 865.2 865.7 869.9 871.5 912.6 912.9 913.6 914.5 914.7 916.8 917.6 917.6 921.7 922.3 669.9 673.0 674.7 676.9 677.0 14248.4 14553.0 14578.3 14607.2 14648.3 14478.2 15099.7 15152.7 15154.2 15168.4 11557.4 11801.1 11838.5 11848.5 11849.4 3839.8 3840.2 3850.4 3852.9 3941.7 53634.0 53851.7 56789.1 59177.0 65524.0 11013.4 11425.6 11473.1 11583.0 11731.5 18804.2 19130.0 20982.9 21193.2 21202.2 8314.9 8318.5 8385.6 8439.7 8550.7 4723.2 4751.7 4792.5 4876.1 5000.9 3466.9 3579.7 3584.6 3596.7 3611.2 637.6 644.5 645.5 651.2 660.3 697.5 738.6 758.6 768.4 782.1 7474.4 7647.6 7857.9 7984.0 8067.6 685.2 731.8 745.7 778.3 798.1 3767.2 3852.8 3941.8 4058.0 4082.2 48953.8 62574.7 71828.0 92975.0 98784.0 27488.6 27805.4 52894.0 72152.6 72556.3 45827.8 50128.5 65666.3 66922.0 67348.0 8080.5 8421.8 8501.8 8538.8 8554.4 39010.0 41038.2 41552.4 41909.6 44845.3 41095.6 41456.0 43718.8 60835.0 62034.4 11871.7 11927.7 11935.6 11937.2 12525.2 13497.7 13641.5 13655.4 13794.9 13815.2 12205.8 12411.6 12681.8 12793.4 12928.0 11937.8 12088.2 12189.3 12743.2 13004.4 12185.0 12408.6 12975.2 13002.7 13096.7 9711.5 10048.0 10091.4 10328.7 10789.8 9834.0 10048.9 10138.9 10220.3 10237.5 18:09:53 INFO - PROCESS | 1031 | -------- Summary: end -------- 18:09:53 INFO - PROCESS | 1031 | 18:09:54 INFO - TEST-INFO | 1031: exit 0 18:09:54 INFO - TEST-OK | dromaeo_css | took 1113784ms 18:09:54 INFO - TEST-START | kraken 18:09:54 INFO - operating with platform_type : linux_ 18:09:54 INFO - Initialising browser for kraken test... 18:09:54 INFO - TEST-INFO | started process 1474 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpPmQASj/profile http://localhost:44724/getInfo.html) 18:09:58 INFO - PROCESS | 1474 | __metrics Screen width/height:1600/1200 18:09:58 INFO - PROCESS | 1474 | colorDepth:24 18:09:58 INFO - PROCESS | 1474 | Browser inner width/height: 1024/697 18:09:58 INFO - PROCESS | 1474 | __metrics 18:09:59 ERROR - PROCESS | 1474 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3197: TypeError: this.tabs is undefined 18:10:00 INFO - TEST-INFO | 1474: exit 0 18:10:00 INFO - Browser initialized. 18:10:00 INFO - Running cycle 1/1 for kraken test... 18:10:00 INFO - TEST-INFO | started process 1610 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpPmQASj/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:10:11 INFO - PROCESS | 1610 | RSS: Main: 147140608 18:10:11 INFO - PROCESS | 1610 | 18:10:14 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:44724/tests/kraken/driver.html?testName=audio-beat-detection) 18:10:15 INFO - PROCESS | 1610 | RSS: Main: 153968640 18:10:15 INFO - PROCESS | 1610 | 18:10:18 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:44724/tests/kraken/driver.html?testName=audio-dft) 18:10:18 INFO - PROCESS | 1610 | RSS: Main: 153006080 18:10:18 INFO - PROCESS | 1610 | 18:10:21 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:44724/tests/kraken/driver.html?testName=audio-fft) 18:10:22 INFO - PROCESS | 1610 | RSS: Main: 152657920 18:10:22 INFO - PROCESS | 1610 | 18:10:24 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:44724/tests/kraken/driver.html?testName=audio-oscillator) 18:10:24 INFO - PROCESS | 1610 | RSS: Main: 152715264 18:10:24 INFO - PROCESS | 1610 | 18:10:26 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:44724/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:10:27 INFO - PROCESS | 1610 | RSS: Main: 152354816 18:10:27 INFO - PROCESS | 1610 | 18:10:30 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:44724/tests/kraken/driver.html?testName=imaging-darkroom) 18:10:31 INFO - PROCESS | 1610 | RSS: Main: 155459584 18:10:31 INFO - PROCESS | 1610 | 18:10:34 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:44724/tests/kraken/driver.html?testName=imaging-desaturate) 18:10:35 INFO - PROCESS | 1610 | RSS: Main: 155627520 18:10:35 INFO - PROCESS | 1610 | 18:10:37 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:44724/tests/kraken/driver.html?testName=json-parse-financial) 18:10:38 INFO - PROCESS | 1610 | RSS: Main: 155394048 18:10:38 INFO - PROCESS | 1610 | 18:10:40 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:44724/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:10:40 INFO - PROCESS | 1610 | RSS: Main: 154402816 18:10:40 INFO - PROCESS | 1610 | 18:10:42 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:10:43 INFO - PROCESS | 1610 | RSS: Main: 154435584 18:10:43 INFO - PROCESS | 1610 | 18:10:45 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:10:45 INFO - PROCESS | 1610 | RSS: Main: 155004928 18:10:45 INFO - PROCESS | 1610 | 18:10:48 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:10:48 INFO - PROCESS | 1610 | RSS: Main: 154886144 18:10:48 INFO - PROCESS | 1610 | 18:10:51 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:10:52 INFO - PROCESS | 1610 | RSS: Main: 155435008 18:10:52 INFO - PROCESS | 1610 | 18:10:53 INFO - PROCESS | 1610 | Cycle 1(1): loaded http://localhost:44724/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:44724/tests/kraken/driver.html?testName=ai-astar) 18:10:54 INFO - PROCESS | 1610 | RSS: Main: 157495296 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | __start_tp_report 18:10:54 INFO - PROCESS | 1610 | _x_x_mozilla_page_load 18:10:54 INFO - PROCESS | 1610 | _x_x_mozilla_page_load_details 18:10:54 INFO - PROCESS | 1610 | |i|pagename|runs| 18:10:54 INFO - PROCESS | 1610 | |0;ai-astar;103;112;112;112;113;111;115;111;111;111 18:10:54 INFO - PROCESS | 1610 | |1;audio-beat-detection;147;121;123;162;124;122;123;122;150;121 18:10:54 INFO - PROCESS | 1610 | |2;audio-dft;163;162;166;162;161;161;161;165;163;162 18:10:54 INFO - PROCESS | 1610 | |3;audio-fft;76;75;75;115;76;75;75;75;112;75 18:10:54 INFO - PROCESS | 1610 | |4;audio-oscillator;83;81;114;83;83;82;93;82;82;103 18:10:54 INFO - PROCESS | 1610 | |5;imaging-gaussian-blur;118;117;117;117;117;118;116;117;116;117 18:10:54 INFO - PROCESS | 1610 | |6;imaging-darkroom;147;148;147;147;146;147;147;147;147;147 18:10:54 INFO - PROCESS | 1610 | |7;imaging-desaturate;87;86;86;87;85;85;85;87;85;85 18:10:54 INFO - PROCESS | 1610 | |8;json-parse-financial;54;54;53;55;54;57;55;54;54;58 18:10:54 INFO - PROCESS | 1610 | |9;json-stringify-tinderbox;59;60;59;59;59;59;59;60;59;60 18:10:54 INFO - PROCESS | 1610 | |10;stanford-crypto-aes;75;75;76;74;74;74;76;79;78;81 18:10:54 INFO - PROCESS | 1610 | |11;stanford-crypto-ccm;125;140;137;131;130;121;124;127;170;123 18:10:54 INFO - PROCESS | 1610 | |12;stanford-crypto-pbkdf2;155;159;159;162;156;154;158;161;152;155 18:10:54 INFO - PROCESS | 1610 | |13;stanford-crypto-sha256-iterative;65;63;69;62;62;62;62;62;64;60 18:10:54 INFO - PROCESS | 1610 | __end_tp_report 18:10:54 INFO - PROCESS | 1610 | __start_cc_report 18:10:54 INFO - PROCESS | 1610 | _x_x_mozilla_cycle_collect,801 18:10:54 INFO - PROCESS | 1610 | __end_cc_report 18:10:54 INFO - PROCESS | 1610 | __startTimestamp1487902254127__endTimestamp 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | ------- Summary: start ------- 18:10:54 INFO - PROCESS | 1610 | Number of tests: 14 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#0] ai-astar Cycles:10 Average:111.10 Median:112.00 stddev:3.11 (2.8%) stddev-sans-first:1.32 18:10:54 INFO - PROCESS | 1610 | Values: 103.0 112.0 112.0 112.0 113.0 111.0 115.0 111.0 111.0 111.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#1] audio-beat-detection Cycles:10 Average:131.50 Median:123.50 stddev:15.33 (12.4%) stddev-sans-first:15.20 18:10:54 INFO - PROCESS | 1610 | Values: 147.0 121.0 123.0 162.0 124.0 122.0 123.0 122.0 150.0 121.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#2] audio-dft Cycles:10 Average:162.60 Median:162.50 stddev:1.71 (1.1%) stddev-sans-first:1.81 18:10:54 INFO - PROCESS | 1610 | Values: 163.0 162.0 166.0 162.0 161.0 161.0 161.0 165.0 163.0 162.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#3] audio-fft Cycles:10 Average:82.90 Median:75.00 stddev:16.15 (21.5%) stddev-sans-first:16.93 18:10:54 INFO - PROCESS | 1610 | Values: 76.0 75.0 75.0 115.0 76.0 75.0 75.0 75.0 112.0 75.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#4] audio-oscillator Cycles:10 Average:88.60 Median:82.50 stddev:11.33 (13.7%) stddev-sans-first:11.83 18:10:54 INFO - PROCESS | 1610 | Values: 83.0 81.0 114.0 83.0 83.0 82.0 93.0 82.0 82.0 103.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.67 (0.6%) stddev-sans-first:0.60 18:10:54 INFO - PROCESS | 1610 | Values: 118.0 117.0 117.0 117.0 117.0 118.0 116.0 117.0 116.0 117.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.47 (0.3%) stddev-sans-first:0.50 18:10:54 INFO - PROCESS | 1610 | Values: 147.0 148.0 147.0 147.0 146.0 147.0 147.0 147.0 147.0 147.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#7] imaging-desaturate Cycles:10 Average:85.80 Median:86.00 stddev:0.92 (1.1%) stddev-sans-first:0.87 18:10:54 INFO - PROCESS | 1610 | Values: 87.0 86.0 86.0 87.0 85.0 85.0 85.0 87.0 85.0 85.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#8] json-parse-financial Cycles:10 Average:54.80 Median:54.50 stddev:1.55 (2.8%) stddev-sans-first:1.62 18:10:54 INFO - PROCESS | 1610 | Values: 54.0 54.0 53.0 55.0 54.0 57.0 55.0 54.0 54.0 58.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#9] json-stringify-tinderbox Cycles:10 Average:59.30 Median:59.00 stddev:0.48 (0.8%) stddev-sans-first:0.50 18:10:54 INFO - PROCESS | 1610 | Values: 59.0 60.0 59.0 59.0 59.0 59.0 59.0 60.0 59.0 60.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#10] stanford-crypto-aes Cycles:10 Average:76.20 Median:76.00 stddev:2.39 (3.2%) stddev-sans-first:2.50 18:10:54 INFO - PROCESS | 1610 | Values: 75.0 75.0 76.0 74.0 74.0 74.0 76.0 79.0 78.0 81.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#11] stanford-crypto-ccm Cycles:10 Average:132.80 Median:130.50 stddev:14.42 (11.1%) stddev-sans-first:15.02 18:10:54 INFO - PROCESS | 1610 | Values: 125.0 140.0 137.0 131.0 130.0 121.0 124.0 127.0 170.0 123.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:157.10 Median:158.50 stddev:3.21 (2.0%) stddev-sans-first:3.32 18:10:54 INFO - PROCESS | 1610 | Values: 155.0 159.0 159.0 162.0 156.0 154.0 158.0 161.0 152.0 155.0 18:10:54 INFO - PROCESS | 1610 | 18:10:54 INFO - PROCESS | 1610 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.10 Median:62.50 stddev:2.47 (4.0%) stddev-sans-first:2.52 18:10:54 INFO - PROCESS | 1610 | Values: 65.0 63.0 69.0 62.0 62.0 62.0 62.0 62.0 64.0 60.0 18:10:54 INFO - PROCESS | 1610 | -------- Summary: end -------- 18:10:54 INFO - PROCESS | 1610 | 18:10:55 INFO - TEST-INFO | 1610: exit 0 18:10:55 INFO - TEST-OK | kraken | took 61081ms 18:10:55 INFO - SUITE-END | took 1174s 18:10:55 INFO - Completed test suite (00:19:35) 18:10:55 INFO - javascript benchmark 18:10:55 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7406.213824245843, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3239.1416274687203, 3263.216827961287, 3263.592050993626, 3268.0359294008267, 3276.7706260561754, 5732.398098199692, 5834.620749651275, 5853.975554278, 5854.5023672987845, 5862.970685146568, 5812.4768770810615, 5872.119182122684, 5873.853153671161, 5875.294964604253, 5882.264716910387, 5313.73431328433, 5333.599980001496, 5341.973290133544, 5381.19282107685, 5391.433899440561, 5368.570514358842, 5386.78452861885, 5388.946110538884, 5392.1911713243135, 5406.324209473816, 5101.6683915545555, 5116.1302578561545, 5367.436419175989, 5380.408155102936, 5391.541718953894, 5206.45332240115, 5224.973875130619, 5289.735513224324, 5336.4129945705945, 5401.297831281948, 5248.685078895279, 5335.439778823245, 5354.009508240949, 5355.946440535623, 5358.892822143574, 5799.652020878761, 5821.79623713168, 5856.209411729405, 5886.499647529965, 5914.053751399799, 5919.112133180014, 5960.344362120163, 6042.788502402439, 6135.141080248769, 6199.783007594758, 6052.757889684407, 6077.665728384937, 6083.756649734005, 6171.166892469549, 6172.259328880518, 5703.08750599902, 5727.1695604137585, 5735.455131762517, 5735.8852822944145, 5739.7991070312755, 6143.634700640286, 6191.628502289877, 6237.656928868956, 6276.592021518587, 6283.842903927439, 6040.335563088057, 6053.182820319289, 6062.878742425127, 6072.453479186895, 6097.512199024068, 5843.707814609253, 6155.076738489262, 6157.8460538486, 6160.9383906160365, 6175.59858609189, 5820.912686309709, 6021.729022194012, 6068.878622427526, 6098.512119030555, 6139.124180917401, 6113.57204995646, 6156.045812899008, 6159.353267906895, 6175.042868355412, 6178.104174894615, 4739.834105806281, 4743.810247590127, 4748.738819364899, 4764.666473346832, 4774.474807771212, 4062.5937406259136, 4111.814968326433, 4135.400366946776, 4142.420061191436, 4175.394567787654, 5806.709664516758, 5853.795117170878, 5859.882802343929, 5885.676287804126, 5900.291964964232, 6188.845278868064, 6214.036824292242, 6217.0052791553135, 6218.81343559694, 6239.594426362272, 5724.77100915967, 5773.740181691834, 5813.3895940925595, 5861.150133230658, 5926.259217597801, 5348.705821179872, 5365.436629153961, 5387.865303367447, 5395.7841686332895, 5398.217258497496, 6406.1031455597185, 6449.774257900951, 6458.838529036811, 6459.741610335628, 6464.0, 5829.09649004405, 5931.851703707442, 6239.594426362272, 6245.469135123565, 6261.937380626136, 6299.433051025429, 6355.205599300088, 6357.96821015892, 6398.0402939559435, 6459.128017717548, 6107.053406721788, 6113.2969708482315, 6116.296625887901, 6116.29662588808, 6131.84670383244, 5987.34139244674, 6203.658798766111, 6248.562600617913, 6254.061890716429, 6256.687165641609, 5896.7936122235515, 5908.350081490947, 5985.640861548147, 5995.310539288038, 5995.490383317292, 6019.367966363644, 6019.608725432833, 6035.0, 6065.6663883486835, 6075.544334175043, 5921.3782552831335, 5971.044632858721, 5979.701014949323, 5991.970040149771, 5993.61041532299, 5934.3175534814045, 5970.671613061323, 5981.252343457068, 6017.127516509994, 6091.573589848668, 5914.4381283777975, 5921.4966727826895, 5932.347441781487, 5955.225820643289, 5967.104934259895], "value": 5689.035454702663, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [554.5314209492977, 602.0818252165448, 612.996935015325, 665.8035879415572, 689.8137502874221, 41341.17317653649, 42261.57738422615, 44549.0, 44627.330590041136, 44628.0, 44887.551124488746, 45934.540654593446, 45981.54018459815, 46014.76992615041, 46273.0, 8496.660133594649, 8679.132086791302, 8839.07189745077, 10847.240693151483, 11098.112151027899, 10937.289076210021, 11015.83476247857, 11039.779204415907, 11065.50205240766, 11075.280106793072, 11052.557897684082, 11109.777804443906, 11111.999920007198, 11115.944420277927, 11133.276337038067, 11018.283811552263, 11039.337639741601, 11075.224734268604, 11079.50142243597, 11080.113590912708, 10886.510107045202, 10954.342739435659, 10961.397123158224, 10969.670909872717, 10977.780444391148, 45088.549114508765, 45203.54796452059, 45265.77367113176, 45401.09197816025, 45676.54323456789, 3685.5208822852856, 3805.9619403805887, 3880.670143037817, 4016.959830401717, 4238.639715624176, 33860.153496162544, 33868.83065584681, 33906.0, 34123.6587634123, 34263.31473370543, 4511.323301504768, 4574.748388838612, 4606.193916064709, 4615.3617103637325, 4636.235021221494, 334185.0, 336110.0, 336272.0, 336462.0, 336810.0, 63413.0, 63807.0, 64101.038484422774, 64101.67949160224, 64101.67949160318, 67072.6646366765, 67244.32755672479, 67273.66363168153, 67278.66360668263, 67679.66160169168, 16832.0, 16968.06675632852, 17428.738568921475, 17612.20745066475, 17626.5593360167, 12813.167144135601, 13426.597202083953, 13573.660658483617, 13581.932090339486, 13602.93198534001, 20976.26583069585, 21248.575028499345, 21481.78518214829, 21575.78424215769, 21611.67582486264, 7451.180370159278, 7525.849483010418, 7587.734429294948, 7591.8861217081785, 7723.691052357843, 995.6216637677636, 1010.545254635417, 1102.5479553383075, 1130.7173206698326, 1132.705496570881, 31957.969246765675, 32415.51376729351, 32468.512972305434, 32966.67033329636, 33172.3365532688, 1132.898039176478, 1145.873953865074, 1155.7110722319421, 1181.8936295733424, 1210.082019998295, 17284.91357543204, 17507.124643767762, 17565.38521151779, 17670.823291767174, 17732.468025959242, 489284.0, 495570.0, 496520.0, 497455.0, 498554.0, 63539.68230158912, 64373.0, 64698.0, 64866.0, 64902.35097648963, 1374.113696665665, 1419.6805718713206, 1425.2731107135435, 1450.4125829039467, 1451.122071146962, 31095.0, 31106.377872442878, 31598.684013159575, 32000.839995799874, 32513.349733004736, 48062.356570387565, 48261.5173848257, 48334.516654833, 48402.273965889835, 48520.272195917794, 412629.0, 414777.0, 416631.0, 417546.0, 421774.0, 30299.848500757354, 30739.692603074578, 31124.0, 31268.843655781577, 32965.83517082399, 49252.507474924794, 49469.752651236515, 49953.75023124861, 50676.0, 51323.74338128435, 42316.36525452182, 43107.0, 43534.56465435305, 43688.344674830536, 44030.779846100566, 41616.375754364315, 42179.789101054295, 42598.148037039704, 43525.78237108794, 44506.0, 41571.0, 41722.0, 42356.36465453082, 42716.718498445094, 42858.14283714371, 36045.81977090098, 38209.0, 38446.23107537778, 38689.2262154761, 39268.410973835984, 28489.572656409757, 28639.14082577526, 28663.570046448902, 28765.712342876304, 28854.278643033253], "value": 21372.193482673876, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [413.6752649170401, 416.84576706618554, 425.36408069935453, 427.08603588321, 441.8276872019913, 18554.536136596576, 19433.222671093175, 20158.697619535684, 20289.49276268094, 20397.898010509925, 19421.22315107394, 19614.313499027536, 19818.90090549545, 19920.0, 20145.496362590944, 5669.404712505189, 5922.88154236915, 5924.437178468039, 5931.555133364994, 5931.940680593204, 4235.6187943085115, 5334.146536554152, 5804.187413762077, 5903.88192236155, 6550.443212326958, 6536.673166341688, 6580.045893345486, 6585.308542603029, 6590.703418346162, 6612.338766123397, 6430.903536446934, 6603.9669801650925, 6625.238097618787, 6656.70044847983, 6663.900041499382, 5809.941900581025, 5989.0, 5994.910076348859, 5996.130561068664, 6006.609570377956, 13807.309634518233, 16707.331706731715, 18824.152913118807, 19219.32732354375, 19238.903805481023, 2192.7039849620255, 2358.327876555191, 2382.4401265702545, 2406.7833894949363, 2862.1127450490417, 9807.215422766161, 10388.688339349832, 10575.682729518127, 12580.685482863002, 14256.35846386915, 1976.1305025788752, 2009.6836572045333, 2030.9893205726373, 2047.6314263432575, 2107.8419118566167, 74924.0, 79177.99999999942, 81920.59039704823, 88374.5581272096, 90775.54612226896, 11226.550937962553, 11234.157438192005, 11436.542538298374, 11518.769624607628, 11860.110491713156, 16607.169641517874, 16617.916910415614, 16640.667186656443, 16649.83350166507, 16670.833291666928, 8429.957850210709, 8484.448510846774, 8594.742157735278, 8672.653093876173, 8809.471431714117, 8223.753287401387, 8306.750797476085, 8457.154284571494, 8473.95763021181, 8474.364422668325, 4971.1549036663855, 4975.701457912537, 5033.421156566968, 5111.182210846247, 5194.3766747990485, 1915.3775023117541, 2048.539078707309, 2084.2288353309373, 2125.2455378340464, 2171.4137182960512, 913.620847348343, 990.5294984882267, 1046.0459463229006, 1095.6439157273917, 1147.449224372306, 19938.102785374693, 20032.298869539496, 20303.390898273075, 20324.288649897182, 20385.796142038686, 1009.4246279620546, 1018.0837246478229, 1025.3642741500319, 1046.2048842879467, 1070.571771291474, 9975.102240798218, 11181.706476458836, 11386.202965792316, 11405.14461415397, 11583.710407239887, 424562.0, 430662.0, 448602.0, 458991.0, 459868.0, 55088.898222036136, 89986.0, 91200.54399728091, 92085.53957230171, 93022.0, 1032.9535170917327, 1039.2828948025838, 1043.8799538053222, 1052.55792567122, 1072.5816931396762, 17388.217530210917, 17706.73439898377, 17713.468595942144, 17784.644307114046, 18077.457676269732, 41946.37080443735, 42191.1561768769, 42736.0, 43092.35361469518, 43993.34009989789, 53674.73162634318, 57303.71348143233, 57777.422225778886, 57916.0, 58426.4157358421, 7905.762827115196, 8020.0, 8218.0, 8275.089740128702, 8416.284615807725, 11770.646880593597, 11994.340311282964, 12553.246805191719, 12621.684457888627, 12923.418446169757, 10320.741981450525, 10334.431606261427, 11129.55481780752, 11189.384583847966, 11298.548058077913, 10179.592816287266, 10747.677569672922, 10757.623483178051, 10793.19051071157, 10893.0, 10885.619003334845, 10969.945150274198, 11059.612913547988, 11169.888301116885, 11324.60363887293, 8022.197780221931, 8285.171482851667, 8334.6666133354, 8686.826263474568, 8848.734537963872, 8092.109867914407, 10406.47967601632, 11169.106471482099, 11184.608538701432, 11402.372869492257], "value": 9320.455157048273, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1502.992485037575, 1530.8316085230626, 1690.2224976510804, 1814.2198854492578, 1840.1167439628978, 7839.333656639178, 8055.879161812578, 8444.704435344764, 8720.694775682845, 8832.425892316995, 8424.0, 8746.431481953668, 8752.518611476366, 8964.551772411369, 8991.550422478866, 2483.230198638423, 2495.463475352799, 2513.070164039308, 2517.5720127578265, 2518.9496210075786, 2443.389152711822, 2507.6865391826022, 2512.321673148249, 2514.0823599386276, 2543.2878793937725, 2419.5040016796515, 2458.791002764767, 2463.470353873917, 2470.72821989581, 2472.863992480422, 2348.3072493614427, 2355.9175428859908, 2370.608849539824, 2371.9288421347387, 2375.239923224569, 2446.926592202237, 2447.608382658766, 2457.4839283750434, 2477.046337160188, 2477.4797292568583, 8549.444286121383, 8599.656013759442, 8610.095939926281, 8624.784380390478, 8867.822643547157, 5346.545543628797, 5476.890462190734, 5482.506574408322, 5482.780688772445, 5487.862803429906, 3283.277678910636, 3325.48454989477, 3371.5616969794014, 3395.5076513905346, 3482.512448257246, 1003.7942221844577, 1009.2329829329689, 1038.2524582300732, 1050.7005503431562, 1067.3755852826107, 12346.753064938652, 12443.440045197987, 12468.937655311665, 12489.063320250927, 12495.062870284764, 4853.708777473363, 4912.95087049125, 5051.898962020812, 5064.164412871834, 5122.257272695439, 10335.379877207391, 10370.481475926174, 10377.688669339932, 10382.169426445866, 10390.584376625002, 5563.554915606742, 5576.079946808731, 5578.8047418340975, 5601.187827764951, 5603.747831347518, 4947.282644016669, 5108.540231379194, 5154.690718556899, 5168.560672342818, 5263.0, 3886.805659717003, 3908.413737939332, 4007.779572123561, 4012.498437695288, 4080.4083407906282, 1153.2676750263474, 1163.2322667039882, 1169.6607983684637, 1171.701216189866, 1187.7268228307364, 858.8754630578657, 918.4535201555065, 927.174814415171, 938.1462868789368, 947.2800671489717, 5712.485876271156, 5847.8245652630485, 5869.2956845178, 5880.235569375954, 6201.131841542187, 950.805084957582, 977.5503268496429, 991.2912267728465, 1004.2217281606668, 1032.6024480575034, 3704.722145839019, 3767.773933563995, 3793.2223894101644, 3801.239752049601, 3853.113783829735, 10756.515956781963, 11023.06303964156, 11126.276792008493, 11142.777144457228, 11178.832317515244, 10830.620928267474, 10972.725681857857, 11027.779444411068, 11031.338119712844, 11053.557857685602, 7896.802579935547, 8379.83240335202, 8542.231199191978, 8564.657413703506, 8602.612882420306, 5469.835904922858, 5750.913736294043, 5885.793997210077, 5957.076653118774, 5988.520918326611, 9626.518674066128, 10265.076143147153, 10266.486675666038, 10297.691069267934, 10336.638217662347, 10073.395596264247, 10169.135623472088, 10183.0, 10336.586536538454, 10371.429571373646, 7489.513181643176, 7628.8855667163925, 7673.961630191813, 7681.961590192013, 7718.266764657348, 8529.360297977553, 8571.528565928933, 8602.655893764178, 8631.309495240492, 8636.395452318277, 7465.328120469184, 7624.504407213513, 7794.961025194838, 7852.1755215703815, 8100.83798324042, 7437.8140546486775, 7445.516041457288, 7525.285097915689, 7538.0, 7630.961845190738, 6860.279670634512, 6870.141232345957, 6911.89632155508, 6954.79135625932, 6992.860142797217, 4864.756762161948, 4907.460179380194, 4924.729139897197, 4979.128652485728, 5085.796568137381, 4778.402699662543, 4826.276058591099, 4865.756712164449, 4881.658283920234, 4953.281774142802], "value": 4670.592842597109, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [340.97954122752634, 343.54823407219504, 356.48487934934025, 357.59234472701144, 366.7597723491111, 5427.728613569326, 5570.749316280767, 5675.574331925107, 5683.261176047114, 5702.401247868971, 5400.891982160354, 5497.285352904127, 5585.609007369476, 5605.691686957216, 5648.915266271009, 4410.338449232617, 4429.737524805415, 4433.423654924855, 4437.733735975836, 4441.844535441261, 4190.2248084104385, 4352.347147927804, 4405.140997505488, 4427.911441771163, 4484.349769283452, 4330.307150855863, 4334.869953901388, 4346.15250026245, 4351.978240108795, 4369.300911854104, 4354.368616550598, 4357.694961352722, 4358.193734159191, 4366.6026871400845, 4371.300591905312, 3799.3920972644246, 3839.884803455901, 3857.1514266861245, 3857.5756666766633, 3898.9256227242317, 5430.864228394283, 5448.346198456171, 5476.397596264408, 5479.643823151482, 5483.479069488392, 4979.30289759434, 4981.72600506972, 4988.7505624718615, 5005.299258103868, 5014.122528557525, 5729.169270455803, 5827.679477628729, 5860.0, 5862.296524417055, 5880.4119588041285, 4192.434021407102, 4193.20329137466, 4198.412222288882, 4230.555791641864, 4246.7027308088445, 6155.692215389257, 6186.474149697281, 6196.81409557714, 6209.192804935375, 6221.96889015552, 4204.969782403331, 4278.251306021434, 4301.505326887385, 4304.956950430455, 4316.43886294786, 4338.327559228262, 4352.0, 4369.737815731003, 4371.453568303962, 4386.495553011445, 4984.601231901439, 4992.975035124874, 5008.749562521859, 5022.84931452057, 5037.974810125999, 5667.659940403589, 5769.307683078057, 5911.881762364815, 5992.730327135202, 6003.309619393738, 1432.3912337256625, 1453.3024148408822, 1462.6855226126434, 1466.2961778346453, 1470.7499725046769, 955.1737746849064, 980.2452111873818, 995.3530205366569, 1009.485162567096, 1011.1607365886297, 5515.310586176728, 5523.7790488380815, 5526.723663816793, 5529.751161197756, 5548.472895074961, 5785.326317788151, 5797.275340582427, 5827.708614569255, 5828.6794226317115, 5867.677277749679, 5454.7818087276855, 5553.4724201200825, 5558.833235002957, 5707.914381284284, 5764.625299355528, 3090.242890491799, 3122.6877312269044, 3152.716255537013, 3165.3036332006923, 3175.142711467891, 6005.399460054047, 6072.696365181723, 6104.8779024420155, 6105.694715264219, 6124.571280010446, 6172.012478003498, 6180.721867515973, 6188.4739797117745, 6230.345813689588, 6255.437010669061, 6221.3778622138325, 6227.532935029891, 6230.937690623126, 6288.685565721696, 6356.809295721136, 5966.522678185822, 6006.909896351645, 6032.4570788629235, 6047.140938525082, 6095.695215239131, 6025.126356678345, 6036.939630603813, 6059.969700151471, 6081.331053584014, 6096.451319381277, 6137.588354678538, 6244.906326405016, 6298.779542715983, 6315.5894866833505, 6381.3937675920715, 4367.192069467159, 4389.0, 4410.977945110254, 4414.624756895571, 4450.376947227326, 5860.912086318794, 6023.3073196582955, 6117.296510901303, 6145.6927153641245, 6156.661383623944, 5824.767009319749, 5915.467607915309, 5950.553708471795, 5955.106733989936, 5986.311574169026, 5924.0, 5927.31835838884, 5937.614055086406, 5940.940590594038, 5946.405359464019, 5614.466625670555, 5862.296524417097, 5865.706714664335, 5879.353271140086, 5892.882142357043, 5964.31410387811, 5965.224520812267, 5976.133460648269, 5987.670678112746, 6000.939990600213, 5640.71796410186, 5801.477866991991, 5825.650460972355, 5834.562407819346, 5836.241288632451], "value": 4488.2935685405255, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [766.3792328214143, 768.3469051306387, 803.5259197073725, 821.6343727041466, 824.6536454689032, 14255.714885702293, 14819.18494482803, 15224.923875380622, 15229.238538073094, 15380.077195368258, 14621.853781462181, 14943.85056149441, 14967.775483367759, 14985.475508357209, 15005.474808381708, 720.8342081321299, 745.8732015557341, 826.3636999510373, 854.811941372897, 863.5380071661663, 857.4169564696004, 865.1867244789909, 865.709987154301, 869.9130086991313, 871.5119533061505, 912.6075787411411, 912.9360944733871, 913.6071489259616, 914.4696076275744, 914.6798620482845, 916.7524768312585, 917.564157025411, 917.5733284022962, 921.6635927886273, 922.3082687984012, 669.8894682377402, 672.993270067298, 674.7402250133684, 676.9187697476334, 676.9661516924183, 14248.358823852952, 14553.0, 14578.343974521173, 14607.196604186765, 14648.267586620734, 14478.203698796668, 15099.698006039927, 15152.696946061127, 15154.166520841349, 15168.393264269416, 11557.364344961024, 11801.114916381306, 11838.46726897283, 11848.466818993165, 11849.40752962357, 3839.8464061437508, 3840.1551658635058, 3850.3646898261754, 3852.8844134676006, 3941.743786653887, 53634.0, 53851.730741346044, 56789.148162777594, 59177.0, 65524.0, 11013.449327533592, 11425.60010399632, 11473.139514536277, 11583.0, 11731.530738770523, 18804.247830086642, 19130.0, 20982.895085524473, 21193.152273908872, 21202.15191392358, 8314.875276870851, 8318.542480163649, 8385.580720963928, 8439.70461033861, 8550.657973681107, 4723.244280915037, 4751.714897106184, 4792.520747925179, 4876.146674331978, 5000.89998200034, 3466.930661386758, 3579.731520136, 3584.6415358463946, 3596.7122630189524, 3611.1694310308776, 637.6269882119012, 644.5455953552735, 645.4997377032837, 651.2445563146726, 660.2736989311815, 697.4524997876744, 738.564247094217, 758.5714071549556, 768.4313607930203, 782.1318336646318, 7474.364679002346, 7647.579383133981, 7857.882131768028, 7984.041914970125, 8067.556284404297, 685.239384283445, 731.7841236835146, 745.6756311004731, 778.283978739561, 798.0622768247403, 3767.208886133888, 3852.8073596320073, 3941.763494190358, 4057.9797101014306, 4082.2039702258367, 48953.755231223615, 62574.68712656499, 71828.0, 92975.0, 98784.0, 27488.58767118495, 27805.443891122064, 52894.0, 72152.63923680453, 72556.27443725601, 45827.77086114548, 50128.49871501311, 65666.34333656602, 66922.0, 67348.0, 8080.515169089874, 8421.789455263668, 8501.829963400574, 8538.78653033679, 8554.358423118167, 39010.0, 41038.17923641451, 41552.37671434991, 41909.58090419057, 44845.32732009088, 41095.589044109176, 41456.0, 43718.78140609276, 60835.0, 62034.37965620466, 11871.703207419883, 11927.701807454883, 11935.641930742091, 11937.16439849237, 12525.248485090924, 13497.730045398841, 13641.522546711214, 13655.385507651981, 13794.93102534481, 13815.240161791198, 12205.755884882075, 12411.565595204125, 12681.8097728536, 12793.42429590652, 12928.03039772002, 11937.761244775229, 12088.15382923222, 12189.329586872807, 12743.171693839871, 13004.414801334153, 12185.0, 12408.62774116778, 12975.221486710827, 13002.739945200854, 13096.672583185496, 9711.465869377253, 10048.0, 10091.444970526398, 10328.741781455523, 10789.838152427563, 9834.0331933615, 10048.949755251177, 10138.89861101409, 10220.28458007962, 10237.48812559384], "value": 6946.334260306582, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1469.7999999999997, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 112.0, 112.0, 113.0, 111.0, 115.0, 111.0, 111.0, 111.0], "value": 111.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 121.0, 123.0, 162.0, 124.0, 122.0, 123.0, 122.0, 150.0, 121.0], "value": 131.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 166.0, 162.0, 161.0, 161.0, 161.0, 165.0, 163.0, 162.0], "value": 162.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 75.0, 115.0, 76.0, 75.0, 75.0, 75.0, 112.0, 75.0], "value": 82.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 81.0, 114.0, 83.0, 83.0, 82.0, 93.0, 82.0, 82.0, 103.0], "value": 88.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 117.0, 117.0, 118.0, 116.0, 117.0, 116.0, 117.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 148.0, 147.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 147.0], "value": 147.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 86.0, 86.0, 87.0, 85.0, 85.0, 85.0, 87.0, 85.0, 85.0], "value": 85.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 53.0, 55.0, 54.0, 57.0, 55.0, 54.0, 54.0, 58.0], "value": 54.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 60.0, 59.0, 59.0, 59.0, 59.0, 59.0, 60.0, 59.0, 60.0], "value": 59.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 74.0, 74.0, 74.0, 76.0, 79.0, 78.0, 81.0], "value": 76.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 140.0, 137.0, 131.0, 130.0, 121.0, 124.0, 127.0, 170.0, 123.0], "value": 132.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 159.0, 159.0, 162.0, 156.0, 154.0, 158.0, 161.0, 152.0, 155.0], "value": 157.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 63.0, 69.0, 62.0, 62.0, 62.0, 62.0, 62.0, 64.0, 60.0], "value": 63.1, "unit": "score"}]}]} 18:10:55 INFO - Return code: 0 18:10:55 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 18:10:55 ERROR - # TBPL SUCCESS # 18:10:55 INFO - Running post-action listener: _resource_record_post_action 18:10:55 INFO - [mozharness: 2017-02-24 02:10:55.439704Z] Finished run-tests step (success) 18:10:55 INFO - Running post-run listener: _resource_record_post_run 18:10:55 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 16384; Write bytes: 329854976; Read time: 336; Write time: 205216 18:10:55 INFO - TinderboxPrint: CPU usage
13.2% 18:10:55 INFO - TinderboxPrint: I/O read bytes / time
16,384 / 336 18:10:55 INFO - TinderboxPrint: I/O write bytes / time
329,854,976 / 205,216 18:10:55 INFO - TinderboxPrint: CPU idle
8,232.8 (86.8%) 18:10:55 INFO - TinderboxPrint: CPU user
1,202.3 (12.7%) 18:10:55 INFO - TinderboxPrint: Swap in / out
0 / 0 18:10:55 INFO - install - Wall time: 14s; CPU: 13.0%; Read bytes: 0; Write bytes: 112398336; Read time: 0; Write time: 93332 18:10:55 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 16384; Write bytes: 217456640; Read time: 336; Write time: 111884 18:10:56 INFO - Running post-run listener: _upload_blobber_files 18:10:56 INFO - Blob upload gear active. 18:10:56 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:10:56 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 18:10:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:10:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:10:56 INFO - (blobuploader) - INFO - Open directory for files ... 18:10:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:10:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:10:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:10:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:10:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:10:57 INFO - (blobuploader) - INFO - Done attempting. 18:10:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 18:10:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:10:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:11:00 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 18:11:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:11:00 INFO - (blobuploader) - INFO - Done attempting. 18:11:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:11:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:11:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:11:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:11:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:11:01 INFO - (blobuploader) - INFO - Done attempting. 18:11:01 INFO - (blobuploader) - INFO - Iteration through files over. 18:11:01 INFO - Return code: 0 18:11:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:11:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:11:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/19b7b32d1a4029e6c2ac15b105865ce4cab37fd05344df5b2a5dbc6e55f71d5194f3fd5ba0cff4709e9685931097b306c7f2ef5a40bd2161553c0f4c1269e93a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/86ed331c6104a8396b56a73f8674e713ecbe26c7153acefd1c54605a942192f7a68ed569b6b71915cb2a71dd71a12ec5af02e4c24e75f0c261275f20dfb1c7c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/7f2a4f4cf29d387f0406cea39dfcccad452c3ebc3c28f5583f4f5825049dc39ecfb292cade2e6a8eeb91567fb1e91588ca827f37911dcc28e59008f09986852f"} 18:11:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:11:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:11:01 INFO - Contents: 18:11:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/19b7b32d1a4029e6c2ac15b105865ce4cab37fd05344df5b2a5dbc6e55f71d5194f3fd5ba0cff4709e9685931097b306c7f2ef5a40bd2161553c0f4c1269e93a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/86ed331c6104a8396b56a73f8674e713ecbe26c7153acefd1c54605a942192f7a68ed569b6b71915cb2a71dd71a12ec5af02e4c24e75f0c261275f20dfb1c7c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/7f2a4f4cf29d387f0406cea39dfcccad452c3ebc3c28f5583f4f5825049dc39ecfb292cade2e6a8eeb91567fb1e91588ca827f37911dcc28e59008f09986852f"} 18:11:01 INFO - Running post-run listener: copy_logs_to_upload_dir 18:11:01 INFO - Copying logs to upload dir... 18:11:01 INFO - mkdir: /builds/slave/test/build/upload/logs 18:11:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1232.450911 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 32 secs) (at 2017-02-23 18:11:01.546331) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-23 18:11:01.549571) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/19b7b32d1a4029e6c2ac15b105865ce4cab37fd05344df5b2a5dbc6e55f71d5194f3fd5ba0cff4709e9685931097b306c7f2ef5a40bd2161553c0f4c1269e93a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/86ed331c6104a8396b56a73f8674e713ecbe26c7153acefd1c54605a942192f7a68ed569b6b71915cb2a71dd71a12ec5af02e4c24e75f0c261275f20dfb1c7c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/7f2a4f4cf29d387f0406cea39dfcccad452c3ebc3c28f5583f4f5825049dc39ecfb292cade2e6a8eeb91567fb1e91588ca827f37911dcc28e59008f09986852f"} build_url:https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011464 build_url: 'https://queue.taskcluster.net/v1/task/ZjLYWMuvTbiRSNDJ8hLfrA/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/19b7b32d1a4029e6c2ac15b105865ce4cab37fd05344df5b2a5dbc6e55f71d5194f3fd5ba0cff4709e9685931097b306c7f2ef5a40bd2161553c0f4c1269e93a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/86ed331c6104a8396b56a73f8674e713ecbe26c7153acefd1c54605a942192f7a68ed569b6b71915cb2a71dd71a12ec5af02e4c24e75f0c261275f20dfb1c7c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/7f2a4f4cf29d387f0406cea39dfcccad452c3ebc3c28f5583f4f5825049dc39ecfb292cade2e6a8eeb91567fb1e91588ca827f37911dcc28e59008f09986852f"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-23 18:11:01.574212) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 18:11:01.574529) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1487900891.525357-1311259561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004572 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-23 18:11:01.658979) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-23 18:11:01.659305) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-23 18:11:01.659654) ========= ========= Total master_lag: 0.16 =========