builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-049 starttime: 1494257105.34 results: success (0) revision: 38f862749aed4e9a874182a9019e0671289088b0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.343192) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.343634) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.343924) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.486059) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.486345) ========= 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=db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-08 08:25:06-- 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% 25.1M=0s 2017-05-08 08:25:06 (25.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.132813 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.681818) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.682131) ========= 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=db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021375 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.735806) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:05.736137) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 38f862749aed4e9a874182a9019e0671289088b0 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 38f862749aed4e9a874182a9019e0671289088b0 --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=db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-08 08:25:06,823 truncating revision to first 12 chars 2017-05-08 08:25:06,823 Setting DEBUG logging. 2017-05-08 08:25:06,823 attempt 1/10 2017-05-08 08:25:06,823 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/38f862749aed?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-08 08:25:07,188 unpacking tar archive at: mozilla-central-38f862749aed/testing/mozharness/ program finished with exit code 0 elapsedTime=0.771453 ========= master_lag: 0.16 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:06.672188) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:06.672487) ========= script_repo_revision: 38f862749aed4e9a874182a9019e0671289088b0 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:06.672851) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:06.677149) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-08 08:25:06.699656) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-05-08 08:25:06.699960) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 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', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] 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=db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:25:07 INFO - MultiFileLogger online at 20170508 08:25:07 in /builds/slave/test 08:25:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 08:25:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:25:07 INFO - {'append_to_log': False, 08:25:07 INFO - 'base_work_dir': '/builds/slave/test', 08:25:07 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 08:25:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:25:07 INFO - 'branch': 'Firefox-Non-PGO', 08:25:07 INFO - 'buildbot_json_path': 'buildprops.json', 08:25:07 INFO - 'config_files': ('talos/linux_config.py',), 08:25:07 INFO - 'default_actions': ('clobber', 08:25:07 INFO - 'read-buildbot-config', 08:25:07 INFO - 'download-and-extract', 08:25:07 INFO - 'populate-webroot', 08:25:07 INFO - 'create-virtualenv', 08:25:07 INFO - 'install', 08:25:07 INFO - 'run-tests'), 08:25:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:25:07 INFO - 'download_minidump_stackwalk': True, 08:25:07 INFO - 'download_symbols': 'ondemand', 08:25:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:25:07 INFO - 'tooltool.py': '/tools/tooltool.py', 08:25:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:25:07 INFO - '/tools/misc-python/virtualenv.py')}, 08:25:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:25:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:25:07 INFO - 'gecko_profile': False, 08:25:07 INFO - 'gecko_profile_interval': 0, 08:25:07 INFO - 'installer_path': 'installer.exe', 08:25:07 INFO - 'log_level': 'info', 08:25:07 INFO - 'log_name': 'talos', 08:25:07 INFO - 'log_to_console': True, 08:25:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:25:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:25:07 INFO - 'opt_config_files': (), 08:25:07 INFO - 'pip_index': False, 08:25:07 INFO - 'suite': 'dromaeojs-e10s', 08:25:07 INFO - 'system_bits': '32', 08:25:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:25:07 INFO - 'title': 'talos-linux64-ix-049', 08:25:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:25:07 INFO - 'use_talos_json': True, 08:25:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:25:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:25:07 INFO - 'work_dir': 'build'} 08:25:07 INFO - [mozharness: 2017-05-08 15:25:07.875834Z] Running clobber step. 08:25:07 INFO - Running pre-action listener: _resource_record_pre_action 08:25:07 INFO - Running main action method: clobber 08:25:07 INFO - rmtree: /builds/slave/test/build 08:25:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:25:09 INFO - Running post-action listener: _resource_record_post_action 08:25:09 INFO - [mozharness: 2017-05-08 15:25:09.332324Z] Finished clobber step (success) 08:25:09 INFO - [mozharness: 2017-05-08 15:25:09.332422Z] Running read-buildbot-config step. 08:25:09 INFO - Running pre-action listener: _resource_record_pre_action 08:25:09 INFO - Running main action method: read_buildbot_config 08:25:09 INFO - Using buildbot properties: 08:25:09 INFO - { 08:25:09 INFO - "project": "", 08:25:09 INFO - "product": "firefox", 08:25:09 INFO - "who": "ffxbld@noreply.mozilla.org", 08:25:09 INFO - "installer_path": "public/build/target.tar.bz2", 08:25:09 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 08:25:09 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 08:25:09 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 08:25:09 INFO - "stage_platform": "linux64", 08:25:09 INFO - "basedir": "/builds/slave/test", 08:25:09 INFO - "buildnumber": 816, 08:25:09 INFO - "platform": "ubuntu64_hw", 08:25:09 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 08:25:09 INFO - "slavebuilddir": "test", 08:25:09 INFO - "taskId": "WTtOFv6VROKHC1wJ37wIWA", 08:25:09 INFO - "branch": "mozilla-central", 08:25:09 INFO - "script_repo_revision": "production", 08:25:09 INFO - "revision": "38f862749aed4e9a874182a9019e0671289088b0", 08:25:09 INFO - "slavename": "talos-linux64-ix-049", 08:25:09 INFO - "repo_path": "mozilla-central" 08:25:09 INFO - } 08:25:09 INFO - Finding installer, test and symbols from parent task. 08:25:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WTtOFv6VROKHC1wJ37wIWA'}, attempt #1 08:25:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WTtOFv6VROKHC1wJ37wIWA'}, attempt #1 08:25:10 INFO - Task dependencies: Oe226z5xTsiEQ3kFoQ55xw 08:25:10 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw'}, attempt #1 08:25:10 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2 08:25:10 INFO - Set test_url: https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/test_packages.json 08:25:10 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.crashreporter-symbols.zip 08:25:10 INFO - Running post-action listener: _resource_record_post_action 08:25:10 INFO - [mozharness: 2017-05-08 15:25:10.711756Z] Finished read-buildbot-config step (success) 08:25:10 INFO - [mozharness: 2017-05-08 15:25:10.711972Z] Running download-and-extract step. 08:25:10 INFO - Running pre-action listener: _resource_record_pre_action 08:25:10 INFO - Running main action method: download_and_extract 08:25:10 INFO - mkdir: /builds/slave/test/build/tests 08:25:10 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')]} 08:25:10 INFO - trying https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.test_packages.json 08:25:10 INFO - Downloading https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:25:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:25:11 INFO - Downloaded 986 bytes. 08:25:11 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:25:11 INFO - Using the following test package requirements: 08:25:11 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 08:25:11 INFO - u'common': [u'target.common.tests.zip'], 08:25:11 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:25:11 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:25:11 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:25:11 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:25:11 INFO - u'mozbase': [u'target.common.tests.zip'], 08:25:11 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:25:11 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:25:11 INFO - u'web-platform': [u'target.common.tests.zip', 08:25:11 INFO - u'target.web-platform.tests.zip'], 08:25:11 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:25:11 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 08:25:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.common.tests.zip 08:25:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:25:11 INFO - Fetch https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.common.tests.zip into memory 08:25:13 INFO - Content-Length response header: 58440921 08:25:13 INFO - Bytes received: 58440921 08:25:23 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 08:25:23 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.common.tests.zip 08:25:23 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:25:23 INFO - Fetch https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.common.tests.zip into memory 08:25:25 INFO - Content-Length response header: 58440921 08:25:25 INFO - Bytes received: 58440921 08:25:36 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.talos.tests.zip 08:25:36 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:25:36 INFO - Fetch https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.talos.tests.zip into memory 08:25:37 INFO - Content-Length response header: 14409362 08:25:37 INFO - Bytes received: 14409362 08:25:37 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')]} 08:25:37 INFO - trying https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2 08:25:37 INFO - Downloading https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:25:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:25:40 INFO - Downloaded 58345439 bytes. 08:25:40 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2 08:25:40 INFO - mkdir: /builds/slave/test/properties 08:25:40 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:25:40 INFO - Writing to file /builds/slave/test/properties/build_url 08:25:40 INFO - Contents: 08:25:40 INFO - build_url:https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2 08:25:40 INFO - Running post-action listener: _resource_record_post_action 08:25:40 INFO - Running post-action listener: set_extra_try_arguments 08:25:40 INFO - [mozharness: 2017-05-08 15:25:40.809346Z] Finished download-and-extract step (success) 08:25:40 INFO - [mozharness: 2017-05-08 15:25:40.809443Z] Running populate-webroot step. 08:25:40 INFO - Running pre-action listener: _resource_record_pre_action 08:25:40 INFO - Running main action method: populate_webroot 08:25:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:25:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:25:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:25:40 INFO - '--tppagecycles', 08:25:40 INFO - '7'], 08:25:40 INFO - 'tests': ['tsvgm']}}, 08:25:40 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:25:40 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:25:40 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:25:40 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:25:40 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:25:40 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:25:40 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['damp', 'tps']}, 08:25:40 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'tests': ['damp', 'tps']}, 08:25:40 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['dromaeo_dom']}, 08:25:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:25:40 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 08:25:40 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 08:25:40 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['a11yr', 08:25:40 INFO - 'ts_paint', 08:25:40 INFO - 'tpaint', 08:25:40 INFO - 'sessionrestore', 08:25:40 INFO - 'sessionrestore_no_auto_restore', 08:25:40 INFO - 'tabpaint']}, 08:25:40 INFO - 'other-e10s': {'tests': ['a11yr', 08:25:40 INFO - 'ts_paint', 08:25:40 INFO - 'tpaint', 08:25:40 INFO - 'sessionrestore', 08:25:40 INFO - 'sessionrestore_no_auto_restore', 08:25:40 INFO - 'tabpaint']}, 08:25:40 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:25:40 INFO - 'ts_paint', 08:25:40 INFO - 'tpaint', 08:25:40 INFO - 'sessionrestore', 08:25:40 INFO - 'sessionrestore_no_auto_restore', 08:25:40 INFO - 'tabpaint']}, 08:25:40 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:25:40 INFO - 'ts_paint', 08:25:40 INFO - 'tpaint', 08:25:40 INFO - 'sessionrestore', 08:25:40 INFO - 'sessionrestore_no_auto_restore', 08:25:40 INFO - 'tabpaint']}, 08:25:40 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['a11yr', 08:25:40 INFO - 'ts_paint', 08:25:40 INFO - 'tpaint', 08:25:40 INFO - 'sessionrestore', 08:25:40 INFO - 'sessionrestore_no_auto_restore', 08:25:40 INFO - 'tabpaint']}, 08:25:40 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['a11yr', 08:25:40 INFO - 'ts_paint', 08:25:40 INFO - 'tpaint', 08:25:40 INFO - 'sessionrestore', 08:25:40 INFO - 'sessionrestore_no_auto_restore', 08:25:40 INFO - 'tabpaint']}, 08:25:40 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 08:25:40 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 08:25:40 INFO - 'bloom_basic_ref']}, 08:25:40 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['tsvgx', 08:25:40 INFO - 'tsvgr_opacity', 08:25:40 INFO - 'tart', 08:25:40 INFO - 'tscrollx', 08:25:40 INFO - 'cart', 08:25:40 INFO - 'tsvg_static']}, 08:25:40 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:25:40 INFO - 'tsvgr_opacity', 08:25:40 INFO - 'tart', 08:25:40 INFO - 'tscrollx', 08:25:40 INFO - 'cart', 08:25:40 INFO - 'tsvg_static']}, 08:25:40 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'talos_options': ['--disable-e10s'], 08:25:40 INFO - 'tests': ['tp5o']}, 08:25:40 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:25:40 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'talos_options': ['--disable-e10s', 08:25:40 INFO - '--xperf_path', 08:25:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:25:40 INFO - 'tests': ['tp5n']}, 08:25:40 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:25:40 INFO - 'talos_options': ['--xperf_path', 08:25:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:25:40 INFO - 'tests': ['tp5n']}}, 08:25:40 INFO - 'talos.zip': {'path': '', 08:25:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:25:40 INFO - Running post-action listener: _resource_record_post_action 08:25:40 INFO - [mozharness: 2017-05-08 15:25:40.823042Z] Finished populate-webroot step (success) 08:25:40 INFO - [mozharness: 2017-05-08 15:25:40.823130Z] Running create-virtualenv step. 08:25:40 INFO - Running pre-action listener: _resource_record_pre_action 08:25:40 INFO - Running main action method: create_virtualenv 08:25:40 INFO - Creating virtualenv /builds/slave/test/build/venv 08:25:40 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 08:25:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:25:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:25:40 INFO - Using real prefix '/usr' 08:25:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:25:41 INFO - Installing distribute.............................................................................................................................................................................................done. 08:25:43 INFO - Installing pip.................done. 08:25:43 INFO - Return code: 0 08:25:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:25:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:25:43 INFO - Reading from file tmpfile_stdout 08:25:43 INFO - Output received: 08:25:43 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) 08:25:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:25:43 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')]} 08:25:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:43 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')]} 08:25:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:43 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:43 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 08:25:43 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 08:25:43 INFO - Using env: {'DISPLAY': ':0', 08:25:43 INFO - 'HOME': '/home/cltbld', 08:25:43 INFO - 'LANG': 'en_US.UTF-8', 08:25:43 INFO - 'LANGUAGE': 'en_US:en', 08:25:43 INFO - 'LOGNAME': 'cltbld', 08:25:43 INFO - 'MAIL': '/var/mail/cltbld', 08:25:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:43 INFO - 'MOZ_NO_REMOTE': '1', 08:25:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:43 INFO - 'NO_EM_RESTART': '1', 08:25:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:43 INFO - 'PWD': '/builds/slave/test', 08:25:43 INFO - 'SHELL': '/bin/bash', 08:25:43 INFO - 'SHLVL': '1', 08:25:43 INFO - 'TERM': 'linux', 08:25:43 INFO - 'TMOUT': '86400', 08:25:43 INFO - 'USER': 'cltbld', 08:25:43 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:43 INFO - '_': '/tools/buildbot/bin/python'} 08:25:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:43 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 08:25:43 INFO - Cleaning up... 08:25:43 INFO - Return code: 0 08:25:43 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:25:43 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')]} 08:25:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:43 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')]} 08:25:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:43 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:43 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 08:25:43 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 08:25:43 INFO - Using env: {'DISPLAY': ':0', 08:25:43 INFO - 'HOME': '/home/cltbld', 08:25:43 INFO - 'LANG': 'en_US.UTF-8', 08:25:43 INFO - 'LANGUAGE': 'en_US:en', 08:25:43 INFO - 'LOGNAME': 'cltbld', 08:25:43 INFO - 'MAIL': '/var/mail/cltbld', 08:25:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:43 INFO - 'MOZ_NO_REMOTE': '1', 08:25:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:43 INFO - 'NO_EM_RESTART': '1', 08:25:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:43 INFO - 'PWD': '/builds/slave/test', 08:25:43 INFO - 'SHELL': '/bin/bash', 08:25:43 INFO - 'SHLVL': '1', 08:25:43 INFO - 'TERM': 'linux', 08:25:43 INFO - 'TMOUT': '86400', 08:25:43 INFO - 'USER': 'cltbld', 08:25:43 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:43 INFO - '_': '/tools/buildbot/bin/python'} 08:25:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:44 INFO - Downloading/unpacking psutil>=3.1.1 08:25:44 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 08:25:44 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 08:25:44 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 08:25:44 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 08:25:44 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 08:25:44 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 08:25:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:25:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:25:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:25:45 INFO - Installing collected packages: psutil 08:25:45 INFO - Running setup.py install for psutil 08:25:45 INFO - building 'psutil._psutil_linux' extension 08:25:45 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 08:25:45 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 08:25:45 INFO - building 'psutil._psutil_posix' extension 08:25:45 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 08:25:45 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 08:25:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:25:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:25:45 INFO - Successfully installed psutil 08:25:45 INFO - Cleaning up... 08:25:45 INFO - Return code: 0 08:25:45 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:25:45 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')]} 08:25:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:45 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')]} 08:25:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:45 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:45 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 08:25:45 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 08:25:45 INFO - Using env: {'DISPLAY': ':0', 08:25:45 INFO - 'HOME': '/home/cltbld', 08:25:45 INFO - 'LANG': 'en_US.UTF-8', 08:25:45 INFO - 'LANGUAGE': 'en_US:en', 08:25:45 INFO - 'LOGNAME': 'cltbld', 08:25:45 INFO - 'MAIL': '/var/mail/cltbld', 08:25:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:45 INFO - 'MOZ_NO_REMOTE': '1', 08:25:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:45 INFO - 'NO_EM_RESTART': '1', 08:25:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:45 INFO - 'PWD': '/builds/slave/test', 08:25:45 INFO - 'SHELL': '/bin/bash', 08:25:45 INFO - 'SHLVL': '1', 08:25:45 INFO - 'TERM': 'linux', 08:25:45 INFO - 'TMOUT': '86400', 08:25:45 INFO - 'USER': 'cltbld', 08:25:45 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:45 INFO - '_': '/tools/buildbot/bin/python'} 08:25:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:46 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25:47 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:25:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:25:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:25:47 INFO - Installing collected packages: mozsystemmonitor 08:25:47 INFO - Running setup.py install for mozsystemmonitor 08:25:47 INFO - Successfully installed mozsystemmonitor 08:25:47 INFO - Cleaning up... 08:25:47 INFO - Return code: 0 08:25:47 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:25:47 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')]} 08:25:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:47 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')]} 08:25:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:47 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:47 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 08:25:47 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 08:25:47 INFO - Using env: {'DISPLAY': ':0', 08:25:47 INFO - 'HOME': '/home/cltbld', 08:25:47 INFO - 'LANG': 'en_US.UTF-8', 08:25:47 INFO - 'LANGUAGE': 'en_US:en', 08:25:47 INFO - 'LOGNAME': 'cltbld', 08:25:47 INFO - 'MAIL': '/var/mail/cltbld', 08:25:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:47 INFO - 'MOZ_NO_REMOTE': '1', 08:25:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:47 INFO - 'NO_EM_RESTART': '1', 08:25:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:47 INFO - 'PWD': '/builds/slave/test', 08:25:47 INFO - 'SHELL': '/bin/bash', 08:25:47 INFO - 'SHLVL': '1', 08:25:47 INFO - 'TERM': 'linux', 08:25:47 INFO - 'TMOUT': '86400', 08:25:47 INFO - 'USER': 'cltbld', 08:25:47 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:47 INFO - '_': '/tools/buildbot/bin/python'} 08:25:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:47 INFO - Downloading/unpacking jsonschema==2.5.1 08:25:47 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 08:25:47 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 08:25:47 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 08:25:47 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 08:25:47 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 08:25:47 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 08:25:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:25:48 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:25:48 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 08:25:48 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 08:25:48 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 08:25:48 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 08:25:48 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 08:25:48 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 08:25:48 INFO - Downloading functools32-3.2.3-2.tar.gz 08:25:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:25:48 INFO - warning: no files found matching '*.txt' 08:25:48 INFO - no previously-included directories found matching 'build' 08:25:48 INFO - no previously-included directories found matching 'dist' 08:25:48 INFO - no previously-included directories found matching '.git*' 08:25:48 INFO - Installing collected packages: jsonschema, functools32 08:25:48 INFO - Running setup.py install for functools32 08:25:48 INFO - warning: no files found matching '*.txt' 08:25:48 INFO - no previously-included directories found matching 'build' 08:25:48 INFO - no previously-included directories found matching 'dist' 08:25:48 INFO - no previously-included directories found matching '.git*' 08:25:48 INFO - Successfully installed jsonschema functools32 08:25:48 INFO - Cleaning up... 08:25:49 INFO - Return code: 0 08:25:49 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:25: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')]} 08:25:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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')]} 08:25:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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', '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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:25: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 functools32==3.2.3-2 08:25:49 INFO - Using env: {'DISPLAY': ':0', 08:25:49 INFO - 'HOME': '/home/cltbld', 08:25:49 INFO - 'LANG': 'en_US.UTF-8', 08:25:49 INFO - 'LANGUAGE': 'en_US:en', 08:25:49 INFO - 'LOGNAME': 'cltbld', 08:25:49 INFO - 'MAIL': '/var/mail/cltbld', 08:25:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:49 INFO - 'MOZ_NO_REMOTE': '1', 08:25:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:49 INFO - 'NO_EM_RESTART': '1', 08:25:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:49 INFO - 'PWD': '/builds/slave/test', 08:25:49 INFO - 'SHELL': '/bin/bash', 08:25:49 INFO - 'SHLVL': '1', 08:25:49 INFO - 'TERM': 'linux', 08:25:49 INFO - 'TMOUT': '86400', 08:25:49 INFO - 'USER': 'cltbld', 08:25:49 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:49 INFO - '_': '/tools/buildbot/bin/python'} 08:25:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:49 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:25:49 INFO - Cleaning up... 08:25:49 INFO - Return code: 0 08:25:49 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:25: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')]} 08:25:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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')]} 08:25:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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', '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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:25: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 blobuploader==1.2.4 08:25:49 INFO - Using env: {'DISPLAY': ':0', 08:25:49 INFO - 'HOME': '/home/cltbld', 08:25:49 INFO - 'LANG': 'en_US.UTF-8', 08:25:49 INFO - 'LANGUAGE': 'en_US:en', 08:25:49 INFO - 'LOGNAME': 'cltbld', 08:25:49 INFO - 'MAIL': '/var/mail/cltbld', 08:25:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:49 INFO - 'MOZ_NO_REMOTE': '1', 08:25:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:49 INFO - 'NO_EM_RESTART': '1', 08:25:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:49 INFO - 'PWD': '/builds/slave/test', 08:25:49 INFO - 'SHELL': '/bin/bash', 08:25:49 INFO - 'SHLVL': '1', 08:25:49 INFO - 'TERM': 'linux', 08:25:49 INFO - 'TMOUT': '86400', 08:25:49 INFO - 'USER': 'cltbld', 08:25:49 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:49 INFO - '_': '/tools/buildbot/bin/python'} 08:25:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:49 INFO - Downloading/unpacking blobuploader==1.2.4 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25:50 INFO - Downloading blobuploader-1.2.4.tar.gz 08:25:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:25:50 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:25:50 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 08:25:50 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 08:25:50 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 08:25:50 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 08:25:50 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 08:25:50 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 08:25:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:25:51 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25:51 INFO - Downloading docopt-0.6.1.tar.gz 08:25:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:25:51 INFO - Installing collected packages: blobuploader, requests, docopt 08:25:51 INFO - Running setup.py install for blobuploader 08:25:51 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:25:51 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:25:51 INFO - Running setup.py install for requests 08:25:51 INFO - Running setup.py install for docopt 08:25:51 INFO - Successfully installed blobuploader requests docopt 08:25:51 INFO - Cleaning up... 08:25:51 INFO - Return code: 0 08:25:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:25: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')]} 08:25:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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')]} 08:25:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:51 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:51 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 08:25:51 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 08:25:51 INFO - Using env: {'DISPLAY': ':0', 08:25:51 INFO - 'HOME': '/home/cltbld', 08:25:51 INFO - 'LANG': 'en_US.UTF-8', 08:25:51 INFO - 'LANGUAGE': 'en_US:en', 08:25:51 INFO - 'LOGNAME': 'cltbld', 08:25:51 INFO - 'MAIL': '/var/mail/cltbld', 08:25:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:51 INFO - 'MOZ_NO_REMOTE': '1', 08:25:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:51 INFO - 'NO_EM_RESTART': '1', 08:25:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:51 INFO - 'PWD': '/builds/slave/test', 08:25:51 INFO - 'SHELL': '/bin/bash', 08:25:51 INFO - 'SHLVL': '1', 08:25:51 INFO - 'TERM': 'linux', 08:25:51 INFO - 'TMOUT': '86400', 08:25:51 INFO - 'USER': 'cltbld', 08:25:51 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:51 INFO - '_': '/tools/buildbot/bin/python'} 08:25:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:25:52 INFO - Running setup.py (path:/tmp/pip-Aa09rL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:25:52 INFO - Running setup.py (path:/tmp/pip-I8ru4G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:25:52 INFO - Running setup.py (path:/tmp/pip-_8bTuZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:25:52 INFO - Running setup.py (path:/tmp/pip-1IU0jz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:25:52 INFO - Running setup.py (path:/tmp/pip-QXYJIe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:25:52 INFO - Running setup.py (path:/tmp/pip-hqLZSi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:25:52 INFO - Running setup.py (path:/tmp/pip-lcMbaz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:25:52 INFO - Running setup.py (path:/tmp/pip-bmLLRG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:25:52 INFO - Running setup.py (path:/tmp/pip-6Om7VJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:25:52 INFO - Running setup.py (path:/tmp/pip-laM6DA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:25:52 INFO - Running setup.py (path:/tmp/pip-QyHsGJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:25:52 INFO - Running setup.py (path:/tmp/pip-jaU9ep-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:25:52 INFO - Running setup.py (path:/tmp/pip-SiTw1U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:25:53 INFO - Running setup.py (path:/tmp/pip-Kv06KR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:25:53 INFO - Running setup.py (path:/tmp/pip-4ws5SP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:25:53 INFO - Running setup.py (path:/tmp/pip-lpVE1q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:25:53 INFO - Running setup.py (path:/tmp/pip-6xAydN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:25:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:25:53 INFO - Running setup.py install for manifestparser 08:25:53 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:25:53 INFO - Running setup.py install for mozcrash 08:25:53 INFO - Running setup.py install for mozdebug 08:25:53 INFO - Running setup.py install for mozdevice 08:25:53 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:25:53 INFO - Running setup.py install for mozfile 08:25:53 INFO - Running setup.py install for mozhttpd 08:25:53 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:25:53 INFO - Running setup.py install for mozinfo 08:25:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Running setup.py install for mozInstall 08:25:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Running setup.py install for mozleak 08:25:54 INFO - Running setup.py install for mozlog 08:25:54 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Running setup.py install for moznetwork 08:25:54 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Running setup.py install for mozprocess 08:25:54 INFO - Running setup.py install for mozprofile 08:25:54 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Running setup.py install for mozrunner 08:25:54 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:25:54 INFO - Running setup.py install for mozscreenshot 08:25:54 INFO - Running setup.py install for moztest 08:25:54 INFO - Running setup.py install for mozversion 08:25:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:25:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:25:55 INFO - Cleaning up... 08:25:55 INFO - Return code: 0 08:25:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:25:55 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')]} 08:25:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:55 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')]} 08:25:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:55 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:55 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 08:25:55 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 08:25:55 INFO - Using env: {'DISPLAY': ':0', 08:25:55 INFO - 'HOME': '/home/cltbld', 08:25:55 INFO - 'LANG': 'en_US.UTF-8', 08:25:55 INFO - 'LANGUAGE': 'en_US:en', 08:25:55 INFO - 'LOGNAME': 'cltbld', 08:25:55 INFO - 'MAIL': '/var/mail/cltbld', 08:25:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:55 INFO - 'MOZ_NO_REMOTE': '1', 08:25:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:55 INFO - 'NO_EM_RESTART': '1', 08:25:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:55 INFO - 'PWD': '/builds/slave/test', 08:25:55 INFO - 'SHELL': '/bin/bash', 08:25:55 INFO - 'SHLVL': '1', 08:25:55 INFO - 'TERM': 'linux', 08:25:55 INFO - 'TMOUT': '86400', 08:25:55 INFO - 'USER': 'cltbld', 08:25:55 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:55 INFO - '_': '/tools/buildbot/bin/python'} 08:25:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:25:55 INFO - Running setup.py (path:/tmp/pip-L4vZht-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:25:55 INFO - Running setup.py (path:/tmp/pip-ECh6Uk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:25:55 INFO - Running setup.py (path:/tmp/pip-hUtm_g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:25:55 INFO - Running setup.py (path:/tmp/pip-5kuhg4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:25:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:25:55 INFO - Running setup.py (path:/tmp/pip-FbG3BL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:25:55 INFO - Running setup.py (path:/tmp/pip-wIErVE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:25:55 INFO - Running setup.py (path:/tmp/pip-a3QVEr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:25:55 INFO - Running setup.py (path:/tmp/pip-148Vht-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:25:55 INFO - Running setup.py (path:/tmp/pip-CqDP1G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:25:55 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)) 08:25:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:25:56 INFO - Running setup.py (path:/tmp/pip-RgO4Uk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:25:56 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:25:56 INFO - Running setup.py (path:/tmp/pip-u_zyiq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:25:56 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:25:56 INFO - Running setup.py (path:/tmp/pip-oOnFW5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:25:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:25:56 INFO - Running setup.py (path:/tmp/pip-QBAoNU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:25:56 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:25:56 INFO - Running setup.py (path:/tmp/pip-wLsitY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:25:56 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:25:56 INFO - Running setup.py (path:/tmp/pip-V6hb2n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:25:56 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:25:56 INFO - Running setup.py (path:/tmp/pip-836T4X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:25:56 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)) 08:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:25:56 INFO - Running setup.py (path:/tmp/pip-V1jFwC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:25:56 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)) 08:25:56 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)) 08:25:56 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)) 08:25:56 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)) 08:25:56 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:25:56 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:25:56 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25: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 08:25:57 INFO - Downloading blessings-1.6.tar.gz 08:25:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:25:57 INFO - Installing collected packages: blessings 08:25:57 INFO - Running setup.py install for blessings 08:25:57 INFO - Successfully installed blessings 08:25:57 INFO - Cleaning up... 08:25:57 INFO - Return code: 0 08:25:57 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:25:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:25:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:25:58 INFO - Reading from file tmpfile_stdout 08:25:58 INFO - Current package versions: 08:25:58 INFO - argparse == 1.2.1 08:25:58 INFO - blessings == 1.6 08:25:58 INFO - blobuploader == 1.2.4 08:25:58 INFO - docopt == 0.6.1 08:25:58 INFO - functools32 == 3.2.3-2 08:25:58 INFO - jsonschema == 2.5.1 08:25:58 INFO - manifestparser == 1.1 08:25:58 INFO - mozInstall == 1.12 08:25:58 INFO - mozcrash == 1.0 08:25:58 INFO - mozdebug == 0.1 08:25:58 INFO - mozdevice == 0.50 08:25:58 INFO - mozfile == 1.2 08:25:58 INFO - mozhttpd == 0.7 08:25:58 INFO - mozinfo == 0.9 08:25:58 INFO - mozleak == 0.1 08:25:58 INFO - mozlog == 3.4 08:25:58 INFO - moznetwork == 0.27 08:25:58 INFO - mozprocess == 0.25 08:25:58 INFO - mozprofile == 0.28 08:25:58 INFO - mozrunner == 6.13 08:25:58 INFO - mozscreenshot == 0.1 08:25:58 INFO - mozsystemmonitor == 0.3 08:25:58 INFO - moztest == 0.8 08:25:58 INFO - mozversion == 1.4 08:25:58 INFO - psutil == 3.1.1 08:25:58 INFO - requests == 1.2.3 08:25:58 INFO - wsgiref == 0.1.2 08:25:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:25: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')]} 08:25:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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')]} 08:25:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:58 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:58 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 08:25:58 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 08:25:58 INFO - Using env: {'DISPLAY': ':0', 08:25:58 INFO - 'HOME': '/home/cltbld', 08:25:58 INFO - 'LANG': 'en_US.UTF-8', 08:25:58 INFO - 'LANGUAGE': 'en_US:en', 08:25:58 INFO - 'LOGNAME': 'cltbld', 08:25:58 INFO - 'MAIL': '/var/mail/cltbld', 08:25:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:58 INFO - 'MOZ_NO_REMOTE': '1', 08:25:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:58 INFO - 'NO_EM_RESTART': '1', 08:25:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:58 INFO - 'PWD': '/builds/slave/test', 08:25:58 INFO - 'SHELL': '/bin/bash', 08:25:58 INFO - 'SHLVL': '1', 08:25:58 INFO - 'TERM': 'linux', 08:25:58 INFO - 'TMOUT': '86400', 08:25:58 INFO - 'USER': 'cltbld', 08:25:58 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:58 INFO - '_': '/tools/buildbot/bin/python'} 08:25:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 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)) 08:25:58 INFO - Cleaning up... 08:25:58 INFO - Return code: 0 08:25:58 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:25: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')]} 08:25:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:25:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25: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')]} 08:25:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:25:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:25:58 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 0x20d91f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x244b770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, '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': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', '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 08:25:58 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 08:25:58 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 08:25:58 INFO - Using env: {'DISPLAY': ':0', 08:25:58 INFO - 'HOME': '/home/cltbld', 08:25:58 INFO - 'LANG': 'en_US.UTF-8', 08:25:58 INFO - 'LANGUAGE': 'en_US:en', 08:25:58 INFO - 'LOGNAME': 'cltbld', 08:25:58 INFO - 'MAIL': '/var/mail/cltbld', 08:25:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:25:58 INFO - 'MOZ_NO_REMOTE': '1', 08:25:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:25:58 INFO - 'NO_EM_RESTART': '1', 08:25:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:25:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:25:58 INFO - 'PWD': '/builds/slave/test', 08:25:58 INFO - 'SHELL': '/bin/bash', 08:25:58 INFO - 'SHLVL': '1', 08:25:58 INFO - 'TERM': 'linux', 08:25:58 INFO - 'TMOUT': '86400', 08:25:58 INFO - 'USER': 'cltbld', 08:25:58 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:25:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:25:58 INFO - '_': '/tools/buildbot/bin/python'} 08:25:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:25:58 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:25:58 INFO - Cleaning up... 08:25:58 INFO - Return code: 0 08:25:58 INFO - Running post-action listener: _resource_record_post_action 08:25:58 INFO - Running post-action listener: _start_resource_monitoring 08:25:58 INFO - Starting resource monitoring. 08:25:58 INFO - [mozharness: 2017-05-08 15:25:58.643898Z] Finished create-virtualenv step (success) 08:25:58 INFO - [mozharness: 2017-05-08 15:25:58.644373Z] Running install step. 08:25:58 INFO - Running pre-action listener: _resource_record_pre_action 08:25:58 INFO - Running main action method: install 08:25:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:25:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:25:58 INFO - Reading from file tmpfile_stdout 08:25:58 INFO - Detecting whether we're running mozinstall >=1.0... 08:25:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:25:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:25:58 INFO - Reading from file tmpfile_stdout 08:25:58 INFO - Output received: 08:25:58 INFO - Usage: mozinstall [options] installer 08:25:58 INFO - Options: 08:25:58 INFO - -h, --help show this help message and exit 08:25:58 INFO - -d DEST, --destination=DEST 08:25:58 INFO - Directory to install application into. [default: 08:25:58 INFO - "/builds/slave/test"] 08:25:58 INFO - --app=APP Application being installed. [default: firefox] 08:25:58 INFO - mkdir: /builds/slave/test/build/application 08:25:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:25:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:26:13 INFO - Reading from file tmpfile_stdout 08:26:13 INFO - Output received: 08:26:13 INFO - /builds/slave/test/build/application/firefox/firefox 08:26:13 INFO - Running post-action listener: _resource_record_post_action 08:26:13 INFO - [mozharness: 2017-05-08 15:26:13.828516Z] Finished install step (success) 08:26:13 INFO - [mozharness: 2017-05-08 15:26:13.828794Z] Running run-tests step. 08:26:13 INFO - Running pre-action listener: _resource_record_pre_action 08:26:13 INFO - Running main action method: run_tests 08:26:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:26:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:26:13 INFO - Python 2.7.3 08:26:13 INFO - Return code: 0 08:26:13 INFO - grabbing minidump binary from tooltool 08:26:13 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')]} 08:26:13 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 0x2448a30>, '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 0x24497f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2449ca0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:26:13 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 08:26:13 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 08:26:13 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 08:26:13 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:26:13 INFO - Return code: 0 08:26:13 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:26:13 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:26:13 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:26:13 INFO - ENV: RUST_BACKTRACE is now 1 08:26:13 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:26:13 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:26:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-049', '--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 08:26:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-049 --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 08:26:13 INFO - Using env: {'DISPLAY': ':0', 08:26:13 INFO - 'HOME': '/home/cltbld', 08:26:13 INFO - 'LANG': 'en_US.UTF-8', 08:26:13 INFO - 'LANGUAGE': 'en_US:en', 08:26:13 INFO - 'LOGNAME': 'cltbld', 08:26:13 INFO - 'MAIL': '/var/mail/cltbld', 08:26:13 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:26:13 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:26:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:26:13 INFO - 'MOZ_NO_REMOTE': '1', 08:26:13 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:26:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:26:13 INFO - 'NO_EM_RESTART': '1', 08:26:13 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:26:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:26:13 INFO - 'PWD': '/builds/slave/test', 08:26:13 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:26:13 INFO - 'RUST_BACKTRACE': '1', 08:26:13 INFO - 'SHELL': '/bin/bash', 08:26:13 INFO - 'SHLVL': '1', 08:26:13 INFO - 'TERM': 'linux', 08:26:13 INFO - 'TMOUT': '86400', 08:26:13 INFO - 'USER': 'cltbld', 08:26:13 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792', 08:26:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:26:13 INFO - '_': '/tools/buildbot/bin/python'} 08:26:13 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-049', '--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 08:26:14 INFO - mozversion application_buildid: 20170508145929 08:26:14 INFO - mozversion application_changeset: 38f862749aed4e9a874182a9019e0671289088b0 08:26:14 INFO - mozversion application_display_name: Nightly 08:26:14 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:26:14 INFO - mozversion application_name: Firefox 08:26:14 INFO - mozversion application_remotingname: firefox 08:26:14 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 08:26:14 INFO - mozversion application_vendor: Mozilla 08:26:14 INFO - mozversion application_version: 55.0a1 08:26:14 INFO - mozversion platform_buildid: 20170508145929 08:26:14 INFO - mozversion platform_changeset: 38f862749aed4e9a874182a9019e0671289088b0 08:26:14 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 08:26:14 INFO - mozversion platform_version: 55.0a1 08:26:14 INFO - using testdate: 1494257174 08:26:14 INFO - actual date: 1494257174 08:26:14 INFO - starting webserver on 'localhost:38412' 08:26:14 INFO - SUITE-START | Running 2 tests 08:26:14 INFO - TEST-START | dromaeo_css 08:26:14 INFO - operating with platform_type : linux_ 08:26:14 INFO - Initialising browser for dromaeo_css test... 08:26:14 INFO - TEST-INFO | started process 9333 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp54RuCn/profile http://localhost:38412/getInfo.html) 08:26:18 INFO - PID 9333 | __metrics Screen width/height:1600/1200 08:26:18 INFO - PID 9333 | colorDepth:24 08:26:18 INFO - PID 9333 | Browser inner width/height: 1024/695 08:26:18 INFO - PID 9333 | __metrics 08:26:20 INFO - TEST-INFO | 9333: exit 0 08:26:20 INFO - Browser initialized. 08:26:20 INFO - Running cycle 1/1 for dromaeo_css test... 08:26:20 INFO - TEST-INFO | started process 9504 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp54RuCn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:26:32 INFO - PID 9504 | RSS: Main: 159551488 08:26:32 INFO - PID 9504 | 08:29:37 INFO - PID 9504 | Cycle 1(1): loaded http://localhost:38412/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38412/tests/dromaeo/cssquery-ext.html) 08:29:39 INFO - PID 9504 | RSS: Main: 163028992 08:29:39 INFO - PID 9504 | 08:32:42 INFO - PID 9504 | Cycle 1(1): loaded http://localhost:38412/tests/dromaeo/cssquery-ext.html (next: http://localhost:38412/tests/dromaeo/cssquery-jquery.html) 08:32:42 INFO - PID 9504 | RSS: Main: 158400512 08:32:42 INFO - PID 9504 | 08:35:44 INFO - PID 9504 | Cycle 1(1): loaded http://localhost:38412/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38412/tests/dromaeo/cssquery-mootools.html) 08:35:45 INFO - PID 9504 | RSS: Main: 168763392 08:35:45 INFO - PID 9504 | 08:38:47 INFO - PID 9504 | Cycle 1(1): loaded http://localhost:38412/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38412/tests/dromaeo/cssquery-prototype.html) 08:38:47 INFO - PID 9504 | RSS: Main: 159178752 08:38:47 INFO - PID 9504 | 08:41:50 INFO - PID 9504 | Cycle 1(1): loaded http://localhost:38412/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38412/tests/dromaeo/cssquery-yui.html) 08:41:51 INFO - PID 9504 | RSS: Main: 162701312 08:41:51 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | Cycle 1(1): loaded http://localhost:38412/tests/dromaeo/cssquery-yui.html (next: http://localhost:38412/tests/dromaeo/cssquery-dojo.html) 08:44:53 INFO - PID 9504 | RSS: Main: 167936000 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | __start_tp_report 08:44:53 INFO - PID 9504 | _x_x_mozilla_page_load 08:44:53 INFO - PID 9504 | _x_x_mozilla_page_load_details 08:44:53 INFO - PID 9504 | |i|pagename|runs| 08:44:53 INFO - PID 9504 | |0;dojo.html;2722.101706436876;2743.1770468859363;2753.6833264174625;2765.460735156644;2788.916332510023;5042.9914017196525;5202.583793296532;5218.921716174261;5232.6075544334235;5235;5159.303494028305;5186.896262074766;5208.296879921209;5255.658382205163;5301.655392399492;4609.608183304406;4635.374224479702;4652.511486293941;4664.673472856902;4726.291056341542;4667.323238130469;4694.53054694533;4730.881727956811;4732.597729193023;4759.381280433556;4590.60979816716;4594.563516465931;4649.976750116228;4658.930116048262;4679.789409476582;4678.134545109166;4682.508336624674;4699.577038066556;4710.9764451177525;4729.935764453005;4594;4658.953410465886;4660.883477913046;4670.042641258534;4680.110778951988;5074.746262686851;5136.717480538568;5149.588032957355;5230.816921407771;5231.712255825966;5659.349174844904;5665.1502274658715;5677.716114194315;5708.20085188074;5751.626144300607;5685.630434021817;5686.317641883001;5695.886082278373;5699.287589051369;5707.3721890592005;5194.636375453758;5267.683938963598;5294.364676238876;5307.920381194285;5314.73426328682;5664.980303545319;5732.971335143297;5761.452661997104;5763;5766.04860198071;5563.499285064283;5585.497305242548;5591.804286849941;5632.5212356950115;5634.352049514277;5495.53287970519;5653.038983372837;5655.264815573949;5680.204771332017;5691.3170419549915;5506.504414602705;5566.35986861508;5601.215829783833;5615.382307946123;5632.633878797865;5511.834644960658;5544.473275038865;5554.805716770833;5560.277163968739;5579.358373787067;4526.366308716782;4537.296719008559;4548.1813273610405;4567.200739870509;4577.793999270041;3963.3460479021214;4014.739041962263;4015.678745700337;4024.2756303865;4030.8186131624147;4835.153848076572;4850.781714822841;4855.878603034952;4856.878578035577;4863.781129849165;5615.8876822464135;5622.353429355595;5624.91562626561;5635.436456354331;5635.605507614509;4827.710337379768;4864.100141473838;4864.610831133501;4866.367372241657;4981.925271120864;4935.7532123393685;4953.306537084811;4963.6525443218625;4965.975170124127;5011.599072074226;5309.946900530946;5322.467753224647;5340.626156169186;5343.759530821045;5347.946520534745;5577.888442231051;5634.352049514358;5652.123920792284;5657.886842263049;5665.376808550974;5360.222767698584;5360.705161216015;5374.785008599612;5403.8108666196495;5430.266913966564;5587.217789509553;5589.049861523632;5597.6641401516035;5598.440155984369;5610.214569960127;5569.303837020372;5637.379888212211;5715.457031581993;5738.540916726568;5792.652440853562;5366.242038216623;5466.125419932791;5480.068388374066;5489.807856724996;5494.2857428534035;5432.483914028161;5457.317835270591;5458.372287186866;5464.426235245401;5466.699331536644;5287.9735601321745;5325.840224793263;5337.546308563816;5389.8922021558565;5391.730413479232;5432.809851655331;5493.368262649687;5520.91718624229;5531.612787104864;5565.7217139143695;5308.362996440452;5323.441038690882;5324.148136298329;5324.281222035131;5330.573554115584 08:44:53 INFO - PID 9504 | |1;ext.html;707.2715103443453;716.9032180655613;1007.3200589602017;1028.321307936762;1102.2119184782878;30056.797728090878;31028.06915792524;31243;31254.68745312546;31290.06129816109;28832;28894.277643058882;29004;29156.416871662554;29171.416571668608;5196.688198708071;5307.787688492475;6352.809415717536;6487.7729279475225;6488;6742.359475849787;6850.93149068508;6879.140107486564;6900.378965893068;6903.6548172591165;6944.375006249436;6995.160580730319;7000.579965202079;7003.47473939454;7018.859622807541;6903.6548172591165;6927.307269273032;6947.305269473063;6952.304769523058;6957.443404527626;6822.829429264259;6891.517593768438;6892.172939247273;6894.448444124458;6907.274736152732;30745;31041.379172416426;31102;31120;31235.219119521968;3001.294695746498;3010.036788227768;3018.0644000359957;3022.8035177713377;3043.3761078978755;23655;23778.64332035021;23796.881015594983;23940.880295598585;23971.161009364587;2976.627921509811;2977.493826049577;2978.8212707237417;2979.493486107367;2984.388200418909;137240;137695;137804.31097844546;138047;138212;37972.43041354382;39645.80177099096;39655;39958.40062399067;40084;40962;40984.590154098674;41348;41370.79314603468;41412;12816.743665126645;12908.741825163444;12919.741605168032;13014.609561713163;13044.152130111512;10117.140043096271;10227;10307.84538231927;10352.585896564204;10354.585816567404;12480.315157453628;12594.81107783384;12620.621381358575;12652.114351995457;12828.422720977578;5277.947220527745;5282.920756188661;5289.70906600133;5357.919631205535;5358.33020872391;874.5452364770284;904.5115637555647;907.7957459571544;912.4342907397456;922.391221793613;20702.171913123606;21292.254771083248;21441.785582143977;21471.355859324245;21915.561688766134;970.3207754571828;983.7884854756119;1000.3847633705365;1002.3484734922213;1005.2762011351815;11045.171612129123;11143.442827858575;11218.326900386002;11335.43322833855;11383.975442210241;175374;175729;175885;176521.1173944122;177385;39849.20301593952;40101.1979760409;40155.799221004294;40162.598374016474;40250.19499609991;1199.9764132400298;1223.6084452974962;1227.4415141110774;1227.5887577661406;1232.1436601562007;20272;20391.898040509703;21069.473263168544;21252.468688282297;21540.676889846352;27614.585781212896;27660.723392765816;27669.16992490148;27679.30801729973;27723.445531088862;131722;134140;150023;150492;151095;26335.34161645974;26639;27004.189874303804;27011.189664310103;27112.593311100743;30877.228069298446;31731.36537269288;32089.67910320867;32480.350392991535;32536.34927301488;24998.125065622615;25466.745332546438;25477.872610636827;26103;26302.21093367202;24572.754272457045;24816;25278.74721252764;26308.605370919835;26570;27102.864485678234;27900.30249243785;28078.71921280761;28108.297292567848;28156.155315340573;24115.517689646458;24265.878670606533;24319.392015199763;25014.624780627943;25212.369690757878;20269;21084;21122.788772112082;21147.78852211458;21152.153913843274 08:44:53 INFO - PID 9504 | |2;jquery.html;392.3545767212935;401.85131501344506;418.73201151263186;427.7369417808049;431.14848174854654;11421.179260769217;12110.878891211085;16753.664926701473;17311.740323895152;17409.477715668534;13954.860451395483;17657.64684706305;17967.82032179678;17976.91011544944;18038.278468861263;5464.754086066127;5568.081266591008;5608.074667679828;5621.381648018714;5658.151277308396;5212.609054320922;5395.244665746799;5421.132618780976;5455.863603409907;5473.644213126154;5415.350157981028;5418.756155972991;5427.023135835568;5443.428440013801;5451.2640793492965;5289.497497737709;5523.475269849358;5525.640833345839;5547.667139971614;5560.833175004756;5024.773885175139;5041;5046.09170349337;5048.469910659402;5053.444121146671;21964.560708785895;22202.55594888093;22705.545889082292;23619.40951476227;23675.289741307788;1647.5551601067764;1702.8552573031307;1709.991450042742;1712.9057901815395;1713.4088739384893;14282.714345713028;14939.626509337244;14970.101793892292;15071.09573425587;15133.167675777828;2110.0610228448345;2111.915523379063;2156.256091648379;2180.760116387196;2187.212603462768;89985.55007224987;91068;91532;94096;96437.51781241049;10984.395858227874;11111.611093611686;11184.664460066211;11394.94302528482;11702.2978621283;15861.841381586268;15883.444079457395;15913.204339782964;15982.60043498922;15983.360665573247;7621.466497345133;7665.195154508808;7924.841503169904;7966.800829979297;8001.279884810278;7105.822354441077;7106.111736032996;7139.178994415709;7321.816954576072;7332.853342933112;7060.18807837095;7082.752103676346;7128.718809980756;7163.462740294499;7200.207977122513;2096.5282811367624;2098.213170061227;2116.745990481152;2136.786321367882;2290.4617414907484;821.8315245374683;844.9239568438747;865.7056600755773;866.4108406283661;875.2866413872673;17050.914745426195;17244.827551724324;17663;17765.822341776675;17859.196336164903;861.5132450165636;876.1851478125404;878.1657425445852;884.274894586433;885.3315746611396;9307.255419566418;9665.758356041015;9779.26655500826;9876.506174691236;9883.357581757307;378989;383499;388004;390415;391101;72860.63569682224;73382.2661773386;73815.63092184505;75253.62373188099;77865.2213477858;1037.766502536923;1052.1898138433364;1068.7167900506372;1115.8214685650257;1126.037238161393;17702.557436064202;17808.643827123127;18703.82035054017;18747.718784217974;18917.90541047286;38947.2210555793;40288;40330.193396131326;40516.1896762069;41344.37983430311;50227.24659130043;50587.24119138142;50791.23813142732;50875.491245087076;51710.482895170564;8246.216609422096;8358.749237522885;8419.11599282091;8515.40392172542;8560.91439085601;12617.93691031539;13163.53927612529;13174.275414852274;13503.12229705066;13531.932340338235;11021.44892755375;11036.613718519813;11103.278286911325;11829.467673954865;11892.405379731152;9815.901840981498;9945.900540994788;10089.142422894136;10091.545880435251;10982.286151400134;11126.721831954266;11203.159763017644;11817.231879927776;11839.526418943491;11916.940415297868;8298.21166989135;8417.24658857322;8541.701040463555;8594.398392112493;8753.29973602123;11292.378919159524;11331.830022549833;11379.317240965569;11504;11598.07215422781 08:44:53 INFO - PID 9504 | |3;mootools.html;1187.8277649740787;1239.8574163971145;1250.3560666256874;1252.6805664555536;1255.008543250832;8935.285177185826;9215.354925155241;9241.537923103842;9352.251819854404;9451.810963780721;9306.162445379914;9429.858552121706;9474.573644186012;9477.38397004196;9491.952540237306;2140.240214723774;2162.113533451285;2169.8698078115362;2181.454636340915;2183.6287831068757;2125.978740212601;2181.2365672014826;2192.5176461178517;2194.4623567226054;2194.5830292244423;1998.1308130963077;2008.7589489261236;2042.9795702043011;2051.476873397289;2051.7332746742977;2092.3304542546393;2134.1570079818384;2140.818030467412;2141.36829635258;2147.559750251203;2011.0648548425052;2076.512019675375;2133.0827744070043;2135.3273718778537;2143.3034263864306;9051.321150913642;9113.863292050559;9147.22248608869;9169.495677737721;9201.033891441437;5138.743062846843;5302.125149350352;5312.2297266896085;5323.600729945231;5355.062863998824;3124.906252812419;3283.1627934876456;3339.2820543583002;3361.478970759536;3397.2186397128553;1071.410724101741;1086.8804431512526;1091.9508622112023;1143.7598104398087;1148.718563951837;13547.187168769906;13657.317134143253;13709.108907921052;13734.93132534331;13735.381907814073;4341.435613370305;4426.1369033038245;4694.788734506956;4701.059788042405;4720.952790472052;10082.949585252027;10086.142677872464;10113;10122.54448549817;10124.190064794799;5226.033183860998;5227.424983251839;5229.424763276113;5229.529342359206;5235.319408476874;4578.725276483422;4580.152671755736;4622.237330840374;4850.975745121323;4856.757162141878;3762;3835.137094153793;3864.381698928158;3914.080191155076;3942.7634341939;1175.8236264560214;1182.810750279951;1183.0476466444422;1196.916215864881;1199.736058067224;645.4320198225531;671.177807186193;694.5520139509988;694.6804469943781;697.194740075214;4957.90084198314;5035.219540971156;5041.873953151201;5228.320318358589;6224.719887605069;810.2545657994659;825.4675734151439;827.8509868223657;840.13885767088;840.1808236968907;3401.727861771052;3483.8606455741487;3493.406120959392;3526.523919270917;3597.8201089945396;11830.822537661941;12384.81422778659;12425.068119891044;12436.689082772822;12448.875511244953;11920.225185362924;12303.75392492163;12344.444499997522;12360.320182389874;12392.690182745504;7051.612161331073;7326.04761381017;7326.4505162113055;7338.889916651361;7349.448791340671;5320.255164277081;5454.754536045967;5485.451454854483;5487.094629386106;5728.4271572844045;10889.074428673335;10897.346159230472;11013.83479247796;11109.055730263019;11169.106471482099;11183.664490065312;11298.887011130113;11306.208565400342;11398.658040258806;11492.310461372344;6717.764878229434;6872.931270687229;8386.454880432751;8938.955305223431;8942.552872356486;9314.394564353295;9481.431114133175;9533.142017218484;9545.47499887485;9554.761130971503;7535.773926781986;7612.657430415534;7645.885311720217;7716.228377162463;7863.646135924012;7419.740309089372;7501.1373692023935;7625.771226863203;7733.845323093619;7777.922220777946;7046.084009078992;7140.428765698628;7234.16807067173;7240.782776516713;7256.963715181601;4955.900881982412;5269.077911365419;5303.390110137384;5304.283921670525;5353.759080841293;4912.48418916023;4927.211646136601;5008.273800299009;5014.674046186986;5164.9741751291 08:44:53 INFO - PID 9504 | |4;prototype.html;356.86974254397137;373.2553555656464;373.5293530152008;377.07616339967086;383.9289731399691;5568.470995255449;5570.359408668004;5578.693171875545;5593.972030139854;5619.129034999576;5453.3728621208575;5461.18082287657;5462.945370546303;5466.289382380295;5474.37044739855;4163.20899029185;4249.192653395845;4279.379489973952;4286.39990401344;4312.784360781964;4278.743275403485;4291.304934550851;4295.377170310303;4297;4309.267424537836;4262.254105531535;4269.252880745873;4275.593818587229;4282.7858607069675;4300.6344460720875;4168.687348448879;4280.079782846703;4286.485621725397;4288.69979101463;4288.849890253858;3808.21931504041;3842.4812650292133;3844.788536630484;3845.9615403845883;3867.0719027433215;5365.651232669903;5379.435159308256;5387.272718183034;5401.297831281908;5405.648632838853;4988.6757360771435;5068;5089.312942752718;5103.54068133866;5106.591472682177;5770.105633626795;5814.418558144194;5815.680137592431;5824.184614154022;5835.387284335126;4317.711612845165;4317.805698743564;4325.199838029975;4328.091100868822;4332.566743325674;5475.972620136914;6013.488853447462;6131.816045518642;6133.69331533426;6155.507559395238;4041.959580404217;4054.1486287879875;4086.836526538905;4088.2232375848494;4091.2226676931286;4121.196366708463;4123.60825721556;4133.42132101506;4135.958640413617;4139.234241665302;4718.245080787057;4760.809567617256;4769.35613692154;4784.186688263004;4788.760561971888;5782.710864456761;5793.594448388572;5794.710264486759;5798.739056742456;5811.215485909433;1392.095138160204;1395.9720805583831;1396.1274203622736;1400.3068481101716;1416.752068388028;907.3467103685336;931.7886747228575;959.3045042344384;967.9564419601135;968.4237878462303;5119.029173768126;5119.206522988943;5130.153524668388;5136.38203965757;5143.639945203875;6020.207269420324;6030.728617212236;6058.515318774487;6060.666663333471;6068.848278793065;4895.6817806843155;5088.262201980766;5110.28456016158;5114.71869047206;5158.38099428071;3152.7004934531183;3169.6196456425378;3182.220356012792;3190.5373720810353;3201.143336864613;5436.266104075979;5673.602847800615;5698.772049118072;5699.344575373885;5701.686407247641;5995.700214989233;6082.635041897501;6149.815505534841;6157.768446310666;6180.289266734383;5648.717564121777;5649.717514124277;5660.2075709400715;5667.234923285304;5680.460356266148;5742.827715168552;5949.405059494016;5995.700214989321;6011.72947217385;6022.969885150546;5858.882822343444;5880.647161170344;5918.260217472816;5918.644881307136;5928;5634.070378387521;5637.49262566371;5644.915326270027;5657.349404818498;5661.348944871393;4046.3728122141115;4077.3272410053196;4083.3466645336603;4102.261592913304;4115.218108559364;6040.607360521552;6046.183765191643;6049.455549000611;6062.454379105901;6071.332153463027;5659.349174844946;5818.301803783573;5821.970890145522;5823.651400444846;5826.41735826414;5710.229119068873;5770.711464426846;5780.566457515619;5811.215485909348;5819.6508209507565;5694.715264236855;5701.914471283017;5702.116171993348;5726.942730572641;5734.655920644775;5616.971915140398;5806.129080637938;5843.1235314703135;5854.209681692917;5864.736086876015;5673.262475878275;5682.005649011489;5684.77260909559;5686.57350698691;5691.3170419549915 08:44:53 INFO - PID 9504 | |5;yui.html;720.8738470767614;734.8860926556382;752.5334292738502;757.3827330725459;770.7263921307936;12648.494060237592;13143;13330.866691333096;13748.58754237372;15052.473163439281;14103.647408814759;14624.122552646848;14780.187089710062;15035.248237588105;15133.92433037836;894.4186278918689;911.803962148138;912.0696889173073;913.9177474027337;915.9038300978401;821.708293555788;897.1208215948375;911.968081117161;917.7889085510336;920.779013036873;948.3788118782209;954.8138113067954;955.7753927826955;956.220680145679;958.5925981457852;953.9713808585719;954.0840792838883;955.3169483819067;956.516958935733;958.6117622362954;692.8025512728899;699.4299645788666;699.867025265198;702.1714377035097;702.4871843554234;12809.295488748116;12880.420381082873;12901.612951611467;12907.419166137452;14058.507952221624;13318.200907945555;14238.145711257253;14434.855651443457;14544.490942817056;14588.051776634486;12629.621111366674;13768.449262029506;13923.094998825043;14019.859801402059;14070.296485175802;2752.1330780804183;2794.273488892882;2802.341449759305;2804.3129433288973;2835.1777984384503;66861;68367.31632683659;69246;70242;70472.59054818926;12443.315617641116;12534.74930501385;12715.491380344683;12815.551455699006;12855.357232138356;18936.52658683544;19083.90458047701;19626.313079042164;19708.21167153298;20015.599688006158;5941.494972927263;6109.633421994695;6115.296740874856;6118.1128736332985;6136.539759518054;3010.232390740347;3061.73975212105;3064.050144455226;3096.287853793595;3107.5494053362136;3326.550915626408;3335.116194208537;3364.091695242271;3382.3573521030926;3400.7619466637593;651.1632552170438;666.0342503370036;666.1040899989506;667.8831204539187;668.6790340636521;556.858001209689;568.5508448325776;578.2627150383295;579.4524174654911;592.0674936974283;9039.81920361589;9235.215006724504;9476.147146756824;9544.141027307576;9794.853077203848;538.5045757902739;543.3642638113416;554.464941331617;555.3308263542422;563.3240111865778;4730.101280756645;4842.854714358575;4970.304157417964;4987.850364489072;5225.817096401608;56530.43469565334;56656.15015774767;59823;64579.354206457334;66639.66680166568;50230.49769502331;50556.494435055916;50696.23955640668;52070;52409;45251;46305.53694463147;46883.765581172556;47136.986712259;48958;9969.601215951281;10195.541200646137;10252.64115755945;10520.631777887736;10785.514651840529;24857.751422485544;25424.872875636243;26291.73708262893;26366;26702.732972670026;42940;43261.567384325754;43390.783046084565;43835.342469863615;45478.54521454876;13624.114432561852;13890.652733681738;13898.722025559635;14051.36768845384;14169.29153542298;14715.484958026418;14764.704705906037;14829.480968166494;14921.776173357626;15053.397864085315;13837.169769813843;13842.4463021478;13876.306184690524;13889.65275868071;14173.078749881637;13279.269640169883;13385.732285354043;13463.528776492776;13506;13608.455661773418;13288.468461261442;13417.530386436429;13462.932685336511;13495.25776082325;13572;10004;10129.797404051731;10269.178465722875;10278.537465813906;10832.783344332911;10592.682219533426;10985.231033827555;11188.440577970907;11273.830892536782;11296 08:44:53 INFO - PID 9504 | __end_tp_report 08:44:53 INFO - PID 9504 | __start_cc_report 08:44:53 INFO - PID 9504 | _x_x_mozilla_cycle_collect,371 08:44:53 INFO - PID 9504 | __end_cc_report 08:44:53 INFO - PID 9504 | __startTimestamp1494258293258__endTimestamp 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | ------- Summary: start ------- 08:44:53 INFO - PID 9504 | Number of tests: 6 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | [#0] dojo.html Cycles:165 Average:5154.14 Median:5325.84 stddev:603.93 (11.3%) stddev-sans-first:574.86 08:44:53 INFO - PID 9504 | Values: 2722.1 2743.2 2753.7 2765.5 2788.9 5043.0 5202.6 5218.9 5232.6 5235.0 5159.3 5186.9 5208.3 5255.7 5301.7 4609.6 4635.4 4652.5 4664.7 4726.3 4667.3 4694.5 4730.9 4732.6 4759.4 4590.6 4594.6 4650.0 4658.9 4679.8 4678.1 4682.5 4699.6 4711.0 4729.9 4594.0 4659.0 4660.9 4670.0 4680.1 5074.7 5136.7 5149.6 5230.8 5231.7 5659.3 5665.2 5677.7 5708.2 5751.6 5685.6 5686.3 5695.9 5699.3 5707.4 5194.6 5267.7 5294.4 5307.9 5314.7 5665.0 5733.0 5761.5 5763.0 5766.0 5563.5 5585.5 5591.8 5632.5 5634.4 5495.5 5653.0 5655.3 5680.2 5691.3 5506.5 5566.4 5601.2 5615.4 5632.6 5511.8 5544.5 5554.8 5560.3 5579.4 4526.4 4537.3 4548.2 4567.2 4577.8 3963.3 4014.7 4015.7 4024.3 4030.8 4835.2 4850.8 4855.9 4856.9 4863.8 5615.9 5622.4 5624.9 5635.4 5635.6 4827.7 4864.1 4864.6 4866.4 4981.9 4935.8 4953.3 4963.7 4966.0 5011.6 5309.9 5322.5 5340.6 5343.8 5347.9 5577.9 5634.4 5652.1 5657.9 5665.4 5360.2 5360.7 5374.8 5403.8 5430.3 5587.2 5589.0 5597.7 5598.4 5610.2 5569.3 5637.4 5715.5 5738.5 5792.7 5366.2 5466.1 5480.1 5489.8 5494.3 5432.5 5457.3 5458.4 5464.4 5466.7 5288.0 5325.8 5337.5 5389.9 5391.7 5432.8 5493.4 5520.9 5531.6 5565.7 5308.4 5323.4 5324.1 5324.3 5330.6 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | [#1] ext.html Cycles:180 Average:28957.23 Median:27701.38 stddev:39576.23 (142.9%) stddev-sans-first:39630.40 08:44:53 INFO - PID 9504 | Values: 707.3 716.9 1007.3 1028.3 1102.2 30056.8 31028.1 31243.0 31254.7 31290.1 28832.0 28894.3 29004.0 29156.4 29171.4 5196.7 5307.8 6352.8 6487.8 6488.0 6742.4 6850.9 6879.1 6900.4 6903.7 6944.4 6995.2 7000.6 7003.5 7018.9 6903.7 6927.3 6947.3 6952.3 6957.4 6822.8 6891.5 6892.2 6894.4 6907.3 30745.0 31041.4 31102.0 31120.0 31235.2 3001.3 3010.0 3018.1 3022.8 3043.4 23655.0 23778.6 23796.9 23940.9 23971.2 2976.6 2977.5 2978.8 2979.5 2984.4 137240.0 137695.0 137804.3 138047.0 138212.0 37972.4 39645.8 39655.0 39958.4 40084.0 40962.0 40984.6 41348.0 41370.8 41412.0 12816.7 12908.7 12919.7 13014.6 13044.2 10117.1 10227.0 10307.8 10352.6 10354.6 12480.3 12594.8 12620.6 12652.1 12828.4 5277.9 5282.9 5289.7 5357.9 5358.3 874.5 904.5 907.8 912.4 922.4 20702.2 21292.3 21441.8 21471.4 21915.6 970.3 983.8 1000.4 1002.3 1005.3 11045.2 11143.4 11218.3 11335.4 11384.0 175374.0 175729.0 175885.0 176521.1 177385.0 39849.2 40101.2 40155.8 40162.6 40250.2 1200.0 1223.6 1227.4 1227.6 1232.1 20272.0 20391.9 21069.5 21252.5 21540.7 27614.6 27660.7 27669.2 27679.3 27723.4 131722.0 134140.0 150023.0 150492.0 151095.0 26335.3 26639.0 27004.2 27011.2 27112.6 30877.2 31731.4 32089.7 32480.4 32536.3 24998.1 25466.7 25477.9 26103.0 26302.2 24572.8 24816.0 25278.7 26308.6 26570.0 27102.9 27900.3 28078.7 28108.3 28156.2 24115.5 24265.9 24319.4 25014.6 25212.4 20269.0 21084.0 21122.8 21147.8 21152.2 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | [#2] jquery.html Cycles:180 Average:25567.78 Median:20344.93 stddev:64229.71 (315.7%) stddev-sans-first:64382.08 08:44:53 INFO - PID 9504 | Values: 392.4 401.9 418.7 427.7 431.1 11421.2 12110.9 16753.7 17311.7 17409.5 13954.9 17657.6 17967.8 17976.9 18038.3 5464.8 5568.1 5608.1 5621.4 5658.2 5212.6 5395.2 5421.1 5455.9 5473.6 5415.4 5418.8 5427.0 5443.4 5451.3 5289.5 5523.5 5525.6 5547.7 5560.8 5024.8 5041.0 5046.1 5048.5 5053.4 21964.6 22202.6 22705.5 23619.4 23675.3 1647.6 1702.9 1710.0 1712.9 1713.4 14282.7 14939.6 14970.1 15071.1 15133.2 2110.1 2111.9 2156.3 2180.8 2187.2 89985.6 91068.0 91532.0 94096.0 96437.5 10984.4 11111.6 11184.7 11394.9 11702.3 15861.8 15883.4 15913.2 15982.6 15983.4 7621.5 7665.2 7924.8 7966.8 8001.3 7105.8 7106.1 7139.2 7321.8 7332.9 7060.2 7082.8 7128.7 7163.5 7200.2 2096.5 2098.2 2116.7 2136.8 2290.5 821.8 844.9 865.7 866.4 875.3 17050.9 17244.8 17663.0 17765.8 17859.2 861.5 876.2 878.2 884.3 885.3 9307.3 9665.8 9779.3 9876.5 9883.4 378989.0 383499.0 388004.0 390415.0 391101.0 72860.6 73382.3 73815.6 75253.6 77865.2 1037.8 1052.2 1068.7 1115.8 1126.0 17702.6 17808.6 18703.8 18747.7 18917.9 38947.2 40288.0 40330.2 40516.2 41344.4 50227.2 50587.2 50791.2 50875.5 51710.5 8246.2 8358.7 8419.1 8515.4 8560.9 12617.9 13163.5 13174.3 13503.1 13531.9 11021.4 11036.6 11103.3 11829.5 11892.4 9815.9 9945.9 10089.1 10091.5 10982.3 11126.7 11203.2 11817.2 11839.5 11916.9 8298.2 8417.2 8541.7 8594.4 8753.3 11292.4 11331.8 11379.3 11504.0 11598.1 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | [#3] mootools.html Cycles:180 Average:5912.87 Median:4697.92 stddev:3705.47 (78.9%) stddev-sans-first:3698.85 08:44:53 INFO - PID 9504 | Values: 1187.8 1239.9 1250.4 1252.7 1255.0 8935.3 9215.4 9241.5 9352.3 9451.8 9306.2 9429.9 9474.6 9477.4 9492.0 2140.2 2162.1 2169.9 2181.5 2183.6 2126.0 2181.2 2192.5 2194.5 2194.6 1998.1 2008.8 2043.0 2051.5 2051.7 2092.3 2134.2 2140.8 2141.4 2147.6 2011.1 2076.5 2133.1 2135.3 2143.3 9051.3 9113.9 9147.2 9169.5 9201.0 5138.7 5302.1 5312.2 5323.6 5355.1 3124.9 3283.2 3339.3 3361.5 3397.2 1071.4 1086.9 1092.0 1143.8 1148.7 13547.2 13657.3 13709.1 13734.9 13735.4 4341.4 4426.1 4694.8 4701.1 4721.0 10082.9 10086.1 10113.0 10122.5 10124.2 5226.0 5227.4 5229.4 5229.5 5235.3 4578.7 4580.2 4622.2 4851.0 4856.8 3762.0 3835.1 3864.4 3914.1 3942.8 1175.8 1182.8 1183.0 1196.9 1199.7 645.4 671.2 694.6 694.7 697.2 4957.9 5035.2 5041.9 5228.3 6224.7 810.3 825.5 827.9 840.1 840.2 3401.7 3483.9 3493.4 3526.5 3597.8 11830.8 12384.8 12425.1 12436.7 12448.9 11920.2 12303.8 12344.4 12360.3 12392.7 7051.6 7326.0 7326.5 7338.9 7349.4 5320.3 5454.8 5485.5 5487.1 5728.4 10889.1 10897.3 11013.8 11109.1 11169.1 11183.7 11298.9 11306.2 11398.7 11492.3 6717.8 6872.9 8386.5 8939.0 8942.6 9314.4 9481.4 9533.1 9545.5 9554.8 7535.8 7612.7 7645.9 7716.2 7863.6 7419.7 7501.1 7625.8 7733.8 7777.9 7046.1 7140.4 7234.2 7240.8 7257.0 4955.9 5269.1 5303.4 5304.3 5353.8 4912.5 4927.2 5008.3 5014.7 5165.0 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | [#4] prototype.html Cycles:180 Average:4813.47 Median:5475.17 stddev:1414.80 (25.8%) stddev-sans-first:1378.66 08:44:53 INFO - PID 9504 | Values: 356.9 373.3 373.5 377.1 383.9 5568.5 5570.4 5578.7 5594.0 5619.1 5453.4 5461.2 5462.9 5466.3 5474.4 4163.2 4249.2 4279.4 4286.4 4312.8 4278.7 4291.3 4295.4 4297.0 4309.3 4262.3 4269.3 4275.6 4282.8 4300.6 4168.7 4280.1 4286.5 4288.7 4288.8 3808.2 3842.5 3844.8 3846.0 3867.1 5365.7 5379.4 5387.3 5401.3 5405.6 4988.7 5068.0 5089.3 5103.5 5106.6 5770.1 5814.4 5815.7 5824.2 5835.4 4317.7 4317.8 4325.2 4328.1 4332.6 5476.0 6013.5 6131.8 6133.7 6155.5 4042.0 4054.1 4086.8 4088.2 4091.2 4121.2 4123.6 4133.4 4136.0 4139.2 4718.2 4760.8 4769.4 4784.2 4788.8 5782.7 5793.6 5794.7 5798.7 5811.2 1392.1 1396.0 1396.1 1400.3 1416.8 907.3 931.8 959.3 968.0 968.4 5119.0 5119.2 5130.2 5136.4 5143.6 6020.2 6030.7 6058.5 6060.7 6068.8 4895.7 5088.3 5110.3 5114.7 5158.4 3152.7 3169.6 3182.2 3190.5 3201.1 5436.3 5673.6 5698.8 5699.3 5701.7 5995.7 6082.6 6149.8 6157.8 6180.3 5648.7 5649.7 5660.2 5667.2 5680.5 5742.8 5949.4 5995.7 6011.7 6023.0 5858.9 5880.6 5918.3 5918.6 5928.0 5634.1 5637.5 5644.9 5657.3 5661.3 4046.4 4077.3 4083.3 4102.3 4115.2 6040.6 6046.2 6049.5 6062.5 6071.3 5659.3 5818.3 5822.0 5823.7 5826.4 5710.2 5770.7 5780.6 5811.2 5819.7 5694.7 5701.9 5702.1 5726.9 5734.7 5617.0 5806.1 5843.1 5854.2 5864.7 5673.3 5682.0 5684.8 5686.6 5691.3 08:44:53 INFO - PID 9504 | 08:44:53 INFO - PID 9504 | [#5] yui.html Cycles:180 Average:14920.23 Median:3349.60 stddev:17434.57 (520.5%) stddev-sans-first:17450.87 08:44:53 INFO - PID 9504 | Values: 720.9 734.9 752.5 757.4 770.7 12648.5 13143.0 13330.9 13748.6 15052.5 14103.6 14624.1 14780.2 15035.2 15133.9 894.4 911.8 912.1 913.9 915.9 821.7 897.1 912.0 917.8 920.8 948.4 954.8 955.8 956.2 958.6 954.0 954.1 955.3 956.5 958.6 692.8 699.4 699.9 702.2 702.5 12809.3 12880.4 12901.6 12907.4 14058.5 13318.2 14238.1 14434.9 14544.5 14588.1 12629.6 13768.4 13923.1 14019.9 14070.3 2752.1 2794.3 2802.3 2804.3 2835.2 66861.0 68367.3 69246.0 70242.0 70472.6 12443.3 12534.7 12715.5 12815.6 12855.4 18936.5 19083.9 19626.3 19708.2 20015.6 5941.5 6109.6 6115.3 6118.1 6136.5 3010.2 3061.7 3064.1 3096.3 3107.5 3326.6 3335.1 3364.1 3382.4 3400.8 651.2 666.0 666.1 667.9 668.7 556.9 568.6 578.3 579.5 592.1 9039.8 9235.2 9476.1 9544.1 9794.9 538.5 543.4 554.5 555.3 563.3 4730.1 4842.9 4970.3 4987.9 5225.8 56530.4 56656.2 59823.0 64579.4 66639.7 50230.5 50556.5 50696.2 52070.0 52409.0 45251.0 46305.5 46883.8 47137.0 48958.0 9969.6 10195.5 10252.6 10520.6 10785.5 24857.8 25424.9 26291.7 26366.0 26702.7 42940.0 43261.6 43390.8 43835.3 45478.5 13624.1 13890.7 13898.7 14051.4 14169.3 14715.5 14764.7 14829.5 14921.8 15053.4 13837.2 13842.4 13876.3 13889.7 14173.1 13279.3 13385.7 13463.5 13506.0 13608.5 13288.5 13417.5 13462.9 13495.3 13572.0 10004.0 10129.8 10269.2 10278.5 10832.8 10592.7 10985.2 11188.4 11273.8 11296.0 08:44:53 INFO - PID 9504 | -------- Summary: end -------- 08:44:53 INFO - PID 9504 | 08:44:54 INFO - TEST-INFO | 9504: exit 0 08:44:54 INFO - TEST-OK | dromaeo_css | took 1119955ms 08:44:54 INFO - TEST-START | kraken 08:44:54 INFO - operating with platform_type : linux_ 08:44:54 INFO - Initialising browser for kraken test... 08:44:54 INFO - TEST-INFO | started process 9930 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYCFbJc/profile http://localhost:38412/getInfo.html) 08:44:58 INFO - PID 9930 | __metrics Screen width/height:1600/1200 08:44:58 INFO - PID 9930 | colorDepth:24 08:44:58 INFO - PID 9930 | Browser inner width/height: 1024/695 08:44:58 INFO - PID 9930 | __metrics 08:45:00 INFO - TEST-INFO | 9930: exit 0 08:45:00 INFO - Browser initialized. 08:45:00 INFO - Running cycle 1/1 for kraken test... 08:45:00 INFO - TEST-INFO | started process 10100 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYCFbJc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:45:12 INFO - PID 10100 | RSS: Main: 160030720 08:45:12 INFO - PID 10100 | 08:45:15 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38412/tests/kraken/driver.html?testName=audio-beat-detection) 08:45:16 INFO - PID 10100 | RSS: Main: 166100992 08:45:16 INFO - PID 10100 | 08:45:18 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38412/tests/kraken/driver.html?testName=audio-dft) 08:45:19 INFO - PID 10100 | RSS: Main: 165076992 08:45:19 INFO - PID 10100 | 08:45:22 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38412/tests/kraken/driver.html?testName=audio-fft) 08:45:22 INFO - PID 10100 | RSS: Main: 161517568 08:45:22 INFO - PID 10100 | 08:45:24 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38412/tests/kraken/driver.html?testName=audio-oscillator) 08:45:25 INFO - PID 10100 | RSS: Main: 161902592 08:45:25 INFO - PID 10100 | 08:45:27 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38412/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:45:28 INFO - PID 10100 | RSS: Main: 162672640 08:45:28 INFO - PID 10100 | 08:45:31 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38412/tests/kraken/driver.html?testName=imaging-darkroom) 08:45:32 INFO - PID 10100 | RSS: Main: 167682048 08:45:32 INFO - PID 10100 | 08:45:35 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38412/tests/kraken/driver.html?testName=imaging-desaturate) 08:45:36 INFO - PID 10100 | RSS: Main: 165675008 08:45:36 INFO - PID 10100 | 08:45:39 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38412/tests/kraken/driver.html?testName=json-parse-financial) 08:45:39 INFO - PID 10100 | RSS: Main: 166723584 08:45:39 INFO - PID 10100 | 08:45:41 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38412/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:45:42 INFO - PID 10100 | RSS: Main: 166871040 08:45:42 INFO - PID 10100 | 08:45:43 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:45:44 INFO - PID 10100 | RSS: Main: 167043072 08:45:44 INFO - PID 10100 | 08:45:46 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:45:47 INFO - PID 10100 | RSS: Main: 166952960 08:45:47 INFO - PID 10100 | 08:45:49 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:45:50 INFO - PID 10100 | RSS: Main: 167288832 08:45:50 INFO - PID 10100 | 08:45:53 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:45:54 INFO - PID 10100 | RSS: Main: 167538688 08:45:54 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | Cycle 1(1): loaded http://localhost:38412/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38412/tests/kraken/driver.html?testName=ai-astar) 08:45:56 INFO - PID 10100 | RSS: Main: 169029632 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | __start_tp_report 08:45:56 INFO - PID 10100 | _x_x_mozilla_page_load 08:45:56 INFO - PID 10100 | _x_x_mozilla_page_load_details 08:45:56 INFO - PID 10100 | |i|pagename|runs| 08:45:56 INFO - PID 10100 | |0;ai-astar;106;111;112;111;112;111;112;113;113;112 08:45:56 INFO - PID 10100 | |1;audio-beat-detection;148;125;126;173;125;128;126;124;144;124 08:45:56 INFO - PID 10100 | |2;audio-dft;163;164;163;165;166;166;173;165;166;165 08:45:56 INFO - PID 10100 | |3;audio-fft;75;75;75;114;75;77;75;74;92;75 08:45:56 INFO - PID 10100 | |4;audio-oscillator;84;85;106;84;83;83;104;84;84;101 08:45:56 INFO - PID 10100 | |5;imaging-gaussian-blur;114;114;117;114;115;114;115;118;114;115 08:45:56 INFO - PID 10100 | |6;imaging-darkroom;151;150;151;153;150;155;153;154;150;151 08:45:56 INFO - PID 10100 | |7;imaging-desaturate;96;94;94;95;96;95;95;96;95;94 08:45:56 INFO - PID 10100 | |8;json-parse-financial;54;54;53;53;54;54;57;54;54;54 08:45:56 INFO - PID 10100 | |9;json-stringify-tinderbox;56;55;56;56;55;55;55;55;55;56 08:45:56 INFO - PID 10100 | |10;stanford-crypto-aes;82;83;81;81;82;82;81;84;82;83 08:45:56 INFO - PID 10100 | |11;stanford-crypto-ccm;133;132;140;132;132;133;130;137;183;131 08:45:56 INFO - PID 10100 | |12;stanford-crypto-pbkdf2;181;189;187;183;190;189;189;193;188;188 08:45:56 INFO - PID 10100 | |13;stanford-crypto-sha256-iterative;72;72;70;71;72;74;71;71;71;71 08:45:56 INFO - PID 10100 | __end_tp_report 08:45:56 INFO - PID 10100 | __start_cc_report 08:45:56 INFO - PID 10100 | _x_x_mozilla_cycle_collect,836 08:45:56 INFO - PID 10100 | __end_cc_report 08:45:56 INFO - PID 10100 | __startTimestamp1494258356475__endTimestamp 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | ------- Summary: start ------- 08:45:56 INFO - PID 10100 | Number of tests: 14 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#0] ai-astar Cycles:10 Average:111.30 Median:112.00 stddev:2.00 (1.8%) stddev-sans-first:0.78 08:45:56 INFO - PID 10100 | Values: 106.0 111.0 112.0 111.0 112.0 111.0 112.0 113.0 113.0 112.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#1] audio-beat-detection Cycles:10 Average:134.30 Median:127.00 stddev:16.13 (12.7%) stddev-sans-first:16.33 08:45:56 INFO - PID 10100 | Values: 148.0 125.0 126.0 173.0 125.0 128.0 126.0 124.0 144.0 124.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#2] audio-dft Cycles:10 Average:165.60 Median:165.50 stddev:2.84 (1.7%) stddev-sans-first:2.85 08:45:56 INFO - PID 10100 | Values: 163.0 164.0 163.0 165.0 166.0 166.0 173.0 165.0 166.0 165.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#3] audio-fft Cycles:10 Average:80.70 Median:75.00 stddev:12.87 (17.2%) stddev-sans-first:13.48 08:45:56 INFO - PID 10100 | Values: 75.0 75.0 75.0 114.0 75.0 77.0 75.0 74.0 92.0 75.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#4] audio-oscillator Cycles:10 Average:89.80 Median:84.00 stddev:9.66 (11.5%) stddev-sans-first:10.01 08:45:56 INFO - PID 10100 | Values: 84.0 85.0 106.0 84.0 83.0 83.0 104.0 84.0 84.0 101.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#5] imaging-gaussian-blur Cycles:10 Average:115.00 Median:115.00 stddev:1.41 (1.2%) stddev-sans-first:1.45 08:45:56 INFO - PID 10100 | Values: 114.0 114.0 117.0 114.0 115.0 114.0 115.0 118.0 114.0 115.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#6] imaging-darkroom Cycles:10 Average:151.80 Median:152.00 stddev:1.81 (1.2%) stddev-sans-first:1.90 08:45:56 INFO - PID 10100 | Values: 151.0 150.0 151.0 153.0 150.0 155.0 153.0 154.0 150.0 151.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.82 (0.9%) stddev-sans-first:0.78 08:45:56 INFO - PID 10100 | Values: 96.0 94.0 94.0 95.0 96.0 95.0 95.0 96.0 95.0 94.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#8] json-parse-financial Cycles:10 Average:54.10 Median:54.00 stddev:1.10 (2.0%) stddev-sans-first:1.17 08:45:56 INFO - PID 10100 | Values: 54.0 54.0 53.0 53.0 54.0 54.0 57.0 54.0 54.0 54.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#9] json-stringify-tinderbox Cycles:10 Average:55.40 Median:55.50 stddev:0.52 (0.9%) stddev-sans-first:0.50 08:45:56 INFO - PID 10100 | Values: 56.0 55.0 56.0 56.0 55.0 55.0 55.0 55.0 55.0 56.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#10] stanford-crypto-aes Cycles:10 Average:82.10 Median:82.00 stddev:0.99 (1.2%) stddev-sans-first:1.05 08:45:56 INFO - PID 10100 | Values: 82.0 83.0 81.0 81.0 82.0 82.0 81.0 84.0 82.0 83.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#11] stanford-crypto-ccm Cycles:10 Average:138.30 Median:133.00 stddev:15.99 (12.0%) stddev-sans-first:16.84 08:45:56 INFO - PID 10100 | Values: 133.0 132.0 140.0 132.0 132.0 133.0 130.0 137.0 183.0 131.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:187.70 Median:189.00 stddev:3.43 (1.8%) stddev-sans-first:2.65 08:45:56 INFO - PID 10100 | Values: 181.0 189.0 187.0 183.0 190.0 189.0 189.0 193.0 188.0 188.0 08:45:56 INFO - PID 10100 | 08:45:56 INFO - PID 10100 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.50 Median:71.50 stddev:1.08 (1.5%) stddev-sans-first:1.13 08:45:56 INFO - PID 10100 | Values: 72.0 72.0 70.0 71.0 72.0 74.0 71.0 71.0 71.0 71.0 08:45:56 INFO - PID 10100 | -------- Summary: end -------- 08:45:56 INFO - PID 10100 | 08:45:57 INFO - TEST-INFO | 10100: exit 0 08:45:57 INFO - TEST-OK | kraken | took 63714ms 08:45:57 INFO - SUITE-END | took 1183s 08:45:58 INFO - Completed test suite (00:19:44) 08:45:58 INFO - javascript benchmark 08:45:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6630.610422632206, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2722.101706436876, 2743.1770468859363, 2753.6833264174625, 2765.460735156644, 2788.916332510023, 5042.9914017196525, 5202.583793296532, 5218.921716174261, 5232.6075544334235, 5235.0, 5159.303494028305, 5186.896262074766, 5208.296879921209, 5255.658382205163, 5301.655392399492, 4609.608183304406, 4635.374224479702, 4652.511486293941, 4664.673472856902, 4726.291056341542, 4667.323238130469, 4694.53054694533, 4730.881727956811, 4732.597729193023, 4759.381280433556, 4590.60979816716, 4594.563516465931, 4649.976750116228, 4658.930116048262, 4679.789409476582, 4678.134545109166, 4682.508336624674, 4699.577038066556, 4710.9764451177525, 4729.935764453005, 4594.0, 4658.953410465886, 4660.883477913046, 4670.042641258534, 4680.110778951988, 5074.746262686851, 5136.717480538568, 5149.588032957355, 5230.816921407771, 5231.712255825966, 5659.349174844904, 5665.1502274658715, 5677.716114194315, 5708.20085188074, 5751.626144300607, 5685.630434021817, 5686.317641883001, 5695.886082278373, 5699.287589051369, 5707.3721890592005, 5194.636375453758, 5267.683938963598, 5294.364676238876, 5307.920381194285, 5314.73426328682, 5664.980303545319, 5732.971335143297, 5761.452661997104, 5763.0, 5766.04860198071, 5563.499285064283, 5585.497305242548, 5591.804286849941, 5632.5212356950115, 5634.352049514277, 5495.53287970519, 5653.038983372837, 5655.264815573949, 5680.204771332017, 5691.3170419549915, 5506.504414602705, 5566.35986861508, 5601.215829783833, 5615.382307946123, 5632.633878797865, 5511.834644960658, 5544.473275038865, 5554.805716770833, 5560.277163968739, 5579.358373787067, 4526.366308716782, 4537.296719008559, 4548.1813273610405, 4567.200739870509, 4577.793999270041, 3963.3460479021214, 4014.739041962263, 4015.678745700337, 4024.2756303865, 4030.8186131624147, 4835.153848076572, 4850.781714822841, 4855.878603034952, 4856.878578035577, 4863.781129849165, 5615.8876822464135, 5622.353429355595, 5624.91562626561, 5635.436456354331, 5635.605507614509, 4827.710337379768, 4864.100141473838, 4864.610831133501, 4866.367372241657, 4981.925271120864, 4935.7532123393685, 4953.306537084811, 4963.6525443218625, 4965.975170124127, 5011.599072074226, 5309.946900530946, 5322.467753224647, 5340.626156169186, 5343.759530821045, 5347.946520534745, 5577.888442231051, 5634.352049514358, 5652.123920792284, 5657.886842263049, 5665.376808550974, 5360.222767698584, 5360.705161216015, 5374.785008599612, 5403.8108666196495, 5430.266913966564, 5587.217789509553, 5589.049861523632, 5597.6641401516035, 5598.440155984369, 5610.214569960127, 5569.303837020372, 5637.379888212211, 5715.457031581993, 5738.540916726568, 5792.652440853562, 5366.242038216623, 5466.125419932791, 5480.068388374066, 5489.807856724996, 5494.2857428534035, 5432.483914028161, 5457.317835270591, 5458.372287186866, 5464.426235245401, 5466.699331536644, 5287.9735601321745, 5325.840224793263, 5337.546308563816, 5389.8922021558565, 5391.730413479232, 5432.809851655331, 5493.368262649687, 5520.91718624229, 5531.612787104864, 5565.7217139143695, 5308.362996440452, 5323.441038690882, 5324.148136298329, 5324.281222035131, 5330.573554115584], "value": 5110.578844623466, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [707.2715103443453, 716.9032180655613, 1007.3200589602017, 1028.321307936762, 1102.2119184782878, 30056.797728090878, 31028.06915792524, 31243.0, 31254.68745312546, 31290.06129816109, 28832.0, 28894.277643058882, 29004.0, 29156.416871662554, 29171.416571668608, 5196.688198708071, 5307.787688492475, 6352.809415717536, 6487.7729279475225, 6488.0, 6742.359475849787, 6850.93149068508, 6879.140107486564, 6900.378965893068, 6903.6548172591165, 6944.375006249436, 6995.160580730319, 7000.579965202079, 7003.47473939454, 7018.859622807541, 6903.6548172591165, 6927.307269273032, 6947.305269473063, 6952.304769523058, 6957.443404527626, 6822.829429264259, 6891.517593768438, 6892.172939247273, 6894.448444124458, 6907.274736152732, 30745.0, 31041.379172416426, 31102.0, 31120.0, 31235.219119521968, 3001.294695746498, 3010.036788227768, 3018.0644000359957, 3022.8035177713377, 3043.3761078978755, 23655.0, 23778.64332035021, 23796.881015594983, 23940.880295598585, 23971.161009364587, 2976.627921509811, 2977.493826049577, 2978.8212707237417, 2979.493486107367, 2984.388200418909, 137240.0, 137695.0, 137804.31097844546, 138047.0, 138212.0, 37972.43041354382, 39645.80177099096, 39655.0, 39958.40062399067, 40084.0, 40962.0, 40984.590154098674, 41348.0, 41370.79314603468, 41412.0, 12816.743665126645, 12908.741825163444, 12919.741605168032, 13014.609561713163, 13044.152130111512, 10117.140043096271, 10227.0, 10307.84538231927, 10352.585896564204, 10354.585816567404, 12480.315157453628, 12594.81107783384, 12620.621381358575, 12652.114351995457, 12828.422720977578, 5277.947220527745, 5282.920756188661, 5289.70906600133, 5357.919631205535, 5358.33020872391, 874.5452364770284, 904.5115637555647, 907.7957459571544, 912.4342907397456, 922.391221793613, 20702.171913123606, 21292.254771083248, 21441.785582143977, 21471.355859324245, 21915.561688766134, 970.3207754571828, 983.7884854756119, 1000.3847633705365, 1002.3484734922213, 1005.2762011351815, 11045.171612129123, 11143.442827858575, 11218.326900386002, 11335.43322833855, 11383.975442210241, 175374.0, 175729.0, 175885.0, 176521.1173944122, 177385.0, 39849.20301593952, 40101.1979760409, 40155.799221004294, 40162.598374016474, 40250.19499609991, 1199.9764132400298, 1223.6084452974962, 1227.4415141110774, 1227.5887577661406, 1232.1436601562007, 20272.0, 20391.898040509703, 21069.473263168544, 21252.468688282297, 21540.676889846352, 27614.585781212896, 27660.723392765816, 27669.16992490148, 27679.30801729973, 27723.445531088862, 131722.0, 134140.0, 150023.0, 150492.0, 151095.0, 26335.34161645974, 26639.0, 27004.189874303804, 27011.189664310103, 27112.593311100743, 30877.228069298446, 31731.36537269288, 32089.67910320867, 32480.350392991535, 32536.34927301488, 24998.125065622615, 25466.745332546438, 25477.872610636827, 26103.0, 26302.21093367202, 24572.754272457045, 24816.0, 25278.74721252764, 26308.605370919835, 26570.0, 27102.864485678234, 27900.30249243785, 28078.71921280761, 28108.297292567848, 28156.155315340573, 24115.517689646458, 24265.878670606533, 24319.392015199763, 25014.624780627943, 25212.369690757878, 20269.0, 21084.0, 21122.788772112082, 21147.78852211458, 21152.153913843274], "value": 14007.821313781693, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [392.3545767212935, 401.85131501344506, 418.73201151263186, 427.7369417808049, 431.14848174854654, 11421.179260769217, 12110.878891211085, 16753.664926701473, 17311.740323895152, 17409.477715668534, 13954.860451395483, 17657.64684706305, 17967.82032179678, 17976.91011544944, 18038.278468861263, 5464.754086066127, 5568.081266591008, 5608.074667679828, 5621.381648018714, 5658.151277308396, 5212.609054320922, 5395.244665746799, 5421.132618780976, 5455.863603409907, 5473.644213126154, 5415.350157981028, 5418.756155972991, 5427.023135835568, 5443.428440013801, 5451.2640793492965, 5289.497497737709, 5523.475269849358, 5525.640833345839, 5547.667139971614, 5560.833175004756, 5024.773885175139, 5041.0, 5046.09170349337, 5048.469910659402, 5053.444121146671, 21964.560708785895, 22202.55594888093, 22705.545889082292, 23619.40951476227, 23675.289741307788, 1647.5551601067764, 1702.8552573031307, 1709.991450042742, 1712.9057901815395, 1713.4088739384893, 14282.714345713028, 14939.626509337244, 14970.101793892292, 15071.09573425587, 15133.167675777828, 2110.0610228448345, 2111.915523379063, 2156.256091648379, 2180.760116387196, 2187.212603462768, 89985.55007224987, 91068.0, 91532.0, 94096.0, 96437.51781241049, 10984.395858227874, 11111.611093611686, 11184.664460066211, 11394.94302528482, 11702.2978621283, 15861.841381586268, 15883.444079457395, 15913.204339782964, 15982.60043498922, 15983.360665573247, 7621.466497345133, 7665.195154508808, 7924.841503169904, 7966.800829979297, 8001.279884810278, 7105.822354441077, 7106.111736032996, 7139.178994415709, 7321.816954576072, 7332.853342933112, 7060.18807837095, 7082.752103676346, 7128.718809980756, 7163.462740294499, 7200.207977122513, 2096.5282811367624, 2098.213170061227, 2116.745990481152, 2136.786321367882, 2290.4617414907484, 821.8315245374683, 844.9239568438747, 865.7056600755773, 866.4108406283661, 875.2866413872673, 17050.914745426195, 17244.827551724324, 17663.0, 17765.822341776675, 17859.196336164903, 861.5132450165636, 876.1851478125404, 878.1657425445852, 884.274894586433, 885.3315746611396, 9307.255419566418, 9665.758356041015, 9779.26655500826, 9876.506174691236, 9883.357581757307, 378989.0, 383499.0, 388004.0, 390415.0, 391101.0, 72860.63569682224, 73382.2661773386, 73815.63092184505, 75253.62373188099, 77865.2213477858, 1037.766502536923, 1052.1898138433364, 1068.7167900506372, 1115.8214685650257, 1126.037238161393, 17702.557436064202, 17808.643827123127, 18703.82035054017, 18747.718784217974, 18917.90541047286, 38947.2210555793, 40288.0, 40330.193396131326, 40516.1896762069, 41344.37983430311, 50227.24659130043, 50587.24119138142, 50791.23813142732, 50875.491245087076, 51710.482895170564, 8246.216609422096, 8358.749237522885, 8419.11599282091, 8515.40392172542, 8560.91439085601, 12617.93691031539, 13163.53927612529, 13174.275414852274, 13503.12229705066, 13531.932340338235, 11021.44892755375, 11036.613718519813, 11103.278286911325, 11829.467673954865, 11892.405379731152, 9815.901840981498, 9945.900540994788, 10089.142422894136, 10091.545880435251, 10982.286151400134, 11126.721831954266, 11203.159763017644, 11817.231879927776, 11839.526418943491, 11916.940415297868, 8298.21166989135, 8417.24658857322, 8541.701040463555, 8594.398392112493, 8753.29973602123, 11292.378919159524, 11331.830022549833, 11379.317240965569, 11504.0, 11598.07215422781], "value": 8953.569473581483, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1187.8277649740787, 1239.8574163971145, 1250.3560666256874, 1252.6805664555536, 1255.008543250832, 8935.285177185826, 9215.354925155241, 9241.537923103842, 9352.251819854404, 9451.810963780721, 9306.162445379914, 9429.858552121706, 9474.573644186012, 9477.38397004196, 9491.952540237306, 2140.240214723774, 2162.113533451285, 2169.8698078115362, 2181.454636340915, 2183.6287831068757, 2125.978740212601, 2181.2365672014826, 2192.5176461178517, 2194.4623567226054, 2194.5830292244423, 1998.1308130963077, 2008.7589489261236, 2042.9795702043011, 2051.476873397289, 2051.7332746742977, 2092.3304542546393, 2134.1570079818384, 2140.818030467412, 2141.36829635258, 2147.559750251203, 2011.0648548425052, 2076.512019675375, 2133.0827744070043, 2135.3273718778537, 2143.3034263864306, 9051.321150913642, 9113.863292050559, 9147.22248608869, 9169.495677737721, 9201.033891441437, 5138.743062846843, 5302.125149350352, 5312.2297266896085, 5323.600729945231, 5355.062863998824, 3124.906252812419, 3283.1627934876456, 3339.2820543583002, 3361.478970759536, 3397.2186397128553, 1071.410724101741, 1086.8804431512526, 1091.9508622112023, 1143.7598104398087, 1148.718563951837, 13547.187168769906, 13657.317134143253, 13709.108907921052, 13734.93132534331, 13735.381907814073, 4341.435613370305, 4426.1369033038245, 4694.788734506956, 4701.059788042405, 4720.952790472052, 10082.949585252027, 10086.142677872464, 10113.0, 10122.54448549817, 10124.190064794799, 5226.033183860998, 5227.424983251839, 5229.424763276113, 5229.529342359206, 5235.319408476874, 4578.725276483422, 4580.152671755736, 4622.237330840374, 4850.975745121323, 4856.757162141878, 3762.0, 3835.137094153793, 3864.381698928158, 3914.080191155076, 3942.7634341939, 1175.8236264560214, 1182.810750279951, 1183.0476466444422, 1196.916215864881, 1199.736058067224, 645.4320198225531, 671.177807186193, 694.5520139509988, 694.6804469943781, 697.194740075214, 4957.90084198314, 5035.219540971156, 5041.873953151201, 5228.320318358589, 6224.719887605069, 810.2545657994659, 825.4675734151439, 827.8509868223657, 840.13885767088, 840.1808236968907, 3401.727861771052, 3483.8606455741487, 3493.406120959392, 3526.523919270917, 3597.8201089945396, 11830.822537661941, 12384.81422778659, 12425.068119891044, 12436.689082772822, 12448.875511244953, 11920.225185362924, 12303.75392492163, 12344.444499997522, 12360.320182389874, 12392.690182745504, 7051.612161331073, 7326.04761381017, 7326.4505162113055, 7338.889916651361, 7349.448791340671, 5320.255164277081, 5454.754536045967, 5485.451454854483, 5487.094629386106, 5728.4271572844045, 10889.074428673335, 10897.346159230472, 11013.83479247796, 11109.055730263019, 11169.106471482099, 11183.664490065312, 11298.887011130113, 11306.208565400342, 11398.658040258806, 11492.310461372344, 6717.764878229434, 6872.931270687229, 8386.454880432751, 8938.955305223431, 8942.552872356486, 9314.394564353295, 9481.431114133175, 9533.142017218484, 9545.47499887485, 9554.761130971503, 7535.773926781986, 7612.657430415534, 7645.885311720217, 7716.228377162463, 7863.646135924012, 7419.740309089372, 7501.1373692023935, 7625.771226863203, 7733.845323093619, 7777.922220777946, 7046.084009078992, 7140.428765698628, 7234.16807067173, 7240.782776516713, 7256.963715181601, 4955.900881982412, 5269.077911365419, 5303.390110137384, 5304.283921670525, 5353.759080841293, 4912.48418916023, 4927.211646136601, 5008.273800299009, 5014.674046186986, 5164.9741751291], "value": 4519.788814796902, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [356.86974254397137, 373.2553555656464, 373.5293530152008, 377.07616339967086, 383.9289731399691, 5568.470995255449, 5570.359408668004, 5578.693171875545, 5593.972030139854, 5619.129034999576, 5453.3728621208575, 5461.18082287657, 5462.945370546303, 5466.289382380295, 5474.37044739855, 4163.20899029185, 4249.192653395845, 4279.379489973952, 4286.39990401344, 4312.784360781964, 4278.743275403485, 4291.304934550851, 4295.377170310303, 4297.0, 4309.267424537836, 4262.254105531535, 4269.252880745873, 4275.593818587229, 4282.7858607069675, 4300.6344460720875, 4168.687348448879, 4280.079782846703, 4286.485621725397, 4288.69979101463, 4288.849890253858, 3808.21931504041, 3842.4812650292133, 3844.788536630484, 3845.9615403845883, 3867.0719027433215, 5365.651232669903, 5379.435159308256, 5387.272718183034, 5401.297831281908, 5405.648632838853, 4988.6757360771435, 5068.0, 5089.312942752718, 5103.54068133866, 5106.591472682177, 5770.105633626795, 5814.418558144194, 5815.680137592431, 5824.184614154022, 5835.387284335126, 4317.711612845165, 4317.805698743564, 4325.199838029975, 4328.091100868822, 4332.566743325674, 5475.972620136914, 6013.488853447462, 6131.816045518642, 6133.69331533426, 6155.507559395238, 4041.959580404217, 4054.1486287879875, 4086.836526538905, 4088.2232375848494, 4091.2226676931286, 4121.196366708463, 4123.60825721556, 4133.42132101506, 4135.958640413617, 4139.234241665302, 4718.245080787057, 4760.809567617256, 4769.35613692154, 4784.186688263004, 4788.760561971888, 5782.710864456761, 5793.594448388572, 5794.710264486759, 5798.739056742456, 5811.215485909433, 1392.095138160204, 1395.9720805583831, 1396.1274203622736, 1400.3068481101716, 1416.752068388028, 907.3467103685336, 931.7886747228575, 959.3045042344384, 967.9564419601135, 968.4237878462303, 5119.029173768126, 5119.206522988943, 5130.153524668388, 5136.38203965757, 5143.639945203875, 6020.207269420324, 6030.728617212236, 6058.515318774487, 6060.666663333471, 6068.848278793065, 4895.6817806843155, 5088.262201980766, 5110.28456016158, 5114.71869047206, 5158.38099428071, 3152.7004934531183, 3169.6196456425378, 3182.220356012792, 3190.5373720810353, 3201.143336864613, 5436.266104075979, 5673.602847800615, 5698.772049118072, 5699.344575373885, 5701.686407247641, 5995.700214989233, 6082.635041897501, 6149.815505534841, 6157.768446310666, 6180.289266734383, 5648.717564121777, 5649.717514124277, 5660.2075709400715, 5667.234923285304, 5680.460356266148, 5742.827715168552, 5949.405059494016, 5995.700214989321, 6011.72947217385, 6022.969885150546, 5858.882822343444, 5880.647161170344, 5918.260217472816, 5918.644881307136, 5928.0, 5634.070378387521, 5637.49262566371, 5644.915326270027, 5657.349404818498, 5661.348944871393, 4046.3728122141115, 4077.3272410053196, 4083.3466645336603, 4102.261592913304, 4115.218108559364, 6040.607360521552, 6046.183765191643, 6049.455549000611, 6062.454379105901, 6071.332153463027, 5659.349174844946, 5818.301803783573, 5821.970890145522, 5823.651400444846, 5826.41735826414, 5710.229119068873, 5770.711464426846, 5780.566457515619, 5811.215485909348, 5819.6508209507565, 5694.715264236855, 5701.914471283017, 5702.116171993348, 5726.942730572641, 5734.655920644775, 5616.971915140398, 5806.129080637938, 5843.1235314703135, 5854.209681692917, 5864.736086876015, 5673.262475878275, 5682.005649011489, 5684.77260909559, 5686.57350698691, 5691.3170419549915], "value": 4367.193462623998, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [720.8738470767614, 734.8860926556382, 752.5334292738502, 757.3827330725459, 770.7263921307936, 12648.494060237592, 13143.0, 13330.866691333096, 13748.58754237372, 15052.473163439281, 14103.647408814759, 14624.122552646848, 14780.187089710062, 15035.248237588105, 15133.92433037836, 894.4186278918689, 911.803962148138, 912.0696889173073, 913.9177474027337, 915.9038300978401, 821.708293555788, 897.1208215948375, 911.968081117161, 917.7889085510336, 920.779013036873, 948.3788118782209, 954.8138113067954, 955.7753927826955, 956.220680145679, 958.5925981457852, 953.9713808585719, 954.0840792838883, 955.3169483819067, 956.516958935733, 958.6117622362954, 692.8025512728899, 699.4299645788666, 699.867025265198, 702.1714377035097, 702.4871843554234, 12809.295488748116, 12880.420381082873, 12901.612951611467, 12907.419166137452, 14058.507952221624, 13318.200907945555, 14238.145711257253, 14434.855651443457, 14544.490942817056, 14588.051776634486, 12629.621111366674, 13768.449262029506, 13923.094998825043, 14019.859801402059, 14070.296485175802, 2752.1330780804183, 2794.273488892882, 2802.341449759305, 2804.3129433288973, 2835.1777984384503, 66861.0, 68367.31632683659, 69246.0, 70242.0, 70472.59054818926, 12443.315617641116, 12534.74930501385, 12715.491380344683, 12815.551455699006, 12855.357232138356, 18936.52658683544, 19083.90458047701, 19626.313079042164, 19708.21167153298, 20015.599688006158, 5941.494972927263, 6109.633421994695, 6115.296740874856, 6118.1128736332985, 6136.539759518054, 3010.232390740347, 3061.73975212105, 3064.050144455226, 3096.287853793595, 3107.5494053362136, 3326.550915626408, 3335.116194208537, 3364.091695242271, 3382.3573521030926, 3400.7619466637593, 651.1632552170438, 666.0342503370036, 666.1040899989506, 667.8831204539187, 668.6790340636521, 556.858001209689, 568.5508448325776, 578.2627150383295, 579.4524174654911, 592.0674936974283, 9039.81920361589, 9235.215006724504, 9476.147146756824, 9544.141027307576, 9794.853077203848, 538.5045757902739, 543.3642638113416, 554.464941331617, 555.3308263542422, 563.3240111865778, 4730.101280756645, 4842.854714358575, 4970.304157417964, 4987.850364489072, 5225.817096401608, 56530.43469565334, 56656.15015774767, 59823.0, 64579.354206457334, 66639.66680166568, 50230.49769502331, 50556.494435055916, 50696.23955640668, 52070.0, 52409.0, 45251.0, 46305.53694463147, 46883.765581172556, 47136.986712259, 48958.0, 9969.601215951281, 10195.541200646137, 10252.64115755945, 10520.631777887736, 10785.514651840529, 24857.751422485544, 25424.872875636243, 26291.73708262893, 26366.0, 26702.732972670026, 42940.0, 43261.567384325754, 43390.783046084565, 43835.342469863615, 45478.54521454876, 13624.114432561852, 13890.652733681738, 13898.722025559635, 14051.36768845384, 14169.29153542298, 14715.484958026418, 14764.704705906037, 14829.480968166494, 14921.776173357626, 15053.397864085315, 13837.169769813843, 13842.4463021478, 13876.306184690524, 13889.65275868071, 14173.078749881637, 13279.269640169883, 13385.732285354043, 13463.528776492776, 13506.0, 13608.455661773418, 13288.468461261442, 13417.530386436429, 13462.932685336511, 13495.25776082325, 13572.0, 10004.0, 10129.797404051731, 10269.178465722875, 10278.537465813906, 10832.783344332911, 10592.682219533426, 10985.231033827555, 11188.440577970907, 11273.830892536782, 11296.0], "value": 6716.328359675806, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1532.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 111.0, 112.0, 111.0, 112.0, 111.0, 112.0, 113.0, 113.0, 112.0], "value": 111.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 125.0, 126.0, 173.0, 125.0, 128.0, 126.0, 124.0, 144.0, 124.0], "value": 134.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 163.0, 165.0, 166.0, 166.0, 173.0, 165.0, 166.0, 165.0], "value": 165.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 114.0, 75.0, 77.0, 75.0, 74.0, 92.0, 75.0], "value": 80.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 106.0, 84.0, 83.0, 83.0, 104.0, 84.0, 84.0, 101.0], "value": 89.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 117.0, 114.0, 115.0, 114.0, 115.0, 118.0, 114.0, 115.0], "value": 115.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 150.0, 151.0, 153.0, 150.0, 155.0, 153.0, 154.0, 150.0, 151.0], "value": 151.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 94.0, 94.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0, 94.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 53.0, 53.0, 54.0, 54.0, 57.0, 54.0, 54.0, 54.0], "value": 54.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 55.0, 56.0, 56.0, 55.0, 55.0, 55.0, 55.0, 55.0, 56.0], "value": 55.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 83.0, 81.0, 81.0, 82.0, 82.0, 81.0, 84.0, 82.0, 83.0], "value": 82.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 132.0, 140.0, 132.0, 132.0, 133.0, 130.0, 137.0, 183.0, 131.0], "value": 138.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [181.0, 189.0, 187.0, 183.0, 190.0, 189.0, 189.0, 193.0, 188.0, 188.0], "value": 187.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 72.0, 70.0, 71.0, 72.0, 74.0, 71.0, 71.0, 71.0, 71.0], "value": 71.5, "unit": "score"}]}]} 08:45:58 INFO - Return code: 0 08:45:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:45:58 INFO - # TBPL SUCCESS # 08:45:58 INFO - Running post-action listener: _resource_record_post_action 08:45:58 INFO - [mozharness: 2017-05-08 15:45:58.284737Z] Finished run-tests step (success) 08:45:58 INFO - Running post-run listener: _resource_record_post_run 08:45:58 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 8192; Write bytes: 358576128; Read time: 200; Write time: 248328 08:45:58 INFO - TinderboxPrint: CPU usage
13.2% 08:45:58 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 200 08:45:58 INFO - TinderboxPrint: I/O write bytes / time
358,576,128 / 248,328 08:45:58 INFO - TinderboxPrint: CPU idle
8,299.1 (86.7%) 08:45:58 INFO - TinderboxPrint: CPU user
1,214.8 (12.7%) 08:45:58 INFO - TinderboxPrint: Swap in / out
0 / 0 08:45:58 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 98062336; Read time: 0; Write time: 107804 08:45:58 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 4096; Write bytes: 260513792; Read time: 192; Write time: 140524 08:45:58 INFO - Running post-run listener: _upload_blobber_files 08:45:58 INFO - Blob upload gear active. 08:45:58 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:45:58 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 08:45:58 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', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:45:58 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 Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:45:59 INFO - (blobuploader) - INFO - Open directory for files ... 08:45:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:45:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:45:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:46:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:46:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:46:00 INFO - (blobuploader) - INFO - Done attempting. 08:46:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:46:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:46:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:46:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:46:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:46:01 INFO - (blobuploader) - INFO - Done attempting. 08:46:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:46:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:46:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:46:01 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:46:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:46:01 INFO - (blobuploader) - INFO - Done attempting. 08:46:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:46:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:46:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:46:05 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:46:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:46:05 INFO - (blobuploader) - INFO - Done attempting. 08:46:05 INFO - (blobuploader) - INFO - Iteration through files over. 08:46:05 INFO - Return code: 0 08:46:05 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:46:05 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:46:05 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/047aae252d660fdacbfebbb50f5073460b26d24d4c8d5a634c42abc15295c7ada8ca08772212b9d8ac04b29502a8076a8ac0fddef2cfbb0d88a86e63b3e0f800", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/af7873b74f9f63f07bdd868cd2fdefc8c8d3c2ead5378b30ec97fb86c29029c9523cfe8c0a0875aaf5df5304e6d1697ff16cbde8c38b8176c2cc93c16808fe60", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/472407a4331903d58fdfe9068149e2b3f5f7fa74e7ceec4d4207034e99a7bc23185c867c8965226256e85c4756ccee3a5277d944258662220a6f3383d4537d88", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da145c4d856615aaa7e2e0246c2eb042c52d1ea03e1e64314929d00468e42155b608b56ea94bd4752322c8957b47de1327a895577ce8ac55d1737034fd66050d"} 08:46:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:46:05 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:46:05 INFO - Contents: 08:46:05 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/047aae252d660fdacbfebbb50f5073460b26d24d4c8d5a634c42abc15295c7ada8ca08772212b9d8ac04b29502a8076a8ac0fddef2cfbb0d88a86e63b3e0f800", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/af7873b74f9f63f07bdd868cd2fdefc8c8d3c2ead5378b30ec97fb86c29029c9523cfe8c0a0875aaf5df5304e6d1697ff16cbde8c38b8176c2cc93c16808fe60", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/472407a4331903d58fdfe9068149e2b3f5f7fa74e7ceec4d4207034e99a7bc23185c867c8965226256e85c4756ccee3a5277d944258662220a6f3383d4537d88", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da145c4d856615aaa7e2e0246c2eb042c52d1ea03e1e64314929d00468e42155b608b56ea94bd4752322c8957b47de1327a895577ce8ac55d1737034fd66050d"} 08:46:05 INFO - Running post-run listener: copy_logs_to_upload_dir 08:46:05 INFO - Copying logs to upload dir... 08:46:05 INFO - mkdir: /builds/slave/test/build/upload/logs 08:46:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1257.737078 ========= master_lag: -0.48 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-05-08 08:46:03.961626) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-08 08:46:03.966349) ========= 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=db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792 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/Firefox-Non-PGO/sha512/047aae252d660fdacbfebbb50f5073460b26d24d4c8d5a634c42abc15295c7ada8ca08772212b9d8ac04b29502a8076a8ac0fddef2cfbb0d88a86e63b3e0f800", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/af7873b74f9f63f07bdd868cd2fdefc8c8d3c2ead5378b30ec97fb86c29029c9523cfe8c0a0875aaf5df5304e6d1697ff16cbde8c38b8176c2cc93c16808fe60", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/472407a4331903d58fdfe9068149e2b3f5f7fa74e7ceec4d4207034e99a7bc23185c867c8965226256e85c4756ccee3a5277d944258662220a6f3383d4537d88", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da145c4d856615aaa7e2e0246c2eb042c52d1ea03e1e64314929d00468e42155b608b56ea94bd4752322c8957b47de1327a895577ce8ac55d1737034fd66050d"} build_url:https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011358 build_url: 'https://queue.taskcluster.net/v1/task/Oe226z5xTsiEQ3kFoQ55xw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/047aae252d660fdacbfebbb50f5073460b26d24d4c8d5a634c42abc15295c7ada8ca08772212b9d8ac04b29502a8076a8ac0fddef2cfbb0d88a86e63b3e0f800", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/af7873b74f9f63f07bdd868cd2fdefc8c8d3c2ead5378b30ec97fb86c29029c9523cfe8c0a0875aaf5df5304e6d1697ff16cbde8c38b8176c2cc93c16808fe60", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/472407a4331903d58fdfe9068149e2b3f5f7fa74e7ceec4d4207034e99a7bc23185c867c8965226256e85c4756ccee3a5277d944258662220a6f3383d4537d88", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da145c4d856615aaa7e2e0246c2eb042c52d1ea03e1e64314929d00468e42155b608b56ea94bd4752322c8957b47de1327a895577ce8ac55d1737034fd66050d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-08 08:46:03.996159) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:46:03.996472) ========= 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=db7e7c15f3ca076d53731445000001ba-1494256523.927601-106659792 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004469 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 08:46:04.081722) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-08 08:46:04.085052) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-08 08:46:04.085350) ========= ========= Total master_lag: -0.12 =========