builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-023 starttime: 1487951330.74 results: success (0) revision: eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.737875) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.738432) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.738740) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.758637) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.759066) ========= 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=6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-24 07:48:51-- 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% 109M=0s 2017-02-24 07:48:52 (109 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.153520 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.926314) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.926675) ========= 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=6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014158 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.976651) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:50.976997) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671 --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=6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-24 07:48:52,127 truncating revision to first 12 chars 2017-02-24 07:48:52,127 Setting DEBUG logging. 2017-02-24 07:48:52,127 attempt 1/10 2017-02-24 07:48:52,127 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/eeeb9c132d0e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-24 07:48:52,672 unpacking tar archive at: mozilla-aurora-eeeb9c132d0e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.815130 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:51.805528) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:51.805871) ========= script_repo_revision: eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:51.806267) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:51.806551) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-24 07:48:51.814838) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2017-02-24 07:48:51.815186) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:48:53 INFO - MultiFileLogger online at 20170224 07:48:53 in /builds/slave/test 07:48:53 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 07:48:53 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:48:53 INFO - {'append_to_log': False, 07:48:53 INFO - 'base_work_dir': '/builds/slave/test', 07:48:53 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 07:48:53 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:48:53 INFO - 'branch': 'Mozilla-Aurora', 07:48:53 INFO - 'buildbot_json_path': 'buildprops.json', 07:48:53 INFO - 'config_files': ('talos/linux_config.py',), 07:48:53 INFO - 'default_actions': ('clobber', 07:48:53 INFO - 'read-buildbot-config', 07:48:53 INFO - 'download-and-extract', 07:48:53 INFO - 'populate-webroot', 07:48:53 INFO - 'create-virtualenv', 07:48:53 INFO - 'install', 07:48:53 INFO - 'run-tests'), 07:48:53 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:48:53 INFO - 'download_minidump_stackwalk': True, 07:48:53 INFO - 'download_symbols': 'ondemand', 07:48:53 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:48:53 INFO - 'tooltool.py': '/tools/tooltool.py', 07:48:53 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:48:53 INFO - '/tools/misc-python/virtualenv.py')}, 07:48:53 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:48:53 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:48:53 INFO - 'installer_path': 'installer.exe', 07:48:53 INFO - 'log_level': 'info', 07:48:53 INFO - 'log_name': 'talos', 07:48:53 INFO - 'log_to_console': True, 07:48:53 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:48:53 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:48:53 INFO - 'opt_config_files': (), 07:48:53 INFO - 'pip_index': False, 07:48:53 INFO - 'sps_profile': False, 07:48:53 INFO - 'sps_profile_interval': 0, 07:48:53 INFO - 'suite': 'dromaeojs', 07:48:53 INFO - 'system_bits': '32', 07:48:53 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:48:53 INFO - 'title': 'talos-linux64-ix-023', 07:48:53 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:48:53 INFO - 'use_talos_json': True, 07:48:53 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:48:53 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:48:53 INFO - 'work_dir': 'build'} 07:48:53 INFO - [mozharness: 2017-02-24 15:48:53.065150Z] Running clobber step. 07:48:53 INFO - Running pre-action listener: _resource_record_pre_action 07:48:53 INFO - Running main action method: clobber 07:48:53 INFO - rmtree: /builds/slave/test/build 07:48:53 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:48:53 INFO - Running post-action listener: _resource_record_post_action 07:48:53 INFO - [mozharness: 2017-02-24 15:48:53.995402Z] Finished clobber step (success) 07:48:53 INFO - [mozharness: 2017-02-24 15:48:53.995501Z] Running read-buildbot-config step. 07:48:53 INFO - Running pre-action listener: _resource_record_pre_action 07:48:53 INFO - Running main action method: read_buildbot_config 07:48:53 INFO - Using buildbot properties: 07:48:53 INFO - { 07:48:53 INFO - "project": "", 07:48:53 INFO - "product": "firefox", 07:48:53 INFO - "who": "jyavenard@mozilla.com", 07:48:53 INFO - "installer_path": "public/build/target.tar.bz2", 07:48:53 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 07:48:53 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 07:48:53 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 07:48:53 INFO - "stage_platform": "linux64-pgo", 07:48:53 INFO - "basedir": "/builds/slave/test", 07:48:53 INFO - "buildnumber": 1077, 07:48:53 INFO - "platform": "ubuntu64_hw", 07:48:53 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 07:48:53 INFO - "slavebuilddir": "test", 07:48:53 INFO - "taskId": "O6SZRCZBRnex0qGv8jrH7g", 07:48:53 INFO - "branch": "mozilla-aurora", 07:48:53 INFO - "script_repo_revision": "production", 07:48:53 INFO - "revision": "eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671", 07:48:53 INFO - "slavename": "talos-linux64-ix-023", 07:48:53 INFO - "repo_path": "releases/mozilla-aurora" 07:48:53 INFO - } 07:48:53 INFO - Finding installer, test and symbols from parent task. 07:48:53 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/O6SZRCZBRnex0qGv8jrH7g'}, attempt #1 07:48:54 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/O6SZRCZBRnex0qGv8jrH7g'}, attempt #1 07:48:54 INFO - Task dependencies: MLVliHpBTm-SW-3j6H1nLg 07:48:54 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg'}, attempt #1 07:48:55 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2 07:48:55 INFO - Set test_url: https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/test_packages.json 07:48:55 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.crashreporter-symbols.zip 07:48:55 INFO - Running post-action listener: _resource_record_post_action 07:48:55 INFO - [mozharness: 2017-02-24 15:48:55.382975Z] Finished read-buildbot-config step (success) 07:48:55 INFO - [mozharness: 2017-02-24 15:48:55.383192Z] Running download-and-extract step. 07:48:55 INFO - Running pre-action listener: _resource_record_pre_action 07:48:55 INFO - Running main action method: download_and_extract 07:48:55 INFO - mkdir: /builds/slave/test/build/tests 07:48: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')]} 07:48:55 INFO - trying https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.test_packages.json 07:48:55 INFO - Downloading https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 07:48:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 07:48:55 INFO - Downloaded 896 bytes. 07:48:55 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 07:48:55 INFO - Using the following test package requirements: 07:48:55 INFO - {u'common': [u'target.common.tests.zip'], 07:48:55 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 07:48:55 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 07:48:55 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 07:48:55 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 07:48:55 INFO - u'mozbase': [u'target.common.tests.zip'], 07:48:55 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 07:48:55 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 07:48:55 INFO - u'web-platform': [u'target.common.tests.zip', 07:48:55 INFO - u'target.web-platform.tests.zip'], 07:48:55 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 07:48:55 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 07:48:55 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.common.tests.zip 07:48:55 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.common.tests.zip'}, attempt #1 07:48:55 INFO - Fetch https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.common.tests.zip into memory 07:48:56 INFO - Expected file size: 21857919 07:48:56 INFO - Obtained file size: 21857919 07:49:00 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 07:49:00 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.common.tests.zip 07:49:00 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.common.tests.zip'}, attempt #1 07:49:00 INFO - Fetch https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.common.tests.zip into memory 07:49:01 INFO - Expected file size: 21857919 07:49:01 INFO - Obtained file size: 21857919 07:49:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.talos.tests.zip 07:49:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 07:49:06 INFO - Fetch https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.talos.tests.zip into memory 07:49:06 INFO - Expected file size: 14403472 07:49:06 INFO - Obtained file size: 14403472 07:49:07 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')]} 07:49:07 INFO - trying https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2 07:49:07 INFO - Downloading https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 07:49:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 07:49:08 INFO - Downloaded 66105030 bytes. 07:49:08 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2 07:49:08 INFO - mkdir: /builds/slave/test/properties 07:49:08 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:49:08 INFO - Writing to file /builds/slave/test/properties/build_url 07:49:08 INFO - Contents: 07:49:08 INFO - build_url:https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2 07:49:08 INFO - Running post-action listener: _resource_record_post_action 07:49:08 INFO - Running post-action listener: set_extra_try_arguments 07:49:08 INFO - [mozharness: 2017-02-24 15:49:08.433916Z] Finished download-and-extract step (success) 07:49:08 INFO - [mozharness: 2017-02-24 15:49:08.434012Z] Running populate-webroot step. 07:49:08 INFO - Running pre-action listener: _resource_record_pre_action 07:49:08 INFO - Running main action method: populate_webroot 07:49:08 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:49:08 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:49:08 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:49:08 INFO - '--tppagecycles', 07:49:08 INFO - '7'], 07:49:08 INFO - 'tests': ['tsvgm']}}, 07:49:08 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:49:08 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:49:08 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:49:08 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:49:08 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:49:08 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:49:08 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['damp', 'tps']}, 07:49:08 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'tests': ['damp', 'tps']}, 07:49:08 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['dromaeo_dom']}, 07:49:08 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:49:08 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['basic_compositor_video']}, 07:49:08 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 07:49:08 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['a11yr', 07:49:08 INFO - 'ts_paint', 07:49:08 INFO - 'tpaint', 07:49:08 INFO - 'sessionrestore', 07:49:08 INFO - 'sessionrestore_no_auto_restore', 07:49:08 INFO - 'tabpaint']}, 07:49:08 INFO - 'other-e10s': {'tests': ['a11yr', 07:49:08 INFO - 'ts_paint', 07:49:08 INFO - 'tpaint', 07:49:08 INFO - 'sessionrestore', 07:49:08 INFO - 'sessionrestore_no_auto_restore', 07:49:08 INFO - 'tabpaint']}, 07:49:08 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:49:08 INFO - 'ts_paint', 07:49:08 INFO - 'tpaint', 07:49:08 INFO - 'sessionrestore', 07:49:08 INFO - 'sessionrestore_no_auto_restore', 07:49:08 INFO - 'tabpaint']}, 07:49:08 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:49:08 INFO - 'ts_paint', 07:49:08 INFO - 'tpaint', 07:49:08 INFO - 'sessionrestore', 07:49:08 INFO - 'sessionrestore_no_auto_restore', 07:49:08 INFO - 'tabpaint']}, 07:49:08 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['a11yr', 07:49:08 INFO - 'ts_paint', 07:49:08 INFO - 'tpaint', 07:49:08 INFO - 'sessionrestore', 07:49:08 INFO - 'sessionrestore_no_auto_restore', 07:49:08 INFO - 'tabpaint']}, 07:49:08 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['a11yr', 07:49:08 INFO - 'ts_paint', 07:49:08 INFO - 'tpaint', 07:49:08 INFO - 'sessionrestore', 07:49:08 INFO - 'sessionrestore_no_auto_restore', 07:49:08 INFO - 'tabpaint']}, 07:49:08 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['tsvgx', 07:49:08 INFO - 'tsvgr_opacity', 07:49:08 INFO - 'tart', 07:49:08 INFO - 'tscrollx', 07:49:08 INFO - 'cart', 07:49:08 INFO - 'tsvg_static']}, 07:49:08 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:49:08 INFO - 'tsvgr_opacity', 07:49:08 INFO - 'tart', 07:49:08 INFO - 'tscrollx', 07:49:08 INFO - 'cart', 07:49:08 INFO - 'tsvg_static']}, 07:49:08 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'talos_options': ['--disable-e10s'], 07:49:08 INFO - 'tests': ['tp5o']}, 07:49:08 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 07:49:08 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'talos_options': ['--disable-e10s', 07:49:08 INFO - '--xperf_path', 07:49:08 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:49:08 INFO - 'tests': ['tp5n']}, 07:49:08 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 07:49:08 INFO - 'talos_options': ['--xperf_path', 07:49:08 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:49:08 INFO - 'tests': ['tp5n']}}, 07:49:08 INFO - 'talos.zip': {'path': '', 07:49:08 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:49:08 INFO - Running post-action listener: _resource_record_post_action 07:49:08 INFO - [mozharness: 2017-02-24 15:49:08.447168Z] Finished populate-webroot step (success) 07:49:08 INFO - [mozharness: 2017-02-24 15:49:08.447257Z] Running create-virtualenv step. 07:49:08 INFO - Running pre-action listener: _resource_record_pre_action 07:49:08 INFO - Running main action method: create_virtualenv 07:49:08 INFO - Creating virtualenv /builds/slave/test/build/venv 07:49:08 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 07:49:08 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:49:08 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:49:08 INFO - Using real prefix '/usr' 07:49:08 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:49:09 INFO - Installing distribute.............................................................................................................................................................................................done. 07:49:11 INFO - Installing pip.................done. 07:49:11 INFO - Return code: 0 07:49:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 07:49:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 07:49:11 INFO - Reading from file tmpfile_stdout 07:49:11 INFO - Output received: 07:49:11 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) 07:49:11 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:49:11 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')]} 07:49:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:11 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')]} 07:49:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:11 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:11 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 07:49:11 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 07:49:11 INFO - Using env: {'DISPLAY': ':0', 07:49:11 INFO - 'HOME': '/home/cltbld', 07:49:11 INFO - 'LANG': 'en_US.UTF-8', 07:49:11 INFO - 'LANGUAGE': 'en_US:en', 07:49:11 INFO - 'LOGNAME': 'cltbld', 07:49:11 INFO - 'MAIL': '/var/mail/cltbld', 07:49:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:11 INFO - 'MOZ_NO_REMOTE': '1', 07:49:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:11 INFO - 'NO_EM_RESTART': '1', 07:49:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:11 INFO - 'PWD': '/builds/slave/test', 07:49:11 INFO - 'SHELL': '/bin/bash', 07:49:11 INFO - 'SHLVL': '1', 07:49:11 INFO - 'TERM': 'linux', 07:49:11 INFO - 'TMOUT': '86400', 07:49:11 INFO - 'USER': 'cltbld', 07:49:11 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:11 INFO - '_': '/tools/buildbot/bin/python'} 07:49:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:11 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 07:49:11 INFO - Cleaning up... 07:49:11 INFO - Return code: 0 07:49:11 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:49:11 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')]} 07:49:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:11 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')]} 07:49:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:11 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:11 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 07:49:11 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 07:49:11 INFO - Using env: {'DISPLAY': ':0', 07:49:11 INFO - 'HOME': '/home/cltbld', 07:49:11 INFO - 'LANG': 'en_US.UTF-8', 07:49:11 INFO - 'LANGUAGE': 'en_US:en', 07:49:11 INFO - 'LOGNAME': 'cltbld', 07:49:11 INFO - 'MAIL': '/var/mail/cltbld', 07:49:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:11 INFO - 'MOZ_NO_REMOTE': '1', 07:49:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:11 INFO - 'NO_EM_RESTART': '1', 07:49:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:11 INFO - 'PWD': '/builds/slave/test', 07:49:11 INFO - 'SHELL': '/bin/bash', 07:49:11 INFO - 'SHLVL': '1', 07:49:11 INFO - 'TERM': 'linux', 07:49:11 INFO - 'TMOUT': '86400', 07:49:11 INFO - 'USER': 'cltbld', 07:49:11 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:11 INFO - '_': '/tools/buildbot/bin/python'} 07:49:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:11 INFO - Downloading/unpacking psutil>=3.1.1 07:49:11 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 07:49:11 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 07:49:11 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 07:49:11 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 07:49:11 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 07:49:11 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 07:49:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:49:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:49:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:49:13 INFO - Installing collected packages: psutil 07:49:13 INFO - Running setup.py install for psutil 07:49:13 INFO - building 'psutil._psutil_linux' extension 07:49:13 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 07:49:14 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 07:49:14 INFO - building 'psutil._psutil_posix' extension 07:49:14 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 07:49:14 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 07:49:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:49:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:49:14 INFO - Successfully installed psutil 07:49:14 INFO - Cleaning up... 07:49:14 INFO - Return code: 0 07:49:14 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:49:14 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')]} 07:49:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:14 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')]} 07:49:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:14 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:14 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 07:49:14 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 07:49:14 INFO - Using env: {'DISPLAY': ':0', 07:49:14 INFO - 'HOME': '/home/cltbld', 07:49:14 INFO - 'LANG': 'en_US.UTF-8', 07:49:14 INFO - 'LANGUAGE': 'en_US:en', 07:49:14 INFO - 'LOGNAME': 'cltbld', 07:49:14 INFO - 'MAIL': '/var/mail/cltbld', 07:49:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:14 INFO - 'MOZ_NO_REMOTE': '1', 07:49:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:14 INFO - 'NO_EM_RESTART': '1', 07:49:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:14 INFO - 'PWD': '/builds/slave/test', 07:49:14 INFO - 'SHELL': '/bin/bash', 07:49:14 INFO - 'SHLVL': '1', 07:49:14 INFO - 'TERM': 'linux', 07:49:14 INFO - 'TMOUT': '86400', 07:49:14 INFO - 'USER': 'cltbld', 07:49:14 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:14 INFO - '_': '/tools/buildbot/bin/python'} 07:49:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:14 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:49:14 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 07:49:14 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 07:49:14 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 07:49:14 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 07:49:14 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 07:49:14 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 07:49:16 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:49:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:49:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:49:16 INFO - Installing collected packages: mozsystemmonitor 07:49:16 INFO - Running setup.py install for mozsystemmonitor 07:49:16 INFO - Successfully installed mozsystemmonitor 07:49:16 INFO - Cleaning up... 07:49:16 INFO - Return code: 0 07:49:16 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:49:16 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')]} 07:49:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:16 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')]} 07:49:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:16 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:16 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 07:49:16 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 07:49:16 INFO - Using env: {'DISPLAY': ':0', 07:49:16 INFO - 'HOME': '/home/cltbld', 07:49:16 INFO - 'LANG': 'en_US.UTF-8', 07:49:16 INFO - 'LANGUAGE': 'en_US:en', 07:49:16 INFO - 'LOGNAME': 'cltbld', 07:49:16 INFO - 'MAIL': '/var/mail/cltbld', 07:49:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:16 INFO - 'MOZ_NO_REMOTE': '1', 07:49:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:16 INFO - 'NO_EM_RESTART': '1', 07:49:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:16 INFO - 'PWD': '/builds/slave/test', 07:49:16 INFO - 'SHELL': '/bin/bash', 07:49:16 INFO - 'SHLVL': '1', 07:49:16 INFO - 'TERM': 'linux', 07:49:16 INFO - 'TMOUT': '86400', 07:49:16 INFO - 'USER': 'cltbld', 07:49:16 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:16 INFO - '_': '/tools/buildbot/bin/python'} 07:49:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:16 INFO - Downloading/unpacking jsonschema==2.5.1 07:49:16 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 07:49:16 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 07:49:16 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 07:49:16 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 07:49:16 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 07:49:16 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 07:49:18 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:49:19 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 INFO - Downloading functools32-3.2.3-2.tar.gz 07:49:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:49:19 INFO - warning: no files found matching '*.txt' 07:49:19 INFO - no previously-included directories found matching 'build' 07:49:19 INFO - no previously-included directories found matching 'dist' 07:49:19 INFO - no previously-included directories found matching '.git*' 07:49:19 INFO - Installing collected packages: jsonschema, functools32 07:49:19 INFO - Running setup.py install for functools32 07:49:19 INFO - warning: no files found matching '*.txt' 07:49:19 INFO - no previously-included directories found matching 'build' 07:49:19 INFO - no previously-included directories found matching 'dist' 07:49:19 INFO - no previously-included directories found matching '.git*' 07:49:19 INFO - Successfully installed jsonschema functools32 07:49:19 INFO - Cleaning up... 07:49:19 INFO - Return code: 0 07:49:19 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 07:49:19 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')]} 07:49:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:19 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')]} 07:49:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:19 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:19 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 07:49:19 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 07:49:19 INFO - Using env: {'DISPLAY': ':0', 07:49:19 INFO - 'HOME': '/home/cltbld', 07:49:19 INFO - 'LANG': 'en_US.UTF-8', 07:49:19 INFO - 'LANGUAGE': 'en_US:en', 07:49:19 INFO - 'LOGNAME': 'cltbld', 07:49:19 INFO - 'MAIL': '/var/mail/cltbld', 07:49:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:19 INFO - 'MOZ_NO_REMOTE': '1', 07:49:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:19 INFO - 'NO_EM_RESTART': '1', 07:49:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:19 INFO - 'PWD': '/builds/slave/test', 07:49:19 INFO - 'SHELL': '/bin/bash', 07:49:19 INFO - 'SHLVL': '1', 07:49:19 INFO - 'TERM': 'linux', 07:49:19 INFO - 'TMOUT': '86400', 07:49:19 INFO - 'USER': 'cltbld', 07:49:19 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:19 INFO - '_': '/tools/buildbot/bin/python'} 07:49:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:19 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 07:49:19 INFO - Cleaning up... 07:49:19 INFO - Return code: 0 07:49:19 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:49:19 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')]} 07:49:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:19 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')]} 07:49:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:19 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:19 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 07:49:19 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 07:49:19 INFO - Using env: {'DISPLAY': ':0', 07:49:19 INFO - 'HOME': '/home/cltbld', 07:49:19 INFO - 'LANG': 'en_US.UTF-8', 07:49:19 INFO - 'LANGUAGE': 'en_US:en', 07:49:19 INFO - 'LOGNAME': 'cltbld', 07:49:19 INFO - 'MAIL': '/var/mail/cltbld', 07:49:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:19 INFO - 'MOZ_NO_REMOTE': '1', 07:49:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:19 INFO - 'NO_EM_RESTART': '1', 07:49:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:19 INFO - 'PWD': '/builds/slave/test', 07:49:19 INFO - 'SHELL': '/bin/bash', 07:49:19 INFO - 'SHLVL': '1', 07:49:19 INFO - 'TERM': 'linux', 07:49:19 INFO - 'TMOUT': '86400', 07:49:19 INFO - 'USER': 'cltbld', 07:49:19 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:19 INFO - '_': '/tools/buildbot/bin/python'} 07:49:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:19 INFO - Downloading/unpacking blobuploader==1.2.4 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 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 07:49:19 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 07:49:21 INFO - Downloading blobuploader-1.2.4.tar.gz 07:49:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:49:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:49:22 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 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 07:49:22 INFO - Downloading docopt-0.6.1.tar.gz 07:49:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:49:22 INFO - Installing collected packages: blobuploader, requests, docopt 07:49:22 INFO - Running setup.py install for blobuploader 07:49:22 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:49:22 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:49:22 INFO - Running setup.py install for requests 07:49:23 INFO - Running setup.py install for docopt 07:49:23 INFO - Successfully installed blobuploader requests docopt 07:49:23 INFO - Cleaning up... 07:49:23 INFO - Return code: 0 07:49:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:49:23 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')]} 07:49:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:23 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')]} 07:49:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:23 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:23 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 07:49:23 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 07:49:23 INFO - Using env: {'DISPLAY': ':0', 07:49:23 INFO - 'HOME': '/home/cltbld', 07:49:23 INFO - 'LANG': 'en_US.UTF-8', 07:49:23 INFO - 'LANGUAGE': 'en_US:en', 07:49:23 INFO - 'LOGNAME': 'cltbld', 07:49:23 INFO - 'MAIL': '/var/mail/cltbld', 07:49:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:23 INFO - 'MOZ_NO_REMOTE': '1', 07:49:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:23 INFO - 'NO_EM_RESTART': '1', 07:49:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:23 INFO - 'PWD': '/builds/slave/test', 07:49:23 INFO - 'SHELL': '/bin/bash', 07:49:23 INFO - 'SHLVL': '1', 07:49:23 INFO - 'TERM': 'linux', 07:49:23 INFO - 'TMOUT': '86400', 07:49:23 INFO - 'USER': 'cltbld', 07:49:23 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:23 INFO - '_': '/tools/buildbot/bin/python'} 07:49:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:49:23 INFO - Running setup.py (path:/tmp/pip-LEglCh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:49:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:49:23 INFO - Running setup.py (path:/tmp/pip-Zg4_wE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:49:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:49:23 INFO - Running setup.py (path:/tmp/pip-b0i3eq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:49:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:49:23 INFO - Running setup.py (path:/tmp/pip-6m0Wom-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:49:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:49:23 INFO - Running setup.py (path:/tmp/pip-HxxtJy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:49:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:49:23 INFO - Running setup.py (path:/tmp/pip-INM369-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:49:24 INFO - Running setup.py (path:/tmp/pip-lAnmmq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:49:24 INFO - Running setup.py (path:/tmp/pip-I7GpCL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:49:24 INFO - Running setup.py (path:/tmp/pip-VeWEv7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:49:24 INFO - Running setup.py (path:/tmp/pip-qaPSbq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:49:24 INFO - Running setup.py (path:/tmp/pip-HMI4VK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:49:24 INFO - Running setup.py (path:/tmp/pip-PsohpP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:49:24 INFO - Running setup.py (path:/tmp/pip-rEAuXh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:49:24 INFO - Running setup.py (path:/tmp/pip-sVjM14-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:49:24 INFO - Running setup.py (path:/tmp/pip-Rh54Me-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:49:24 INFO - Running setup.py (path:/tmp/pip-xK6a8I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:49:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:49:24 INFO - Running setup.py (path:/tmp/pip-79VXsi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:49:24 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:49:24 INFO - Running setup.py install for manifestparser 07:49:24 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:49:24 INFO - Running setup.py install for mozcrash 07:49:25 INFO - Running setup.py install for mozdebug 07:49:25 INFO - Running setup.py install for mozdevice 07:49:25 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Running setup.py install for mozfile 07:49:25 INFO - Running setup.py install for mozhttpd 07:49:25 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Running setup.py install for mozinfo 07:49:25 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Running setup.py install for mozInstall 07:49:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Running setup.py install for mozleak 07:49:25 INFO - Running setup.py install for mozlog 07:49:25 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Running setup.py install for moznetwork 07:49:25 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:49:25 INFO - Running setup.py install for mozprocess 07:49:26 INFO - Running setup.py install for mozprofile 07:49:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:49:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:49:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:49:26 INFO - Running setup.py install for mozrunner 07:49:26 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:49:26 INFO - Running setup.py install for mozscreenshot 07:49:26 INFO - Running setup.py install for moztest 07:49:26 INFO - Running setup.py install for mozversion 07:49:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:49:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:49:26 INFO - Cleaning up... 07:49:26 INFO - Return code: 0 07:49:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:49:26 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')]} 07:49:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:26 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')]} 07:49:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:26 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:26 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 07:49:26 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 07:49:26 INFO - Using env: {'DISPLAY': ':0', 07:49:26 INFO - 'HOME': '/home/cltbld', 07:49:26 INFO - 'LANG': 'en_US.UTF-8', 07:49:26 INFO - 'LANGUAGE': 'en_US:en', 07:49:26 INFO - 'LOGNAME': 'cltbld', 07:49:26 INFO - 'MAIL': '/var/mail/cltbld', 07:49:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:26 INFO - 'MOZ_NO_REMOTE': '1', 07:49:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:26 INFO - 'NO_EM_RESTART': '1', 07:49:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:26 INFO - 'PWD': '/builds/slave/test', 07:49:26 INFO - 'SHELL': '/bin/bash', 07:49:26 INFO - 'SHLVL': '1', 07:49:26 INFO - 'TERM': 'linux', 07:49:26 INFO - 'TMOUT': '86400', 07:49:26 INFO - 'USER': 'cltbld', 07:49:26 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:26 INFO - '_': '/tools/buildbot/bin/python'} 07:49:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:49:26 INFO - Running setup.py (path:/tmp/pip-xydjTz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:49:26 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)) 07:49:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:49:26 INFO - Running setup.py (path:/tmp/pip-IT4REl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:49:26 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)) 07:49:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:49:26 INFO - Running setup.py (path:/tmp/pip-NlX99d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:49:27 INFO - Running setup.py (path:/tmp/pip-WQs12c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:49:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:49:27 INFO - Running setup.py (path:/tmp/pip-KDIItj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:49:27 INFO - Running setup.py (path:/tmp/pip-e6FS0R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:49:27 INFO - Running setup.py (path:/tmp/pip-8iTNPW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:49:27 INFO - Running setup.py (path:/tmp/pip-MUzv3y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:49:27 INFO - Running setup.py (path:/tmp/pip-JtqoV2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:49:27 INFO - Running setup.py (path:/tmp/pip-0bzDBu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:49:27 INFO - Running setup.py (path:/tmp/pip-3eRt75-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:49:27 INFO - Running setup.py (path:/tmp/pip-peOdzT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:49:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:49:27 INFO - Running setup.py (path:/tmp/pip-qIdThH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:49:27 INFO - Running setup.py (path:/tmp/pip-fyVr17-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:49:27 INFO - Running setup.py (path:/tmp/pip-Fj7TYJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:49:27 INFO - Running setup.py (path:/tmp/pip-5DKs3A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:49:27 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)) 07:49:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:49:27 INFO - Running setup.py (path:/tmp/pip-wbCIut-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:49:28 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)) 07:49:28 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)) 07:49:28 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)) 07:49:28 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)) 07:49:28 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:49:28 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:49:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:49:28 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 07:49:28 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 07:49:28 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 07:49:28 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 07:49:28 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 07:49:28 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 07:49:30 INFO - Downloading blessings-1.6.tar.gz 07:49:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:49:30 INFO - Installing collected packages: blessings 07:49:30 INFO - Running setup.py install for blessings 07:49:30 INFO - Successfully installed blessings 07:49:30 INFO - Cleaning up... 07:49:30 INFO - Return code: 0 07:49:30 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:49:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:49:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:49:30 INFO - Reading from file tmpfile_stdout 07:49:30 INFO - Current package versions: 07:49:30 INFO - argparse == 1.2.1 07:49:30 INFO - blessings == 1.6 07:49:30 INFO - blobuploader == 1.2.4 07:49:30 INFO - docopt == 0.6.1 07:49:30 INFO - functools32 == 3.2.3-2 07:49:30 INFO - jsonschema == 2.5.1 07:49:30 INFO - manifestparser == 1.1 07:49:30 INFO - mozInstall == 1.12 07:49:30 INFO - mozcrash == 1.0 07:49:30 INFO - mozdebug == 0.1 07:49:30 INFO - mozdevice == 0.49 07:49:30 INFO - mozfile == 1.2 07:49:30 INFO - mozhttpd == 0.7 07:49:30 INFO - mozinfo == 0.9 07:49:30 INFO - mozleak == 0.1 07:49:30 INFO - mozlog == 3.4 07:49:30 INFO - moznetwork == 0.27 07:49:30 INFO - mozprocess == 0.24 07:49:30 INFO - mozprofile == 0.28 07:49:30 INFO - mozrunner == 6.13 07:49:30 INFO - mozscreenshot == 0.1 07:49:30 INFO - mozsystemmonitor == 0.3 07:49:30 INFO - moztest == 0.8 07:49:30 INFO - mozversion == 1.4 07:49:30 INFO - psutil == 3.1.1 07:49:30 INFO - requests == 1.2.3 07:49:30 INFO - wsgiref == 0.1.2 07:49:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:49:30 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')]} 07:49:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:30 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')]} 07:49:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:30 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:30 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 07:49:30 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 07:49:30 INFO - Using env: {'DISPLAY': ':0', 07:49:30 INFO - 'HOME': '/home/cltbld', 07:49:30 INFO - 'LANG': 'en_US.UTF-8', 07:49:30 INFO - 'LANGUAGE': 'en_US:en', 07:49:30 INFO - 'LOGNAME': 'cltbld', 07:49:30 INFO - 'MAIL': '/var/mail/cltbld', 07:49:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:30 INFO - 'MOZ_NO_REMOTE': '1', 07:49:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:30 INFO - 'NO_EM_RESTART': '1', 07:49:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:30 INFO - 'PWD': '/builds/slave/test', 07:49:30 INFO - 'SHELL': '/bin/bash', 07:49:30 INFO - 'SHLVL': '1', 07:49:30 INFO - 'TERM': 'linux', 07:49:30 INFO - 'TMOUT': '86400', 07:49:30 INFO - 'USER': 'cltbld', 07:49:30 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:30 INFO - '_': '/tools/buildbot/bin/python'} 07:49:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 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)) 07:49:30 INFO - Cleaning up... 07:49:30 INFO - Return code: 0 07:49:30 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:49:30 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')]} 07:49:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:49:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:30 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')]} 07:49:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:49:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:49:30 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 0x17621f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1872a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ad4630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, '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': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', '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 07:49:30 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 07:49:30 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 07:49:30 INFO - Using env: {'DISPLAY': ':0', 07:49:30 INFO - 'HOME': '/home/cltbld', 07:49:30 INFO - 'LANG': 'en_US.UTF-8', 07:49:30 INFO - 'LANGUAGE': 'en_US:en', 07:49:30 INFO - 'LOGNAME': 'cltbld', 07:49:30 INFO - 'MAIL': '/var/mail/cltbld', 07:49:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:30 INFO - 'MOZ_NO_REMOTE': '1', 07:49:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:30 INFO - 'NO_EM_RESTART': '1', 07:49:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:30 INFO - 'PWD': '/builds/slave/test', 07:49:30 INFO - 'SHELL': '/bin/bash', 07:49:30 INFO - 'SHLVL': '1', 07:49:30 INFO - 'TERM': 'linux', 07:49:30 INFO - 'TMOUT': '86400', 07:49:30 INFO - 'USER': 'cltbld', 07:49:30 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:30 INFO - '_': '/tools/buildbot/bin/python'} 07:49:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:49:30 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:49:30 INFO - Cleaning up... 07:49:31 INFO - Return code: 0 07:49:31 INFO - Running post-action listener: _resource_record_post_action 07:49:31 INFO - Running post-action listener: _start_resource_monitoring 07:49:31 INFO - Starting resource monitoring. 07:49:31 INFO - [mozharness: 2017-02-24 15:49:31.040978Z] Finished create-virtualenv step (success) 07:49:31 INFO - [mozharness: 2017-02-24 15:49:31.041491Z] Running install step. 07:49:31 INFO - Running pre-action listener: _resource_record_pre_action 07:49:31 INFO - Running main action method: install 07:49:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:49:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:49:31 INFO - Reading from file tmpfile_stdout 07:49:31 INFO - Detecting whether we're running mozinstall >=1.0... 07:49:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:49:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:49:31 INFO - Reading from file tmpfile_stdout 07:49:31 INFO - Output received: 07:49:31 INFO - Usage: mozinstall [options] installer 07:49:31 INFO - Options: 07:49:31 INFO - -h, --help show this help message and exit 07:49:31 INFO - -d DEST, --destination=DEST 07:49:31 INFO - Directory to install application into. [default: 07:49:31 INFO - "/builds/slave/test"] 07:49:31 INFO - --app=APP Application being installed. [default: firefox] 07:49:31 INFO - mkdir: /builds/slave/test/build/application 07:49:31 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'] 07:49:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 07:49:47 INFO - Reading from file tmpfile_stdout 07:49:47 INFO - Output received: 07:49:47 INFO - /builds/slave/test/build/application/firefox/firefox 07:49:47 INFO - Running post-action listener: _resource_record_post_action 07:49:47 INFO - [mozharness: 2017-02-24 15:49:47.822963Z] Finished install step (success) 07:49:47 INFO - [mozharness: 2017-02-24 15:49:47.823237Z] Running run-tests step. 07:49:47 INFO - Running pre-action listener: _resource_record_pre_action 07:49:47 INFO - Running main action method: run_tests 07:49:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:49:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:49:47 INFO - Python 2.7.3 07:49:47 INFO - Return code: 0 07:49:47 INFO - grabbing minidump binary from tooltool 07:49: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')]} 07:49:47 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 0x1b5d850>, '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 0x1ad26d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ad2b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:49:47 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 07:49:47 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 07:49:47 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 07:49:47 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:49:47 INFO - Return code: 0 07:49:47 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:49:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:49:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:49:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:49:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:49:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-023', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 07:49:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-023 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 07:49:47 INFO - Using env: {'DISPLAY': ':0', 07:49:47 INFO - 'HOME': '/home/cltbld', 07:49:47 INFO - 'LANG': 'en_US.UTF-8', 07:49:47 INFO - 'LANGUAGE': 'en_US:en', 07:49:47 INFO - 'LOGNAME': 'cltbld', 07:49:47 INFO - 'MAIL': '/var/mail/cltbld', 07:49:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:49:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:49:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:49:47 INFO - 'MOZ_NO_REMOTE': '1', 07:49:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:49:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:49:47 INFO - 'NO_EM_RESTART': '1', 07:49:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:49:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:49:47 INFO - 'PWD': '/builds/slave/test', 07:49:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:49:47 INFO - 'SHELL': '/bin/bash', 07:49:47 INFO - 'SHLVL': '1', 07:49:47 INFO - 'TERM': 'linux', 07:49:47 INFO - 'TMOUT': '86400', 07:49:47 INFO - 'USER': 'cltbld', 07:49:47 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308', 07:49:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:49:47 INFO - '_': '/tools/buildbot/bin/python'} 07:49:47 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-023', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 07:49:48 INFO - mozversion application_buildid: 20170224145040 07:49:48 INFO - mozversion application_changeset: eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671 07:49:48 INFO - mozversion application_display_name: FirefoxDeveloperEdition 07:49:48 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:49:48 INFO - mozversion application_name: Firefox 07:49:48 INFO - mozversion application_remotingname: firefox-dev 07:49:48 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 07:49:48 INFO - mozversion application_vendor: Mozilla 07:49:48 INFO - mozversion application_version: 53.0a2 07:49:48 INFO - mozversion platform_buildid: 20170224145040 07:49:48 INFO - mozversion platform_changeset: eeeb9c132d0ed10d0f76f51a4b25cfb2f76bd671 07:49:48 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 07:49:48 INFO - mozversion platform_version: 53.0a2 07:49:48 INFO - using testdate: 1487951388 07:49:48 INFO - actual date: 1487951388 07:49:48 INFO - starting webserver on 'localhost:49862' 07:49:48 INFO - SUITE-START | Running 2 tests 07:49:48 INFO - TEST-START | dromaeo_css 07:49:48 INFO - operating with platform_type : linux_ 07:49:48 INFO - Initialising browser for dromaeo_css test... 07:49:48 INFO - TEST-INFO | started process 10607 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMcZj6i/profile http://localhost:49862/getInfo.html) 07:49:52 INFO - PROCESS | 10607 | __metrics Screen width/height:1600/1200 07:49:52 INFO - PROCESS | 10607 | colorDepth:24 07:49:52 INFO - PROCESS | 10607 | Browser inner width/height: 1024/697 07:49:52 INFO - PROCESS | 10607 | __metrics 07:49:52 INFO - PROCESS | 10607 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 07:49:52 INFO - PROCESS | 10607 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:49:53 INFO - TEST-INFO | 10607: exit 0 07:49:53 INFO - Browser initialized. 07:49:53 INFO - Running cycle 1/1 for dromaeo_css test... 07:49:53 INFO - TEST-INFO | started process 10700 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMcZj6i/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:50:05 INFO - PROCESS | 10700 | RSS: Main: 138244096 07:50:05 INFO - PROCESS | 10700 | 07:53:05 INFO - PROCESS | 10700 | Cycle 1(1): loaded http://localhost:49862/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49862/tests/dromaeo/cssquery-ext.html) 07:53:07 INFO - PROCESS | 10700 | RSS: Main: 249425920 07:53:07 INFO - PROCESS | 10700 | 07:54:55 INFO - PROCESS | 10700 | ************************* 07:54:55 INFO - PROCESS | 10700 | A coding exception was thrown and uncaught in a Task. 07:54:55 INFO - PROCESS | 10700 | 07:54:55 ERROR - PROCESS | 10700 | Full message: TypeError: NetworkError when attempting to fetch resource. 07:54:55 INFO - PROCESS | 10700 | Full stack: 07:54:55 INFO - PROCESS | 10700 | ************************* 07:56:09 INFO - PROCESS | 10700 | Cycle 1(1): loaded http://localhost:49862/tests/dromaeo/cssquery-ext.html (next: http://localhost:49862/tests/dromaeo/cssquery-jquery.html) 07:56:09 INFO - PROCESS | 10700 | RSS: Main: 233984000 07:56:09 INFO - PROCESS | 10700 | 07:59:11 INFO - PROCESS | 10700 | Cycle 1(1): loaded http://localhost:49862/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49862/tests/dromaeo/cssquery-mootools.html) 07:59:12 INFO - PROCESS | 10700 | RSS: Main: 219205632 07:59:12 INFO - PROCESS | 10700 | 08:02:14 INFO - PROCESS | 10700 | Cycle 1(1): loaded http://localhost:49862/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49862/tests/dromaeo/cssquery-prototype.html) 08:02:14 INFO - PROCESS | 10700 | RSS: Main: 231010304 08:02:14 INFO - PROCESS | 10700 | 08:05:17 INFO - PROCESS | 10700 | Cycle 1(1): loaded http://localhost:49862/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49862/tests/dromaeo/cssquery-yui.html) 08:05:17 INFO - PROCESS | 10700 | RSS: Main: 184631296 08:05:17 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | Cycle 1(1): loaded http://localhost:49862/tests/dromaeo/cssquery-yui.html (next: http://localhost:49862/tests/dromaeo/cssquery-dojo.html) 08:08:20 INFO - PROCESS | 10700 | RSS: Main: 267722752 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | __start_tp_report 08:08:20 INFO - PROCESS | 10700 | _x_x_mozilla_page_load 08:08:20 INFO - PROCESS | 10700 | _x_x_mozilla_page_load_details 08:08:20 INFO - PROCESS | 10700 | |i|pagename|runs| 08:08:20 INFO - PROCESS | 10700 | |0;dojo.html;3306.3222039481907;3335.899923002309;3341.6825401586857;3368.9326213475715;3379.2903490267045;5484.561235101192;5506.229127922094;5525.392206857247;5534.75093620787;5536.695481748502;5485.067538518451;5542.362628297747;5544.6395984261;5546.750396232169;5565.777368905239;5034.219695947125;5053.77258023388;5077.746112694369;5086.593072554187;5145.536901678848;4978.402591688984;5008.974955125237;5013;5095.821646242363;5139.614528910328;4984.75076246188;5053.36832895888;5080.0601888650535;5103.106956282636;5110.8466745997675;5107.157319042353;5108.131617625013;5116.437191908887;5117.334746482933;5151.5106064923775;4866.537678920497;4881.170201065827;5041.873953151201;5046.495350464924;5106.923396149061;5370.570354371641;5435.809746658888;5450.400455949843;5467.617266791326;5515.200295957104;5856.209411729405;5906.557008224358;5916.704164791743;5918.40815918409;5919.467247947662;5688.715564221814;5934.940650593525;5949;5959.225300710923;5962.97018514909;5386.946130538723;5467.507924286793;5512.39363669996;5519.39286678469;5571;6011.939880601226;6014.1580178775;6015.037593984942;6024.698765061729;6034.336223015464;5730.770769169187;5799.043157878903;5803.9552880481915;5808.07070868659;5819.388964158787;5647.068233741386;5697.088465845445;5766.913496297559;5811;5838.036723940587;5811.564132690065;5851.034579294369;5861.3552509223955;5881.1178323251;5886;5876.559258055663;5878.764849405976;5879.794207202727;5881.029630111069;5886.146508756292;4051.6758659307184;4105.938410923779;4120.237756015147;4128;4145.813438395279;3770.6606405423095;3778.074371778932;3791.5071040764524;3795.905102372463;3812.542494900574;5677.9211949729415;5679.148127780866;5685.658860468385;5689.487946084872;5691.117876729114;5681.687507187062;5770.105633626795;5798.333191682926;5869.882602347929;5870.853228669232;5629.43705629442;5640.5487560995025;5654.37801841797;5657.830265092054;5664.065429204217;4984.327115839388;5031.169856973558;5031.698098114125;5035.144025515671;5067.189249720027;5978.1929439525975;6028.517718582503;6040.305364883095;6075.605085669417;6135.754569817157;5871.853203669772;5878.29460464747;5880.911786323294;5884.6469211847425;5915.615484993462;6071.453569178619;6093.086037094294;6093.086037094471;6095.420935011167;6096.237970253718;5571.944280557304;5688.601797874109;5754.827355179351;5789.739461724148;5800.767969281182;5900.822975310747;5945.821625351246;5959.463648271676;5962.97018514922;5997.640141591519;5807.245058142415;5808.970955145366;5809;5812.360640329645;5813.738381772746;5650.152477128464;5658.321001479849;5787.39232380594;5792.507636850914;5800.361960184461;5695.943040569707;5728.742206600629;5743.994800909908;5747.597668163188;5788.82633520995;5783.392743761844;5795.681237531976;5836.854078648068;5840;5850.414958504116;5554.50009499147;5718.485336319584;5728.656280623176;5729.598928074995;5731.942680573307 08:08:20 INFO - PROCESS | 10700 | |1;ext.html;558.6285120394937;580.7618876260734;592.2005292854647;620.7920346683861;670.3598063849024;36673.349699263534;45399.31901021483;47724.045519089595;47848.76075619626;53279.73360133204;51638.225426618534;52374;52462.475375246235;52557;52578.73710631451;8472.576371181447;9219.308551858603;9361.906380936172;9409.341346105775;9415.387999780027;8710.433821801595;10823.729406764814;11123.443827808618;11125.499352529116;11507.712307192345;10944.45277736114;10995.945020274887;11003.889961100407;11011.394373309466;11023.559057637685;10907.890921090768;10941.781164376747;10949;10955.83566246507;10967.890321096767;11167.664970050912;11233.831492527619;11234.831477527843;11243.325400475998;11244.437778111143;48125.75937120327;48530.27204591934;48550.51449485495;48696;48707;4384.408104905829;4485.192665320241;4498.685092043558;4526.660500462479;4712.575868171881;33161.3367732644;33270.667293327;33335.6666433335;33661.495077573854;34442.31115377678;4325.243082460588;4371.431713877208;4401.383806267125;4403.9779801100785;4445.399871017404;389743;389791;390786.99999999715;391207;391518;60876.69561652252;61033.69483152556;61206.38793612007;61234.693826531475;61244;64596.677016614616;64656;64768.35231647623;64783.67608162023;64844;18772.155253013647;19147.712784308245;19180.328688496116;19183.52041198981;19328.516787080436;13495.932520337336;13816.378262977989;14761.188134652697;15013.549593512213;15184.240787960558;19030.52423689391;19852.73166269259;19884.105215265346;20023.199072036954;20073.799262007193;7457.142428620669;7632.542047477169;7651.234876512415;7660.0466880945005;7880.605969701492;1003.5433877585681;1015.9796804064025;1017.6743442098606;1029.4183786160945;1035.5288343803552;34740;34938;35162.29675406477;35246.823765881;35283.82358088193;1083.2451428685579;1153.3195414705197;1155.110564865066;1171.2738102376582;1196.8144937534696;15569.299381527859;15954.521364359089;16037.198140092949;16252.918735406247;16474.505764827074;502732;503877;506844;508702;510770;58564.414355856745;58978.11532827011;59052.704736476044;59073;59222.40777592255;1535.2016951185321;1539.7921280627197;1558.306553583667;1560.8361122082244;1588.356715530212;29275;30702;30826;31126.533102003035;31159;51143.744281278356;51769.22346164735;51994.74002629962;52008.21987670112;52087.739561301954;467496;467740;471231;471443;474593;24678.629820553066;28318;28426;28990.420191596473;30052.549211761405;45786.31320530261;45817.312740308254;46049;46271.76864115658;46502;46443.53556464392;47406.762966186325;48218.03563928632;53702.19446708224;53803.19295210653;46717;50561.49438505715;50691.23963140629;50834.49165508446;51301;49198.26202606892;49453;49978;51051.23423148582;51226.74386628192;47346.28980565225;48331.75834120807;48552;49322.50677493323;50291;31945.520817188226;32165.517517236793;32178.628769690073;32179.195520111247;32424.351512969137 08:08:20 INFO - PROCESS | 10700 | |2;jquery.html;430.82982222022304;439.7053973837529;440.2295982031445;443.44347843456467;449.14886290479564;20289.289874854385;20842.89578552105;21918;22084.558308833854;22275.220367287147;21965.450863728416;23238.535229295405;23253.534929301448;23441.64837527434;23608.29175124749;5938.435848594388;5963.284405871302;6123.846903827395;6151.907721384183;6155.846103847395;5989.191459153024;6006.189164462785;6029.095635654643;6030.33666296707;6054.122152287916;5840.211571437865;5988.640681559099;5992.730327135289;5996.22049133612;6078.878422431549;6061.333253342151;6117.388261173892;6121.632702037848;6123.846903827418;6128.693565321739;5435.537979271767;5463.262459567987;5504.862378440531;5526.778928842841;5527.336719593674;21532.56934861294;21633;24563.38591535208;25651;25964.610530842052;2795.580662900581;2928.926776830575;3033.3175035617032;3054.068509104722;3093.8917137900066;15944.441944532002;16159.353625854952;16225.675486490203;16271.430499932445;16428.1785910704;1991.9103640336075;2013.4865609269689;2020.6261841559212;2038.5311378383055;2040.9387718368473;96407.51796241043;96960.51519742356;97581.51209243908;98008;99344;12299.323537205539;12370.505179792888;12484.500619975099;12622.55821046259;12664.240145591293;18071.72892406615;18076.096195190188;18082.819171808376;18088.63822723538;18123.09384530768;9088.272938164931;9166.358354915092;9212.907870921204;9227.44635321883;9328.160465558132;8742.650293988168;8759.693410730593;8808.955955220183;9053.139951704577;9088.409253398508;4878.365812444359;5279.47205279469;5356.7857285708915;5358.490943360374;5515.814099968526;2110.1981247125996;2132.093860109478;2162.2540223622823;2211.1818627108073;2242.1031587365183;932.3520153493392;945.0832692288469;951.5194826612654;966.1787480641399;969.8060387922444;19155.61688766217;21128.900546880923;21181.258655946967;21364.572708546053;21491;950.8621249918862;966.4201479112477;973.4208146153028;974.2011550528499;983.4492684096929;11619.477123529461;11693.415329233505;11777.528898844123;11803.645890623295;11863.644090677293;667914;685984;712012;749597;755934;104133;104490.47754761178;107791;112770;114648;1029.5161274201264;1050.217587897037;1066.632011955874;1080.5839751695653;1094.6114129484079;17944.820551794837;18262.36081737186;18295.81704182941;18334.266629334677;18655.440336789918;43030.35454468248;46586.301205482625;46674.53325466702;46965.76517117392;47241;66205.66897165483;67722.66138669275;67893;68840;69176;8427.662893484192;8502.44734092282;8576.842126312868;8602.78493037654;8818.823623527365;12486.562970295996;14044.508442204882;14128.152310861382;14188.219647919463;14364.640883977567;11627;11775.293482391084;12006;12074.637760867188;12154.635360939186;10055;11373.943130284295;11499.137564682514;11686.824697629372;11743.76512469763;11684.70788230301;11786.351750653796;11875.881241187477;12111.091668124749;12213.572524961584;8776.78058048554;8861.33539984491;8997.571043259439;9007.324450666096;9122.498262595356;8459.069502354612;10710.250282480152;11593.130515211224;11688.240264382788;11938.22401543897 08:08:20 INFO - PROCESS | 10700 | |3;mootools.html;1353.6277523680992;1482.347766982528;1487.1856335270973;1488.4343949299266;1497.7079469503444;7736.999999999993;8433.493990360583;8748.78128046799;8765.16730910564;9021.413608115468;8821.823563528726;8878.955605221965;8900.955495222515;8913.777155571113;8920.197182253596;2164.9242276520326;2233.352327824929;2446.8654224017673;2485.440775825443;2491.9003239870385;2240.406292332533;2289.3246492284816;2301.942451438719;2311.52613714189;2323.256557901472;2352.9764702353013;2363.397333679909;2364.4443555764383;2383.5947888858936;2386.689730335063;2455.545724041049;2470.0613766768693;2484.2671411933525;2496.3509487533192;2497.7127630322566;2368.585497537924;2376.4058985253687;2383.84505007174;2384.248961577115;2389.2712722619767;8761.08008659088;8865.55672216393;8894;8901.065388134217;8903.10968903111;5402.78388864445;5542.528885044776;5544.6118771686;5552.583556233299;5554.1113421852715;3390.8135052572097;3475.287566048954;3538.5046093546925;3593.3352329819068;3610.1335679437007;1360.5238166641695;1377.4008306386754;1406.2687402550719;1428.7713965765427;1484.1095342794345;12106.455209515592;12112.939435302855;12130;12138.15032947694;12155.453004614725;4768.380110585602;4871.683340582851;4905.6811307265625;4915.508449155056;4945.678530895552;10402.959704029536;10425.687229383131;10432.739181520523;10435.426051567085;10444.582216711398;5547.41752116022;5553.361363443256;5562.944370556243;5563.443655634404;5563.666180029211;4900.803967841246;4978.800847966113;4996.825111121093;5020.648554601143;5039.496050395004;4073.167820482213;4139.461869956886;4148.502179738391;4180.665546756252;4180.728252663567;1374.6700791809894;1377.6762460821699;1389.9305034748222;1397.44800803684;1406.3109076552416;1014.1379827146866;1019.8317277649253;1034.2294990232326;1035.5443604813859;1037.1547189040907;5912.17229587858;5916.615419997773;5918.082697181943;5918.822435326861;6245.656488893063;1043.2703086465915;1069.2782371898936;1077.2028698763015;1077.2836064017497;1108.7671588966246;4039.8788036358956;4154.065335299594;4156.729812562174;4158.37624356349;4171.520275168334;10084.596616135419;10380.636677716395;10391.792164156826;10397.11624511925;10400.687979360631;10297.227707921937;10363.792724145474;10373.118284945713;10388.584456621651;10422.374657520573;8072.071711753106;8211.34309255258;8360.45657032291;8365.24712775841;8370.53962032094;5768.163616275533;5839.532837373085;5945.583809133319;5946.494547963299;6038.064100064497;9718.222542196749;9723.173530249725;9736.123748862636;9742.366746161477;9832.901670983485;8706.347023973101;8961.731148065568;9532.857007145038;9871.654492092743;9906.05892440217;7228.49400541957;7333.156686981066;7383.926160738324;7480.4763666544995;7565.621718914143;8604.354673399645;8620.655173792979;8664.176903194186;8666.956665216634;8674.696385626472;7656.310932016146;7787.961060194662;7804.492707973964;7858.410619203468;7981.441299109239;7370.63146842645;7456.664450099867;7458.962705186439;7477.4765766398;7661.425393095428;6891.035255064195;6926.515143939876;6989.685464154024;6995.755148569776;7010.964945175241;5063.544281014726;5066.493350664904;5105.2086926526445;5110.105731497048;5260.026895024433;5045.041442126131;5070.5943524517215;5081.517255860687;5111.156659151198;5138.794448222029 08:08:20 INFO - PROCESS | 10700 | |4;prototype.html;402.1395001278196;406.20384047267356;411.600182492611;417.88717046397454;421.81229352937936;5112.667676601028;5225.268462415255;5355.464453554642;5391.81128660497;5398.137642513331;5164.819231326905;5209.505097015777;5237.8428647140645;5287.312649355578;5291.656042357244;4272.359146128075;4299.098108776571;4299.548547402509;4331.783410829462;4370;4267.893302667427;4325.826966921335;4356.695031347807;4376.190404775127;4386.473623165225;4265.976165720221;4274.187904298189;4312.116016216683;4316.158349121923;4326.935095973563;4279.5078565965005;4281.871543853689;4283.314669652872;4287.5498072702385;4293.8067786949505;3879.9030024249337;3959.267535505912;3967.484227050465;3975.5626881043063;3977.2642061218476;5212.452692467312;5235.790568377261;5239.685618862843;5252.23842542833;5264.236685680593;4935.938773163751;4939.209726443752;4953.157963146274;4968.801247950078;4980.77586508608;5366.6511676741275;5525.530329921961;5564.888702225973;5587.441255874421;5607.971695284541;4266.338717498793;4269.615734583902;4295.818649871279;4308.181445525372;4315.244832154392;5742.109972954198;5774.971125144348;5799.898019376305;5800.303963524362;5826.038703613941;4245.915081698348;4391.8462853799965;4441.977790111029;4448.154850578379;4460.821567137343;4418.1163767246035;4456.952616135271;4461.397711308931;4471.821127154943;4480.955190448119;4893.877653058631;4930.926036109461;4944.357233559686;4952.108620448354;4957.7273249971595;5550.611457197957;5662;5680.375158732536;5687.374388817227;5688.345840228344;1485.95982812032;1493.6191271225769;1499.1829452947952;1501.3319073012406;1501.5495351394538;1047.6228557719214;1083.247143235444;1083.3012706804068;1085.3108276244484;1101.730076131353;5302.3637163540625;5336.91994620081;5346.786128554814;5353.0899747043095;5377.542908852792;5580.330360356702;5584.888302233932;5592.580556458201;5602.159676048544;5630;5210.244514545369;5308.734563271821;5325.627206095536;5351.598630102758;5373.435789242073;2940.3384238546155;2941.7205365490245;2947.1747910585073;2948.1279387589034;2972.6581443134314;5553.750081246354;5836.737346819404;5866.12008198765;5870.444332251956;5884.058550631964;5612.943870561324;5660.179378919213;5684.6020778545935;5701.515371193412;5752.36723960364;5746.683932383759;5781.566382521328;5789.623674461147;5801.491612180779;5813.593048486566;5314.5216930476445;5541.612087153861;5562.3047119110115;5576.91634625489;5589.518777524041;5396.815878631626;5426.70153141581;5438.797287098731;5441.87092421867;5447.1829225616475;5736.598438109292;5744.741486633196;5754.309482862083;5788.016037273758;5797.91303130445;4095;4226.5773422657485;4246.936295955625;4253.638440732572;4270.210011147948;5512.153428601463;5545.500904918576;5547.583931205257;5618.157276408408;5708.714564271853;5243.790248390174;5391.353037635509;5428.782848686008;5450.209719590716;5474.069408200695;5348.689571055116;5364;5403.297571315704;5419.485148910847;5428.430014848542;5334.639666885075;5380.623356365017;5381.8923621526565;5382.085045542189;5384.784608615611;5191.715645116137;5302.867428314323;5407.83776486706;5447.863803404946;5457.645253058538;5292.756202292535;5312.768637172474;5314.468553144655;5319.787208511616;5327.413984461628 08:08:20 INFO - PROCESS | 10700 | |5;yui.html;839.8068444257821;857.8370109679161;859.2438653984493;929.3308817651291;938.7568191773183;16556.503304900856;17057.31770729171;17111.999999999967;17459.214335354907;17559.03425311609;15579.53261402157;15703.371865125382;15873.365065397398;15954.441594544192;16225.918870405661;708.3978618174536;735.7792662201344;835.2607941971369;845.0915266088948;848.9981821450685;794.5709316968859;802.8233788566506;815.4577206157898;819.1890028871434;819.2381085590398;884.8141890203033;886.9068747781487;887.525174031893;887.5739644970419;887.6183241206279;729.9306565876233;759.4569882533959;877.8814859993915;878.2359347367767;879.0111124984393;565.4486875296553;619.3527763487167;623.5884316351187;639.162696867101;642.0497663458061;15634.609134771721;15802.841971580367;15850;15864.04815711061;15897.52307430779;14989.400423983028;15462.768058479132;15799.289031993589;15802.683946321009;16077.196140192944;13961.581152565439;13998.090124141898;14014.509492167826;14233.288335583284;14308.856911430856;3960.1683646434285;4048.2308361411237;4056.9594304056877;4135.6898232632675;4637.327587499827;78655;79301.60349198332;81090;81137;82314.58842705809;12227.266364018009;12297.569585064659;12400.31798251105;12499.3750312484;12548.937255313665;22790.31629051131;22878.885605571864;22920.541589168457;22924.19765308206;22927.312180634606;8708.564571771387;9047.638094476148;9130.086991300817;9276.582553785096;9290.373787732195;5038.748062596929;5069.138246498104;5160.329157209539;5167.6641018333685;5271.1829666401;3821.522309711286;3891.8248678809523;3905.6875449963936;3933.4099885017476;3942.3495123304333;637.9170707807955;642.2036674523557;643.2795269298322;653.8201994451564;655.5312951239791;665.9267480577132;672.3746915368656;684.9246582875879;687.9621620810804;701.9964900175466;11021.724456888482;11394.25937314072;11820.790244485563;12020.879791202151;12239.632811015685;821.4893701254994;827.3091968206495;829.1501211258508;856.6701819799422;861.9870701939476;5406.729663516809;5442.265294185314;5457.645253058538;5500.257465242221;5753.942460575425;67722;69028.6548567264;70906.290937091;80991.59504202442;89947;59163.40836591579;59183;62445.12664620069;69061.65469172722;72553.27446725465;65452.345476545575;67390;68185.65907170433;69369;70420.88737337888;11430.371329576954;12159.79278740799;12193.268403895794;12213.267203967434;12238.510459581874;44759.328610070224;45172.32241516445;45535;46130.308045380014;47521.52478475171;54428.455715443924;54868.45131548633;57294.713526432104;58929;60488.697556511936;15961.600959975629;16012.439564615182;16197.271122799266;16236.594085147966;16324;16297.511074667305;16943;17093.658126837145;17479.300827966737;18411.723824142915;15987.200639967723;16043.117628530543;16784.496465106065;16792.916035419745;17098.316067357166;15299.61750956235;15757;16370.672586547964;16660.50018499447;16870.409535666193;15172.317245723749;15708.60728481797;16176.919115404347;16833.663326733153;16881.324747010472;11730.76538469243;12063.879361206627;12164.452599633214;12329.938350308192;13095.41070651804;12340.691482712646;12629.494820207088;12725.87274127247;12744.74510509803;13374.799378009144 08:08:20 INFO - PROCESS | 10700 | __end_tp_report 08:08:20 INFO - PROCESS | 10700 | __start_cc_report 08:08:20 INFO - PROCESS | 10700 | _x_x_mozilla_cycle_collect,1048 08:08:20 INFO - PROCESS | 10700 | __end_cc_report 08:08:20 INFO - PROCESS | 10700 | __startTimestamp1487952500883__endTimestamp 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | ------- Summary: start ------- 08:08:20 INFO - PROCESS | 10700 | Number of tests: 6 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | [#0] dojo.html Cycles:165 Average:5464.09 Median:5691.12 stddev:636.58 (11.2%) stddev-sans-first:615.62 08:08:20 INFO - PROCESS | 10700 | Values: 3306.3 3335.9 3341.7 3368.9 3379.3 5484.6 5506.2 5525.4 5534.8 5536.7 5485.1 5542.4 5544.6 5546.8 5565.8 5034.2 5053.8 5077.7 5086.6 5145.5 4978.4 5009.0 5013.0 5095.8 5139.6 4984.8 5053.4 5080.1 5103.1 5110.8 5107.2 5108.1 5116.4 5117.3 5151.5 4866.5 4881.2 5041.9 5046.5 5106.9 5370.6 5435.8 5450.4 5467.6 5515.2 5856.2 5906.6 5916.7 5918.4 5919.5 5688.7 5934.9 5949.0 5959.2 5963.0 5386.9 5467.5 5512.4 5519.4 5571.0 6011.9 6014.2 6015.0 6024.7 6034.3 5730.8 5799.0 5804.0 5808.1 5819.4 5647.1 5697.1 5766.9 5811.0 5838.0 5811.6 5851.0 5861.4 5881.1 5886.0 5876.6 5878.8 5879.8 5881.0 5886.1 4051.7 4105.9 4120.2 4128.0 4145.8 3770.7 3778.1 3791.5 3795.9 3812.5 5677.9 5679.1 5685.7 5689.5 5691.1 5681.7 5770.1 5798.3 5869.9 5870.9 5629.4 5640.5 5654.4 5657.8 5664.1 4984.3 5031.2 5031.7 5035.1 5067.2 5978.2 6028.5 6040.3 6075.6 6135.8 5871.9 5878.3 5880.9 5884.6 5915.6 6071.5 6093.1 6093.1 6095.4 6096.2 5571.9 5688.6 5754.8 5789.7 5800.8 5900.8 5945.8 5959.5 5963.0 5997.6 5807.2 5809.0 5809.0 5812.4 5813.7 5650.2 5658.3 5787.4 5792.5 5800.4 5695.9 5728.7 5744.0 5747.6 5788.8 5783.4 5795.7 5836.9 5840.0 5850.4 5554.5 5718.5 5728.7 5729.6 5731.9 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | [#1] ext.html Cycles:180 Average:63865.77 Median:4465.30 stddev:120999.15 (2709.8%) stddev-sans-first:121245.22 08:08:20 INFO - PROCESS | 10700 | Values: 558.6 580.8 592.2 620.8 670.4 36673.3 45399.3 47724.0 47848.8 53279.7 51638.2 52374.0 52462.5 52557.0 52578.7 8472.6 9219.3 9361.9 9409.3 9415.4 8710.4 10823.7 11123.4 11125.5 11507.7 10944.5 10995.9 11003.9 11011.4 11023.6 10907.9 10941.8 10949.0 10955.8 10967.9 11167.7 11233.8 11234.8 11243.3 11244.4 48125.8 48530.3 48550.5 48696.0 48707.0 4384.4 4485.2 4498.7 4526.7 4712.6 33161.3 33270.7 33335.7 33661.5 34442.3 4325.2 4371.4 4401.4 4404.0 4445.4 389743.0 389791.0 390787.0 391207.0 391518.0 60876.7 61033.7 61206.4 61234.7 61244.0 64596.7 64656.0 64768.4 64783.7 64844.0 18772.2 19147.7 19180.3 19183.5 19328.5 13495.9 13816.4 14761.2 15013.5 15184.2 19030.5 19852.7 19884.1 20023.2 20073.8 7457.1 7632.5 7651.2 7660.0 7880.6 1003.5 1016.0 1017.7 1029.4 1035.5 34740.0 34938.0 35162.3 35246.8 35283.8 1083.2 1153.3 1155.1 1171.3 1196.8 15569.3 15954.5 16037.2 16252.9 16474.5 502732.0 503877.0 506844.0 508702.0 510770.0 58564.4 58978.1 59052.7 59073.0 59222.4 1535.2 1539.8 1558.3 1560.8 1588.4 29275.0 30702.0 30826.0 31126.5 31159.0 51143.7 51769.2 51994.7 52008.2 52087.7 467496.0 467740.0 471231.0 471443.0 474593.0 24678.6 28318.0 28426.0 28990.4 30052.5 45786.3 45817.3 46049.0 46271.8 46502.0 46443.5 47406.8 48218.0 53702.2 53803.2 46717.0 50561.5 50691.2 50834.5 51301.0 49198.3 49453.0 49978.0 51051.2 51226.7 47346.3 48331.8 48552.0 49322.5 50291.0 31945.5 32165.5 32178.6 32179.2 32424.4 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | [#2] jquery.html Cycles:180 Average:37276.90 Median:2981.12 stddev:117468.35 (3940.4%) stddev-sans-first:117765.29 08:08:20 INFO - PROCESS | 10700 | Values: 430.8 439.7 440.2 443.4 449.1 20289.3 20842.9 21918.0 22084.6 22275.2 21965.5 23238.5 23253.5 23441.6 23608.3 5938.4 5963.3 6123.8 6151.9 6155.8 5989.2 6006.2 6029.1 6030.3 6054.1 5840.2 5988.6 5992.7 5996.2 6078.9 6061.3 6117.4 6121.6 6123.8 6128.7 5435.5 5463.3 5504.9 5526.8 5527.3 21532.6 21633.0 24563.4 25651.0 25964.6 2795.6 2928.9 3033.3 3054.1 3093.9 15944.4 16159.4 16225.7 16271.4 16428.2 1991.9 2013.5 2020.6 2038.5 2040.9 96407.5 96960.5 97581.5 98008.0 99344.0 12299.3 12370.5 12484.5 12622.6 12664.2 18071.7 18076.1 18082.8 18088.6 18123.1 9088.3 9166.4 9212.9 9227.4 9328.2 8742.7 8759.7 8809.0 9053.1 9088.4 4878.4 5279.5 5356.8 5358.5 5515.8 2110.2 2132.1 2162.3 2211.2 2242.1 932.4 945.1 951.5 966.2 969.8 19155.6 21128.9 21181.3 21364.6 21491.0 950.9 966.4 973.4 974.2 983.4 11619.5 11693.4 11777.5 11803.6 11863.6 667914.0 685984.0 712012.0 749597.0 755934.0 104133.0 104490.5 107791.0 112770.0 114648.0 1029.5 1050.2 1066.6 1080.6 1094.6 17944.8 18262.4 18295.8 18334.3 18655.4 43030.4 46586.3 46674.5 46965.8 47241.0 66205.7 67722.7 67893.0 68840.0 69176.0 8427.7 8502.4 8576.8 8602.8 8818.8 12486.6 14044.5 14128.2 14188.2 14364.6 11627.0 11775.3 12006.0 12074.6 12154.6 10055.0 11373.9 11499.1 11686.8 11743.8 11684.7 11786.4 11875.9 12111.1 12213.6 8776.8 8861.3 8997.6 9007.3 9122.5 8459.1 10710.3 11593.1 11688.2 11938.2 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | [#3] mootools.html Cycles:180 Average:5788.51 Median:4962.24 stddev:3162.42 (63.7%) stddev-sans-first:3153.73 08:08:20 INFO - PROCESS | 10700 | Values: 1353.6 1482.3 1487.2 1488.4 1497.7 7737.0 8433.5 8748.8 8765.2 9021.4 8821.8 8879.0 8901.0 8913.8 8920.2 2164.9 2233.4 2446.9 2485.4 2491.9 2240.4 2289.3 2301.9 2311.5 2323.3 2353.0 2363.4 2364.4 2383.6 2386.7 2455.5 2470.1 2484.3 2496.4 2497.7 2368.6 2376.4 2383.8 2384.2 2389.3 8761.1 8865.6 8894.0 8901.1 8903.1 5402.8 5542.5 5544.6 5552.6 5554.1 3390.8 3475.3 3538.5 3593.3 3610.1 1360.5 1377.4 1406.3 1428.8 1484.1 12106.5 12112.9 12130.0 12138.2 12155.5 4768.4 4871.7 4905.7 4915.5 4945.7 10403.0 10425.7 10432.7 10435.4 10444.6 5547.4 5553.4 5562.9 5563.4 5563.7 4900.8 4978.8 4996.8 5020.6 5039.5 4073.2 4139.5 4148.5 4180.7 4180.7 1374.7 1377.7 1389.9 1397.4 1406.3 1014.1 1019.8 1034.2 1035.5 1037.2 5912.2 5916.6 5918.1 5918.8 6245.7 1043.3 1069.3 1077.2 1077.3 1108.8 4039.9 4154.1 4156.7 4158.4 4171.5 10084.6 10380.6 10391.8 10397.1 10400.7 10297.2 10363.8 10373.1 10388.6 10422.4 8072.1 8211.3 8360.5 8365.2 8370.5 5768.2 5839.5 5945.6 5946.5 6038.1 9718.2 9723.2 9736.1 9742.4 9832.9 8706.3 8961.7 9532.9 9871.7 9906.1 7228.5 7333.2 7383.9 7480.5 7565.6 8604.4 8620.7 8664.2 8667.0 8674.7 7656.3 7788.0 7804.5 7858.4 7981.4 7370.6 7456.7 7459.0 7477.5 7661.4 6891.0 6926.5 6989.7 6995.8 7011.0 5063.5 5066.5 5105.2 5110.1 5260.0 5045.0 5070.6 5081.5 5111.2 5138.8 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | [#4] prototype.html Cycles:180 Average:4716.66 Median:5297.56 stddev:1302.97 (24.6%) stddev-sans-first:1265.74 08:08:20 INFO - PROCESS | 10700 | Values: 402.1 406.2 411.6 417.9 421.8 5112.7 5225.3 5355.5 5391.8 5398.1 5164.8 5209.5 5237.8 5287.3 5291.7 4272.4 4299.1 4299.5 4331.8 4370.0 4267.9 4325.8 4356.7 4376.2 4386.5 4266.0 4274.2 4312.1 4316.2 4326.9 4279.5 4281.9 4283.3 4287.5 4293.8 3879.9 3959.3 3967.5 3975.6 3977.3 5212.5 5235.8 5239.7 5252.2 5264.2 4935.9 4939.2 4953.2 4968.8 4980.8 5366.7 5525.5 5564.9 5587.4 5608.0 4266.3 4269.6 4295.8 4308.2 4315.2 5742.1 5775.0 5799.9 5800.3 5826.0 4245.9 4391.8 4442.0 4448.2 4460.8 4418.1 4457.0 4461.4 4471.8 4481.0 4893.9 4930.9 4944.4 4952.1 4957.7 5550.6 5662.0 5680.4 5687.4 5688.3 1486.0 1493.6 1499.2 1501.3 1501.5 1047.6 1083.2 1083.3 1085.3 1101.7 5302.4 5336.9 5346.8 5353.1 5377.5 5580.3 5584.9 5592.6 5602.2 5630.0 5210.2 5308.7 5325.6 5351.6 5373.4 2940.3 2941.7 2947.2 2948.1 2972.7 5553.8 5836.7 5866.1 5870.4 5884.1 5612.9 5660.2 5684.6 5701.5 5752.4 5746.7 5781.6 5789.6 5801.5 5813.6 5314.5 5541.6 5562.3 5576.9 5589.5 5396.8 5426.7 5438.8 5441.9 5447.2 5736.6 5744.7 5754.3 5788.0 5797.9 4095.0 4226.6 4246.9 4253.6 4270.2 5512.2 5545.5 5547.6 5618.2 5708.7 5243.8 5391.4 5428.8 5450.2 5474.1 5348.7 5364.0 5403.3 5419.5 5428.4 5334.6 5380.6 5381.9 5382.1 5384.8 5191.7 5302.9 5407.8 5447.9 5457.6 5292.8 5312.8 5314.5 5319.8 5327.4 08:08:20 INFO - PROCESS | 10700 | 08:08:20 INFO - PROCESS | 10700 | [#5] yui.html Cycles:180 Average:18655.33 Median:45353.66 stddev:22435.81 (49.5%) stddev-sans-first:22458.86 08:08:20 INFO - PROCESS | 10700 | Values: 839.8 857.8 859.2 929.3 938.8 16556.5 17057.3 17112.0 17459.2 17559.0 15579.5 15703.4 15873.4 15954.4 16225.9 708.4 735.8 835.3 845.1 849.0 794.6 802.8 815.5 819.2 819.2 884.8 886.9 887.5 887.6 887.6 729.9 759.5 877.9 878.2 879.0 565.4 619.4 623.6 639.2 642.0 15634.6 15802.8 15850.0 15864.0 15897.5 14989.4 15462.8 15799.3 15802.7 16077.2 13961.6 13998.1 14014.5 14233.3 14308.9 3960.2 4048.2 4057.0 4135.7 4637.3 78655.0 79301.6 81090.0 81137.0 82314.6 12227.3 12297.6 12400.3 12499.4 12548.9 22790.3 22878.9 22920.5 22924.2 22927.3 8708.6 9047.6 9130.1 9276.6 9290.4 5038.7 5069.1 5160.3 5167.7 5271.2 3821.5 3891.8 3905.7 3933.4 3942.3 637.9 642.2 643.3 653.8 655.5 665.9 672.4 684.9 688.0 702.0 11021.7 11394.3 11820.8 12020.9 12239.6 821.5 827.3 829.2 856.7 862.0 5406.7 5442.3 5457.6 5500.3 5753.9 67722.0 69028.7 70906.3 80991.6 89947.0 59163.4 59183.0 62445.1 69061.7 72553.3 65452.3 67390.0 68185.7 69369.0 70420.9 11430.4 12159.8 12193.3 12213.3 12238.5 44759.3 45172.3 45535.0 46130.3 47521.5 54428.5 54868.5 57294.7 58929.0 60488.7 15961.6 16012.4 16197.3 16236.6 16324.0 16297.5 16943.0 17093.7 17479.3 18411.7 15987.2 16043.1 16784.5 16792.9 17098.3 15299.6 15757.0 16370.7 16660.5 16870.4 15172.3 15708.6 16176.9 16833.7 16881.3 11730.8 12063.9 12164.5 12329.9 13095.4 12340.7 12629.5 12725.9 12744.7 13374.8 08:08:20 INFO - PROCESS | 10700 | -------- Summary: end -------- 08:08:20 INFO - PROCESS | 10700 | 08:08:21 INFO - TEST-INFO | 10700: exit 0 08:08:21 INFO - TEST-OK | dromaeo_css | took 1113552ms 08:08:21 INFO - TEST-START | kraken 08:08:21 INFO - operating with platform_type : linux_ 08:08:21 INFO - Initialising browser for kraken test... 08:08:21 INFO - TEST-INFO | started process 11019 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsLwpEK/profile http://localhost:49862/getInfo.html) 08:08:25 INFO - PROCESS | 11019 | __metrics Screen width/height:1600/1200 08:08:25 INFO - PROCESS | 11019 | colorDepth:24 08:08:25 INFO - PROCESS | 11019 | Browser inner width/height: 1024/697 08:08:25 INFO - PROCESS | 11019 | __metrics 08:08:26 INFO - PROCESS | 11019 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:08:26 INFO - PROCESS | 11019 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:08:27 INFO - TEST-INFO | 11019: exit 0 08:08:27 INFO - Browser initialized. 08:08:27 INFO - Running cycle 1/1 for kraken test... 08:08:27 INFO - TEST-INFO | started process 11111 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsLwpEK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:08:39 INFO - PROCESS | 11111 | RSS: Main: 138285056 08:08:39 INFO - PROCESS | 11111 | 08:08:41 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49862/tests/kraken/driver.html?testName=audio-beat-detection) 08:08:42 INFO - PROCESS | 11111 | RSS: Main: 181616640 08:08:42 INFO - PROCESS | 11111 | 08:08:45 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49862/tests/kraken/driver.html?testName=audio-dft) 08:08:45 INFO - PROCESS | 11111 | RSS: Main: 172216320 08:08:45 INFO - PROCESS | 11111 | 08:08:48 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49862/tests/kraken/driver.html?testName=audio-fft) 08:08:49 INFO - PROCESS | 11111 | RSS: Main: 263561216 08:08:49 INFO - PROCESS | 11111 | 08:08:51 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49862/tests/kraken/driver.html?testName=audio-oscillator) 08:08:51 INFO - PROCESS | 11111 | RSS: Main: 170446848 08:08:51 INFO - PROCESS | 11111 | 08:08:53 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49862/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:08:54 INFO - PROCESS | 11111 | RSS: Main: 172793856 08:08:54 INFO - PROCESS | 11111 | 08:08:57 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49862/tests/kraken/driver.html?testName=imaging-darkroom) 08:08:57 INFO - PROCESS | 11111 | RSS: Main: 211386368 08:08:57 INFO - PROCESS | 11111 | 08:09:01 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49862/tests/kraken/driver.html?testName=imaging-desaturate) 08:09:01 INFO - PROCESS | 11111 | RSS: Main: 209870848 08:09:01 INFO - PROCESS | 11111 | 08:09:04 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49862/tests/kraken/driver.html?testName=json-parse-financial) 08:09:05 INFO - PROCESS | 11111 | RSS: Main: 208285696 08:09:05 INFO - PROCESS | 11111 | 08:09:06 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49862/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:09:07 INFO - PROCESS | 11111 | RSS: Main: 170848256 08:09:07 INFO - PROCESS | 11111 | 08:09:09 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:09:09 INFO - PROCESS | 11111 | RSS: Main: 177676288 08:09:09 INFO - PROCESS | 11111 | 08:09:11 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:09:12 INFO - PROCESS | 11111 | RSS: Main: 187068416 08:09:12 INFO - PROCESS | 11111 | 08:09:14 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:09:15 INFO - PROCESS | 11111 | RSS: Main: 196440064 08:09:15 INFO - PROCESS | 11111 | 08:09:18 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:09:18 INFO - PROCESS | 11111 | RSS: Main: 193138688 08:09:18 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | Cycle 1(1): loaded http://localhost:49862/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49862/tests/kraken/driver.html?testName=ai-astar) 08:09:20 INFO - PROCESS | 11111 | RSS: Main: 245166080 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | __start_tp_report 08:09:20 INFO - PROCESS | 11111 | _x_x_mozilla_page_load 08:09:20 INFO - PROCESS | 11111 | _x_x_mozilla_page_load_details 08:09:20 INFO - PROCESS | 11111 | |i|pagename|runs| 08:09:20 INFO - PROCESS | 11111 | |0;ai-astar;102;110;110;110;110;110;112;109;110;109 08:09:20 INFO - PROCESS | 11111 | |1;audio-beat-detection;142;122;118;153;117;120;117;118;139;118 08:09:20 INFO - PROCESS | 11111 | |2;audio-dft;161;160;161;162;161;160;160;161;161;159 08:09:20 INFO - PROCESS | 11111 | |3;audio-fft;75;76;76;112;76;76;76;77;94;75 08:09:20 INFO - PROCESS | 11111 | |4;audio-oscillator;82;83;104;82;82;82;97;84;83;96 08:09:20 INFO - PROCESS | 11111 | |5;imaging-gaussian-blur;116;117;117;116;117;117;117;117;118;118 08:09:20 INFO - PROCESS | 11111 | |6;imaging-darkroom;147;147;146;148;147;146;147;148;146;147 08:09:20 INFO - PROCESS | 11111 | |7;imaging-desaturate;97;96;97;95;95;95;95;95;95;94 08:09:20 INFO - PROCESS | 11111 | |8;json-parse-financial;48;50;49;50;49;50;49;50;49;50 08:09:20 INFO - PROCESS | 11111 | |9;json-stringify-tinderbox;64;64;65;64;65;64;63;64;64;64 08:09:20 INFO - PROCESS | 11111 | |10;stanford-crypto-aes;76;79;76;76;76;78;77;75;81;75 08:09:20 INFO - PROCESS | 11111 | |11;stanford-crypto-ccm;124;122;119;124;121;120;122;119;157;128 08:09:20 INFO - PROCESS | 11111 | |12;stanford-crypto-pbkdf2;159;158;163;157;158;157;157;158;159;158 08:09:20 INFO - PROCESS | 11111 | |13;stanford-crypto-sha256-iterative;63;61;61;61;61;63;60;60;59;59 08:09:20 INFO - PROCESS | 11111 | __end_tp_report 08:09:20 INFO - PROCESS | 11111 | __start_cc_report 08:09:20 INFO - PROCESS | 11111 | _x_x_mozilla_cycle_collect,1531 08:09:20 INFO - PROCESS | 11111 | __end_cc_report 08:09:20 INFO - PROCESS | 11111 | __startTimestamp1487952560587__endTimestamp 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | ------- Summary: start ------- 08:09:20 INFO - PROCESS | 11111 | Number of tests: 14 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#0] ai-astar Cycles:10 Average:109.20 Median:110.00 stddev:2.66 (2.4%) stddev-sans-first:0.87 08:09:20 INFO - PROCESS | 11111 | Values: 102.0 110.0 110.0 110.0 110.0 110.0 112.0 109.0 110.0 109.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#1] audio-beat-detection Cycles:10 Average:126.40 Median:121.00 stddev:13.16 (10.9%) stddev-sans-first:12.69 08:09:20 INFO - PROCESS | 11111 | Values: 142.0 122.0 118.0 153.0 117.0 120.0 117.0 118.0 139.0 118.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#2] audio-dft Cycles:10 Average:160.60 Median:161.00 stddev:0.84 (0.5%) stddev-sans-first:0.88 08:09:20 INFO - PROCESS | 11111 | Values: 161.0 160.0 161.0 162.0 161.0 160.0 160.0 161.0 161.0 159.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#3] audio-fft Cycles:10 Average:81.30 Median:76.00 stddev:12.21 (16.1%) stddev-sans-first:12.74 08:09:20 INFO - PROCESS | 11111 | Values: 75.0 76.0 76.0 112.0 76.0 76.0 76.0 77.0 94.0 75.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#4] audio-oscillator Cycles:10 Average:87.50 Median:83.00 stddev:8.22 (9.9%) stddev-sans-first:8.48 08:09:20 INFO - PROCESS | 11111 | Values: 82.0 83.0 104.0 82.0 82.0 82.0 97.0 84.0 83.0 96.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.67 (0.6%) stddev-sans-first:0.60 08:09:20 INFO - PROCESS | 11111 | Values: 116.0 117.0 117.0 116.0 117.0 117.0 117.0 117.0 118.0 118.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#6] imaging-darkroom Cycles:10 Average:146.90 Median:147.00 stddev:0.74 (0.5%) stddev-sans-first:0.78 08:09:20 INFO - PROCESS | 11111 | Values: 147.0 147.0 146.0 148.0 147.0 146.0 147.0 148.0 146.0 147.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.00 stddev:0.97 (1.0%) stddev-sans-first:0.83 08:09:20 INFO - PROCESS | 11111 | Values: 97.0 96.0 97.0 95.0 95.0 95.0 95.0 95.0 95.0 94.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#8] json-parse-financial Cycles:10 Average:49.40 Median:50.00 stddev:0.70 (1.4%) stddev-sans-first:0.53 08:09:20 INFO - PROCESS | 11111 | Values: 48.0 50.0 49.0 50.0 49.0 50.0 49.0 50.0 49.0 50.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#9] json-stringify-tinderbox Cycles:10 Average:64.10 Median:64.00 stddev:0.57 (0.9%) stddev-sans-first:0.60 08:09:20 INFO - PROCESS | 11111 | Values: 64.0 64.0 65.0 64.0 65.0 64.0 63.0 64.0 64.0 64.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#10] stanford-crypto-aes Cycles:10 Average:76.90 Median:76.50 stddev:1.91 (2.5%) stddev-sans-first:2.00 08:09:20 INFO - PROCESS | 11111 | Values: 76.0 79.0 76.0 76.0 76.0 78.0 77.0 75.0 81.0 75.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#11] stanford-crypto-ccm Cycles:10 Average:125.60 Median:123.00 stddev:11.36 (9.2%) stddev-sans-first:12.04 08:09:20 INFO - PROCESS | 11111 | Values: 124.0 122.0 119.0 124.0 121.0 120.0 122.0 119.0 157.0 128.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:158.40 Median:158.00 stddev:1.78 (1.1%) stddev-sans-first:1.87 08:09:20 INFO - PROCESS | 11111 | Values: 159.0 158.0 163.0 157.0 158.0 157.0 157.0 158.0 159.0 158.0 08:09:20 INFO - PROCESS | 11111 | 08:09:20 INFO - PROCESS | 11111 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.80 Median:61.00 stddev:1.40 (2.3%) stddev-sans-first:1.24 08:09:20 INFO - PROCESS | 11111 | Values: 63.0 61.0 61.0 61.0 61.0 63.0 60.0 60.0 59.0 59.0 08:09:20 INFO - PROCESS | 11111 | -------- Summary: end -------- 08:09:20 INFO - PROCESS | 11111 | 08:09:21 INFO - TEST-INFO | 11111: exit 0 08:09:21 INFO - TEST-OK | kraken | took 59952ms 08:09:21 INFO - SUITE-END | took 1173s 08:09:21 INFO - Completed test suite (00:19:33) 08:09:21 INFO - javascript benchmark 08:09:21 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3306.3222039481907, 3335.899923002309, 3341.6825401586857, 3368.9326213475715, 3379.2903490267045, 5484.561235101192, 5506.229127922094, 5525.392206857247, 5534.75093620787, 5536.695481748502, 5485.067538518451, 5542.362628297747, 5544.6395984261, 5546.750396232169, 5565.777368905239, 5034.219695947125, 5053.77258023388, 5077.746112694369, 5086.593072554187, 5145.536901678848, 4978.402591688984, 5008.974955125237, 5013.0, 5095.821646242363, 5139.614528910328, 4984.75076246188, 5053.36832895888, 5080.0601888650535, 5103.106956282636, 5110.8466745997675, 5107.157319042353, 5108.131617625013, 5116.437191908887, 5117.334746482933, 5151.5106064923775, 4866.537678920497, 4881.170201065827, 5041.873953151201, 5046.495350464924, 5106.923396149061, 5370.570354371641, 5435.809746658888, 5450.400455949843, 5467.617266791326, 5515.200295957104, 5856.209411729405, 5906.557008224358, 5916.704164791743, 5918.40815918409, 5919.467247947662, 5688.715564221814, 5934.940650593525, 5949.0, 5959.225300710923, 5962.97018514909, 5386.946130538723, 5467.507924286793, 5512.39363669996, 5519.39286678469, 5571.0, 6011.939880601226, 6014.1580178775, 6015.037593984942, 6024.698765061729, 6034.336223015464, 5730.770769169187, 5799.043157878903, 5803.9552880481915, 5808.07070868659, 5819.388964158787, 5647.068233741386, 5697.088465845445, 5766.913496297559, 5811.0, 5838.036723940587, 5811.564132690065, 5851.034579294369, 5861.3552509223955, 5881.1178323251, 5886.0, 5876.559258055663, 5878.764849405976, 5879.794207202727, 5881.029630111069, 5886.146508756292, 4051.6758659307184, 4105.938410923779, 4120.237756015147, 4128.0, 4145.813438395279, 3770.6606405423095, 3778.074371778932, 3791.5071040764524, 3795.905102372463, 3812.542494900574, 5677.9211949729415, 5679.148127780866, 5685.658860468385, 5689.487946084872, 5691.117876729114, 5681.687507187062, 5770.105633626795, 5798.333191682926, 5869.882602347929, 5870.853228669232, 5629.43705629442, 5640.5487560995025, 5654.37801841797, 5657.830265092054, 5664.065429204217, 4984.327115839388, 5031.169856973558, 5031.698098114125, 5035.144025515671, 5067.189249720027, 5978.1929439525975, 6028.517718582503, 6040.305364883095, 6075.605085669417, 6135.754569817157, 5871.853203669772, 5878.29460464747, 5880.911786323294, 5884.6469211847425, 5915.615484993462, 6071.453569178619, 6093.086037094294, 6093.086037094471, 6095.420935011167, 6096.237970253718, 5571.944280557304, 5688.601797874109, 5754.827355179351, 5789.739461724148, 5800.767969281182, 5900.822975310747, 5945.821625351246, 5959.463648271676, 5962.97018514922, 5997.640141591519, 5807.245058142415, 5808.970955145366, 5809.0, 5812.360640329645, 5813.738381772746, 5650.152477128464, 5658.321001479849, 5787.39232380594, 5792.507636850914, 5800.361960184461, 5695.943040569707, 5728.742206600629, 5743.994800909908, 5747.597668163188, 5788.82633520995, 5783.392743761844, 5795.681237531976, 5836.854078648068, 5840.0, 5850.414958504116, 5554.50009499147, 5718.485336319584, 5728.656280623176, 5729.598928074995, 5731.942680573307], "value": 5420.2198225628235, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [558.6285120394937, 580.7618876260734, 592.2005292854647, 620.7920346683861, 670.3598063849024, 36673.349699263534, 45399.31901021483, 47724.045519089595, 47848.76075619626, 53279.73360133204, 51638.225426618534, 52374.0, 52462.475375246235, 52557.0, 52578.73710631451, 8472.576371181447, 9219.308551858603, 9361.906380936172, 9409.341346105775, 9415.387999780027, 8710.433821801595, 10823.729406764814, 11123.443827808618, 11125.499352529116, 11507.712307192345, 10944.45277736114, 10995.945020274887, 11003.889961100407, 11011.394373309466, 11023.559057637685, 10907.890921090768, 10941.781164376747, 10949.0, 10955.83566246507, 10967.890321096767, 11167.664970050912, 11233.831492527619, 11234.831477527843, 11243.325400475998, 11244.437778111143, 48125.75937120327, 48530.27204591934, 48550.51449485495, 48696.0, 48707.0, 4384.408104905829, 4485.192665320241, 4498.685092043558, 4526.660500462479, 4712.575868171881, 33161.3367732644, 33270.667293327, 33335.6666433335, 33661.495077573854, 34442.31115377678, 4325.243082460588, 4371.431713877208, 4401.383806267125, 4403.9779801100785, 4445.399871017404, 389743.0, 389791.0, 390786.99999999715, 391207.0, 391518.0, 60876.69561652252, 61033.69483152556, 61206.38793612007, 61234.693826531475, 61244.0, 64596.677016614616, 64656.0, 64768.35231647623, 64783.67608162023, 64844.0, 18772.155253013647, 19147.712784308245, 19180.328688496116, 19183.52041198981, 19328.516787080436, 13495.932520337336, 13816.378262977989, 14761.188134652697, 15013.549593512213, 15184.240787960558, 19030.52423689391, 19852.73166269259, 19884.105215265346, 20023.199072036954, 20073.799262007193, 7457.142428620669, 7632.542047477169, 7651.234876512415, 7660.0466880945005, 7880.605969701492, 1003.5433877585681, 1015.9796804064025, 1017.6743442098606, 1029.4183786160945, 1035.5288343803552, 34740.0, 34938.0, 35162.29675406477, 35246.823765881, 35283.82358088193, 1083.2451428685579, 1153.3195414705197, 1155.110564865066, 1171.2738102376582, 1196.8144937534696, 15569.299381527859, 15954.521364359089, 16037.198140092949, 16252.918735406247, 16474.505764827074, 502732.0, 503877.0, 506844.0, 508702.0, 510770.0, 58564.414355856745, 58978.11532827011, 59052.704736476044, 59073.0, 59222.40777592255, 1535.2016951185321, 1539.7921280627197, 1558.306553583667, 1560.8361122082244, 1588.356715530212, 29275.0, 30702.0, 30826.0, 31126.533102003035, 31159.0, 51143.744281278356, 51769.22346164735, 51994.74002629962, 52008.21987670112, 52087.739561301954, 467496.0, 467740.0, 471231.0, 471443.0, 474593.0, 24678.629820553066, 28318.0, 28426.0, 28990.420191596473, 30052.549211761405, 45786.31320530261, 45817.312740308254, 46049.0, 46271.76864115658, 46502.0, 46443.53556464392, 47406.762966186325, 48218.03563928632, 53702.19446708224, 53803.19295210653, 46717.0, 50561.49438505715, 50691.23963140629, 50834.49165508446, 51301.0, 49198.26202606892, 49453.0, 49978.0, 51051.23423148582, 51226.74386628192, 47346.28980565225, 48331.75834120807, 48552.0, 49322.50677493323, 50291.0, 31945.520817188226, 32165.517517236793, 32178.628769690073, 32179.195520111247, 32424.351512969137], "value": 22066.921180450532, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [430.82982222022304, 439.7053973837529, 440.2295982031445, 443.44347843456467, 449.14886290479564, 20289.289874854385, 20842.89578552105, 21918.0, 22084.558308833854, 22275.220367287147, 21965.450863728416, 23238.535229295405, 23253.534929301448, 23441.64837527434, 23608.29175124749, 5938.435848594388, 5963.284405871302, 6123.846903827395, 6151.907721384183, 6155.846103847395, 5989.191459153024, 6006.189164462785, 6029.095635654643, 6030.33666296707, 6054.122152287916, 5840.211571437865, 5988.640681559099, 5992.730327135289, 5996.22049133612, 6078.878422431549, 6061.333253342151, 6117.388261173892, 6121.632702037848, 6123.846903827418, 6128.693565321739, 5435.537979271767, 5463.262459567987, 5504.862378440531, 5526.778928842841, 5527.336719593674, 21532.56934861294, 21633.0, 24563.38591535208, 25651.0, 25964.610530842052, 2795.580662900581, 2928.926776830575, 3033.3175035617032, 3054.068509104722, 3093.8917137900066, 15944.441944532002, 16159.353625854952, 16225.675486490203, 16271.430499932445, 16428.1785910704, 1991.9103640336075, 2013.4865609269689, 2020.6261841559212, 2038.5311378383055, 2040.9387718368473, 96407.51796241043, 96960.51519742356, 97581.51209243908, 98008.0, 99344.0, 12299.323537205539, 12370.505179792888, 12484.500619975099, 12622.55821046259, 12664.240145591293, 18071.72892406615, 18076.096195190188, 18082.819171808376, 18088.63822723538, 18123.09384530768, 9088.272938164931, 9166.358354915092, 9212.907870921204, 9227.44635321883, 9328.160465558132, 8742.650293988168, 8759.693410730593, 8808.955955220183, 9053.139951704577, 9088.409253398508, 4878.365812444359, 5279.47205279469, 5356.7857285708915, 5358.490943360374, 5515.814099968526, 2110.1981247125996, 2132.093860109478, 2162.2540223622823, 2211.1818627108073, 2242.1031587365183, 932.3520153493392, 945.0832692288469, 951.5194826612654, 966.1787480641399, 969.8060387922444, 19155.61688766217, 21128.900546880923, 21181.258655946967, 21364.572708546053, 21491.0, 950.8621249918862, 966.4201479112477, 973.4208146153028, 974.2011550528499, 983.4492684096929, 11619.477123529461, 11693.415329233505, 11777.528898844123, 11803.645890623295, 11863.644090677293, 667914.0, 685984.0, 712012.0, 749597.0, 755934.0, 104133.0, 104490.47754761178, 107791.0, 112770.0, 114648.0, 1029.5161274201264, 1050.217587897037, 1066.632011955874, 1080.5839751695653, 1094.6114129484079, 17944.820551794837, 18262.36081737186, 18295.81704182941, 18334.266629334677, 18655.440336789918, 43030.35454468248, 46586.301205482625, 46674.53325466702, 46965.76517117392, 47241.0, 66205.66897165483, 67722.66138669275, 67893.0, 68840.0, 69176.0, 8427.662893484192, 8502.44734092282, 8576.842126312868, 8602.78493037654, 8818.823623527365, 12486.562970295996, 14044.508442204882, 14128.152310861382, 14188.219647919463, 14364.640883977567, 11627.0, 11775.293482391084, 12006.0, 12074.637760867188, 12154.635360939186, 10055.0, 11373.943130284295, 11499.137564682514, 11686.824697629372, 11743.76512469763, 11684.70788230301, 11786.351750653796, 11875.881241187477, 12111.091668124749, 12213.572524961584, 8776.78058048554, 8861.33539984491, 8997.571043259439, 9007.324450666096, 9122.498262595356, 8459.069502354612, 10710.250282480152, 11593.130515211224, 11688.240264382788, 11938.22401543897], "value": 10122.57914913038, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1353.6277523680992, 1482.347766982528, 1487.1856335270973, 1488.4343949299266, 1497.7079469503444, 7736.999999999993, 8433.493990360583, 8748.78128046799, 8765.16730910564, 9021.413608115468, 8821.823563528726, 8878.955605221965, 8900.955495222515, 8913.777155571113, 8920.197182253596, 2164.9242276520326, 2233.352327824929, 2446.8654224017673, 2485.440775825443, 2491.9003239870385, 2240.406292332533, 2289.3246492284816, 2301.942451438719, 2311.52613714189, 2323.256557901472, 2352.9764702353013, 2363.397333679909, 2364.4443555764383, 2383.5947888858936, 2386.689730335063, 2455.545724041049, 2470.0613766768693, 2484.2671411933525, 2496.3509487533192, 2497.7127630322566, 2368.585497537924, 2376.4058985253687, 2383.84505007174, 2384.248961577115, 2389.2712722619767, 8761.08008659088, 8865.55672216393, 8894.0, 8901.065388134217, 8903.10968903111, 5402.78388864445, 5542.528885044776, 5544.6118771686, 5552.583556233299, 5554.1113421852715, 3390.8135052572097, 3475.287566048954, 3538.5046093546925, 3593.3352329819068, 3610.1335679437007, 1360.5238166641695, 1377.4008306386754, 1406.2687402550719, 1428.7713965765427, 1484.1095342794345, 12106.455209515592, 12112.939435302855, 12130.0, 12138.15032947694, 12155.453004614725, 4768.380110585602, 4871.683340582851, 4905.6811307265625, 4915.508449155056, 4945.678530895552, 10402.959704029536, 10425.687229383131, 10432.739181520523, 10435.426051567085, 10444.582216711398, 5547.41752116022, 5553.361363443256, 5562.944370556243, 5563.443655634404, 5563.666180029211, 4900.803967841246, 4978.800847966113, 4996.825111121093, 5020.648554601143, 5039.496050395004, 4073.167820482213, 4139.461869956886, 4148.502179738391, 4180.665546756252, 4180.728252663567, 1374.6700791809894, 1377.6762460821699, 1389.9305034748222, 1397.44800803684, 1406.3109076552416, 1014.1379827146866, 1019.8317277649253, 1034.2294990232326, 1035.5443604813859, 1037.1547189040907, 5912.17229587858, 5916.615419997773, 5918.082697181943, 5918.822435326861, 6245.656488893063, 1043.2703086465915, 1069.2782371898936, 1077.2028698763015, 1077.2836064017497, 1108.7671588966246, 4039.8788036358956, 4154.065335299594, 4156.729812562174, 4158.37624356349, 4171.520275168334, 10084.596616135419, 10380.636677716395, 10391.792164156826, 10397.11624511925, 10400.687979360631, 10297.227707921937, 10363.792724145474, 10373.118284945713, 10388.584456621651, 10422.374657520573, 8072.071711753106, 8211.34309255258, 8360.45657032291, 8365.24712775841, 8370.53962032094, 5768.163616275533, 5839.532837373085, 5945.583809133319, 5946.494547963299, 6038.064100064497, 9718.222542196749, 9723.173530249725, 9736.123748862636, 9742.366746161477, 9832.901670983485, 8706.347023973101, 8961.731148065568, 9532.857007145038, 9871.654492092743, 9906.05892440217, 7228.49400541957, 7333.156686981066, 7383.926160738324, 7480.4763666544995, 7565.621718914143, 8604.354673399645, 8620.655173792979, 8664.176903194186, 8666.956665216634, 8674.696385626472, 7656.310932016146, 7787.961060194662, 7804.492707973964, 7858.410619203468, 7981.441299109239, 7370.63146842645, 7456.664450099867, 7458.962705186439, 7477.4765766398, 7661.425393095428, 6891.035255064195, 6926.515143939876, 6989.685464154024, 6995.755148569776, 7010.964945175241, 5063.544281014726, 5066.493350664904, 5105.2086926526445, 5110.105731497048, 5260.026895024433, 5045.041442126131, 5070.5943524517215, 5081.517255860687, 5111.156659151198, 5138.794448222029], "value": 4718.2643614493545, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [402.1395001278196, 406.20384047267356, 411.600182492611, 417.88717046397454, 421.81229352937936, 5112.667676601028, 5225.268462415255, 5355.464453554642, 5391.81128660497, 5398.137642513331, 5164.819231326905, 5209.505097015777, 5237.8428647140645, 5287.312649355578, 5291.656042357244, 4272.359146128075, 4299.098108776571, 4299.548547402509, 4331.783410829462, 4370.0, 4267.893302667427, 4325.826966921335, 4356.695031347807, 4376.190404775127, 4386.473623165225, 4265.976165720221, 4274.187904298189, 4312.116016216683, 4316.158349121923, 4326.935095973563, 4279.5078565965005, 4281.871543853689, 4283.314669652872, 4287.5498072702385, 4293.8067786949505, 3879.9030024249337, 3959.267535505912, 3967.484227050465, 3975.5626881043063, 3977.2642061218476, 5212.452692467312, 5235.790568377261, 5239.685618862843, 5252.23842542833, 5264.236685680593, 4935.938773163751, 4939.209726443752, 4953.157963146274, 4968.801247950078, 4980.77586508608, 5366.6511676741275, 5525.530329921961, 5564.888702225973, 5587.441255874421, 5607.971695284541, 4266.338717498793, 4269.615734583902, 4295.818649871279, 4308.181445525372, 4315.244832154392, 5742.109972954198, 5774.971125144348, 5799.898019376305, 5800.303963524362, 5826.038703613941, 4245.915081698348, 4391.8462853799965, 4441.977790111029, 4448.154850578379, 4460.821567137343, 4418.1163767246035, 4456.952616135271, 4461.397711308931, 4471.821127154943, 4480.955190448119, 4893.877653058631, 4930.926036109461, 4944.357233559686, 4952.108620448354, 4957.7273249971595, 5550.611457197957, 5662.0, 5680.375158732536, 5687.374388817227, 5688.345840228344, 1485.95982812032, 1493.6191271225769, 1499.1829452947952, 1501.3319073012406, 1501.5495351394538, 1047.6228557719214, 1083.247143235444, 1083.3012706804068, 1085.3108276244484, 1101.730076131353, 5302.3637163540625, 5336.91994620081, 5346.786128554814, 5353.0899747043095, 5377.542908852792, 5580.330360356702, 5584.888302233932, 5592.580556458201, 5602.159676048544, 5630.0, 5210.244514545369, 5308.734563271821, 5325.627206095536, 5351.598630102758, 5373.435789242073, 2940.3384238546155, 2941.7205365490245, 2947.1747910585073, 2948.1279387589034, 2972.6581443134314, 5553.750081246354, 5836.737346819404, 5866.12008198765, 5870.444332251956, 5884.058550631964, 5612.943870561324, 5660.179378919213, 5684.6020778545935, 5701.515371193412, 5752.36723960364, 5746.683932383759, 5781.566382521328, 5789.623674461147, 5801.491612180779, 5813.593048486566, 5314.5216930476445, 5541.612087153861, 5562.3047119110115, 5576.91634625489, 5589.518777524041, 5396.815878631626, 5426.70153141581, 5438.797287098731, 5441.87092421867, 5447.1829225616475, 5736.598438109292, 5744.741486633196, 5754.309482862083, 5788.016037273758, 5797.91303130445, 4095.0, 4226.5773422657485, 4246.936295955625, 4253.638440732572, 4270.210011147948, 5512.153428601463, 5545.500904918576, 5547.583931205257, 5618.157276408408, 5708.714564271853, 5243.790248390174, 5391.353037635509, 5428.782848686008, 5450.209719590716, 5474.069408200695, 5348.689571055116, 5364.0, 5403.297571315704, 5419.485148910847, 5428.430014848542, 5334.639666885075, 5380.623356365017, 5381.8923621526565, 5382.085045542189, 5384.784608615611, 5191.715645116137, 5302.867428314323, 5407.83776486706, 5447.863803404946, 5457.645253058538, 5292.756202292535, 5312.768637172474, 5314.468553144655, 5319.787208511616, 5327.413984461628], "value": 4327.061914366723, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [839.8068444257821, 857.8370109679161, 859.2438653984493, 929.3308817651291, 938.7568191773183, 16556.503304900856, 17057.31770729171, 17111.999999999967, 17459.214335354907, 17559.03425311609, 15579.53261402157, 15703.371865125382, 15873.365065397398, 15954.441594544192, 16225.918870405661, 708.3978618174536, 735.7792662201344, 835.2607941971369, 845.0915266088948, 848.9981821450685, 794.5709316968859, 802.8233788566506, 815.4577206157898, 819.1890028871434, 819.2381085590398, 884.8141890203033, 886.9068747781487, 887.525174031893, 887.5739644970419, 887.6183241206279, 729.9306565876233, 759.4569882533959, 877.8814859993915, 878.2359347367767, 879.0111124984393, 565.4486875296553, 619.3527763487167, 623.5884316351187, 639.162696867101, 642.0497663458061, 15634.609134771721, 15802.841971580367, 15850.0, 15864.04815711061, 15897.52307430779, 14989.400423983028, 15462.768058479132, 15799.289031993589, 15802.683946321009, 16077.196140192944, 13961.581152565439, 13998.090124141898, 14014.509492167826, 14233.288335583284, 14308.856911430856, 3960.1683646434285, 4048.2308361411237, 4056.9594304056877, 4135.6898232632675, 4637.327587499827, 78655.0, 79301.60349198332, 81090.0, 81137.0, 82314.58842705809, 12227.266364018009, 12297.569585064659, 12400.31798251105, 12499.3750312484, 12548.937255313665, 22790.31629051131, 22878.885605571864, 22920.541589168457, 22924.19765308206, 22927.312180634606, 8708.564571771387, 9047.638094476148, 9130.086991300817, 9276.582553785096, 9290.373787732195, 5038.748062596929, 5069.138246498104, 5160.329157209539, 5167.6641018333685, 5271.1829666401, 3821.522309711286, 3891.8248678809523, 3905.6875449963936, 3933.4099885017476, 3942.3495123304333, 637.9170707807955, 642.2036674523557, 643.2795269298322, 653.8201994451564, 655.5312951239791, 665.9267480577132, 672.3746915368656, 684.9246582875879, 687.9621620810804, 701.9964900175466, 11021.724456888482, 11394.25937314072, 11820.790244485563, 12020.879791202151, 12239.632811015685, 821.4893701254994, 827.3091968206495, 829.1501211258508, 856.6701819799422, 861.9870701939476, 5406.729663516809, 5442.265294185314, 5457.645253058538, 5500.257465242221, 5753.942460575425, 67722.0, 69028.6548567264, 70906.290937091, 80991.59504202442, 89947.0, 59163.40836591579, 59183.0, 62445.12664620069, 69061.65469172722, 72553.27446725465, 65452.345476545575, 67390.0, 68185.65907170433, 69369.0, 70420.88737337888, 11430.371329576954, 12159.79278740799, 12193.268403895794, 12213.267203967434, 12238.510459581874, 44759.328610070224, 45172.32241516445, 45535.0, 46130.308045380014, 47521.52478475171, 54428.455715443924, 54868.45131548633, 57294.713526432104, 58929.0, 60488.697556511936, 15961.600959975629, 16012.439564615182, 16197.271122799266, 16236.594085147966, 16324.0, 16297.511074667305, 16943.0, 17093.658126837145, 17479.300827966737, 18411.723824142915, 15987.200639967723, 16043.117628530543, 16784.496465106065, 16792.916035419745, 17098.316067357166, 15299.61750956235, 15757.0, 16370.672586547964, 16660.50018499447, 16870.409535666193, 15172.317245723749, 15708.60728481797, 16176.919115404347, 16833.663326733153, 16881.324747010472, 11730.76538469243, 12063.879361206627, 12164.452599633214, 12329.938350308192, 13095.41070651804, 12340.691482712646, 12629.494820207088, 12725.87274127247, 12744.74510509803, 13374.799378009144], "value": 7896.053628126797, "unit": "score"}], "name": "dromaeo_css", "value": 7616.355604743442, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 110.0, 110.0, 110.0, 110.0, 110.0, 112.0, 109.0, 110.0, 109.0], "value": 109.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 122.0, 118.0, 153.0, 117.0, 120.0, 117.0, 118.0, 139.0, 118.0], "value": 126.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 160.0, 161.0, 162.0, 161.0, 160.0, 160.0, 161.0, 161.0, 159.0], "value": 160.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 76.0, 112.0, 76.0, 76.0, 76.0, 77.0, 94.0, 75.0], "value": 81.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 83.0, 104.0, 82.0, 82.0, 82.0, 97.0, 84.0, 83.0, 96.0], "value": 87.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 146.0, 148.0, 147.0, 146.0, 147.0, 148.0, 146.0, 147.0], "value": 146.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 96.0, 97.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 94.0], "value": 95.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [48.0, 50.0, 49.0, 50.0, 49.0, 50.0, 49.0, 50.0, 49.0, 50.0], "value": 49.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 65.0, 64.0, 65.0, 64.0, 63.0, 64.0, 64.0, 64.0], "value": 64.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 79.0, 76.0, 76.0, 76.0, 78.0, 77.0, 75.0, 81.0, 75.0], "value": 76.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 122.0, 119.0, 124.0, 121.0, 120.0, 122.0, 119.0, 157.0, 128.0], "value": 125.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 158.0, 163.0, 157.0, 158.0, 157.0, 157.0, 158.0, 159.0, 158.0], "value": 158.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 61.0, 61.0, 61.0, 61.0, 63.0, 60.0, 60.0, 59.0, 59.0], "value": 60.8, "unit": "score"}], "name": "kraken", "value": 1459.5, "alertThreshold": 2.0}]} 08:09:21 INFO - Return code: 0 08:09:21 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:09:21 ERROR - # TBPL SUCCESS # 08:09:21 INFO - Running post-action listener: _resource_record_post_action 08:09:21 INFO - [mozharness: 2017-02-24 16:09:21.916474Z] Finished run-tests step (success) 08:09:21 INFO - Running post-run listener: _resource_record_post_run 08:09:21 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 381894656; Read time: 16; Write time: 273076 08:09:21 INFO - TinderboxPrint: CPU usage
13.1% 08:09:21 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 08:09:21 INFO - TinderboxPrint: I/O write bytes / time
381,894,656 / 273,076 08:09:21 INFO - TinderboxPrint: CPU idle
8,255.8 (86.9%) 08:09:21 INFO - TinderboxPrint: CPU user
1,196.3 (12.6%) 08:09:21 INFO - TinderboxPrint: Swap in / out
0 / 0 08:09:21 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 109576192; Read time: 0; Write time: 116832 08:09:22 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 4096; Write bytes: 254480384; Read time: 16; Write time: 152532 08:09:22 INFO - Running post-run listener: _upload_blobber_files 08:09:22 INFO - Blob upload gear active. 08:09:22 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:09:22 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:09:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:09:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:09:22 INFO - (blobuploader) - INFO - Open directory for files ... 08:09:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:09:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:09:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:09:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:09:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:09:23 INFO - (blobuploader) - INFO - Done attempting. 08:09:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:09:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:09:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:09:24 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:09:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:09:24 INFO - (blobuploader) - INFO - Done attempting. 08:09:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:09:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:09:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:09:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:09:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:09:25 INFO - (blobuploader) - INFO - Done attempting. 08:09:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:09:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:09:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:09:28 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:09:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:09:28 INFO - (blobuploader) - INFO - Done attempting. 08:09:28 INFO - (blobuploader) - INFO - Iteration through files over. 08:09:28 INFO - Return code: 0 08:09:28 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:09:28 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:09:28 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/56799dfe3fe2d82d6ad212684f3251d7bdb03dc2629752cd388c256e506778a575c0af261a4cc29cdd6d2871a2c2646cefe98a4ba348c658d13db9be0da2ee6e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa538889e04ee509bda73b8928f7a25800512821704241282718172f9cac81d55e406a30ff2c07f3bd18a3b135c47e6140a10035775411836bbc33f1ea3d564e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c3b2ee25a96b954a61274875fbfd6bc78d0bc004822d203f21b8ad95919319277d253e8738244d26ae87b9fe37a38eacc611699c593c4977159f630970eb4fc1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f9e4cdb232544cd8668f2ccfb3c6813f2d242ebdb3e0613228e43c920d1281608e7d5b0833edbaea1246e1a8a47407281d328c32c7a4f7a71f6e5968110103d2"} 08:09:28 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:09:28 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:09:28 INFO - Contents: 08:09:28 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/56799dfe3fe2d82d6ad212684f3251d7bdb03dc2629752cd388c256e506778a575c0af261a4cc29cdd6d2871a2c2646cefe98a4ba348c658d13db9be0da2ee6e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa538889e04ee509bda73b8928f7a25800512821704241282718172f9cac81d55e406a30ff2c07f3bd18a3b135c47e6140a10035775411836bbc33f1ea3d564e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c3b2ee25a96b954a61274875fbfd6bc78d0bc004822d203f21b8ad95919319277d253e8738244d26ae87b9fe37a38eacc611699c593c4977159f630970eb4fc1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f9e4cdb232544cd8668f2ccfb3c6813f2d242ebdb3e0613228e43c920d1281608e7d5b0833edbaea1246e1a8a47407281d328c32c7a4f7a71f6e5968110103d2"} 08:09:28 INFO - Running post-run listener: copy_logs_to_upload_dir 08:09:28 INFO - Copying logs to upload dir... 08:09:28 INFO - mkdir: /builds/slave/test/build/upload/logs 08:09:28 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.759776 ========= master_lag: 0.18 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2017-02-24 08:09:27.751336) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-24 08:09:27.760108) ========= 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=6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/56799dfe3fe2d82d6ad212684f3251d7bdb03dc2629752cd388c256e506778a575c0af261a4cc29cdd6d2871a2c2646cefe98a4ba348c658d13db9be0da2ee6e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa538889e04ee509bda73b8928f7a25800512821704241282718172f9cac81d55e406a30ff2c07f3bd18a3b135c47e6140a10035775411836bbc33f1ea3d564e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c3b2ee25a96b954a61274875fbfd6bc78d0bc004822d203f21b8ad95919319277d253e8738244d26ae87b9fe37a38eacc611699c593c4977159f630970eb4fc1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f9e4cdb232544cd8668f2ccfb3c6813f2d242ebdb3e0613228e43c920d1281608e7d5b0833edbaea1246e1a8a47407281d328c32c7a4f7a71f6e5968110103d2"} build_url:https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011328 build_url: 'https://queue.taskcluster.net/v1/task/MLVliHpBTm-SW-3j6H1nLg/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/56799dfe3fe2d82d6ad212684f3251d7bdb03dc2629752cd388c256e506778a575c0af261a4cc29cdd6d2871a2c2646cefe98a4ba348c658d13db9be0da2ee6e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa538889e04ee509bda73b8928f7a25800512821704241282718172f9cac81d55e406a30ff2c07f3bd18a3b135c47e6140a10035775411836bbc33f1ea3d564e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c3b2ee25a96b954a61274875fbfd6bc78d0bc004822d203f21b8ad95919319277d253e8738244d26ae87b9fe37a38eacc611699c593c4977159f630970eb4fc1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f9e4cdb232544cd8668f2ccfb3c6813f2d242ebdb3e0613228e43c920d1281608e7d5b0833edbaea1246e1a8a47407281d328c32c7a4f7a71f6e5968110103d2"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-24 08:09:27.802810) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 08:09:27.803234) ========= 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=6d15e502d8e29d5d2676d664000001c3-1487950159.7791-1358107308 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004605 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-24 08:09:27.858215) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-24 08:09:27.860570) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-24 08:09:27.860913) ========= ========= Total master_lag: 0.32 =========